1technophile / OpenMQTTGateway

MQTT gateway for ESP8266 or ESP32 with bidirectional 433mhz/315mhz/868mhz, Infrared communications, BLE, Bluetooth, beacons detection, mi flora, mi jia, LYWSD02, LYWSD03MMC, Mi Scale, TPMS, BBQ thermometer compatibility & LoRa.
https://docs.openmqttgateway.com
GNU General Public License v3.0
3.59k stars 790 forks source link

Some BLE Advertising Packets lost #714

Closed sleepwalkera closed 3 years ago

sleepwalkera commented 4 years ago

Mijia smart locks use miBeacon (BLE advertising packet) to report door opening events. Although it is encrypted, I found that when a door opening event occurs, the service data always starts with the frame control bit "4840".

Normal service data: "5840fc03c12d3837a7fafc3ea5b482c0336a086cb5c2"

data name
5840 Frame Control
fc03 Product ID
c1 Frame Counter
2d3837a7fafc MAC Address
3ea5b482c0336a086cb5c2 encrypt data

Door opening service data: "4840fc03a6eac3e7a81407f0ed151451d6167be5d50828ce"

data name
4840 Frame Control
fc03 Product ID
a6eac3e7a81407f0ed151451d6167be5d50828ce encrypt data

Therefore, I can simply use the frame control bit to identify the door open event. I verified this with a simple pyblue script. However, when I tried to capture ble packets using OMG, I found that not every BLE advertising packet was captured by BTtoMQTT. Although I set TimeBtw_Read to 500, the scanning speed is still very slow, and I think I missed some event packets.

I want to disable other features such as device discovery to speed up scanning. But I am not familiar with the code. Can you give me some debugging guidance?

https://iot.mi.com/new/doc/embedded-development/ble/ble-mibeacon.html

1technophile commented 4 years ago

Hello,

Nice finding!

You should try to play with setInterval and setWindow parameters. By default they are set to 100, try maybe to go down the window to 50.

1technophile commented 4 years ago

I want to disable other features such as device discovery to speed up scanning. But I am not familiar with the code. Can you give me some debugging guidance?

Just comment ZmqttDiscovery if you are using Arduino IDE or remove this line if using platformio

1technophile commented 4 years ago

Note that I will add the possibility to change the interval and window parameter in config_BT.h

sleepwalkera commented 4 years ago

Thanks for your reply and debugging guidance I have tried to set the setInterval and setWindow parameters to 50, or even 10, but still losing data packets. This is my simple bluepy script. It runs perfectly on my laptop, and never lose any event packet. https://pastebin.com/03NG61nk I only have one esp32-dev, and I observed the serial port output, there was a very long pause after some lines, and the information in between was lost, unless the data packet of the door opening signal happened to be captured.

