MMM-OralB / Bluetooth equipped toothbrush integration

lavolp3

and more debugging messages, sorry for the spamming:

[2020-04-23 00:51:53.902] [LOG]    00:51:53 <log> MMM-BluetoothDevices starting hub (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/node_helper.js:23 Class.startHub)
[2020-04-23 00:51:58.845] [LOG]    00:51:58 <log> MMM-BluetoothDevices unhandled adapter msg: {"serial":1536,"path":"/org/bluez/hci0","interface":"org.freedesktop.DBus.Properties","member":"PropertiesChanged","signature":"sa{sv}as","sender":":1.8","type":4,"flags":1,"body":["org.bluez.Adapter1",[["UUIDs",[[{"type":"a","child":[{"type":"s","child":[]}]}],[["00001112-0000-1000-8000-00805f9b34fb","00001801-0000-1000-8000-00805f9b34fb","0000110e-0000-1000-8000-00805f9b34fb","00001800-0000-1000-8000-00805f9b34fb","00001200-0000-1000-8000-00805f9b34fb","0000110c-0000-1000-8000-00805f9b34fb","0000110a-0000-1000-8000-00805f9b34fb","0000111f-0000-1000-8000-00805f9b34fb","00001805-0000-1000-8000-00805f9b34fb"]]]]],[]]} (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:32 Logger.debug)
[2020-04-23 00:52:01.474] [LOG]    00:52:01 <log> MMM-BluetoothDevices unhandled adapter msg: {"serial":1542,"path":"/org/bluez/hci0","interface":"org.freedesktop.DBus.Properties","member":"PropertiesChanged","signature":"sa{sv}as","sender":":1.8","type":4,"flags":1,"body":["org.bluez.Adapter1",[["Discovering",[[{"type":"b","child":[]}],[true]]]],[]]} (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:32 Logger.debug)
[2020-04-23 00:52:01.993] [LOG]    00:52:01 <log> MMM-BluetoothDevices trying to connect to: DIRKS OralB 1/2 (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
[2020-04-23 00:52:13.667] [LOG]    00:52:13 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
[2020-04-23 00:52:13.834] [LOG]    00:52:13 <log> MMM-BluetoothDevices awaiting services for device: DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:32 Logger.debug)
[2020-04-23 00:52:17.445] [LOG]    00:52:17 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
[2020-04-23 00:52:23.028] [LOG]    00:52:23 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
[2020-04-23 00:52:33.871] [ERROR]  00:52:33 <error> MMM-BluetoothDevices unhandled exception: (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:47 Logger.error)
[2020-04-23 00:52:33.875] [ERROR]  00:52:33 <error> MMM-BluetoothDevices Error: Error: waitForServicesResolved: timeout exceeded (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:47 Logger.error)
[2020-04-23 00:52:33.905] [LOG]    00:52:33 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
[2020-04-23 00:52:44.875] [LOG]    00:52:44 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
[2020-04-23 00:52:55.859] [LOG]    00:52:55 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
[2020-04-23 00:53:06.911] [LOG]    00:53:06 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
[2020-04-23 00:53:17.884] [LOG]    00:53:17 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
[2020-04-23 00:53:28.849] [LOG]    00:53:28 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)

timodejong95

@lavolp3 No worries, check I will have a look at this when I find some time, probably this weekend. Seems that the devices couldn’t connect at the first try but failed in de second which is triggered instantly.

@djerik Thanks for sharing

I will try and fix the issues you send to be, thanks for sharing and excuses for the bugs! I might write some tests because the manual tests are stacking up and code coverage is always good.

lavolp3

@timodejong95 said in MMM-OralB / Bluetooth equipped toothbrush integration:

@lavolp3 No worries, check I will have a look at this when I find some time, probably this weekend. Seems that the devices couldn’t connect at the first try but failed in de second which is triggered instantly.

I don’t have a problem with that. Devices are connecting well as soon as I activate them. Everything works really well except no battery status shown.
Apparently the waitForService process ends unresolved, hence is not able to get the information from the battery service

[2020-04-23 00:52:33.875] [ERROR]  00:52:33  MMM-BluetoothDevices Error: Error: waitForServicesResolved: timeout exceeded (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:47 Logger.error)

timodejong95

@lavolp3 Check I get you. Just to be sure, you did do npm install I changed a package? If not then I will comeback to it when I have tested it myself.

lavolp3

@timodejong95 said in MMM-OralB / Bluetooth equipped toothbrush integration:

@lavolp3 Check I get you. Just to be sure, you did do npm install I changed a package? If not then I will comeback to it when I have tested it myself.

Yes I did.
Did it now again (but no new installations) and trying again tonight

timodejong95

@lavolp3 Oké check, well no need to try again tonight because your up-to-date then. I will let you know when I have looked at it. For now you can prevent the errors by removing the battery in the tracks array.

timodejong95

I have just pushed some new changes which improve connecting, and a few tests cases for device connection. It requires a npm install.

@lavolp3 and @djerik if you have some time could you try it out? Also I though you already had it on but if not it might be handy to enable debugLogs.

