May 28 21:37:00 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:00.780+07:00 level=INFO msg="new address was allocated" component=ble/conn old=37 new=38 May 28 21:37:00 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:01 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:04 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:04.839+07:00 level=INFO msg="new address was allocated" component=ble/conn old=38 new=39 May 28 21:37:05 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:05 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:08 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:08.138+07:00 level=INFO msg="new address was allocated" component=ble/conn old=39 new=40 May 28 21:37:08 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:08 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:08 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:37:09 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:09.955+07:00 level=INFO msg="new address was allocated" component=ble/conn old=40 new=41 May 28 21:37:10 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:10 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:10 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:37:11 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:11.703+07:00 level=INFO msg="new address was allocated" component=ble/conn old=41 new=42 May 28 21:37:11 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:12 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:12 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:37:13 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:13.448+07:00 level=INFO msg="new address was allocated" component=ble/conn old=42 new=43 May 28 21:37:13 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:13 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:16 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:16.691+07:00 level=INFO msg="new address was allocated" component=ble/conn old=43 new=44 May 28 21:37:16 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:17 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:18 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:18.690+07:00 level=INFO msg="new address was allocated" component=ble/conn old=44 new=45 May 28 21:37:18 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:19 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:19 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:37:20 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:20.417+07:00 level=INFO msg="new address was allocated" component=ble/conn old=45 new=46 May 28 21:37:20 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:20 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:20 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:37:22 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:22.226+07:00 level=INFO msg="new address was allocated" component=ble/conn old=46 new=47 May 28 21:37:22 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:22 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:22 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:37:23 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:23.972+07:00 level=INFO msg="new address was allocated" component=ble/conn old=47 new=48 May 28 21:37:24 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:24 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:27 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:27.170+07:00 level=INFO msg="new address was allocated" component=ble/conn old=48 new=49 May 28 21:37:27 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:27 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:27 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:37:28 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:28.969+07:00 level=INFO msg="new address was allocated" component=ble/conn old=49 new=50 May 28 21:37:29 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:29 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:29 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:37:30 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:30.697+07:00 level=INFO msg="new address was allocated" component=ble/conn old=50 new=51 May 28 21:37:30 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:31 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:31 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:37:32 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:32.500+07:00 level=INFO msg="new address was allocated" component=ble/conn old=51 new=52 May 28 21:37:32 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:32 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:34 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:34.435+07:00 level=INFO msg="new address was allocated" component=ble/conn old=52 new=53 May 28 21:37:34 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:34 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:38 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:38.929+07:00 level=INFO msg="new address was allocated" component=ble/conn old=53 new=54 May 28 21:37:39 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:39 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:40 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:40.771+07:00 level=INFO msg="new address was allocated" component=ble/conn old=54 new=55 May 28 21:37:41 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:41 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:44 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:44.135+07:00 level=INFO msg="new address was allocated" component=ble/conn old=55 new=56 May 28 21:37:44 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:44 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:44 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:37:45 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:45.985+07:00 level=INFO msg="new address was allocated" component=ble/conn old=56 new=57 May 28 21:37:46 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:46 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:47 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:47.955+07:00 level=INFO msg="new address was allocated" component=ble/conn old=57 new=58 May 28 21:37:48 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:48 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:48 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:37:49 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:49.764+07:00 level=INFO msg="new address was allocated" component=ble/conn old=58 new=59 May 28 21:37:49 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:50 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:50 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:37:51 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:51.495+07:00 level=INFO msg="new address was allocated" component=ble/conn old=59 new=60 May 28 21:37:51 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:51 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:53 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:53.471+07:00 level=INFO msg="new address was allocated" component=ble/conn old=60 new=61 May 28 21:37:53 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:53 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:55 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:55.406+07:00 level=INFO msg="new address was allocated" component=ble/conn old=61 new=62 May 28 21:37:55 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:55 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:56 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:37:57 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:57.200+07:00 level=INFO msg="new address was allocated" component=ble/conn old=62 new=63 May 28 21:37:57 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:57 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:57 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:37:58 volumio volumio5-onboarding[1799]: time=2026-05-28T21:37:58.894+07:00 level=INFO msg="new address was allocated" component=ble/conn old=63 new=64 May 28 21:37:59 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:59 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:37:59 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:38:00 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:00.683+07:00 level=INFO msg="new address was allocated" component=ble/conn old=64 new=65 May 28 21:38:00 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:01 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:01 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:38:02 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:02.453+07:00 level=INFO msg="new address was allocated" component=ble/conn old=65 new=66 May 28 21:38:02 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:02 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:03 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:38:04 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:04.301+07:00 level=INFO msg="new address was allocated" component=ble/conn old=66 new=67 May 28 21:38:04 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:04 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:05 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:38:06 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:06.084+07:00 level=INFO msg="new address was allocated" component=ble/conn old=67 new=68 May 28 21:38:06 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:06 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:08 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:08.122+07:00 level=INFO msg="new address was allocated" component=ble/conn old=68 new=69 May 28 21:38:08 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:08 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:09 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:09.996+07:00 level=INFO msg="new address was allocated" component=ble/conn old=69 new=70 May 28 21:38:10 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:10 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:12 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:12.027+07:00 level=INFO msg="new address was allocated" component=ble/conn old=70 new=71 May 28 21:38:12 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:12 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:12 volumio kernel: Bluetooth: hci0: Opcode 0x200a failed: -16 May 28 21:38:13 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:13.778+07:00 level=INFO msg="new address was allocated" component=ble/conn old=71 new=72 May 28 21:38:13 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:14 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:15 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:15.763+07:00 level=INFO msg="new address was allocated" component=ble/conn old=72 new=73 May 28 21:38:15 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:16 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:30 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:30.918+07:00 level=INFO msg="player skip next request" component=server type=REQUEST_TYPE_PLAYER_SKIP_NEXT peer="192.168.31.106:58270 @ 0x1cb6bd0" latency=201.694018ms timeout=10s May 28 21:38:30 volumio volumio[1229]: info: CoreCommandRouter::volumioNext May 28 21:38:30 volumio volumio[1229]: info: CoreStateMachine::next May 28 21:38:30 volumio volumio[1229]: info: ControllerMpd::next May 28 21:38:30 volumio volumio[1229]: verbose: ControllerMpd::sendMpdCommand next May 28 21:38:31 volumio volumio[1229]: info: May 28 21:38:31 volumio volumio[1229]: ---------------------------- MPD announces state update: player May 28 21:38:31 volumio volumio[1229]: info: sendMpdCommand next took 103 milliseconds May 28 21:38:31 volumio volumio[1229]: info: ControllerMpd::getState May 28 21:38:31 volumio volumio[1229]: verbose: ControllerMpd::sendMpdCommand status May 28 21:38:31 volumio volumio[1229]: info: sendMpdCommand status took 1 milliseconds May 28 21:38:31 volumio volumio[1229]: verbose: ControllerMpd::parseState May 28 21:38:31 volumio volumio[1229]: info: ControllerMpd::pushState May 28 21:38:31 volumio volumio[1229]: info: CoreCommandRouter::servicePushState May 28 21:38:31 volumio volumio[1229]: info: CoreStateMachine::pushState May 28 21:38:31 volumio volumio[1229]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 28 21:38:31 volumio volumio[1229]: info: CoreCommandRouter::volumioPushState May 28 21:38:31 volumio volumio[1229]: info: CorePlayQueue::getTrack 0 May 28 21:38:31 volumio volumio[1229]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} May 28 21:38:31 volumio volumio[1229]: verbose: CURRENT POSITION 0 May 28 21:38:31 volumio volumio[1229]: info: CoreStateMachine::syncState stateService stop May 28 21:38:31 volumio volumio[1229]: info: CoreStateMachine::syncState currentStatus play May 28 21:38:31 volumio volumio[1229]: info: CoreStateMachine::play index undefined May 28 21:38:31 volumio volumio[1229]: info: CoreStateMachine::setConsumeUpdateService undefined May 28 21:38:31 volumio volumio[1229]: info: CoreStateMachine::pushState May 28 21:38:31 volumio volumio[1229]: info: CorePlayQueue::getTrack 1 May 28 21:38:31 volumio volumio[1229]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 28 21:38:31 volumio volumio[1229]: info: CoreCommandRouter::volumioPushState May 28 21:38:31 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:31.090+07:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.31.106:58270 @ 0x1cb6bd0" state=STATUS_PLAYING positionMs=108675 volume=46 May 28 21:38:31 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:31.090+07:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.31.106:58270 @ 0x1cb6bd0" id="http://localhost:6601/?codec=flac-mp4&transport=raw&key=&url=https%3A%2F%2Fext-strm-runvs04mts-02.strm.yandex.net%2Fmusic-v2%2Fraw%2Fysign1%3D47e2127ef70dd5044c7f4d086c6c8f22cc3d9d4b30de9629404e2eaad4451f59%2Clid%3D1640%2Cpfx%2Csecret_version%3Dver-1%2Csfx%2Csource%3Dmds%2Cts%3D6a260afe%2F0%2F5283616%2F1dcdcab1.200711988.5.40841082%2Fflac-mp4&ext=.flac" title="Good Guys Only Win in Movies" May 28 21:38:31 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:31.116+07:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.31.106:58270 @ 0x1cb6bd0" state=STATUS_STOPPED positionMs= volume=46 May 28 21:38:31 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:31.117+07:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.31.106:58270 @ 0x1cb6bd0" id=yandex_music/track/2166640:40384222@user:onyourwave title="Show Me the Way" May 28 21:38:31 volumio volumio[1229]: info: CorePlayQueue::getTrack 1 May 28 21:38:31 volumio volumio[1229]: info: CoreStateMachine::startPlaybackTimer May 28 21:38:31 volumio volumio[1229]: info: CorePlayQueue::getTrack 1 May 28 21:38:31 volumio volumio[1229]: verbose: ControllerMpd::sendMpdCommand stop May 28 21:38:31 volumio volumio[1229]: info: ------------------------------ 122ms May 28 21:38:31 volumio volumio[1229]: info: CoreStateMachine::pushState May 28 21:38:31 volumio volumio[1229]: info: CorePlayQueue::getTrack 1 May 28 21:38:31 volumio volumio[1229]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 28 21:38:31 volumio volumio[1229]: info: CoreCommandRouter::volumioPushState May 28 21:38:31 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:31.177+07:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.31.106:58270 @ 0x1cb6bd0" state=STATUS_STOPPED positionMs=0 volume=46 May 28 21:38:31 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:31.177+07:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.31.106:58270 @ 0x1cb6bd0" id=yandex_music/track/2166640:40384222@user:onyourwave title="Show Me the Way" May 28 21:38:31 volumio volumio[1229]: info: sendMpdCommand stop took 91 milliseconds May 28 21:38:31 volumio volumio[1229]: verbose: ControllerMpd::sendMpdCommand clear May 28 21:38:31 volumio volumio[1229]: info: CoreCommandRouter::volumioGetQueue May 28 21:38:31 volumio volumio[1229]: info: CoreStateMachine::getQueue May 28 21:38:31 volumio volumio[1229]: info: CorePlayQueue::getQueue May 28 21:38:31 volumio volumio[1229]: info: May 28 21:38:31 volumio volumio[1229]: ---------------------------- MPD announces system playlist update May 28 21:38:31 volumio volumio[1229]: info: Ignoring MPD Status Update May 28 21:38:31 volumio volumio[1229]: info: sendMpdCommand clear took 67 milliseconds May 28 21:38:31 volumio volumio[1229]: error: updateQueue error: null May 28 21:38:31 volumio volumio[1229]: info: ------------------------------ 104ms May 28 21:38:31 volumio volumio[1229]: verbose: ControllerMpd::sendMpdCommand addid "http://localhost:6601/?codec=flac-mp4&transport=raw&key=&url=https%3A%2F%2Fext-strm-runvs04mts-01.strm.yandex.net%2Fmusic-v2%2Fraw%2Fysign1%3D706ac8c74541e411f3ec0b14a0d6da443558ed4632dbad989f1ab9ee80f91a95%2Clid%3D1640%2Cpfx%2Csecret_version%3Dver-1%2Csfx%2Csource%3Dmds%2Cts%3D6a261af5%2F0%2F1613462%2F18678771.214757706.5.2166640%2Fflac-mp4&ext=.flac" May 28 21:38:31 volumio volumio[1229]: info: sendMpdCommand addid "http://localhost:6601/?codec=flac-mp4&transport=raw&key=&url=https%3A%2F%2Fext-strm-runvs04mts-01.strm.yandex.net%2Fmusic-v2%2Fraw%2Fysign1%3D706ac8c74541e411f3ec0b14a0d6da443558ed4632dbad989f1ab9ee80f91a95%2Clid%3D1640%2Cpfx%2Csecret_version%3Dver-1%2Csfx%2Csource%3Dmds%2Cts%3D6a261af5%2F0%2F1613462%2F18678771.214757706.5.2166640%2Fflac-mp4&ext=.flac" took 0 milliseconds May 28 21:38:31 volumio volumio[1229]: verbose: MPD COMMAND [object Object] May 28 21:38:31 volumio volumio[1229]: verbose: MPD COMMAND [object Object] May 28 21:38:31 volumio volumio[1229]: verbose: MPD COMMAND [object Object] May 28 21:38:31 volumio volumio[1229]: info: May 28 21:38:31 volumio volumio[1229]: ---------------------------- MPD announces system playlist update May 28 21:38:31 volumio volumio[1229]: info: Ignoring MPD Status Update May 28 21:38:31 volumio volumio[1229]: info: May 28 21:38:31 volumio volumio[1229]: ---------------------------- MPD announces system playlist update May 28 21:38:31 volumio volumio[1229]: info: Ignoring MPD Status Update May 28 21:38:31 volumio volumio[1229]: info: CoreStateMachine::setConsumeUpdateService mpd May 28 21:38:31 volumio volumio[1229]: verbose: ControllerMpd::sendMpdCommand play May 28 21:38:31 volumio volumio[1229]: info: ------------------------------ 47ms May 28 21:38:31 volumio volumio[1229]: info: ------------------------------ 2ms May 28 21:38:31 volumio volumio[1229]: info: sendMpdCommand play took 2 milliseconds May 28 21:38:33 volumio volumio[1229]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 28 21:38:33 volumio volumio[1229]: Error: Client network socket disconnected before secure TLS connection was established May 28 21:38:33 volumio volumio[1229]: at connResetException (node:internal/errors:720:14) May 28 21:38:33 volumio volumio[1229]: at TLSSocket.onConnectEnd (node:_tls_wrap:1682:19) May 28 21:38:33 volumio volumio[1229]: at TLSSocket.emit (node:events:526:35) May 28 21:38:33 volumio volumio[1229]: at endReadableNT (node:internal/streams/readable:1376:12) May 28 21:38:33 volumio volumio[1229]: at process.processTicksAndRejections (node:internal/process/task_queues:82:21) { May 28 21:38:33 volumio volumio[1229]: code: 'ECONNRESET', May 28 21:38:33 volumio volumio[1229]: path: null, May 28 21:38:33 volumio volumio[1229]: host: 'ext-strm-runvs04mts-01.strm.yandex.net', May 28 21:38:33 volumio volumio[1229]: port: 443, May 28 21:38:33 volumio volumio[1229]: localAddress: undefined May 28 21:38:33 volumio volumio[1229]: } May 28 21:38:33 volumio volumio[1229]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 28 21:38:35 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:35.677+07:00 level=INFO msg="new address was allocated" component=ble/conn old=73 new=74 May 28 21:38:35 volumio dbus-daemon[744]: [system] Rejected send message, 0 matched rules; type="error", sender=":1.26" (uid=0 pid=1799 comm="/usr/bin/volumio5-onboarding") interface="(unset)" member="(unset)" error name="org.freedesktop.DBus.Error.UnknownMethod" requested_reply="0" destination=":1.4" (uid=0 pid=798 comm="/usr/libexec/bluetooth/bluetoothd --noplugin=sap,b") May 28 21:38:36 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:36.128+07:00 level=INFO msg="app ready event" component=server event=CLIENT_EVENT_TYPE_APP_READY peer="00:00:00:00:00:00%49 @ 0x1c5e5a0" latency=2m52.291660286s platform=PLATFORM_IOS version=5.260413.0 May 28 21:38:36 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:36.256+07:00 level=INFO msg="device data request" component=server type=REQUEST_TYPE_DEVICE_DATA peer="00:00:00:00:00:00%49 @ 0x1c5e5a0" latency=2m52.41811277s timeout=10s May 28 21:38:36 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:36.256+07:00 level=INFO msg="emitting device capabilities changed event" component=server peer="00:00:00:00:00:00%49 @ 0x1c5e5a0" May 28 21:38:36 volumio sudo[2244]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-05-28 21:37' May 28 21:38:36 volumio sudo[2244]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 28 21:38:36 volumio volumio5-onboarding[1799]: time=2026-05-28T21:38:36.384+07:00 level=INFO msg="navigate to next page" component=server type=REQUEST_TYPE_CONTINUE_NAVIGATION peer="00:00:00:00:00:00%49 @ 0x1c5e5a0" latency=2m51.55938576s timeout=10s from=APP_PAGE_ROOT to=APP_PAGE_LEGACY_DEVICE PRETTY_NAME="Raspbian GNU/Linux 12 (bookworm)" NAME="Raspbian GNU/Linux" VERSION_ID="12" VERSION="12 (bookworm)" VERSION_CODENAME=bookworm ID=raspbian ID_LIKE=debian HOME_URL="http://www.raspbian.org/" SUPPORT_URL="http://www.raspbian.org/RaspbianForums" BUG_REPORT_URL="http://www.raspbian.org/RaspbianBugs" VOLUMIO_BUILD_VERSION="18952480e8d8c63f22208e9007a0f47a9563eae6" VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd" VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2" VOLUMIO_BE_VERSION="0e58f1861fa88e02087981b8d91f7511f0e7011b" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue Mar 24 17:20:52 UTC 2026" VOLUMIO_VERSION="4.119" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="d0c2fd9dbc5e70e58c32413c12353563"