23:47:05.009 -> N: Found 4 devices, scan end deinit controller 23:47:05.009 -> N: Scan begin 23:47:05.254 -> N: Device detected: F4FEFB808731 23:47:05.634 -> N: Device detected: 5389494A8B78 23:47:05.736 -> N: Device detected: FCFAA737382D 23:47:05.736 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:47:05.736 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-68,"servicedata":"5840fc03722d3837a7fafcc16dc0837ec89e8d4e38fb"} 23:47:15.217 -> N: Found 3 devices, scan end deinit controller 23:47:15.217 -> N: Scan begin 23:47:15.431 -> N: Device detected: F4FEFB808731 23:47:15.465 -> N: Device detected: FCFAA737382D 23:47:15.465 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:47:15.465 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-75,"servicedata":"5840fc03732d3837a7fafcf2e1c8bc4a51f0eb67deb7"} 23:47:16.631 -> N: Device detected: 5389494A8B78 23:47:25.440 -> N: Found 3 devices, scan end deinit controller 23:47:25.440 -> N: Scan begin 23:47:25.825 -> N: Device detected: FCFAA737382D 23:47:25.825 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:47:25.825 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-66,"servicedata":"5840fc03732d3837a7fafcf2e1c8bc4a51f0eb67deb7"} 23:47:26.104 -> N: Device detected: F4FEFB808731 23:47:26.770 -> N: Device detected: 5389494A8B78 23:47:35.661 -> N: Found 3 devices, scan end deinit controller 23:47:35.661 -> N: Scan begin 23:47:36.114 -> N: Device detected: 5389494A8B78 23:47:36.185 -> N: Device detected: FCFAA737382D 23:47:36.185 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:47:36.185 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-73,"servicedata":"5840fc03732d3837a7fafcf2e1c8bc4a51f0eb67deb7"} 23:47:36.185 -> N: Device detected: F4FEFB808731 23:47:45.858 -> N: Found 3 devices, scan end deinit controller 23:47:45.894 -> N: Scan begin 23:47:46.209 -> N: Device detected: FCFAA737382D 23:47:46.591 -> N: Device detected: 5389494A8B78 23:47:48.043 -> N: Device detected: F4FEFB808731 23:47:56.091 -> N: Found 3 devices, scan end deinit controller 23:47:56.091 -> N: Scan begin 23:47:56.547 -> N: Device detected: FCFAA737382D 23:47:56.547 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:47:56.547 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-70,"servicedata":"5840fc03732d3837a7fafcf2e1c8bc4a51f0eb67deb7"} 23:47:56.584 -> N: Device detected: F4FEFB808731 23:47:57.075 -> N: Device detected: 5389494A8B78 23:47:58.621 -> N: Subject: /SYStoMQTT 23:47:58.621 -> N: Received json : {"uptime":243,"version":"version_tag","freemem":53132,"rssi":-58,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":10,"modules":"BT"} 23:48:06.287 -> N: Found 3 devices, scan end deinit controller 23:48:06.324 -> N: Scan begin 23:48:06.568 -> N: Device detected: FCFAA737382D 23:48:06.568 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:48:06.568 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-70,"servicedata":"5840fc03742d3837a7fafc9c51da641f2ce9e3acbea5"} 23:48:06.603 -> N: Device detected: F4FEFB808731 23:48:08.912 -> N: Device detected: 5389494A8B78 23:48:16.506 -> N: Found 3 devices, scan end deinit controller 23:48:16.540 -> N: Scan begin 23:48:16.816 -> N: Device detected: F4FEFB808731 23:48:17.216 -> N: Device detected: FCFAA737382D 23:48:17.216 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:48:17.216 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-72,"servicedata":"5840fc03742d3837a7fafc9c51da641f2ce9e3acbea5"} 23:48:19.653 -> N: Device detected: 5389494A8B78 23:48:26.753 -> N: Found 3 devices, scan end deinit controller 23:48:26.753 -> N: Scan begin 23:48:27.067 -> N: Device detected: 5389494A8B78 23:48:27.884 -> N: Device detected: FCFAA737382D 23:48:27.884 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:48:27.884 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-71,"servicedata":"5840fc03742d3837a7fafc9c51da641f2ce9e3acbea5"} 23:48:28.869 -> N: Device detected: F4FEFB808731 23:48:36.954 -> N: Found 3 devices, scan end deinit controller 23:48:36.954 -> N: Scan begin 23:48:37.347 -> N: Device detected: F4FEFB808731 23:48:37.589 -> N: Device detected: FCFAA737382D 23:48:37.807 -> N: Device detected: 5389494A8B78 23:48:47.191 -> N: Found 3 devices, scan end deinit controller 23:48:47.191 -> N: Scan begin 23:48:47.750 -> N: Device detected: 5389494A8B78 23:48:47.851 -> N: Device detected: F4FEFB808731 23:48:48.601 -> N: Device detected: FCFAA737382D 23:48:48.601 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:48:48.601 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-70,"servicedata":"5840fc03742d3837a7fafc9c51da641f2ce9e3acbea5"} 23:48:57.399 -> N: Found 3 devices, scan end deinit controller 23:48:57.399 -> N: Scan begin 23:48:57.728 -> N: Device detected: F4FEFB808731 23:48:57.932 -> N: Device detected: 5389494A8B78 23:48:58.650 -> N: Device detected: FCFAA737382D 23:48:58.650 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:48:58.650 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-70,"servicedata":"5840fc03742d3837a7fafc9c51da641f2ce9e3acbea5"} 23:49:07.598 -> N: Found 3 devices, scan end deinit controller 23:49:07.631 -> N: Scan begin 23:49:07.950 -> N: Device detected: F4FEFB808731 23:49:08.020 -> N: Device detected: FCFAA737382D 23:49:08.020 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:49:08.020 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-71,"servicedata":"5840fc03752d3837a7fafc78634cd5c22bdb2c803a02"} 23:49:10.006 -> N: Device detected: 5389494A8B78 23:49:17.816 -> N: Found 3 devices, scan end deinit controller 23:49:17.851 -> N: Scan begin 23:49:18.095 -> N: Device detected: F4FEFB808731 23:49:18.384 -> N: Device detected: FCFAA737382D 23:49:18.384 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:49:18.384 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-70,"servicedata":"5840fc03752d3837a7fafc78634cd5c22bdb2c803a02"} 23:49:19.089 -> N: Device detected: 5389494A8B78 23:49:28.070 -> N: Found 3 devices, scan end deinit controller 23:49:28.070 -> N: Scan begin 23:49:28.391 -> N: Device detected: FCFAA737382D 23:49:28.391 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:49:28.391 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-67,"servicedata":"5840fc03752d3837a7fafc78634cd5c22bdb2c803a02"} 23:49:28.498 -> N: Device detected: F4FEFB808731 23:49:29.023 -> N: Device detected: 5389494A8B78 23:49:38.258 -> N: Found 3 devices, scan end deinit controller 23:49:38.294 -> N: Scan begin 23:49:38.545 -> N: Device detected: F4FEFB808731 23:49:38.650 -> N: Device detected: 5389494A8B78 23:49:39.392 -> N: Device detected: FCFAA737382D 23:49:39.392 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:49:39.392 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-67,"servicedata":"5840fc03752d3837a7fafc78634cd5c22bdb2c803a02"} 23:49:48.495 -> N: Found 3 devices, scan end deinit controller 23:49:48.495 -> N: Scan begin 23:49:48.781 -> N: Device detected: F4FEFB808731 23:49:48.852 -> N: Device detected: 5389494A8B78 23:49:49.748 -> N: Device detected: FCFAA737382D 23:49:49.782 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:49:49.782 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-64,"servicedata":"5840fc03752d3837a7fafc78634cd5c22bdb2c803a02"} 23:49:58.640 -> N: Subject: /SYStoMQTT 23:49:58.640 -> N: Received json : {"uptime":363,"version":"version_tag","freemem":52852,"rssi":-63,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":10,"modules":"BT"} 23:49:58.712 -> N: Found 3 devices, scan end deinit controller 23:49:58.712 -> N: Scan begin 23:49:58.957 -> N: Device detected: F4FEFB808731 23:49:59.310 -> N: Device detected: 5389494A8B78 23:49:59.489 -> N: Device detected: FCFAA737382D 23:50:08.938 -> N: Found 3 devices, scan end deinit controller 23:50:08.938 -> N: Scan begin 23:50:09.321 -> N: Device detected: F4FEFB808731 23:50:09.500 -> N: Device detected: FCFAA737382D 23:50:09.500 -> N: Device detected: 5389494A8B78 23:50:19.137 -> N: Found 3 devices, scan end deinit controller 23:50:19.137 -> N: Scan begin 23:50:19.418 -> N: Device detected: F4FEFB808731 23:50:19.529 -> N: Device detected: FCFAA737382D 23:50:19.665 -> N: Device detected: 5389494A8B78 23:50:29.340 -> N: Found 3 devices, scan end deinit controller 23:50:29.376 -> N: Scan begin 23:50:29.624 -> N: Device detected: F4FEFB808731 23:50:30.341 -> N: Device detected: 5389494A8B78 23:50:30.525 -> N: Device detected: FCFAA737382D 23:50:30.525 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:50:30.525 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-65,"servicedata":"5840fc03762d3837a7fafcb30826e1deeb1032c265ee"} 23:50:39.575 -> N: Found 3 devices, scan end deinit controller 23:50:39.575 -> N: Scan begin 23:50:39.819 -> N: Device detected: F4FEFB808731 23:50:39.998 -> N: Device detected: 5389494A8B78 23:50:40.251 -> N: Device detected: FCFAA737382D 23:50:40.251 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:50:40.251 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-67,"servicedata":"5840fc03762d3837a7fafcb30826e1deeb1032c265ee"} 23:50:49.786 -> N: Found 3 devices, scan end deinit controller 23:50:49.786 -> N: Scan begin 23:50:50.022 -> N: Device detected: F4FEFB808731 23:50:50.588 -> N: Device detected: FCFAA737382D 23:50:51.036 -> N: Device detected: 5389494A8B78 23:50:59.992 -> N: Found 3 devices, scan end deinit controller 23:51:00.030 -> N: Scan begin 23:51:00.421 -> N: Device detected: F4FEFB808731 23:51:00.597 -> N: Device detected: FCFAA737382D 23:51:00.634 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:51:00.634 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-78,"servicedata":"5840fc03762d3837a7fafcb30826e1deeb1032c265ee"} 23:51:00.946 -> N: Device detected: 5389494A8B78 23:51:10.210 -> N: Found 3 devices, scan end deinit controller 23:51:10.244 -> N: Scan begin 23:51:10.639 -> N: Device detected: F4FEFB808731 23:51:10.639 -> N: Device detected: FCFAA737382D 23:51:10.639 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:51:10.639 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-66,"servicedata":"5840fc03772d3837a7fafcc0c3dd53f8863a7ef37eee"} 23:51:12.533 -> N: Device detected: 5389494A8B78 23:51:20.426 -> N: Found 3 devices, scan end deinit controller 23:51:20.463 -> N: Scan begin 23:51:20.711 -> N: Device detected: F4FEFB808731 23:51:21.929 -> N: Device detected: FCFAA737382D 23:51:21.965 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:51:21.965 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-66,"servicedata":"5840fc03772d3837a7fafcc0c3dd53f8863a7ef37eee"} 23:51:23.305 -> N: Device detected: 5389494A8B78 23:51:30.654 -> N: Found 3 devices, scan end deinit controller 23:51:30.654 -> N: Scan begin 23:51:30.936 -> N: Device detected: F4FEFB808731 23:51:31.008 -> N: Device detected: 5389494A8B78 23:51:31.327 -> N: Device detected: FCFAA737382D 23:51:31.327 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:51:31.327 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-66,"servicedata":"5840fc03772d3837a7fafcc0c3dd53f8863a7ef37eee"} 23:51:40.883 -> N: Found 3 devices, scan end deinit controller 23:51:40.883 -> N: Scan begin 23:51:41.169 -> N: Device detected: 5389494A8B78 23:51:41.169 -> N: Device detected: F4FEFB808731 23:51:41.696 -> N: Device detected: FCFAA737382D 23:51:41.696 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:51:41.696 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-65,"servicedata":"5840fc03772d3837a7fafcc0c3dd53f8863a7ef37eee"} 23:51:51.114 -> N: Found 3 devices, scan end deinit controller 23:51:51.114 -> N: Scan begin 23:51:51.324 -> N: Device detected: 5389494A8B78 23:51:51.537 -> N: Device detected: F4FEFB808731 23:51:53.038 -> N: Device detected: FCFAA737382D 23:51:53.038 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:51:53.071 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-66,"servicedata":"5840fc03772d3837a7fafcc0c3dd53f8863a7ef37eee"} 23:51:58.642 -> N: Subject: /SYStoMQTT 23:51:58.642 -> N: Received json : {"uptime":483,"version":"version_tag","freemem":52564,"rssi":-51,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":10,"modules":"BT"} 23:52:01.320 -> N: Found 3 devices, scan end deinit controller 23:52:01.320 -> N: Scan begin 23:52:01.777 -> N: Device detected: F4FEFB808731 23:52:02.123 -> N: Device detected: 5389494A8B78 23:52:02.472 -> N: Device detected: FCFAA737382D 23:52:02.472 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:52:02.472 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-65,"servicedata":"5840fc03772d3837a7fafcc0c3dd53f8863a7ef37eee"} 23:52:11.523 -> N: Found 3 devices, scan end deinit controller 23:52:11.558 -> N: Scan begin 23:52:11.805 -> N: Device detected: F4FEFB808731 23:52:12.222 -> N: Device detected: 5389494A8B78 23:52:13.809 -> N: Device detected: FCFAA737382D 23:52:13.809 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:52:13.842 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-66,"servicedata":"5840fc03782d3837a7fafc2d4856d0cab72b6350c04f"} 23:52:21.757 -> N: Found 3 devices, scan end deinit controller 23:52:21.757 -> N: Scan begin 23:52:22.033 -> N: Device detected: F4FEFB808731 23:52:22.239 -> N: Device detected: FCFAA737382D 23:52:22.239 -> N: Subject: /BTtoMQTT/FCFAA737382D 23:52:22.239 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-66,"servicedata":"5840fc03782d3837a7fafc2d4856d0cab72b6350c04f"} 23:52:22.984 -> N: Device detected: 5389494A8B78

sleepwalkera commented 4 years ago

It seems that before each line of "Found xxx devices, scan end deinit controller", there will be a pause of about 8 to 10 seconds.

1technophile commented 4 years ago

Could you try to set the Scan_duration to 0 so as to see how the gateway behave?

With this value the scan should be continuous but I have never tested it.

sleepwalkera commented 4 years ago

In the end, I tried setting Scan_duration to 3, which perfectly solved the problem and no longer lost the ble advertising packet. Now I can get the door opening event in homeassistant, thank you very much, I am willing to assist in any further testing

1technophile commented 4 years ago

In the end, I tried setting Scan_duration to 3, which perfectly solved the problem and no longer lost the ble advertising packet. Now I can get the door opening event in homeassistant, thank you very much, I am willing to assist in any further testing

Interesting, Did you changed also TimeBtw_Read, setIntervaland setWindowparameters?

sleepwalkera commented 4 years ago

I set TimeBtw_Read to 500, and keep the setInterval and setWindow parameters as default values. It seems that Scan_duration is the key parameter. As long as Scan_duration is reduced, the packet capture rate will be greatly improved. But after hours of testing, I found that as stated in the comments, changing the value of Scan_duration will lead esp32 to instability (crashes and restarts approximately every ten minutes).

11:42:27.386 -> N: Device detected: F4FEFB808731 11:42:29.893 -> N: Found 2 devices, scan end deinit controller 11:42:30.384 -> N: Scan begin 11:42:30.802 -> N: Device detected: F4FEFB808731 11:42:30.910 -> N: Device detected: FCFAA737382D 11:42:30.910 -> N: Subject: /BTtoMQTT/FCFAA737382D 11:42:30.910 -> N: Received json: {"id":"FC:FA:A7:37:38:2D","rssi":-62,"servicedata":"5840fc03a62d3837a7fafc327596a3e2ad05b6556f40"} 11:42:33.595 -> N: Found 2 devices, scan end deinit controller 11:42:34.093 -> N: Scan begin 11:42:34.441 -> N: Device detected: F4FEFB808731 11:42:34.510 -> N: Device detected: FCFAA737382D 11:42:34.510 -> N: Subject: /BTtoMQTT/FCFAA737382D 11:42:34.510 -> N: Received json: {"id":"FC:FA:A7:37:38:2D","rssi":-67,"servicedata":"5840fc03a62d3837a7fafc327596a3e2ad05b6556f40"} 11:42:35.961 -> abort() was called at PC 0x401d13df on core 1 11:42:35.961 -> 11: 42: 35.996 -> Backtrace: 0x400926d0: 0x3ffd0480 0x40092901: 0x3ffd04a0 0x401d13df: 0x3ffd04c0 0x401d1426: 0x3ffd04e0 0x401d14d3: 0x3ffd0500 0x401d1556: 0x3ffd0520 0x401d156d: 0x3ffd0540 0x400da383: 0x3ffd0560 0x400d82e2: 0x3ffd05a0 0x400d59b8: 0x3ffd05c0 0x400ef0dd: 0x3ffd05e0 0x4008ee19: 0x3ffd0600 11:42:35.996 -> 11:42:35.996 -> Rebooting... 11:42:35.996 -> ets Jun 8 2016 00:22:57

At the same time, I would like to know if there is a more efficient way to capture a single specific event in addition to high-frequency scanning, as long as the data is not lost, and a slight delay is acceptable.

Thank you

1technophile commented 4 years ago

Now that you have found an interesting Scan_duration I would try to change the setWindow parameter by putting it down and going up with the setInterval. If you search on the web you may find also some guidance. In all the case you have my encouragements, this is something interesting and that can help many others.

sleepwalkera commented 4 years ago

After two days of testing and running, esp32 seems to no longer work through the openmqttgateway firmware. No matter I re-upload the program or erase the flash, the esp32 enters a repeated cycle and restarts, and it should be damaged. It is not yet known whether it is related to high-frequency scanning, but I suggest adjusting this parameter carefully.

00:19:41.803 -> N: 00:19:41.803 -> * WELCOME TO OpenMQTTGateway ** 00:19:41.909 -> 00:19:41.909 -> Brownout detector was triggered 00:19:41.909 -> 00:19:41.909 -> ets Jun 8 2016 00:22:57 00:19:41.909 -> 00:19:41.909 -> rst:0xc (SW_CPU_RESET),boot:0x13 (SPI_FAST_FLASH_BOOT) 00:19:41.909 -> configsip: 0, SPIWP:0xee 00:19:41.909 -> clk_drv:0x00,q_drv:0x00,d_drv:0x00,cs0_drv:0x00,hd_drv:0x00,wp_drv:0x00 00:19:41.909 -> mode:DIO, clock div:2 00:19:41.909 -> load:0x3fff0018,len:4 00:19:41.909 -> load:0x3fff001c,len:1216 00:19:41.943 -> ho 0 tail 12 room 4 00:19:41.943 -> load:0x40078000,len:9720 00:19:41.943 -> ho 0 tail 12 room 4 00:19:41.943 -> load:0x40080400,len:6364 00:19:41.943 -> entry 0x400806b8 00:19:42.505 -> N: 00:19:42.505 -> * WELCOME TO OpenMQTTGateway ** 00:19:42.607 -> 00:19:42.607 -> Brownout detector was triggered 00:19:42.607 -> 00:19:42.607 -> ets Jun 8 2016 00:22:57 00:19:42.607 -> 00:19:42.607 -> rst:0xc (SW_CPU_RESET),boot:0x13 (SPI_FAST_FLASH_BOOT) 00:19:42.607 -> configsip: 0, SPIWP:0xee 00:19:42.643 -> clk_drv:0x00,q_drv:0x00,d_drv:0x00,cs0_drv:0x00,hd_drv:0x00,wp_drv:0x00 00:19:42.643 -> mode:DIO, clock div:2 00:19:42.643 -> load:0x3fff0018,len:4 00:19:42.643 -> load:0x3fff001c,len:1216 00:19:42.643 -> ho 0 tail 12 room 4 00:19:42.643 -> load:0x40078000,len:9720 00:19:42.643 -> ho 0 tail 12 room 4 00:19:42.643 -> load:0x40080400,len:6364 00:19:42.643 -> entry 0x400806b8 00:19:43.247 -> N: 00:19:43.247 -> * WELCOME TO OpenMQTTGateway ** 00:19:43.318 -> 00:19:43.318 -> Brownout detector was triggered 00:19:43.318 -> 00:19:43.318 -> ets Jun 8 2016 00:22:57 00:19:43.318 -> 00:19:43.318 -> rst:0xc (SW_CPU_RESET),boot:0x13 (SPI_FAST_FLASH_BOOT) 00:19:43.318 -> configsip: 0, SPIWP:0xee 00:19:43.355 -> clk_drv:0x00,q_drv:0x00,d_drv:0x00,cs0_drv:0x00,hd_drv:0x00,wp_drv:0x00 00:19:43.355 -> mode:DIO, clock div:2 00:19:43.355 -> load:0x3fff0018,len:4 00:19:43.355 -> load:0x3fff001c,len:1216 00:19:43.355 -> ho 0 tail 12 room 4 00:19:43.355 -> load:0x40078000,len:9720 00:19:43.355 -> ho 0 tail 12 room 4 00:19:43.355 -> load:0x40080400,len:6364 00:19:43.355 -> entry 0x400806b8 00:19:43.956 -> N: 00:19:43.956 -> * WELCOME TO OpenMQTTGateway ** 00:19:44.025 -> 00:19:44.025 -> Brownout detector was triggered 00:19:44.025 -> 00:19:44.025 -> ets Jun 8 2016 00:22:57 00:19:44.025 -> 00:19:44.025 -> rst:0xc (SW_CPU_RESET),boot:0x13 (SPI_FAST_FLASH_BOOT) 00:19:44.063 -> configsip: 0, SPIWP:0xee 00:19:44.063 -> clk_drv:0x00,q_drv:0x00,d_drv:0x00,cs0_drv:0x00,hd_drv:0x00,wp_drv:0x00 00:19:44.063 -> mode:DIO, clock div:2 00:19:44.063 -> load:0x3fff0018,len:4 00:19:44.063 -> load:0x3fff001c,len:1216 00:19:44.063 -> ho 0 tail 12 room 4 00:19:44.063 -> load:0x40078000,len:9720 00:19:44.063 -> ho 0 tail 12 room 4 00:19:44.063 -> load:0x40080400,len:6364 00:19:44.063 -> entry 0x400806b8 00:19:44.655 -> N: 00:19:44.655 -> * WELCOME TO OpenMQTTGateway ** 00:19:44.759 -> 00:19:44.793 -> Brownout detector was triggered 00:19:44.793 -> 00:19:44.793 -> ets Jun 8 2016 00:22:57 00:19:44.793 -> 00:19:44.793 -> rst:0xc (SW_CPU_RESET),boot:0x13 (SPI_FAST_FLASH_BOOT) 00:19:44.793 -> configsip: 0, SPIWP:0xee 00:19:44.793 -> clk_drv:0x00,q_drv:0x00,d_drv:0x00,cs0_drv:0x00,hd_drv:0x00,wp_drv:0x00 00:19:44.793 -> mode:DIO, clock div:2 00:19:44.793 -> load:0x3fff0018,len:4 00:19:44.793 -> load:0x3fff001c,len:1216 00:19:44.793 -> ho 0 tail 12 room 4 00:19:44.793 -> load:0x40078000,len:9720 00:19:44.793 -> ho 0 tail 12 room 4 00:19:44.793 -> load:0x40080400,len:6364 00:19:44.828 -> entry 0x400806b8 00:19:45.391 -> N: 00:19:45.391 -> * WELCOME TO OpenMQTTGateway ** 00:19:45.501 -> 00:19:45.501 -> Brownout detector was triggered 00:19:45.501 -> 00:19:45.501 -> ets Jun 8 2016 00:22:57 00:19:45.501 -> 00:19:45.501 -> rst:0xc (SW_CPU_RESET),boot:0x13 (SPI_FAST_FLASH_BOOT) 00:19:45.501 -> configsip: 0, SPIWP:0xee 00:19:45.501 -> clk_drv:0x00,q_drv:0x00,d_drv:0x00,cs0_drv:0x00,hd_drv:0x00,wp_drv:0x00 00:19:45.501 -> mode:DIO, clock div:2 00:19:45.501 -> load:0x3fff0018,len:4 00:19:45.501 -> load:0x3fff001c,len:1216 00:19:45.501 -> ho 0 tail 12 room 4 00:19:45.501 -> load:0x40078000,len:9720 00:19:45.501 -> ho 0 tail 12 room 4 00:19:45.539 -> load:0x40080400,len:6364 00:19:45.539 -> entry 0x400806b8 00:19:46.109 -> N: 00:19:46.109 -> ***** WELCOME TO OpenMQTTGateway ** 00:19:46.211 -> 00:19:46.211 -> Brownout detector was triggered 00:19:46.211 -> 00:19:46.211 -> ets Jun 8 2016 00:22:57 00:19:46.211 -> 00:19:46.211 -> rst:0xc (SW_CPU_RESET),boot:0x13 (SPI_FAST_FLASH_BOOT) 00:19:46.211 -> configsip: 0, SPIWP:0xee 00:19:46.211 -> clk_drv:0x00,q_drv:0x00,d_drv:0x00,cs0_drv:0x00,hd_drv:0x00,wp_drv:0x00 00:19:46.211 -> mode:DIO, clock div:2 00:19:46.211 -> load:0x3fff0018,len:4 00:19:46.211 -> load:0x3fff001c,len:1216 00:19:46.211 -> ho 0 tail 12 room 4 00:19:46.211 -> load:0x40078000,len:9720 00:19:46.246 -> ho 0 tail 12 room 4 00:19:46.246 -> load:0x40080400,len:6364 00:19:46.246 -> entry 0x400806b8

1technophile commented 4 years ago

I will submit in the following days a branch with a new BLE library, I would be interested by your feedback on it, if you have some time to test it.

sleepwalkera commented 4 years ago

Great, I am very willing to test it

1technophile commented 4 years ago

Hi @sleepwalkera,

Could you test with the last development version, please?

sleepwalkera commented 4 years ago

Hi @1technophile , Thank you very much for your efforts. After several days of testing, it was found that the current version has amazing and significant improvements in stability. Even after several days of high-frequency scanning, it no longer crashes.


09:12:10.996 -> N: Scan begin 09:12:11.069 -> N: Device detected: F4:FE:FB:80:87:31 09:12:11.069 -> N: Subject: /BTtoMQTT/F4FEFB808731 09:12:11.069 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-71} 09:12:11.388 -> N: Device detected: FC:FA:A7:37:38:2D 09:12:11.421 -> N: Subject: /BTtoMQTT/FCFAA737382D 09:12:11.421 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-74,"servicedata":"5840fc03ad2d3837a7fafc73dc36d98c1f5725cc83dc"} 09:12:12.020 -> N: Found 2 devices, scan number 2 end deinit controller 09:12:12.020 -> N: BLE Connect begin 09:12:12.269 -> N: BLE Connect end 09:12:12.590 -> N: Scan begin 09:12:12.660 -> N: Device detected: F4:FE:FB:80:87:31 09:12:12.660 -> N: Subject: /BTtoMQTT/F4FEFB808731 09:12:12.660 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-70} 09:12:13.022 -> N: Device detected: FC:FA:A7:37:38:2D 09:12:13.022 -> N: Subject: /BTtoMQTT/FCFAA737382D 09:12:13.022 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-77,"servicedata":"5840fc03ad2d3837a7fafc73dc36d98c1f5725cc83dc"} 09:12:13.599 -> N: Found 2 devices, scan number 3 end deinit controller 09:12:13.599 -> N: BLE Connect begin 09:12:13.888 -> N: BLE Connect end 09:12:14.172 -> N: Scan begin 09:12:14.208 -> N: Device detected: F4:FE:FB:80:87:31 09:12:14.208 -> N: Subject: /BTtoMQTT/F4FEFB808731 09:12:14.208 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-72} 09:12:14.635 -> N: Device detected: FC:FA:A7:37:38:2D 09:12:14.635 -> N: Subject: /BTtoMQTT/FCFAA737382D 09:12:14.635 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-76,"servicedata":"5840fc03ad2d3837a7fafc73dc36d98c1f5725cc83dc"} 09:12:15.169 -> N: Found 2 devices, scan number 4 end deinit controller 09:12:15.202 -> N: BLE Connect begin 09:12:15.475 -> N: BLE Connect end 09:12:15.766 -> N: Scan begin 09:12:15.906 -> N: Device detected: F4:FE:FB:80:87:31 09:12:15.906 -> N: Subject: /BTtoMQTT/F4FEFB808731 09:12:15.940 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-71} 09:12:16.255 -> N: Device detected: FC:FA:A7:37:38:2D 09:12:16.255 -> N: Subject: /BTtoMQTT/FCFAA737382D 09:12:16.255 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-77,"servicedata":"5840fc03ad2d3837a7fafc73dc36d98c1f5725cc83dc"} 09:12:16.773 -> N: Found 2 devices, scan number 5 end deinit controller 09:12:16.773 -> N: BLE Connect begin 09:12:17.057 -> N: BLE Connect end 09:12:17.342 -> N: Scan begin 09:12:17.448 -> N: Device detected: F4:FE:FB:80:87:31 09:12:17.448 -> N: Subject: /BTtoMQTT/F4FEFB808731 09:12:17.448 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-70} 09:12:17.870 -> N: Device detected: FC:FA:A7:37:38:2D 09:12:17.870 -> N: Subject: /BTtoMQTT/FCFAA737382D 09:12:17.870 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-77,"servicedata":"5840fc03ad2d3837a7fafc73dc36d98c1f5725cc83dc"} 09:12:18.334 -> N: Found 2 devices, scan number 6 end deinit controller 09:12:18.369 -> N: BLE Connect begin 09:12:18.619 -> N: BLE Connect end 09:12:18.936 -> N: Scan begin 09:12:18.972 -> N: Device detected: F4:FE:FB:80:87:31 09:12:18.972 -> N: Subject: /BTtoMQTT/F4FEFB808731 09:12:18.972 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-73} 09:12:19.481 -> N: Device detected: FC:FA:A7:37:38:2D 09:12:19.481 -> N: Subject: /BTtoMQTT/FCFAA737382D 09:12:19.481 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-77,"servicedata":"5840fc03ad2d3837a7fafc73dc36d98c1f5725cc83dc"} 09:12:19.943 -> N: Found 2 devices, scan number 7 end deinit controller 09:12:19.943 -> N: BLE Connect begin 09:12:20.222 -> N: BLE Connect end 09:12:20.540 -> N: Scan begin 09:12:20.998 -> N: Device detected: F4:FE:FB:80:87:31 09:12:20.998 -> N: Subject: /BTtoMQTT/F4FEFB808731 09:12:21.034 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-72} 09:12:21.432 -> N: Device detected: FC:FA:A7:37:38:2D 09:12:21.432 -> N: Subject: /BTtoMQTT/FCFAA737382D 09:12:21.432 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-77,"servicedata":"5840fc03ad2d3837a7fafc73dc36d98c1f5725cc83dc"} 09:12:21.539 -> N: Found 2 devices, scan number 8 end deinit controller 09:12:21.539 -> N: BLE Connect begin 09:12:21.788 -> N: BLE Connect end 09:12:22.113 -> N: Scan begin 09:12:22.391 -> N: Device detected: FC:FA:A7:37:38:2D 09:12:22.391 -> N: Subject: /BTtoMQTT/FCFAA737382D 09:12:22.391 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-77,"servicedata":"5840fc03ad2d3837a7fafc73dc36d98c1f5725cc83dc"} 09:12:22.676 -> N: Device detected: F4:FE:FB:80:87:31 09:12:22.676 -> N: Subject: /BTtoMQTT/F4FEFB808731 09:12:22.676 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-72} 09:12:23.101 -> N: Found 2 devices, scan number 9 end deinit controller 09:12:23.101 -> N: BLE Connect begin 09:12:23.393 -> N: BLE Connect end 09:12:23.705 -> N: Scan begin 09:12:23.948 -> N: Device detected: F4:FE:FB:80:87:31 09:12:23.948 -> N: Subject: /BTtoMQTT/F4FEFB808731 09:12:23.948 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-70} 09:12:24.021 -> N: Device detected: FC:FA:A7:37:38:2D 09:12:24.021 -> N: Subject: /BTtoMQTT/FCFAA737382D 09:12:24.021 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-76,"servicedata":"5840fc03ad2d3837a7fafc73dc36d98c1f5725cc83dc"} 09:12:24.688 -> N: Found 2 devices, scan number 10 end deinit controller 09:12:24.688 -> N: BLE Connect begin 09:12:24.973 -> N: BLE Connect end 09:12:25.284 -> N: Scan begin 09:12:25.319 -> N: Device detected: F4:FE:FB:80:87:31 09:12:25.319 -> N: Subject: /BTtoMQTT/F4FEFB808731 09:12:25.319 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-72} 09:12:25.319 -> N: Device detected: FC:FA:A7:37:38:2D 09:12:25.319 -> N: Subject: /BTtoMQTT/FCFAA737382D 09:12:25.319 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-76,"servicedata":"5840fc03ad2d3837a7fafc73dc36d98c1f5725cc83dc"} 09:12:26.275 -> N: Found 2 devices, scan number 11 end deinit controller 09:12:26.275 -> N: BLE Connect begin 09:12:26.554 -> N: BLE Connect end