Also I want to thank you for the time you put into this and help me by providing logs and errors so I can improve the module.

lavolp3

@timodejong95 IT WORKED! At least partially, that is.

0|mm  | 00:13:17 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:13:17.988] [LOG]
0|mm  | 00:13:17 <info> MMM-BluetoothDevices reconnecting to: DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:24 Logger.info)
0|mm  | [2020-04-26 00:13:17.995] [LOG]
0|mm  | 00:13:17 <log> MMM-BluetoothDevices trying to connect to: DIRKS OralB 1/1 (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:13:21.469] [LOG]
0|mm  | 00:13:21 <log> MMM-BluetoothDevices connected to device: DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:13:21.534] [LOG]
0|mm  | 00:13:21 <log> MMM-BluetoothDevices awaiting services for device: DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:32 Logger.debug)
0|mm  | [2020-04-26 00:13:21.552] [LOG]    00:13:21 <log> MMM-BluetoothDevices waiting for services to be resolved for: DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:32 Logger.debug)
0|mm  | [2020-04-26 00:13:29.503] [LOG]
0|mm  | 00:13:29 <log> MMM-BluetoothDevices connected to: DIRKS OralB after 1 try (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:13:29.961] [LOG]
0|mm  | 00:13:29 <log> MMM-BluetoothDevices battery updated to: 100% for: DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:32 Logger.debug)
0|mm  | [2020-04-26 00:13:29.966] [LOG]    00:13:29 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:13:29.979] [LOG]    00:13:29 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:13:30.255] [LOG]
0|mm  | 00:13:30 <log> MMM-BluetoothDevices battery updated to: 100% for: DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:32 Logger.debug)
0|mm  | [2020-04-26 00:13:30.259] [LOG]    00:13:30 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:13:31.229] [LOG]
0|mm  | 00:13:31 <log> MMM-BluetoothDevices battery updated to: 99% for: DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:32 Logger.debug)
0|mm  | [2020-04-26 00:13:31.234] [LOG]    00:13:31 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:13:31.466] [LOG]
0|mm  | 00:13:31 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:13:31.520] [LOG]
0|mm  | 00:13:31 <log> MMM-BluetoothDevices connection lost with device: DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:13:33.303] [LOG]
0|mm  | 00:13:33 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:13:33.315] [LOG]
0|mm  | 00:13:33 <info> MMM-BluetoothDevices reconnecting to: DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:24 Logger.info)
0|mm  | [2020-04-26 00:13:33.318] [LOG]    00:13:33 <log> MMM-BluetoothDevices trying to connect to: DIRKS OralB 1/1 (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:13:43.919] [LOG]
0|mm  | 00:13:43 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:13:54.916] [LOG]
0|mm  | 00:13:54 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:14:05.881] [LOG]
0|mm  | 00:14:05 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:14:13.884] [LOG]
0|mm  | 00:14:13 <info> MMM-BluetoothDevices failed to reconnect to: DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:24 Logger.info)
0|mm  | [2020-04-26 00:14:13.886] [LOG]    00:14:13 <log> MMM-BluetoothDevices Error: Error: Couldn't connect to DIRKS OralB after 1 try. (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:32 Logger.debug)
0|mm  | [2020-04-26 00:14:16.957] [LOG]
0|mm  | 00:14:16 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:14:28.049] [LOG]
0|mm  | 00:14:28 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:14:38.869] [LOG]
0|mm  | 00:14:38 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:14:49.968] [LOG]
0|mm  | 00:14:49 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:15:00.855] [LOG]
0|mm  | 00:15:00 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:15:12.156] [LOG]
0|mm  | 00:15:12 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:15:22.928] [LOG]
0|mm  | 00:15:22 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)
0|mm  | [2020-04-26 00:15:33.865] [LOG]
0|mm  | 00:15:33 <log> MMM-BluetoothDevices received device update for DIRKS OralB (/home/pi/MagicMirror/modules/MMM-BluetoothDevices/src/Logger.js:17 Logger.log)

Battery updates are there but only in the beginning.
I would assume my battery drains more than this one percent in 2 minutes but may be wrong.
Nothing displayed on the mirror.
Might still be missing?

timodejong95

@lavolp3 Nice, yeah thats still a thing. I thought it was the way it connects, but the devices automatically disconnects after 20-30 seconds. When disconnected its not able to get the battery status. So what I build that if the devices is disconnected at the first 5 seconds of brushing it’s going to reconnect (1 try). If that succeeds it gets the battery value. If not well, then sadly not.

I haven’t figured out a solution to keep it connected throughout the whole session or just forever. My guess is, the brush might expect data to be send to keep the connection active/alive.

In the logs I see that the reconnection has failed, do you got that every session? Else I might increase the reconnection attempts to 2.

OberfragGER

Did anyone got this running.

I have tested on MM2 - 2.14 and 2.15. No sucess.
Just the Time runs…

Do i have to do anything special like pairing the toothbrush (not possible, pairing nit sucessful).

Im using RPI4 with BT build in.