However, some minor problems were also found in the test. After scanning for a period of time, it is very likely that the servicedata cannot be captured, and the scanning time also increases. Scanning for BLE will automatically stop after a period of time.


00:56:28.834 -> N: BLE Connect begin 00:56:28.834 -> N: BLE Connect end 00:56:28.834 -> N: Scan begin 00:56:28.834 -> N: Device detected: 65:96:00:E7:72:BC 00:56:28.834 -> N: Device detected: FC:FA:A7:37:38:2D 00:56:28.834 -> N: Device detected: F4:FE:FB:80:87:31 00:56:28.834 -> N: Subject: /BTtoMQTT/F4FEFB808731 00:56:28.834 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-75} 00:56:28.834 -> N: Found 3 devices, scan number 4114 end deinit controller 00:56:28.834 -> N: BLE Connect begin 00:56:28.834 -> N: BLE Connect end 00:56:28.834 -> N: Scan begin 00:56:28.834 -> N: Device detected: FC:FA:A7:37:38:2D 00:56:48.866 -> N: Device detected: F4:FE:FB:80:87:31 00:56:48.866 -> N: Subject: /BTtoMQTT/F4FEFB808731 00:56:48.866 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-74} 00:56:48.866 -> N: Found 3 devices, scan number 4115 end deinit controller 00:56:48.866 -> N: BLE Connect begin 00:56:48.866 -> N: BLE Connect end 00:56:48.866 -> N: BLE Connect end 00:56:48.866 -> N: Scan begin 00:56:48.866 -> N: Device detected: 38:F9:D3:23:06:5B 00:56:48.866 -> N: Device detected: 66:F1:DF:CB:E9:BA 00:56:48.866 -> N: Subject: /BTtoMQTT/66F1DFCBE9BA 00:56:48.866 -> N: Received json : {"id":"66:F1:DF:CB:E9:BA","rssi":-79} 00:56:48.866 -> N: Device detected: FC:FA:A7:37:38:2D 00:56:48.866 -> N: Device detected: 65:96:00:E7:72:BC 00:56:48.866 -> N: Device detected: F4:FE:FB:80:87:31 00:56:48.866 -> N: Subject: /BTtoMQTT/F4FEFB808731 00:56:48.866 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-73} 00:56:48.866 -> N: Found 5 devices, scan number 4126 end deinit controller 00:56:48.866 -> N: BLE Connect begin 00:56:48.866 -> N: BLE Connect end 00:56:48.866 -> N: Scan begin 00:56:48.866 -> N: Device detected: 66:F1:DF:CB:E9:BA 00:56:48.866 -> N: Device detected: 38:F9:D3:23:06:5B 00:56:48.866 -> N: Device detected: FC:FA:A7:37:38:2D 00:56:48.866 -> N: Device detected: F4:FE:FB:80:87:31 00:56:48.866 -> N: Subject: /BTtoMQTT/F4FEFB808731 00:56:48.866 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-74} 00:57:08.899 -> N: Device detected: 7E:B6:BF:EB:73:9C 00:57:08.899 -> N: Found 5 devices, scan number 4127 end deinit controller 00:57:08.899 -> N: BLE Connect begin 00:57:08.899 -> N: BLE Connect end 00:57:08.899 -> N: Scan begin 00:57:08.899 -> N: Device detected: FC:FA:A7:37:38:2D 00:57:08.899 -> N: Device detected: 66:F1:DF:CB:E9:BA 00:57:08.899 -> N: Device detected: 38:F9:D3:N: Device detected: 7E:B6:BF:EB:73:9C 00:57:08.899 -> N: Found 5 devices, scan number 4138 end deinit controller 00:57:08.899 -> N: BLE Connect begin 00:57:08.899 -> N: BLE Connect end 00:57:08.899 -> N: Scan begin 00:57:08.899 -> N: Device detected: FC:FA:A7:37:38:2D 00:57:08.899 -> N: Device detected: 66:F1:DF:CB:E9:BA 00:57:08.899 -> N: Device detected: 38:F9:D3:23:06:5B 00:57:08.899 -> N: Device detected: F4:FE:FB:80:87:31 00:57:08.899 -> N: Subject: /BTtoMQTT/F4FEFB808731 00:57:08.899 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-74} 00:57:08.899 -> N: Found 5 devices, scan number 4139 end deinit controller 00:57:08.899 -> N: BLE Connect begin 00:57:08.899 -> N: BLE Connect end 00:57:08.899 -> N: Scan begin 00:57:08.899 -> N: Device detected: 66:F1:DF:CB:E9:BA 00:57:08.899 -> N: Device detected: 7E:B6:BF:EB:73:9C 00:57:08.899 -> N: Device detected: FC:FA:A7:37:38:2D 00:57:08.899 -> N: Subject: /BTtoMQTT/FCFAA737382D 00:57:08.899 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-78,"servicedata":"5840fc03482d3837a7fafce66eaed80dd7061f7a8a7a"} 00:57:28.932 -> N: Device detected: F4:FE:FB:80:87:31 00:57:28.932 -> N: Subject: /BTtoMQTT/F4FEFB808731 00:57:28.932 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-75} 00:57:28.932 -> N: Device detected: 38:F9:D3:23:06:5B 00:57:28.932 -> N: Found 5 devices, scan number 4140 end deinit controller 00:57:28.932 -> N: BLE Connect begN: Subject: /SYStoMQTT 00:57:28.932 -> N: Received json : {"uptime":6606,"version":"version_tag","freemem":65212,"rssi":-64,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 00:57:28.932 -> N: Subject: /SYStoMQTT 00:57:28.932 -> N: Received json : {"uptime":6726,"version":"version_tag","freemem":65212,"rssi":-69,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 00:57:28.932 -> N: Subject: /SYStoMQTT 00:57:28.932 -> N: Received json : {"uptime":6846,"version":"version_tag","freemem":65212,"rssi":-70,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 00:57:28.932 -> N: Subject: /SYStoMQTT 00:57:48.964 -> N: Received json : {"uptime":6966,"version":"version_tag","freemem":65212,"rssi":-69,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 00:57:48.964 -> N: Subject: /SYStoMQTT 00:57:48.964 -> N: Received json : {"uptime":7086,"version":"version_tag","freemem":65212,"rssi":-63,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 00:57:48.964 -> N: Subject: /SYStoMQTT 00:57:48.964 -> N: Received json : {"uptime":7206,"version":"version_tag","freemem":65212,"rssi":-64,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 00:57:48.964 -> N: Subject: /SYStoMQTT 00:57:48.964 -> N: Received json : {"uptime":7326,"version":"version_tag","freemem":65212,"rssi":-69,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 00:57:48.964 -> N: Subject: /SYStoMQTT 00:57:48.964 -> N: Received json : {"uptime":7446,"version":"version_tag","freemem":65212,"rssi":-63,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 00:58:08.997 -> N: Subject: /SYStoMQTT 00:58:08.997 -> N: Received json : {"uptime":7566,"version":"version_tag","freemem":65212,"rssi":-63,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 00:58:08.997 -> N: Subject: /SYStoMQTT 00:58:08.997 -> N: Received json : {"uptime":7686,"version":"version_tag","freemem":65212,"rssi":-63,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 00:58:08.997 -> N: Subject: /SYStoMQTT 00:58:08.997 -> N: Received json : {"uptime":7806,"version":"version_tag","freemem":65212,"rssi":-64,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 00:58:08.997 -> N: Subject: /SYStoMQTT 00:58:08.997 -> N: Received json : {"uptime":7926,"version":"version_tag","freemem":65212,"rssi":-65,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 01:00:09.192 -> N: Subject: /SYStoMQTT 01:00:09.192 -> N: Received json : {"uptime":8046,"version":"version_tag","freemem":65212,"rssi":-69,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 01:02:09.388 -> N: Subject: /SYStoMQTT 01:02:09.388 -> N: Received json : {"uptime":8166,"version":"version_tag","freemem":65212,"rssi":-69,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"}


Everything returned to normal after manual restart.

PS: Scan_duration 1500 ScanBeforeConnect 1 TimeBtwRead 300

1technophile commented 4 years ago

Thanks for the feedback!

I will try to reproduce with your parameters.

sleepwalkera commented 4 years ago

The timing of failure is unpredictable, sometimes it will occur within an hour or two, and sometimes it will take several days.

1technophile commented 4 years ago

Could you try to reproduce with TRACE log level instead of NOTICE please. We will have better chance to catch the problem if we do it both.

sleepwalkera commented 4 years ago

14:50:51.814 -> N: Scan begin 14:50:51.814 -> T: Creating BLE buffer 14:50:51.814 -> N: Device detected: 56:CD:30:84:13:B5 14:50:51.814 -> T: getDeviceByMac 56:CD:30:84:13:B5 14:50:51.814 -> T: Manufacturer Data: 4c0010051b18a4c299 14:50:51.814 -> T: getDeviceByMac 56:CD:30:84:13:B5 14:50:51.814 -> T: manufacturerdata 4c0010051b18a4c299 14:50:51.814 -> T: Remove manufacturer data 14:50:51.814 -> N: Subject: /BTtoMQTT/56CD308413B5 14:50:51.814 -> N: Received json : {"id":"56:CD:30:84:13:B5","rssi":-69,"txpower":12} 14:50:51.814 -> T: jsonPublishing 14:50:51.814 -> N: Found 1 devices, scan number 5195 end deinit controller 14:50:51.814 -> N: BLE Connect begin 14:50:51.814 -> N: BLE Connect end 14:50:51.814 -> T: BT Task running on core: 0 14:50:51.814 -> N: Scan begin 14:50:51.814 -> T: Creating BLE buffer 14:50:51.814 -> N: Device detected: 56:CD:30:84:13:B5 14:50:51.814 -> T: getDeviceByMac 56:CD:30:84:13:B5 14:50:51.814 -> T: Manufacturer Data: 4c0010051b18a4c299 14:51:11.848 -> T: getDeviceByMac 56:CD:30:84:13:B5 14:51:11.848 -> T: manufacturerdata 4c0010051b18a4c299 14:51:11.848 -> T: Remove manufacturer data 14:51:11.848 -> N: Subject: /BTtoMQTT/56CD308413B5 14:51:11.848 -> N: Received json : {"id":"56:CD:30:84:13:B5","rssi":-69,"txpower":12} 14:51:11.848 -> T: jsonPublishing 14:51:11.848 -> N: FouT: BT Task running on core: 0 14:51:11.848 -> N: Scan begin 14:51:11.848 -> T: Creating BLE buffer 14:51:11.848 -> N: Device detected: 56:CD:30:84:13:B5 14:51:11.848 -> T: getDeviceByMac 56:CD:30:84:13:B5 14:51:11.848 -> T: Manufacturer Data: 4c0010051b18a4c299 14:51:11.848 -> T: getDeviceByMac 56:CD:30:84:13:B5 14:51:11.848 -> T: manufacturerdata 4c0010051b18a4c299 14:51:11.848 -> T: Remove manufacturer data 14:51:11.848 -> N: Subject: /BTtoMQTT/56CD308413B5 14:51:11.848 -> N: Received json : {"id":"56:CD:30:84:13:B5","rssi":-78,"txpower":12} 14:51:11.848 -> T: jsonPublishing 14:51:11.848 -> N: Found 1 devices, scan number 5207 end deinit controller 14:51:11.848 -> N: BLE Connect begin 14:51:11.848 -> N: BLE Connect end 14:51:11.848 -> T: BT Task running on core: 0 14:51:11.848 -> N: Scan begin 14:51:11.848 -> T: Creating BLE buffer 14:51:11.848 -> N: Device detected: 56:CD:30:84:13:B5 14:51:11.848 -> T: getDeviceByMac 56:CD:30:84:13:B5 14:51:11.848 -> T: Manufacturer Data: 4c0010051b18a4c299 14:51:11.848 -> T: getDeviceByMac 56:CD:30:84:13:B5 14:51:11.848 -> T: manufacturerdata 4c0010051b18a4c299 14:51:31.881 -> T: Remove manufacturer data 14:51:31.881 -> N: Subject: /BTtoMQTT/56CD308413B5 14:51:31.881 -> N: Received json : {"id":"56:CD:30:84:13:B5","rssi":-78,"txpower":12} 14:51:31.881 -> T: jsonPublishing 14:51:31.881 -> N: Found 1 devices, scan number 5208 end deinit controller 14:51:31.881 -> N: BLE Connect begin 14:51:31.881 -> N: BLE Connect end 14:51:31.881 -> T: BT N: Found 1 devices, scan number 5219 end deinit controller 14:51:31.881 -> N: BLE Connect begin 14:51:31.881 -> N: BLE Connect end 14:51:31.881 -> T: BT Task running on core: 0 14:51:31.881 -> N: Scan begin 14:51:31.881 -> T: Creating BLE buffer 14:51:31.881 -> N: Device detected: 70:D6:7A:03:77:8F 14:51:31.881 -> T: getDeviceByMac 70:D6:7A:03:77:8F 14:51:31.881 -> T: Manufacturer Data: 4c00100503188a36ce 14:51:31.881 -> T: Low rssi, device filtered 14:51:31.881 -> T: Creating BLE buffer 14:51:31.881 -> N: Device detected: 54:AF:A6:43:E4:F1 14:51:31.881 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:51:31.881 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:51:31.881 -> T: Low rssi, device filtered 14:51:31.881 -> N: Found 2 devices, scan number 5220 end deinit controller 14:51:31.881 -> N: BLE Connect begin 14:51:31.881 -> N: BLE Connect end 14:51:31.881 -> T: BT Task running on core: 0 14:51:31.881 -> N: Scan begin 14:51:31.881 -> T: Creating BLE buffer 14:51:31.881 -> N: Device detected: 54:AF:A6:43:E4:F1 14:51:31.881 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:51:31.881 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:51:31.881 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:51:51.915 -> T: manufacturerdata 4c0010051a1c0e88f0 14:51:51.915 -> T: Remove manufacturer data 14:51:51.915 -> N: Subject: /BTtoMQTT/54AFA643E4F1 14:51:51.915 -> N: Received json : {"id":"54:AF:A6:43:E4:F1","rssi":-73,"txpower":12} 14:51:51.915 -> T: jsonPublishing 14:51:51.915 -> N: Found 1 devices, scan number 5221T: Creating BLE buffer 14:51:51.915 -> N: Device detected: 54:AF:A6:43:E4:F1 14:51:51.915 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:51:51.915 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:51:51.915 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:51:51.915 -> T: manufacturerdata 4c0010051a1c0e88f0 14:51:51.915 -> T: Remove manufacturer data 14:51:51.915 -> N: Subject: /BTtoMQTT/54AFA643E4F1 14:51:51.915 -> N: Received json : {"id":"54:AF:A6:43:E4:F1","rssi":-74,"txpower":12} 14:51:51.915 -> T: jsonPublishing 14:51:51.915 -> N: Found 1 devices, scan number 5232 end deinit controller 14:51:51.915 -> N: BLE Connect begin 14:51:51.915 -> N: BLE Connect end 14:51:51.915 -> T: BT Task running on core: 0 14:51:51.915 -> N: Scan begin 14:51:51.915 -> T: Creating BLE buffer 14:51:51.915 -> N: Device detected: 54:AF:A6:43:E4:F1 14:51:51.915 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:51:51.915 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:51:51.915 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:51:51.915 -> T: manufacturerdata 4c0010051a1c0e88f0 14:51:51.915 -> T: Remove manufacturer data 14:51:51.915 -> N: Subject: /BTtoMQTT/54AFA643E4F1 14:52:11.949 -> N: Received json : {"id":"54:AF:A6:43:E4:F1","rssi":-74,"txpower":12} 14:52:11.949 -> T: jsonPublishing 14:52:11.949 -> N: Found 1 devices, scan number 5233 end deinit controller 14:52:11.949 -> N: BLE Connect begin 14:52:11.949 -> N: BLE Connect end 14:52:11.949 -> T: BT Task running on core: 0 14:52:11.949 -> N: Scan begin 14:52:11.949 -> T: CreN: Found 1 devices, scan number 5244 end deinit controller 14:52:11.949 -> N: BLE Connect begin 14:52:11.949 -> N: BLE Connect end 14:52:11.949 -> T: BT Task running on core: 0 14:52:11.949 -> N: Scan begin 14:52:11.949 -> T: Creating BLE buffer 14:52:11.949 -> N: Device detected: 54:AF:A6:43:E4:F1 14:52:11.949 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:52:11.949 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:52:11.949 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:52:11.949 -> T: manufacturerdata 4c0010051a1c0e88f0 14:52:11.949 -> T: Remove manufacturer data 14:52:11.949 -> N: Subject: /BTtoMQTT/54AFA643E4F1 14:52:11.949 -> N: Received json : {"id":"54:AF:A6:43:E4:F1","rssi":-76,"txpower":12} 14:52:11.949 -> T: jsonPublishing 14:52:11.949 -> T: Creating BLE buffer 14:52:11.949 -> N: Device detected: 70:D6:7A:03:77:8F 14:52:11.949 -> T: getDeviceByMac 70:D6:7A:03:77:8F 14:52:11.949 -> T: Manufacturer Data: 4c00100503188a36ce 14:52:11.949 -> T: Low rssi, device filtered 14:52:11.949 -> N: Found 2 devices, scan number 5245 end deinit controller 14:52:11.949 -> N: BLE Connect begin 14:52:11.949 -> N: BLE Connect end 14:52:31.983 -> T: BT Task running on core: 0 14:52:31.983 -> N: Scan begin 14:52:31.983 -> T: Creating BLE buffer 14:52:31.983 -> N: Device detected: 54:AF:A6:43:E4:F1 14:52:31.983 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:52:31.983 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:52:31.983 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:52:31.983 -> T: manufacturerdata 4c0010051N: Found 1 devices, scan number 5257 end deinit controller 14:52:31.983 -> N: BLE Connect begin 14:52:31.983 -> N: BLE Connect end 14:52:31.983 -> T: BT Task running on core: 0 14:52:31.983 -> N: Scan begin 14:52:31.983 -> T: Creating BLE buffer 14:52:31.983 -> N: Device detected: 54:AF:A6:43:E4:F1 14:52:31.983 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:52:31.983 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:52:31.983 -> T: Low rssi, device filtered 14:52:31.983 -> N: Found 1 devices, scan number 5258 end deinit controller 14:52:31.983 -> N: BLE Connect begin 14:52:31.983 -> N: BLE Connect end 14:52:31.983 -> T: BT Task running on core: 0 14:52:31.983 -> N: Scan begin 14:52:31.983 -> T: Creating BLE buffer 14:52:31.983 -> N: Device detected: 54:AF:A6:43:E4:F1 14:52:31.983 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:52:31.983 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:52:31.983 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:52:31.983 -> T: manufacturerdata 4c0010051a1c0e88f0 14:52:31.983 -> T: Remove manufacturer data 14:52:31.983 -> N: Subject: /BTtoMQTT/54AFA643E4F1 14:52:31.983 -> N: Received json : {"id":"54:AF:A6:43:E4:F1","rssi":-77,"txpower":12} 14:52:52.017 -> T: jsonPublishing 14:52:52.017 -> N: Found 1 devices, scan number 5259 end deinit controller 14:52:52.017 -> N: BLE Connect begin 14:52:52.017 -> T: retrieving value of system characteristics Uptime (s):8523 14:52:52.017 -> N: Subject: /SYStoMQTT 14:52:52.017 -> N: Received json : {"uptime":8523,"verN: BLE Connect end 14:52:52.017 -> T: BT Task running on core: 0 14:52:52.017 -> N: Scan begin 14:52:52.017 -> T: Creating BLE buffer 14:52:52.017 -> N: Device detected: 54:AF:A6:43:E4:F1 14:52:52.017 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:52:52.017 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:52:52.017 -> T: Low rssi, device filtered 14:52:52.017 -> N: Found 1 devices, scan number 5270 end deinit controller 14:52:52.017 -> N: BLE Connect begin 14:52:52.017 -> N: BLE Connect end 14:52:52.017 -> T: BT Task running on core: 0 14:52:52.017 -> N: Scan begin 14:52:52.017 -> T: Creating BLE buffer 14:52:52.017 -> N: Device detected: 54:AF:A6:43:E4:F1 14:52:52.017 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:52:52.017 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:52:52.017 -> T: Low rssi, device filtered 14:52:52.017 -> N: Found 1 devices, scan number 5271 end deinit controller 14:52:52.017 -> N: BLE Connect begin 14:52:52.017 -> N: BLE Connect end 14:52:52.017 -> T: BT Task running on core: 0 14:52:52.017 -> N: Scan begin 14:52:52.017 -> T: Creating BLE buffer 14:52:52.017 -> N: Device detected: 54:AF:A6:43:E4:F1 14:52:52.017 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:53:12.050 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:53:12.050 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:53:12.050 -> T: manufacturerdata 4c0010051a1c0e88f0 14:53:12.050 -> T: Remove manufacturer data 14:53:12.050 -> N: Subject: /BTtoMQTT/54AFA643E4F1 14:53:12.050 -> N: Received json : {"id":"54:AF:A6:43:E4:F1","rssi":-78,"txpoT: Creating BLE buffer 14:53:12.050 -> N: Device detected: 54:AF:A6:43:E4:F1 14:53:12.050 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:53:12.050 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:53:12.050 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:53:12.050 -> T: manufacturerdata 4c0010051a1c0e88f0 14:53:12.050 -> T: Remove manufacturer data 14:53:12.050 -> N: Subject: /BTtoMQTT/54AFA643E4F1 14:53:12.050 -> N: Received json : {"id":"54:AF:A6:43:E4:F1","rssi":-76,"txpower":12} 14:53:12.050 -> T: jsonPublishing 14:53:12.050 -> N: Found 1 devices, scan number 5282 end deinit controller 14:53:12.050 -> N: BLE Connect begin 14:53:12.050 -> N: BLE Connect end 14:53:12.050 -> T: BT Task running on core: 0 14:53:12.050 -> N: Scan begin 14:53:12.050 -> T: Creating BLE buffer 14:53:12.050 -> N: Device detected: 54:AF:A6:43:E4:F1 14:53:12.050 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:53:12.050 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:53:12.050 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:53:12.050 -> T: manufacturerdata 4c0010051a1c0e88f0 14:53:12.050 -> T: Remove manufacturer data 14:53:12.050 -> N: Subject: /BTtoMQTT/54AFA643E4F1 14:53:32.084 -> N: Received json : {"id":"54:AF:A6:43:E4:F1","rssi":-77,"txpower":12} 14:53:32.084 -> T: jsonPublishing 14:53:32.084 -> N: Found 1 devices, scan number 5283 end deinit controller 14:53:32.084 -> N: BLE Connect begin 14:53:32.084 -> N: BLE Connect end 14:53:32.084 -> T: BT Task running on core: 0 14:53:32.084 -> N: Scan begin 14:53:32.084 -> N: FouN: BLE Connect end 14:53:32.084 -> T: BT Task running on core: 0 14:53:32.084 -> N: Scan begin 14:53:32.084 -> T: Creating BLE buffer 14:53:32.084 -> N: Device detected: 54:AF:A6:43:E4:F1 14:53:32.084 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:53:32.084 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:53:32.084 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:53:32.084 -> T: manufacturerdata 4c0010051a1c0e88f0 14:53:32.084 -> T: Remove manufacturer data 14:53:32.084 -> N: Subject: /BTtoMQTT/54AFA643E4F1 14:53:32.084 -> N: Received json : {"id":"54:AF:A6:43:E4:F1","rssi":-76,"txpower":12} 14:53:32.084 -> T: jsonPublishing 14:53:32.084 -> N: Found 2 devices, scan number 5295 end deinit controller 14:53:32.084 -> N: BLE Connect begin 14:53:32.084 -> N: BLE Connect end 14:53:32.084 -> T: BT Task running on core: 0 14:53:32.084 -> N: Scan begin 14:53:32.084 -> T: Creating BLE buffer 14:53:32.084 -> N: Device detected: 54:AF:A6:43:E4:F1 14:53:32.084 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:53:32.084 -> T: Manufacturer Data: 4c0010051a1c0e88f0 14:53:32.084 -> T: getDeviceByMac 54:AF:A6:43:E4:F1 14:53:32.084 -> T: manufacturerdata 4c0010051a1c0e88f0 14:53:52.118 -> T: Remove manufacturer data 14:53:52.118 -> N: Subject: /BTtoMQTT/54AFA643E4F1 14:53:52.118 -> N: Received json : {"id":"54:AF:A6:43:E4:F1","rssi":-75,"txpower":12} 14:53:52.118 -> T: jsonPublishing 14:53:52.118 -> N: Found 1 devices, scan number 5296 end deinit controller 14:53:52.118 -> N: BLE Connect begin 14:53:52.118 -> N: BLEW: disconnection_handling, failed 1 times 14:53:52.118 -> W: Attempt to reinit wifi: 0 14:53:52.118 -> W: MQTT connection... 14:53:52.118 -> N: Connected to broker 14:53:52.118 -> T: Subscription OK to the subjects 14:53:52.118 -> T: retrieving value of system characteristics Uptime (s):8643 14:53:52.118 -> N: Subject: /SYStoMQTT 14:53:52.118 -> N: Received json : {"uptime":8643,"version":"version_tag","freemem":41496,"rssi":-37,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 14:53:52.118 -> T: jsonPublishing 14:53:52.118 -> T: retrieving value of system characteristics Uptime (s):8763 14:53:52.118 -> N: Subject: /SYStoMQTT 14:53:52.118 -> N: Received json : {"uptime":8763,"version":"version_tag","freemem":41524,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 14:54:12.152 -> T: jsonPublishing 14:54:12.152 -> T: retrieving value of system characteristics Uptime (s):8883 14:54:12.152 -> N: Subject: /SYStoMQTT 14:54:12.152 -> N: Received json : {"uptime":8883,"version":"version_tag","freemem":41524,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 14:54:12.152 -> T: jsonPublishing 14:54:12.152 -> T: retrieving value of system characteristics Uptime (s):9003 14:54:12.152 -> N: Subject: /SYStoMQTT 14:54:12.152 -> N: Received json : {"uptime":9003,"version":"version_tag","freemem":39636,"rssi":-38,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 14:54:12.152 -> T: jsonPublishing 14:54:12.152 -> T: retrieving value of system characteristics Uptime (s):9123 14:54:12.152 -> N: Subject: /SYStoMQTT 14:54:12.152 -> N: Received json : {"uptime":9123,"version":"version_tag","freemem":41348,"rssi":-48,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 14:54:12.152 -> T: jsonPublishing 14:54:12.152 -> T: retrieving value of system characteristics Uptime (s):9243 14:54:32.185 -> N: Subject: /SYStoMQTT 14:54:32.185 -> N: Received json : {"uptime":9243,"version":"version_tag","freemem":41348,"rssi":-48,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 14:54:32.185 -> T: jsonPublishing 14:54:32.185 -> T: retrieving value of system characteristics Uptime (s):9363 14:54:32.185 -> N: Subject: /SYStoMQTT 14:54:32.185 -> N: Received json : {"uptime":9363,"version":"version_tag","freemem":41348,"rssi":-48,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 14:54:32.185 -> T: jsonPublishing 14:54:32.185 -> T: retrieving value of system characteristics Uptime (s):9483 14:54:32.185 -> N: Subject: /SYStoMQTT 14:54:32.185 -> N: Received json : {"uptime":9483,"version":"version_tag","freemem":41348,"rssi":-48,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 14:54:32.185 -> T: jsonPublishing 14:54:32.185 -> T: retrieving value of system characteristics Uptime (s):9603 14:54:52.219 -> N: Subject: /SYStoMQTT 14:54:52.219 -> N: Received json : {"uptime":9603,"version":"version_tag","freemem":41348,"rssi":-48,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 14:54:52.219 -> T: jsonPublishing 14:54:52.219 -> T: retrieving value of system characteristics Uptime (s):9723 14:54:52.219 -> N: Subject: /SYStoMQTT 14:54:52.219 -> N: Received json : {"uptime":9723,"version":"version_tag","freemem":41348,"rssi":-48,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 14:54:52.219 -> T: jsonPublishing 14:54:52.219 -> T: retrieving value of system characteristics Uptime (s):9843 14:54:52.219 -> N: Subject: /SYStoMQTT 14:54:52.219 -> N: Received json : {"uptime":9843,"version":"version_tag","freemem":41348,"rssi":-48,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 14:54:52.219 -> T: jsonPublishing 14:55:12.253 -> T: retrieving value of system characteristics Uptime (s):9963 14:55:12.253 -> N: Subject: /SYStoMQTT 14:55:12.253 -> N: Received json : {"uptime":9963,"version":"version_tag","freemem":41348,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 14:55:12.253 -> T: jsonPublishing 14:57:12.456 -> T: retrieving value of system characteristics Uptime (s):10083 14:57:12.456 -> N: Subject: /SYStoMQTT 14:57:12.456 -> N: Received json : {"uptime":10083,"version":"version_tag","freemem":41348,"rssi":-48,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 14:57:12.456 -> T: jsonPublishing 14:59:12.659 -> T: retrieving value of system characteristics Uptime (s):10203 14:59:12.659 -> N: Subject: /SYStoMQTT 14:59:12.659 -> N: Received json : {"uptime":10203,"version":"version_tag","freemem":41348,"rssi":-48,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 14:59:12.659 -> T: jsonPublishing 15:01:12.861 -> T: retrieving value of system characteristics Uptime (s):10323 15:01:12.861 -> N: Subject: /SYStoMQTT 15:01:12.861 -> N: Received json : {"uptime":10323,"version":"version_tag","freemem":41348,"rssi":-48,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:01:12.861 -> T: jsonPublishing 15:02:12.963 -> W: MQTT connection... 15:02:12.963 -> W: failure_number_mqtt: 1 15:02:12.963 -> W: failed, rc=-2 15:02:12.963 -> W: disconnection_handling, failed 1 times 15:02:12.963 -> W: Attempt to reinit wifi: 0 15:02:12.963 -> W: wifi disconnected 15:02:32.997 -> W: disconnection_handling, failed 1 times 15:02:32.997 -> W: Attempt to reinit wifi: 0 15:02:32.997 -> W: MQTT connection... 15:02:32.997 -> N: Connected to broker 15:02:32.997 -> T: Subscription OK to the subjects 15:02:32.997 -> W: MQTT connection... 15:02:32.997 -> N: Connected to broker 15:02:32.997 -> T: Subscription OK to the subjects 15:03:13.064 -> T: retrieving value of system characteristics Uptime (s):10443 15:03:13.064 -> N: Subject: /SYStoMQTT 15:03:13.064 -> N: Received json : {"uptime":10443,"version":"version_tag","freemem":41356,"rssi":-39,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:03:13.064 -> T: jsonPublishing 15:05:13.267 -> T: retrieving value of system characteristics Uptime (s):10563 15:05:13.267 -> N: Subject: /SYStoMQTT 15:05:13.267 -> N: Received json : {"uptime":10563,"version":"version_tag","freemem":41384,"rssi":-48,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:05:13.267 -> T: jsonPublishing 15:06:52.740 -> T: retrieving value of system characteristics Uptime (s):10683 15:06:52.778 -> N: Subject: /SYStoMQTT 15:06:52.778 -> N: Received json : {"uptime":10683,"version":"version_tag","freemem":41384,"rssi":-44,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:06:52.778 -> T: jsonPublishing 15:08:52.744 -> T: retrieving value of system characteristics Uptime (s):10803 15:08:52.778 -> N: Subject: /SYStoMQTT 15:08:52.778 -> N: Received json : {"uptime":10803,"version":"version_tag","freemem":41204,"rssi":-42,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:08:52.778 -> T: jsonPublishing 15:10:52.763 -> T: retrieving value of system characteristics Uptime (s):10923 15:10:52.763 -> N: Subject: /SYStoMQTT 15:10:52.763 -> N: Received json : {"uptime":10923,"version":"version_tag","freemem":41204,"rssi":-41,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:10:52.791 -> T: jsonPublishing 15:12:52.761 -> T: retrieving value of system characteristics Uptime (s):11043 15:12:52.796 -> N: Subject: /SYStoMQTT 15:12:52.796 -> N: Received json : {"uptime":11043,"version":"version_tag","freemem":41204,"rssi":-43,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:12:52.796 -> T: jsonPublishing 15:14:52.768 -> T: retrieving value of system characteristics Uptime (s):11163 15:14:52.768 -> N: Subject: /SYStoMQTT 15:14:52.803 -> N: Received json : {"uptime":11163,"version":"version_tag","freemem":41204,"rssi":-48,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:14:52.803 -> T: jsonPublishing 15:16:52.779 -> T: retrieving value of system characteristics Uptime (s):11283 15:16:52.779 -> N: Subject: /SYStoMQTT 15:16:52.779 -> N: Received json : {"uptime":11283,"version":"version_tag","freemem":41204,"rssi":-42,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:16:52.813 -> T: jsonPublishing 15:18:52.796 -> T: retrieving value of system characteristics Uptime (s):11403 15:18:52.796 -> N: Subject: /SYStoMQTT 15:18:52.796 -> N: Received json : {"uptime":11403,"version":"version_tag","freemem":41204,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:18:52.832 -> T: jsonPublishing 15:20:52.797 -> T: retrieving value of system characteristics Uptime (s):11523 15:20:52.797 -> N: Subject: /SYStoMQTT 15:20:52.797 -> N: Received json : {"uptime":11523,"version":"version_tag","freemem":41204,"rssi":-46,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:20:52.832 -> T: jsonPublishing 15:22:52.804 -> T: retrieving value of system characteristics Uptime (s):11643 15:22:52.804 -> N: Subject: /SYStoMQTT 15:22:52.804 -> N: Received json : {"uptime":11643,"version":"version_tag","freemem":41204,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:22:52.842 -> T: jsonPublishing 15:24:52.813 -> T: retrieving value of system characteristics Uptime (s):11763 15:24:52.813 -> N: Subject: /SYStoMQTT 15:24:52.813 -> N: Received json : {"uptime":11763,"version":"version_tag","freemem":41204,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:24:52.848 -> T: jsonPublishing 15:26:52.830 -> T: retrieving value of system characteristics Uptime (s):11883 15:26:52.830 -> N: Subject: /SYStoMQTT 15:26:52.830 -> N: Received json : {"uptime":11883,"version":"version_tag","freemem":41204,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:26:52.830 -> T: jsonPublishing 15:29:11.651 -> T: retrieving value of system characteristics Uptime (s):12003 15:29:11.651 -> N: Subject: /SYStoMQTT 15:29:11.651 -> N: Received json : {"uptime":12003,"version":"version_tag","freemem":41204,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:29:11.651 -> T: jsonPublishing 15:31:11.854 -> T: retrieving value of system characteristics Uptime (s):12123 15:31:11.854 -> N: Subject: /SYStoMQTT 15:31:11.854 -> N: Received json : {"uptime":12123,"version":"version_tag","freemem":41204,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:31:11.854 -> T: jsonPublishing 15:33:12.060 -> T: retrieving value of system characteristics Uptime (s):12243 15:33:12.060 -> N: Subject: /SYStoMQTT 15:33:12.060 -> N: Received json : {"uptime":12243,"version":"version_tag","freemem":41204,"rssi":-47,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:33:12.060 -> T: jsonPublishing 15:35:12.263 -> T: retrieving value of system characteristics Uptime (s):12363 15:35:12.263 -> N: Subject: /SYStoMQTT 15:35:12.263 -> N: Received json : {"uptime":12363,"version":"version_tag","freemem":41204,"rssi":-41,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:35:12.263 -> T: jsonPublishing 15:37:12.466 -> T: retrieving value of system characteristics Uptime (s):12483 15:37:12.466 -> N: Subject: /SYStoMQTT 15:37:12.466 -> N: Received json : {"uptime":12483,"version":"version_tag","freemem":41204,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:37:12.466 -> T: jsonPublishing 15:39:12.668 -> T: retrieving value of system characteristics Uptime (s):12603 15:39:12.668 -> N: Subject: /SYStoMQTT 15:39:12.668 -> N: Received json : {"uptime":12603,"version":"version_tag","freemem":41204,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:39:12.668 -> T: jsonPublishing 15:41:12.871 -> T: retrieving value of system characteristics Uptime (s):12723 15:41:12.871 -> N: Subject: /SYStoMQTT 15:41:12.871 -> N: Received json : {"uptime":12723,"version":"version_tag","freemem":41204,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:41:12.871 -> T: jsonPublishing 15:43:13.073 -> T: retrieving value of system characteristics Uptime (s):12843 15:43:13.073 -> N: Subject: /SYStoMQTT 15:43:13.073 -> N: Received json : {"uptime":12843,"version":"version_tag","freemem":41204,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:43:13.073 -> T: jsonPublishing 15:45:13.275 -> T: retrieving value of system characteristics Uptime (s):12963 15:45:13.275 -> N: Subject: /SYStoMQTT 15:45:13.275 -> N: Received json : {"uptime":12963,"version":"version_tag","freemem":41204,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:45:13.275 -> T: jsonPublishing 15:47:13.478 -> T: retrieving value of system characteristics Uptime (s):13083 15:47:13.478 -> N: Subject: /SYStoMQTT 15:47:13.478 -> N: Received json : {"uptime":13083,"version":"version_tag","freemem":41204,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:47:13.478 -> T: jsonPublishing 15:49:13.680 -> T: retrieving value of system characteristics Uptime (s):13203 15:49:13.680 -> N: Subject: /SYStoMQTT 15:49:13.680 -> N: Received json : {"uptime":13203,"version":"version_tag","freemem":41204,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:49:13.680 -> T: jsonPublishing 15:51:13.883 -> T: retrieving value of system characteristics Uptime (s):13323 15:51:13.883 -> N: Subject: /SYStoMQTT 15:51:13.883 -> N: Received json : {"uptime":13323,"version":"version_tag","freemem":41204,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:51:13.883 -> T: jsonPublishing 15:53:14.085 -> T: retrieving value of system characteristics Uptime (s):13443 15:53:14.085 -> N: Subject: /SYStoMQTT 15:53:14.085 -> N: Received json : {"uptime":13443,"version":"version_tag","freemem":41204,"rssi":-41,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:53:14.085 -> T: jsonPublishing 15:55:14.288 -> T: retrieving value of system characteristics Uptime (s):13563 15:55:14.288 -> N: Subject: /SYStoMQTT 15:55:14.288 -> N: Received json : {"uptime":13563,"version":"version_tag","freemem":41204,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:55:14.288 -> T: jsonPublishing 15:57:14.490 -> T: retrieving value of system characteristics Uptime (s):13683 15:57:14.490 -> N: Subject: /SYStoMQTT 15:57:14.490 -> N: Received json : {"uptime":13683,"version":"version_tag","freemem":41204,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:57:14.490 -> T: jsonPublishing 15:59:14.692 -> T: retrieving value of system characteristics Uptime (s):13803 15:59:14.692 -> N: Subject: /SYStoMQTT 15:59:14.692 -> N: Received json : {"uptime":13803,"version":"version_tag","freemem":41204,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 15:59:14.692 -> T: jsonPublishing 16:01:14.895 -> T: retrieving value of system characteristics Uptime (s):13923 16:01:14.895 -> N: Subject: /SYStoMQTT 16:01:14.895 -> N: Received json : {"uptime":13923,"version":"version_tag","freemem":41204,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:01:14.895 -> T: jsonPublishing 16:03:15.097 -> T: retrieving value of system characteristics Uptime (s):14043 16:03:15.097 -> N: Subject: /SYStoMQTT 16:03:15.097 -> N: Received json : {"uptime":14043,"version":"version_tag","freemem":41204,"rssi":-44,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:03:15.097 -> T: jsonPublishing 16:05:15.300 -> T: retrieving value of system characteristics Uptime (s):14163 16:05:15.300 -> N: Subject: /SYStoMQTT 16:05:15.300 -> N: Received json : {"uptime":14163,"version":"version_tag","freemem":41204,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:05:15.300 -> T: jsonPublishing 16:07:15.502 -> T: retrieving value of system characteristics Uptime (s):14283 16:07:15.502 -> N: Subject: /SYStoMQTT 16:07:15.502 -> N: Received json : {"uptime":14283,"version":"version_tag","freemem":41204,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:07:15.502 -> T: jsonPublishing 16:09:15.705 -> T: retrieving value of system characteristics Uptime (s):14403 16:09:15.705 -> N: Subject: /SYStoMQTT 16:09:15.705 -> N: Received json : {"uptime":14403,"version":"version_tag","freemem":41204,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:09:15.705 -> T: jsonPublishing 16:11:15.907 -> T: retrieving value of system characteristics Uptime (s):14523 16:11:15.907 -> N: Subject: /SYStoMQTT 16:11:15.907 -> N: Received json : {"uptime":14523,"version":"version_tag","freemem":41204,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:11:15.907 -> T: jsonPublishing 16:13:16.110 -> T: retrieving value of system characteristics Uptime (s):14643 16:13:16.110 -> N: Subject: /SYStoMQTT 16:13:16.110 -> N: Received json : {"uptime":14643,"version":"version_tag","freemem":41204,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:13:16.110 -> T: jsonPublishing 16:15:16.313 -> T: retrieving value of system characteristics Uptime (s):14763 16:15:16.313 -> N: Subject: /SYStoMQTT 16:15:16.313 -> N: Received json : {"uptime":14763,"version":"version_tag","freemem":41204,"rssi":-38,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:15:16.313 -> T: jsonPublishing 16:17:16.515 -> T: retrieving value of system characteristics Uptime (s):14883 16:17:16.515 -> N: Subject: /SYStoMQTT 16:17:16.515 -> N: Received json : {"uptime":14883,"version":"version_tag","freemem":41204,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:17:16.515 -> T: jsonPublishing 16:19:16.718 -> T: retrieving value of system characteristics Uptime (s):15003 16:19:16.718 -> N: Subject: /SYStoMQTT 16:19:16.718 -> N: Received json : {"uptime":15003,"version":"version_tag","freemem":41204,"rssi":-39,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:19:16.718 -> T: jsonPublishing 16:21:16.920 -> T: retrieving value of system characteristics Uptime (s):15123 16:21:16.920 -> N: Subject: /SYStoMQTT 16:21:16.920 -> N: Received json : {"uptime":15123,"version":"version_tag","freemem":41204,"rssi":-44,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:21:16.920 -> T: jsonPublishing 16:22:17.021 -> W: MQTT connection... 16:22:17.021 -> W: failure_number_mqtt: 1 16:22:17.021 -> W: failed, rc=-2 16:22:17.021 -> W: disconnection_handling, failed 1 times 16:22:17.021 -> W: Attempt to reinit wifi: 0 16:22:17.021 -> W: wifi disconnected 16:22:37.055 -> W: disconnection_handling, failed 1 times 16:22:37.055 -> W: Attempt to reinit wifi: 0 16:22:37.055 -> W: MQTT connection... 16:22:37.055 -> N: Connected to broker 16:22:37.055 -> T: Subscription OK to the subjects 16:23:17.123 -> T: retrieving value of system characteristics Uptime (s):15243 16:23:17.123 -> N: Subject: /SYStoMQTT 16:23:17.123 -> N: Received json : {"uptime":15243,"version":"version_tag","freemem":41496,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:23:17.123 -> T: jsonPublishing 16:25:17.325 -> T: retrieving value of system characteristics Uptime (s):15363 16:25:17.325 -> N: Subject: /SYStoMQTT 16:25:17.325 -> N: Received json : {"uptime":15363,"version":"version_tag","freemem":39816,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:25:17.325 -> T: jsonPublishing 16:27:17.528 -> T: retrieving value of system characteristics Uptime (s):15483 16:27:17.528 -> N: Subject: /SYStoMQTT 16:27:17.528 -> N: Received json : {"uptime":15483,"version":"version_tag","freemem":41524,"rssi":-39,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:27:17.528 -> T: jsonPublishing 16:29:17.730 -> T: retrieving value of system characteristics Uptime (s):15603 16:29:17.730 -> N: Subject: /SYStoMQTT 16:29:17.730 -> N: Received json : {"uptime":15603,"version":"version_tag","freemem":41348,"rssi":-41,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:29:17.730 -> T: jsonPublishing 16:31:17.933 -> T: retrieving value of system characteristics Uptime (s):15723 16:31:17.933 -> N: Subject: /SYStoMQTT 16:31:17.933 -> N: Received json : {"uptime":15723,"version":"version_tag","freemem":41348,"rssi":-41,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:31:17.933 -> T: jsonPublishing 16:33:18.135 -> T: retrieving value of system characteristics Uptime (s):15843 16:33:18.135 -> N: Subject: /SYStoMQTT 16:33:18.135 -> N: Received json : {"uptime":15843,"version":"version_tag","freemem":41348,"rssi":-44,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:33:18.135 -> T: jsonPublishing 16:35:18.338 -> T: retrieving value of system characteristics Uptime (s):15963 16:35:18.338 -> N: Subject: /SYStoMQTT 16:35:18.338 -> N: Received json : {"uptime":15963,"version":"version_tag","freemem":41348,"rssi":-43,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:35:18.338 -> T: jsonPublishing 16:37:18.540 -> T: retrieving value of system characteristics Uptime (s):16083 16:37:18.540 -> N: Subject: /SYStoMQTT 16:37:18.540 -> N: Received json : {"uptime":16083,"version":"version_tag","freemem":41348,"rssi":-43,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:37:18.540 -> T: jsonPublishing 16:39:18.743 -> T: retrieving value of system characteristics Uptime (s):16203 16:39:18.743 -> N: Subject: /SYStoMQTT 16:39:18.743 -> N: Received json : {"uptime":16203,"version":"version_tag","freemem":41348,"rssi":-43,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:39:18.743 -> T: jsonPublishing 16:41:18.945 -> T: retrieving value of system characteristics Uptime (s):16323 16:41:18.945 -> N: Subject: /SYStoMQTT 16:41:18.945 -> N: Received json : {"uptime":16323,"version":"version_tag","freemem":41348,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:41:18.945 -> T: jsonPublishing 16:43:19.148 -> T: retrieving value of system characteristics Uptime (s):16443 16:43:19.148 -> N: Subject: /SYStoMQTT 16:43:19.148 -> N: Received json : {"uptime":16443,"version":"version_tag","freemem":41348,"rssi":-46,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:43:19.148 -> T: jsonPublishing 16:45:19.350 -> T: retrieving value of system characteristics Uptime (s):16563 16:45:19.350 -> N: Subject: /SYStoMQTT 16:45:19.350 -> N: Received json : {"uptime":16563,"version":"version_tag","freemem":41348,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:45:19.350 -> T: jsonPublishing 16:47:19.553 -> T: retrieving value of system characteristics Uptime (s):16683 16:47:19.553 -> N: Subject: /SYStoMQTT 16:47:19.553 -> N: Received json : {"uptime":16683,"version":"version_tag","freemem":41348,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:47:19.553 -> T: jsonPublishing 16:49:19.755 -> T: retrieving value of system characteristics Uptime (s):16803 16:49:19.755 -> N: Subject: /SYStoMQTT 16:49:19.755 -> N: Received json : {"uptime":16803,"version":"version_tag","freemem":41348,"rssi":-46,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:49:19.755 -> T: jsonPublishing 16:51:19.957 -> T: retrieving value of system characteristics Uptime (s):16923 16:51:19.957 -> N: Subject: /SYStoMQTT 16:51:19.957 -> N: Received json : {"uptime":16923,"version":"version_tag","freemem":41348,"rssi":-46,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:51:19.957 -> T: jsonPublishing 16:53:20.160 -> T: retrieving value of system characteristics Uptime (s):17043 16:53:20.160 -> N: Subject: /SYStoMQTT 16:53:20.160 -> N: Received json : {"uptime":17043,"version":"version_tag","freemem":41348,"rssi":-45,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:53:20.160 -> T: jsonPublishing 16:55:20.362 -> T: retrieving value of system characteristics Uptime (s):17163 16:55:20.362 -> N: Subject: /SYStoMQTT 16:55:20.362 -> N: Received json : {"uptime":17163,"version":"version_tag","freemem":41348,"rssi":-46,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:55:20.362 -> T: jsonPublishing 16:57:20.565 -> T: retrieving value of system characteristics Uptime (s):17283 16:57:20.565 -> N: Subject: /SYStoMQTT 16:57:20.565 -> N: Received json : {"uptime":17283,"version":"version_tag","freemem":41348,"rssi":-46,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:57:20.565 -> T: jsonPublishing 16:59:20.767 -> T: retrieving value of system characteristics Uptime (s):17403 16:59:20.767 -> N: Subject: /SYStoMQTT 16:59:20.767 -> N: Received json : {"uptime":17403,"version":"version_tag","freemem":41348,"rssi":-40,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 16:59:20.767 -> T: jsonPublishing 17:01:20.970 -> T: retrieving value of system characteristics Uptime (s):17523 17:01:20.970 -> N: Subject: /SYStoMQTT 17:01:20.970 -> N: Received json : {"uptime":17523,"version":"version_tag","freemem":41348,"rssi":-38,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 17:01:20.970 -> T: jsonPublishing 17:02:21.071 -> W: MQTT connection... 17:02:21.071 -> W: failure_number_mqtt: 1 17:02:21.071 -> W: failed, rc=-2 17:02:21.071 -> W: disconnection_handling, failed 1 times 17:02:21.071 -> W: Attempt to reinit wifi: 0 17:02:21.071 -> W: wifi disconnected 17:02:41.105 -> W: disconnection_handling, failed 1 times 17:02:41.105 -> W: Attempt to reinit wifi: 0 17:02:41.105 -> W: MQTT connection... 17:02:41.105 -> N: Connected to broker 17:02:41.105 -> T: Subscription OK to the subjects 17:03:21.172 -> T: retrieving value of system characteristics Uptime (s):17643 17:03:21.172 -> N: Subject: /SYStoMQTT 17:03:21.172 -> N: Received json : {"uptime":17643,"version":"version_tag","freemem":41492,"rssi":-46,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 17:03:21.172 -> T: jsonPublishing 17:05:21.375 -> T: retrieving value of system characteristics Uptime (s):17763 17:05:21.375 -> N: Subject: /SYStoMQTT 17:05:21.375 -> N: Received json : {"uptime":17763,"version":"version_tag","freemem":41520,"rssi":-47,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 17:05:21.375 -> T: jsonPublishing 17:07:21.577 -> T: retrieving value of system characteristics Uptime (s):17883 17:07:21.577 -> N: Subject: /SYStoMQTT 17:07:21.577 -> N: Received json : {"uptime":17883,"version":"version_tag","freemem":41520,"rssi":-47,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 17:07:21.577 -> T: jsonPublishing 17:09:21.780 -> T: retrieving value of system characteristics Uptime (s):18003 17:09:21.780 -> N: Subject: /SYStoMQTT 17:09:21.780 -> N: Received json : {"uptime":18003,"version":"version_tag","freemem":41344,"rssi":-47,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 17:09:21.780 -> T: jsonPublishing 17:11:21.982 -> T: retrieving value of system characteristics Uptime (s):18123 17:11:21.982 -> N: Subject: /SYStoMQTT 17:11:21.982 -> N: Received json : {"uptime":18123,"version":"version_tag","freemem":41344,"rssi":-47,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 17:11:21.982 -> T: jsonPublishing 17:13:22.184 -> T: retrieving value of system characteristics Uptime (s):18243 17:13:22.184 -> N: Subject: /SYStoMQTT 17:13:22.184 -> N: Received json : {"uptime":18243,"version":"version_tag","freemem":41344,"rssi":-47,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 17:13:22.184 -> T: jsonPublishing 17:15:22.387 -> T: retrieving value of system characteristics Uptime (s):18363 17:15:22.387 -> N: Subject: /SYStoMQTT 17:15:22.387 -> N: Received json : {"uptime":18363,"version":"version_tag","freemem":41344,"rssi":-46,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 17:15:22.387 -> T: jsonPublishing 17:17:22.589 -> T: retrieving value of system characteristics Uptime (s):18483 17:17:22.589 -> N: Subject: /SYStoMQTT 17:17:22.589 -> N: Received json : {"uptime":18483,"version":"version_tag","freemem":41344,"rssi":-38,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 17:17:22.589 -> T: jsonPublishing 17:19:22.792 -> T: retrieving value of system characteristics Uptime (s):18603 17:19:22.792 -> N: Subject: /SYStoMQTT 17:19:22.792 -> N: Received json : {"uptime":18603,"version":"version_tag","freemem":41344,"rssi":-47,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 17:19:22.792 -> T: jsonPublishing 17:20:53.184 -> T: retrieving value of system characteristics Uptime (s):18723 17:20:53.184 -> N: Subject: /SYStoMQTT 17:20:53.184 -> N: Received json : {"uptime":18723,"version":"version_tag","freemem":41344,"rssi":-42,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 17:20:53.217 -> T: jsonPublishing 17:22:53.187 -> T: retrieving value of system characteristics Uptime (s):18843 17:22:53.187 -> N: Subject: /SYStoMQTT 17:22:53.225 -> N: Received json : {"uptime":18843,"version":"version_tag","freemem":41344,"rssi":-36,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 17:22:53.225 -> T: jsonPublishing 17:24:53.192 -> T: retrieving value of system characteristics Uptime (s):18963 17:24:53.225 -> N: Subject: /SYStoMQTT 17:24:53.225 -> N: Received json : {"uptime":18963,"version":"version_tag","freemem":41344,"rssi":-44,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 17:24:53.225 -> T: jsonPublishing 17:26:53.199 -> T: retrieving value of system characteristics Uptime (s):19083 17:26:53.199 -> N: Subject: /SYStoMQTT 17:26:53.232 -> N: Received json : {"uptime":19083,"version":"version_tag","freemem":41344,"rssi":-44,"SSID":"Openwrt","ip":"192.168.2.6","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 17:26:53.232 -> T: jsonPublishing


Scanning will not resume unless manually restarted

sleepwalkera commented 4 years ago

20:53:31.322 -> N: BLE Connect begin 20:53:31.322 -> N: BLE Connect end 20:53:31.322 -> T: BT Task running on core: 0 20:53:31.322 -> N: Scan begin 20:53:31.322 -> T: Creating BLE buffer 20:53:31.322 -> N: Device detected: FC:FA:A7:37:38:2D 20:53:31.322 -> T: getDeviceByMac FC:FA:A7:37:38:2D 20:53:31.322 -> T: Manufacturer Data: 8f03 20:53:31.322 -> T: Get services data number: 1 20:53:31.322 -> T: Service data: 5840fc035d2d3837a7fafc26db7edfa263354345ee55 20:53:31.322 -> T: Service data UUID: 0xfe95 20:53:31.322 -> T: getDeviceByMac FC:FA:A7:37:38:2D 20:53:31.322 -> T: Checking BLE service data validity 20:53:31.322 -> T: Searching BLE device data 5840fc035d2d3837a7fafc26db7edfa263354345ee55 size 44 20:53:31.322 -> T: Is it a mi flora ? 20:53:31.322 -> T: Is it a vegtrug ? 20:53:31.322 -> T: Is it a LYWSDCGQ? 20:53:31.322 -> T: Is it a JQJCY01YM? 20:53:31.322 -> T: Is it a LYWSD02? 20:53:31.322 -> T: Is it a CGG1? 20:53:31.322 -> T: Is it a MUE4094RT? 20:53:31.322 -> T: Is it a CGP1W? 20:53:31.322 -> T: Is it a CGG1 20:53:31.322 -> T: Is it a CGD1? 20:53:31.322 -> T: Is it a MHO_C401? 20:53:31.322 -> T: Is it a LYWSD03MMC? 20:53:31.322 -> T: servicedatauuid 0xfe95 20:53:31.322 -> T: Is it a MiBand? 20:53:31.322 -> T: Is it a XMTZC04HM? 20:53:31.322 -> T: Is it a XMTZC05HM? 20:53:31.322 -> T: manufacturerdata 8f03 20:53:31.322 -> T: Remove manufacturer data 20:53:31.322 -> T: Removing servicedatauuid 20:53:31.322 -> N: Subject: /BTtoMQTT/FCFAA737382D 20:53:31.322 -> N: Received json : {"id":"FC:FN: BLE Connect end 20:53:31.322 -> T: BT Task running on core: 0 20:53:31.322 -> N: Scan begin 20:53:31.322 -> T: Creating BLE buffer 20:53:31.322 -> N: Device detected: FC:FA:A7:37:38:2D 20:53:31.322 -> T: getDeviceByMac FC:FA:A7:37:38:2D 20:53:31.322 -> T: Manufacturer Data: 8f03 20:53:31.322 -> T: Get services data number: 1 20:53:31.322 -> T: Service data: 5840fc035d2d3837a7fafc26db7edfa263354345ee55 20:53:31.322 -> T: Service data UUID: 0xfe95 20:53:31.322 -> T: getDeviceByMac FC:FA:A7:37:38:2D 20:53:31.322 -> T: Checking BLE service data validity 20:53:31.322 -> T: Searching BLE device data 5840fc035d2d3837a7fafc26db7edfa263354345ee55 size 44 20:53:31.322 -> T: Is it a mi flora ? 20:53:31.322 -> T: Is it a vegtrug ? 20:53:31.322 -> T: Is it a LYWSDCGQ? 20:53:31.322 -> T: Is it a JQJCY01YM? 20:53:31.322 -> T: Is it a LYWSD02? 20:53:31.322 -> T: Is it a CGG1? 20:53:31.322 -> T: Is it a MUE4094RT? 20:53:31.322 -> T: Is it a CGP1W? 20:53:31.322 -> T: Is it a CGG1 20:53:31.322 -> T: Is it a CGD1? 20:53:31.322 -> T: Is it a MHO_C401? 20:53:31.322 -> T: Is it a LYWSD03MMC? 20:53:31.322 -> T: servicedatauuid 0xfe95 20:53:31.322 -> T: Is it a MiBand? 20:53:31.322 -> T: Is it a XMTZC04HM? 20:53:31.322 -> T: Is it a XMTZC05HM? 20:53:31.322 -> T: manufacturerdata 8f03 20:53:31.322 -> T: Remove manufacturer data 20:53:31.322 -> T: Removing servicedatauuid 20:53:31.322 -> N: Subject: /BTtoMQTT/FCFAA737382D 20:53:31.322 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-72,"servicedata":"5840fc035d2d3837a7fafc26db7edfa263354345ee55"} 20:53:31.322 -> T: jsonPublishing 20:53:31.322 -> N: Found 2 devices, scan number 4641 end deinit controller 20:53:31.322 -> N: BLE Connect begin 20:53:31.322 -> N: BLE Connect end 20:53:31.322 -> T: BT Task running on core: 0 20:53:31.322 -> N: Scan begin 20:53:31.322 -> T: Creating BLE buffer 20:53:31.322 -> N: Device detected: FC:FA:A7:37:38:2D 20:53:31.322 -> T: getDeviceByMac FC:FA:A7:37:38:2D 20:53:31.322 -> T: Manufacturer Data: 8f03 20:53:31.322 -> T: Get services data number: 1 20:53:31.322 -> T: Service data: 5840fc035d2d3837a7fafc26db7edfa263354345ee55 20:53:31.322 -> T: Service data UUID: 0xfe95 20:53:31.322 -> T: getDeviceByMac FC:FA:A7:37:38:2D 20:53:31.322 -> T: Checking BLE service data validity 20:53:31.322 -> T: Searching BLE device data 5840fc035d2d3837a7fafc26db7edfa263354345ee55 size 44 20:53:31.322 -> T: Is it a mi flora ? 20:53:31.322 -> T: Is it a vegtrug ? 20:53:31.322 -> T: Is it a LYWSDCGQ? 20:53:31.322 -> T: Is it a JQJCY01YM? 20:53:31.322 -> T: Is it a LYWSD02? 20:53:31.322 -> T: Is it a CGG1? 20:53:31.322 -> T: Is it a MUE4094RT? 20:53:31.322 -> T: Is it a CGP1W? 20:53:31.322 -> T: Is it a CGG1 20:53:31.322 -> T: Is it a CGD1? 20:53:31.322 -> T: Is it a MHO_C401? 20:53:31.322 -> T: Is it a LYWSD03MMC? 20:53:31.322 -> T: servicedatauuid 0xfe95 20:53:31.322 -> T: Is it a MiBand? 20:53:31.322 -> T: Is it a XMTZC04HM? 20:53:31.322 -> T: Is it a XMTZC05HM? 20:53:31.322 -> T: manufacturerdata 8f03 20:53:31.322 -> T: Remove manufacturer data 20:53:31.322 -> T: Removing servicedatauuid 20:53:31.322 -> N: Subject: /BTtoMQTT/FCFAA737382D 20:53:31.322 -> N: RN: Found 1 devices, scan number 4653 end deinit controller 20:53:31.322 -> N: BLE Connect begin 20:53:31.322 -> N: BLE Connect end 20:53:31.322 -> T: BT Task running on core: 0 20:53:31.322 -> N: Scan begin 20:53:31.322 -> T: Creating BLE buffer 20:53:31.322 -> N: Device detected: FC:FA:A7:37:38:2D 20:53:31.322 -> T: getDeviceByMac FC:FA:A7:37:38:2D 20:53:31.322 -> T: Manufacturer Data: 8f03 20:53:31.322 -> T: Get services data number: 1 20:53:31.322 -> T: Service data: 5840fc035e2d3837a7fafc7b4ba002241b2819d2ef69 20:53:31.322 -> T: Service data UUID: 0xfe95 20:53:31.322 -> T: getDeviceByMac FC:FA:A7:37:38:2D 20:53:31.322 -> T: Checking BLE service data validity 20:53:31.322 -> T: Searching BLE device data 5840fc035e2d3837a7fafc7b4ba002241b2819d2ef69 size 44 20:53:31.322 -> T: Is it a mi flora ? 20:53:31.322 -> T: Is it a vegtrug ? 20:53:31.322 -> T: Is it a LYWSDCGQ? 20:53:31.322 -> T: Is it a JQJCY01YM? 20:53:31.322 -> T: Is it a LYWSD02? 20:53:31.322 -> T: Is it a CGG1? 20:53:31.322 -> T: Is it a MUE4094RT? 20:53:31.322 -> T: Is it a CGP1W? 20:53:31.322 -> T: Is it a CGG1 20:53:31.322 -> T: Is it a CGD1? 20:53:31.322 -> T: Is it a MHO_C401? 20:53:31.322 -> T: Is it a LYWSD03MMC? 20:53:31.322 -> T: servicedatauuid 0xfe95 20:53:31.322 -> T: Is it a MiBand? 20:53:31.322 -> T: Is it a XMTZC04HM? 20:53:31.322 -> T: Is it a XMTZC05HM? 20:53:31.322 -> T: manufacturerdata 8f03 20:53:31.322 -> T: Remove manufacturer data 20:53:31.322 -> T: Removing servicedatauuid 20:53:31.322 -> N: Subject: /BTtoMQTT/FCFAA737382D 20:53:31.322 -> N: Received json : {"id":"FC:FT: retrieving value of system characteristics Uptime (s):7736 20:53:31.322 -> N: Subject: /SYStoMQTT 20:53:31.322 -> N: Received json : {"uptime":7736,"version":"version_tag","freemem":49488,"rssi":-73,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 20:53:31.322 -> T: jsonPublishing 20:53:31.322 -> T: retrieving value of system characteristics Uptime (s):7856 20:53:31.322 -> N: Subject: /SYStoMQTT 20:53:31.322 -> N: Received json : {"uptime":7856,"version":"version_tag","freemem":49700,"rssi":-73,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 20:53:31.322 -> T: jsonPublishing 20:53:31.322 -> T: retrieving value of system characteristics Uptime (s):7976 20:53:31.322 -> N: Subject: /SYStoMQTT 20:53:31.322 -> N: Received json : {"uptime":7976,"version":"version_tag","freemem":49700,"rssi":-80,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 20:53:31.322 -> T: jsonPublishing 20:53:31.322 -> T: retrieving value of system characteristics Uptime (s):8096 20:53:31.322 -> N: Subject: /SYStoMQTT 20:53:31.322 -> N: Received json : {"uptime":8096,"version":"version_tag","freemem":49700,"rssi":-76,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 20:53:31.322 -> T: jsonPublishing 20:53:31.322 -> T: retrieving value of system characteristics Uptime (s):8216 20:53:31.322 -> N: Subject: /SYStoMQTT 20:53:31.322 -> N: Received json : {"uptime":8216,"version":"version_tag","freemem":49700,"rssi":-82,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 20:53:31.322 -> T: jsonPublishing 20:53:31.322 -> T: retrieving value of system characteristics Uptime (s):8336 20:53:31.322 -> N: Subject: /SYStoMQTT 20:53:31.322 -> N: Received json : {"uptime":8336,"version":"version_tag","freemem":49700,"rssi":-80,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 20:53:31.322 -> T: jsonPublishing 20:53:31.322 -> T: retrieving value of system characteristics Uptime (s):8456 20:53:31.322 -> N: Subject: /SYStoMQTT 20:53:31.322 -> N: Received json : {"uptime":8456,"version":"version_tag","freemem":49700,"rssi":-75,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 20:53:31.322 -> T: jsonPublishing 20:54:11.497 -> T: retrieving value of system characteristics Uptime (s):8576 20:54:11.497 -> N: Subject: /SYStoMQTT 20:54:11.497 -> N: Received json : {"uptime":8576,"version":"version_tag","freemem":49700,"rssi":-80,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 20:54:11.530 -> T: jsonPublishing 20:56:18.669 -> T: retrieving value of system characteristics Uptime (s):8696 20:56:18.669 -> N: Subject: /SYStoMQTT 20:56:18.669 -> N: Received json : {"uptime":8696,"version":"version_tag","freemem":49700,"rssi":-89,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 20:56:18.669 -> T: jsonPublishing 20:58:11.486 -> T: retrieving value of system characteristics Uptime (s):8816 20:58:11.520 -> N: Subject: /SYStoMQTT 20:58:11.520 -> N: Received json : {"uptime":8816,"version":"version_tag","freemem":49700,"rssi":-80,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":300,"scanbcnct":1,"modules":"RFBT"} 20:58:11.520 -> T: jsonPublishing


Another try

Is there a higher log level? I am very willing to assist in further testing

1technophile commented 4 years ago

Is there a higher log level? I am very willing to assist in further testing

Yes but this one is sufficient. I did not reproduce exactly your issue and my ESP32 is getting quite hot. I will dig into this.

sleepwalkera commented 4 years ago

Thank you. Should I try to reduce the scanning speed? Perhaps this has exceeded the hardware capabilities of esp32? Or is it a software issue?

1technophile commented 4 years ago

Yes maybe try to tune the settings, I don't know if the board is intended to be used like that.

sleepwalkera commented 4 years ago

I don’t know if I’m on the right path to solve the problem. Do specific events published through ble broadcasts must be captured through high-frequency polling? Is there a mechanism such as subscription and callback to capture?

I lowered the frequency of scanning and adjusted the parameters to Scan_duration 2500 ScanBeforeConnect 1 TimeBtwRead 500

The following is another log about ble scanning stopped


22:16:00.218 -> N: BLE Connect begin 22:16:00.218 -> N: BLE Connect end 22:16:00.218 -> T: BT Task running on core: 0 22:16:00.218 -> N: Scan begin 22:16:00.218 -> T: Creating BLE buffer 22:16:00.218 -> N: Device detected: FC:FA:A7:37:38:2D 22:16:00.218 -> T: getDeviceByMac FC:FA:A7:37:38:2D 22:16:00.218 -> T: Manufacturer Data: 8f03 22:16:00.218 -> T: Get services data number: 1 22:16:00.218 -> T: Service data: 5840fc03db2d3837a7fafcb694619708c0176e4aa7b2 22:16:00.218 -> T: Service data UUID: 0xfe95 22:16:00.218 -> T: getDeviceByMac FC:FA:A7:37:38:2D 22:16:00.218 -> T: Checking BLE service data validity 22:16:00.218 -> T: Searching BLE device data 5840fc03db2d3837a7fafcb694619708c0176e4aa7b2 size 44 22:16:00.218 -> T: Is it a mi flora ? 22:16:00.218 -> T: Is it a vegtrug ? 22:16:00.218 -> T: Is it a LYWSDCGQ? 22:16:00.218 -> T: Is it a JQJCY01YM? 22:16:00.218 -> T: Is it a LYWSD02? 22:16:00.218 -> T: Is it a CGG1? 22:16:00.218 -> T: Is it a MUE4094RT? 22:16:00.218 -> T: Is it a CGP1W? 22:16:00.218 -> T: Is it a CGG1 22:16:00.218 -> T: Is it a CGD1? 22:16:00.218 -> T: Is it a MHO_C401? 22:16:00.218 -> T: Is it a LYWSD03MMC? 22:16:00.218 -> T: servicedatauuid 0xfe95 22:16:00.218 -> T: Is it a MiBand? 22:16:00.218 -> T: Is it a XMTZC04HM? 22:16:00.218 -> T: Is it a XMTZC05HM? 22:16:00.218 -> T: manufacturerdata 8f03 22:16:00.218 -> T: Remove manufacturer data 22:16:00.218 -> T: Removing servicedatauuid 22:16:00.218 -> N: Subject: /BTtoMQTT/FCFAA737382D 22:16:00.218 -> N: Received json : {"id":"FC:FN: BLE Connect end 22:16:00.218 -> T: BT Task running on core: 0 22:16:00.218 -> N: Scan begin 22:16:00.218 -> T: Creating BLE buffer 22:16:00.218 -> N: Device detected: 70:9F:EA:92:9D:A5 22:16:00.218 -> T: getDeviceByMac 70:9F:EA:92:9D:A5 22:16:00.218 -> T: Manufacturer Data: 4c001005441c092646 22:16:00.218 -> T: Low rssi, device filtered 22:16:00.218 -> T: Creating BLE buffer 22:16:00.218 -> N: Device detected: FC:FA:A7:37:38:2D 22:16:00.218 -> T: getDeviceByMac FC:FA:A7:37:38:2D 22:16:00.218 -> T: Manufacturer Data: 8f03 22:16:00.218 -> T: Get services data number: 1 22:16:00.218 -> T: Service data: 5840fc03db2d3837a7fafcb694619708c0176e4aa7b2 22:16:00.218 -> T: Service data UUID: 0xfe95 22:16:00.218 -> T: getDeviceByMac FC:FA:A7:37:38:2D 22:16:00.218 -> T: Checking BLE service data validity 22:16:00.218 -> T: Searching BLE device data 5840fc03db2d3837a7fafcb694619708c0176e4aa7b2 size 44 22:16:00.218 -> T: Is it a mi flora ? 22:16:00.218 -> T: Is it a vegtrug ? 22:16:00.218 -> T: Is it a LYWSDCGQ? 22:16:00.218 -> T: Is it a JQJCY01YM? 22:16:00.218 -> T: Is it a LYWSD02? 22:16:00.218 -> T: Is it a CGG1? 22:16:00.218 -> T: Is it a MUE4094RT? 22:16:00.218 -> T: Is it a CGP1W? 22:16:00.218 -> T: Is it a CGG1 22:16:00.218 -> T: Is it a CGD1? 22:16:00.218 -> T: Is it a MHO_C401? 22:16:00.218 -> T: Is it a LYWSD03MMC? 22:16:00.218 -> T: servicedatauuid 0xfe95 22:16:00.218 -> T: Is it a MiBand? 22:16:00.218 -> T: Is it a XMTZC04HM? 22:16:00.218 -> T: Is it a XMTZC05HM? 22:16:00.218 -> T: manufacturerdata 8f03 22:16:00.218 -> T: Remove manufacturer data 22:16:00.218 -> T: RemT: BT Task running on core: 0 22:16:00.218 -> N: Scan begin 22:16:00.218 -> T: Creating BLE buffer 22:16:00.218 -> N: Device detected: 70:9F:EA:92:9D:A5 22:16:00.218 -> T: getDeviceByMac 70:9F:EA:92:9D:A5 22:16:00.218 -> T: Manufacturer Data: 4c001005441c092646 22:16:00.218 -> T: Low rssi, device filtered 22:16:00.218 -> T: Creating BLE buffer 22:16:00.218 -> N: Device detected: 7D:5F:0E:62:9A:F0 22:16:00.218 -> T: getDeviceByMac 7D:5F:0E:62:9A:F0 22:16:00.218 -> T: Manufacturer Data: 4c001005411c7ecc44 22:16:00.218 -> T: Low rssi, device filtered 22:16:00.218 -> T: Creating BLE buffer 22:16:00.218 -> N: Device detected: FC:FA:A7:37:38:2D 22:16:00.218 -> T: getDeviceByMac FC:FA:A7:37:38:2D 22:16:00.218 -> T: Manufacturer Data: 8f03 22:16:00.218 -> T: Get services data number: 1 22:16:00.218 -> T: Service data: 5840fc03dc2d3837a7fafcffda55730b811bbe40c3fb 22:16:00.218 -> T: Service data UUID: 0xfe95 22:16:00.218 -> T: getDeviceByMac FC:FA:A7:37:38:2D 22:16:00.218 -> T: Checking BLE service data validity 22:16:00.218 -> T: Searching BLE device data 5840fc03dc2d3837a7fafcffda55730b811bbe40c3fb size 44 22:16:00.218 -> T: Is it a mi flora ? 22:16:00.218 -> T: Is it a vegtrug ? 22:16:00.218 -> T: Is it a LYWSDCGQ? 22:16:00.218 -> T: Is it a JQJCY01YM? 22:16:00.218 -> T: Is it a LYWSD02? 22:16:00.218 -> T: Is it a CGG1? 22:16:00.218 -> T: Is it a MUE4094RT? 22:16:00.218 -> T: Is it a CGP1W? 22:16:00.218 -> T: Is it a CGG1 22:16:00.218 -> T: Is it a CGD1? 22:16:00.218 -> T: Is it a MHO_C401? 22:16:00.218 -> T: Is it a LYWSD03MMC? 22:16:00.218 -> T: retrieving value of system characteristics Uptime (s):34738 22:16:00.218 -> N: Subject: /SYStoMQTT 22:16:00.218 -> N: Received json : {"uptime":34738,"version":"version_tag","freemem":48884,"rssi":-70,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":500,"scanbcnct":1,"modules":"RFBT"} 22:16:00.218 -> T: jsonPublishing 22:16:00.218 -> T: retrieving value of system characteristics Uptime (s):34858 22:16:00.218 -> N: Subject: /SYStoMQTT 22:16:00.218 -> N: Received json : {"uptime":34858,"version":"version_tag","freemem":48884,"rssi":-69,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":500,"scanbcnct":1,"modules":"RFBT"} 22:16:00.218 -> T: jsonPublishing 22:16:00.218 -> T: retrieving value of system characteristics Uptime (s):34978 22:16:00.218 -> N: Subject: /SYStoMQTT 22:16:00.218 -> N: Received json : {"uptime":34978,"version":"version_tag","freemem":48884,"rssi":-69,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":500,"scanbcnct":1,"modules":"RFBT"} 22:16:00.218 -> T: jsonPublishing 22:16:00.218 -> T: retrieving value of system characteristics Uptime (s):35098 22:16:00.218 -> N: Subject: /SYStoMQTT 22:16:00.218 -> N: Received json : {"uptime":35098,"version":"version_tag","freemem":48884,"rssi":-71,"SSID":"OpenWrt","ip":"192.168.0.191","mac":"80:7D:3A:CA:84:6C","wifiprt":0,"lowpowermode":0,"interval":500,"scanbcnct":1,"modules":"RFBT"} 22:16:00.218 -> T: jsonPublishing

1technophile commented 4 years ago

Maybe we may go to another level and do the test with the BLE library directly, try maybe first to reproduce the issue with the BLEscan example and if reproduced we could ask the library owner its advice. Are you interested in this approach?

sleepwalkera commented 4 years ago

Thanks for your advice. I tested the BLEscan example for a few days. Although the scan did not stop, the scan speed did slow down after running for a few days. I will continue to see if the issue can be reproduced.

sleepwalkera commented 4 years ago

@1technophile I tested the BLEscan example for more than 10 days. The scan did not stop and the issue could not be reproduced.

stale[bot] commented 3 years ago

This issue has been automatically marked as stale because it has not had recent activity. It will be closed if no further activity occurs. Thank you for your contributions.

sleepwalkera commented 3 years ago

@1technophile I have tested with the BLE library directly. Looks like no problem at the library level. Would you go further for this?

1technophile commented 3 years ago

Hi,

Are you using the BLEScan example without any modifications?

sleepwalkera commented 3 years ago

@1technophile Yes, the BLEScan example running stably.

1technophile commented 3 years ago

@sleepwalkera I suppose that you are using this example and remove the delay line only?

1technophile commented 3 years ago

@sleepwalkera could you test the development branch, it now has a lockless queue mechanism that could help with your issue.

sleepwalkera commented 3 years ago

@1technophile After days of testing, it was found that the stability of the lockless queue version has been greatly improved. Although downtime still exists, it is much less likely to happen. Thank you for your hard work. The following is the log

22:27:11.316 -> T: Get services data number: 1 22:27:11.316 -> T: Converted service data (22) to 5840fc035f2d3837a7fafc41a1a6384ff81994cf082f 22:27:11.316 -> T: Service data: 5840fc035f2d3837a7fafc41a1a6384ff81994cf082f 22:27:11.316 -> T: Service data UUID: 0xfe95 22:27:11.316 -> T: getDeviceByMac FC:FA:A7:37:38:2D 22:27:11.316 -> T: Checking BLE service data validity 22:27:11.316 -> T: Searching BLE device data 5840fc035f2d3837a7fafc41a1a6384ff81994cf082f size 44 22:27:11.316 -> T: Is it a mi flora ? 22:27:11.316 -> T: Is it a vegtrug ? 22:27:11.316 -> T: Is it a LYWSDCGQ? 22:27:11.316 -> T: Is it a JQJCY01YM? 22:27:11.316 -> T: Is it a LYWSD02? 22:27:11.316 -> T: Is it a MUE4094RT? 22:27:11.316 -> T: Is it a CGP1W? 22:27:11.316 -> T: Is it a CGG1 22:27:11.316 -> T: Is it a CGD1? 22:27:11.316 -> T: Is it a MHO_C401? 22:27:11.316 -> T: Is it a LYWSD03MMC? 22:27:11.316 -> T: Is it a custom LYWSD03MMC 22:27:11.316 -> T: servicedatauuid 0xfe95 22:27:11.316 -> T: Is it a MiBand? 22:27:11.316 -> T: Is it a XMTZC04HM? 22:27:11.316 -> T: Is it a XMTZC05HM? 22:27:11.316 -> T: manufacturerdata 8f03 22:27:11.316 -> T: Is it a iNode Energy Meter? 22:27:11.316 -> T: Remove manufacturer data 22:27:11.316 -> T: Removing servicedatauuid 22:27:11.316 -> N: Subject: /BTtoMQTT/FCFAA737382D 22:27:11.316 -> N: Received json : {"id":"FC:FA:A7:37:38:2D","rssi":-74,"servicedata":"5840fc035f2d3837a7fafc41a1a6384ff81994cf082f"} 22:27:11.316 -> T: jsonPublishing 22:27:11.316 -> T: Creating BLE buffer 22:27:11.316 -> N: Device detected: 4D:AA:48:42:FB:63 22:27:11.316 -> T: getDeviceByMac 4D:AA:48:42:FB:63 22:27:11.316 -> T: Manufacturer Data: 4c0010052a18211858 22:27:11.316 -> T: Low rssi, device filtered 22:27:11.316 -> T: Creating BLE buffer 22:27:11.316 -> N: Device detected: F4:FE:FB:80:87:31 22:27:11.316 -> T: getDeviceByMac F4:FE:FB:80:87:31 22:27:11.316 -> T: Manufacturer Data: 75004204012067200d0002012b01010001000000000000000000 22:27:11.316 -> T: getDeviceByMac F4:FE:FB:80:87:31 22:27:11.316 -> T: manufacturerdata 75004204012067200d0002012b01010001000000000000000000 22:27:11.316 -> T: Is it a iNode Energy Meter? 22:27:11.316 -> T: Remove manufacturer data 22:27:11.316 -> T: Creating BLE buffer 22:27:11.316 -> N: Subject: /BTtoMQTT/F4FEFB808731 22:27:11.316 -> N: Device detected: 56:56:B8:7B:9C:99 22:27:11.316 -> T: getDeviceByMac 56:56:B8:7B:9C:99 22:27:11.316 -> N: Received json : {"id":"F4:FE:FB:80:87:31","rssi":-78} 22:27:11.316 -> T: Manufacturer Data: 4c000719010f2021888f0100042b04ae4e0dcc83bc779d87e27f8ff176 22:27:11.316 -> T: jsoT: Low rssi, device filtered 22:27:11.316 -> nPublishing 22:27:11.316 -> N: Found 5 devices, scan number 29849 end deinit controller 22:27:11.316 -> N: BLE Connect begin 22:27:11.316 -> N: BLE Connect end

1technophile commented 3 years ago

Much of the credits goes to @csiki2