Feb 09 09:45:40 r-pi-400 ntpd[1025]: CLOCK: time stepped by 3969115.656282 Feb 09 09:45:40 r-pi-400 ntpd[1025]: CLOCK: time changed from 2025-12-25 to 2026-02-09 Feb 09 09:45:40 r-pi-400 ntpd[1025]: INIT: MRU 13107 entries, 13 hash bits, 32768 bytes Feb 09 09:45:40 r-pi-400 volumio[1432]: Forking 3 albumart workers Feb 09 09:45:40 r-pi-400 systemd[1]: Starting dpkg-db-backup.service - Daily dpkg database backup service... Feb 09 09:45:40 r-pi-400 systemd[1]: Started ntpsec-rotate-stats.service - Rotate ntpd stats. Feb 09 09:45:40 r-pi-400 systemd[1]: ntpsec-rotate-stats.service: Deactivated successfully. Feb 09 09:45:40 r-pi-400 systemd[1]: dpkg-db-backup.service: Deactivated successfully. Feb 09 09:45:40 r-pi-400 systemd[1]: Finished dpkg-db-backup.service - Daily dpkg database backup service. Feb 09 09:45:41 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Feb 09 09:45:41 r-pi-400 volumio[1233]: info: CoreCommandRouter::initPlayerControls Feb 09 09:45:41 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:41 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:41 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:41 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:41 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:41 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:41 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:41 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:41 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Feb 09 09:45:41 r-pi-400 sudo[1413]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:41 r-pi-400 volumio[1233]: Express server listening on port 3000 Feb 09 09:45:41 r-pi-400 volumio[1233]: [Metrics] WebUI: 7s 910.35ms Feb 09 09:45:41 r-pi-400 volumio[1233]: info: CoreStateMachine::resetVolumioState Feb 09 09:45:41 r-pi-400 volumio[1233]: info: CoreStateMachine::getcurrentVolume Feb 09 09:45:41 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioRetrievevolume Feb 09 09:45:41 r-pi-400 volumio[1233]: info: Cannot read play queue from file Feb 09 09:45:41 r-pi-400 volumio[1233]: info: Volumio Network Manager: Network status updated: 2 Feb 09 09:45:41 r-pi-400 volumio[1233]: verbose: New Socket.io Connection to 192.168.1.80:3000 from 192.168.1.78 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 1 Feb 09 09:45:41 r-pi-400 volumio[1233]: error: Cannot get ALSA Volume: Error: Alsa Mixer Error: amixer: Unable to find simple control '',0 Feb 09 09:45:42 r-pi-400 volumio-remote-updater[760]: [2026-02-09 09:45:42] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=3&transport=websocket&t=1766654024 101 Feb 09 09:45:42 r-pi-400 volumio[1233]: verbose: New Socket.io Connection to 127.0.0.1:3000 from 127.0.0.1 UA: WebSocket++/0.8.2 Engine version: 3 Transport: websocket Total Clients: 2 Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:45:42 r-pi-400 volumio[1233]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 3 Feb 09 09:45:42 r-pi-400 volumio[1233]: info: VolumeController:: Volume=undefined Mute =false Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CoreStateMachine::pushState Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioPushState Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CoreStateMachine::updateTrackBlock Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrackBlock Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioRetrievevolume Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CoreStateMachine::setRepeat null single undefined Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CoreStateMachine::pushState Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioPushState Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CoreStateMachine::setRandom null Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CoreStateMachine::pushState Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:45:42 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioPushState Feb 09 09:45:42 r-pi-400 volumio[1233]: info: Setting Device type: Raspberry PI Feb 09 09:45:42 r-pi-400 volumio[1233]: error: Cannot get ALSA Volume: Error: Alsa Mixer Error: amixer: Unable to find simple control '',0 Feb 09 09:45:42 r-pi-400 volumio[1233]: info: Completed loading Core Plugins Feb 09 09:45:42 r-pi-400 volumio[1233]: info: Preparing to generate the ALSA configuration file Feb 09 09:45:42 r-pi-400 volumio[1233]: info: USB Boot Capable - Checking Install to Disk functions for: bootusb Feb 09 09:45:42 r-pi-400 volumio[1233]: info: USB Boot Capable - System SBC Revision found in cpuinfo: c03130 Feb 09 09:45:42 r-pi-400 volumio[1233]: info: USB Boot Capable - Found matching device in SBC capable list: Raspberry PI Feb 09 09:45:43 r-pi-400 volumio[1233]: info: VolumeController:: Volume=undefined Mute =false Feb 09 09:45:43 r-pi-400 volumio[1233]: info: CoreStateMachine::pushState Feb 09 09:45:43 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:45:43 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioPushState Feb 09 09:45:43 r-pi-400 volumio[1233]: info: Discovery: A device disappeared from network Feb 09 09:45:43 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , initSocket Feb 09 09:45:43 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:45:43 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:45:43 r-pi-400 volumio[1233]: info: Asound.conf file unchanged, so no further update is needed Feb 09 09:45:43 r-pi-400 volumio[1233]: info: Output device has changed, restarting MPD Feb 09 09:45:43 r-pi-400 sudo[1501]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Feb 09 09:45:43 r-pi-400 sudo[1501]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:43 r-pi-400 volumio[1233]: info: Output device has changed, restarting Shairport Sync Feb 09 09:45:43 r-pi-400 sudo[1501]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:43 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:43 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:45:43 r-pi-400 sudo[1503]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Feb 09 09:45:43 r-pi-400 sudo[1503]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:43 r-pi-400 volumio[1233]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Feb 09 09:45:43 r-pi-400 volumio[1233]: info: ___________ START PLUGINS ___________ Feb 09 09:45:43 r-pi-400 systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. Feb 09 09:45:43 r-pi-400 systemd[1]: Starting mpd.service - Music Player Daemon... Feb 09 09:45:43 r-pi-400 volumio[1233]: info: ControllerMpd::onStart: Initializing MPD Feb 09 09:45:43 r-pi-400 volumio[1233]: info: Creating MPD Configuration file Feb 09 09:45:43 r-pi-400 sudo[1511]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Feb 09 09:45:43 r-pi-400 sudo[1511]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Feb 09 09:45:43 r-pi-400 sudo[1513]: /bin/chown: cannot access '/var/log/mpd.log': No such file or directory Feb 09 09:45:43 r-pi-400 sudo[1511]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:44 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Feb 09 09:45:44 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Feb 09 09:45:44 r-pi-400 volumio[1233]: info: [1770623144038] CoreMusicLibrary::Adding element Media Servers Feb 09 09:45:44 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Feb 09 09:45:44 r-pi-400 sudo[1516]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Feb 09 09:45:44 r-pi-400 sudo[1516]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:44 r-pi-400 sudo[1516]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:44 r-pi-400 volumio[1233]: info: UPNP Browser: Client initialized successfully Feb 09 09:45:44 r-pi-400 sudo[1518]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Feb 09 09:45:44 r-pi-400 sudo[1518]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:44 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:44 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:45:44 r-pi-400 systemd[1]: mpd.service: Deactivated successfully. Feb 09 09:45:44 r-pi-400 systemd[1]: Stopped mpd.service - Music Player Daemon. Feb 09 09:45:44 r-pi-400 systemd[1]: mpd.socket: Deactivated successfully. Feb 09 09:45:44 r-pi-400 systemd[1]: Closed mpd.socket - Music Player Daemon Socket. Feb 09 09:45:44 r-pi-400 systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... Feb 09 09:45:44 r-pi-400 systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. Feb 09 09:45:44 r-pi-400 systemd[1]: Starting mpd.service - Music Player Daemon... Feb 09 09:45:44 r-pi-400 volumio[1233]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Feb 09 09:45:44 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:44 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:45:44 r-pi-400 sudo[1526]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Feb 09 09:45:44 r-pi-400 sudo[1526]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Feb 09 09:45:44 r-pi-400 sudo[1529]: /bin/chown: cannot access '/var/log/mpd.log': No such file or directory Feb 09 09:45:44 r-pi-400 sudo[1526]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:44 r-pi-400 volumio[1233]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Feb 09 09:45:44 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Feb 09 09:45:44 r-pi-400 volumio[1233]: info: [1770623144544] CoreMusicLibrary::Adding element Last_100 Feb 09 09:45:44 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Feb 09 09:45:44 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Feb 09 09:45:44 r-pi-400 volumio[1233]: info: [1770623144546] CoreMusicLibrary::Adding element Webradio Feb 09 09:45:44 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Feb 09 09:45:44 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Feb 09 09:45:44 r-pi-400 volumio[1233]: info: Initializing BBC Radios Feb 09 09:45:45 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Feb 09 09:45:45 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:45:45 r-pi-400 volumio[1233]: info: Loading i18n strings for locale en Feb 09 09:45:45 r-pi-400 volumio[1450]: Starting albumart workers Feb 09 09:45:45 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Feb 09 09:45:45 r-pi-400 volumio[1233]: info: Volumio Calling Home Feb 09 09:45:45 r-pi-400 sudo[1549]: volumio : PWD=/ ; USER=root ; COMMAND=/usr/bin/mkdir -p /data/volumiokioskextensions/IframeKeyboardBridge Feb 09 09:45:45 r-pi-400 sudo[1549]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:45 r-pi-400 sudo[1549]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:45 r-pi-400 volumio[1452]: Starting albumart workers Feb 09 09:45:45 r-pi-400 systemd[1]: systemd-fsckd.service: Deactivated successfully. Feb 09 09:45:45 r-pi-400 sudo[1555]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop getty@tty1.service Feb 09 09:45:45 r-pi-400 sudo[1555]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:46 r-pi-400 sudo[1557]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl disable getty@tty1.service Feb 09 09:45:46 r-pi-400 sudo[1557]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:46 r-pi-400 volumio[1451]: Starting albumart workers Feb 09 09:45:46 r-pi-400 sudo[1559]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl daemon-reload Feb 09 09:45:46 r-pi-400 sudo[1559]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:46 r-pi-400 sudo[1555]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:46 r-pi-400 systemd[1]: Reloading. Feb 09 09:45:46 r-pi-400 dhcpcd[698]: timed out Feb 09 09:45:46 r-pi-400 sh[685]: timed out Feb 09 09:45:46 r-pi-400 sh[603]: ifup: failed to bring up eth0 Feb 09 09:45:47 r-pi-400 systemd[1]: ifup@eth0.service: Main process exited, code=exited, status=1/FAILURE Feb 09 09:45:47 r-pi-400 systemd[1]: ifup@eth0.service: Failed with result 'exit-code'. Feb 09 09:45:47 r-pi-400 systemd[1]: Reloading. Feb 09 09:45:47 r-pi-400 sudo[1559]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:48 r-pi-400 mpd[1530]: 2026-02-09T09:45:48 decoder: Decoder plugin "wildmidi" is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Feb 09 09:45:48 r-pi-400 systemd[1]: Started mpd.service - Music Player Daemon. Feb 09 09:45:48 r-pi-400 systemd[1]: systemd-hostnamed.service: Deactivated successfully. Feb 09 09:45:48 r-pi-400 systemd[1]: upmpdcli.service: Scheduled restart job, restart counter is at 2. Feb 09 09:45:48 r-pi-400 systemd[1]: Stopped upmpdcli.service - UPnP Renderer front-end to MPD. Feb 09 09:45:48 r-pi-400 sudo[1518]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:48 r-pi-400 sudo[1557]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:48 r-pi-400 sudo[1503]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:48 r-pi-400 systemd[1]: Started upmpdcli.service - UPnP Renderer front-end to MPD. Feb 09 09:45:48 r-pi-400 upmpdcli[1628]: Could not open config: /tmp/upmpdcli.conf Feb 09 09:45:48 r-pi-400 systemd[1]: upmpdcli.service: Main process exited, code=exited, status=1/FAILURE Feb 09 09:45:48 r-pi-400 systemd[1]: upmpdcli.service: Failed with result 'exit-code'. Feb 09 09:45:48 r-pi-400 volumio[1233]: info: Discovery: A device disappeared from network Feb 09 09:45:49 r-pi-400 volumio[1233]: info: Discovery: A device disappeared from network Feb 09 09:45:49 r-pi-400 volumio[1233]: info: Discovery: adding 3b060cfb-be06-4ca8-89c6-9781fece782b Feb 09 09:45:49 r-pi-400 volumio[1233]: info: Discovery: Found device R-pi 400 Feb 09 09:45:49 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:45:49 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:45:49 r-pi-400 sudo[1639]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Feb 09 09:45:49 r-pi-400 sudo[1639]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:49 r-pi-400 volumio[1233]: info: Discovery: this is already registered, 3b060cfb-be06-4ca8-89c6-9781fece782b Feb 09 09:45:49 r-pi-400 volumio[1233]: info: Discovery: Found device R-pi 400 Feb 09 09:45:49 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:45:49 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:45:49 r-pi-400 sudo[1639]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:49 r-pi-400 volumio[1233]: info: touch_display: No backlight interface detected. Feb 09 09:45:49 r-pi-400 sudo[1638]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Feb 09 09:45:49 r-pi-400 sudo[1638]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:49 r-pi-400 sudo[1638]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:49 r-pi-400 volumio[1233]: info: touch_display: systemctl daemon-reload succeeded. Feb 09 09:45:49 r-pi-400 volumio[1233]: info: touch_display: systemctl disable getty@tty1.service succeeded. Feb 09 09:45:49 r-pi-400 volumio[1233]: info: touch_display: systemctl stop getty@tty1.service succeeded. Feb 09 09:45:49 r-pi-400 sudo[1643]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start volumio-kiosk.service Feb 09 09:45:49 r-pi-400 sudo[1643]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:49 r-pi-400 volumio[1233]: info: MPD Permissions set Feb 09 09:45:49 r-pi-400 volumio[1233]: info: MPD Permissions set Feb 09 09:45:49 r-pi-400 volumio[1233]: info: Discovery: adding 3f23b3db-8ce7-4b15-b32e-18f05c906b61 Feb 09 09:45:49 r-pi-400 volumio[1233]: info: Discovery: Found device BMW Volumio Feb 09 09:45:49 r-pi-400 volumio[1233]: info: Discovery: Connecting to remote: 192.168.1.78 Feb 09 09:45:49 r-pi-400 sudo[1643]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:49 r-pi-400 sudo[1646]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/cp -r /data/plugins/user_interface/touch_display/iframe_keyboard_bridge/content.js /data/plugins/user_interface/touch_display/iframe_keyboard_bridge/manifest.json /data/volumiokioskextensions/IframeKeyboardBridge/ Feb 09 09:45:49 r-pi-400 sudo[1646]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:49 r-pi-400 sudo[1646]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:49 r-pi-400 volumio[1233]: info: Volumio called home Feb 09 09:45:49 r-pi-400 volumio[1233]: error: MPD error: The expression evaluated to a falsy value: Feb 09 09:45:49 r-pi-400 volumio[1233]: assert.ok(self.idling) Feb 09 09:45:49 r-pi-400 volumio[1233]: error: The expression evaluated to a falsy value: Feb 09 09:45:49 r-pi-400 volumio[1233]: assert.ok(self.idling) Feb 09 09:45:49 r-pi-400 volumio[1233]: error: touch_display: Failed to start volumio-kiosk.service: Error: Command failed: /usr/bin/sudo /bin/systemctl start volumio-kiosk.service Feb 09 09:45:49 r-pi-400 volumio[1233]: Failed to start volumio-kiosk.service: Unit volumio-kiosk.service not found. Feb 09 09:45:49 r-pi-400 volumio[1233]: info: Completed starting Core Plugins Feb 09 09:45:49 r-pi-400 volumio[1233]: info: ------------------------------------------- Feb 09 09:45:49 r-pi-400 volumio[1233]: info: ----- MyVolumio plugins startup ---- Feb 09 09:45:49 r-pi-400 volumio[1233]: info: ------------------------------------------- Feb 09 09:45:49 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Fetching plans data.... Feb 09 09:45:49 r-pi-400 volumio[1233]: info: MPD running with PID1530 Feb 09 09:45:49 r-pi-400 volumio[1233]: ,establishing connection Feb 09 09:45:49 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 09 09:45:49 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 09 09:45:50 r-pi-400 volumio[1233]: info: Discovery: Getting this device information Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:45:50 r-pi-400 volumio[1233]: error: updateQueue error: null Feb 09 09:45:50 r-pi-400 volumio[1233]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 4 Feb 09 09:45:50 r-pi-400 volumio[1233]: info: touch_display: IframeKeyboardBridge extension installed successfully Feb 09 09:45:50 r-pi-400 volumio[1233]: info: touch_display: No Raspberry Pi Foundation touch screen detected. Feb 09 09:45:50 r-pi-400 volumio[1233]: error: updateQueue error: null Feb 09 09:45:50 r-pi-400 sudo[1669]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod a+rw /etc/X11/xorg.conf.d/99-vc4.conf Feb 09 09:45:50 r-pi-400 sudo[1669]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:50 r-pi-400 sudo[1669]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:50 r-pi-400 volumio[1233]: info: Starting Shairport Sync Feb 09 09:45:50 r-pi-400 volumio[1233]: info: Starting Shairport Sync Feb 09 09:45:50 r-pi-400 volumio[1233]: info: Starting Shairport Sync Feb 09 09:45:50 r-pi-400 sudo[1672]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service Feb 09 09:45:50 r-pi-400 sudo[1672]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:50 r-pi-400 sudo[1679]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Feb 09 09:45:50 r-pi-400 sudo[1679]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:50 r-pi-400 sudo[1674]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Feb 09 09:45:50 r-pi-400 sudo[1674]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:50 r-pi-400 systemd[1]: Starting e2scrub_all.service - Online ext4 Metadata Check for All Filesystems... Feb 09 09:45:50 r-pi-400 systemd[1]: e2scrub_all.service: Deactivated successfully. Feb 09 09:45:50 r-pi-400 systemd[1]: Finished e2scrub_all.service - Online ext4 Metadata Check for All Filesystems. Feb 09 09:45:50 r-pi-400 sudo[1678]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Feb 09 09:45:50 r-pi-400 sudo[1678]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:45:50 r-pi-400 volumio[1233]: info: Discovery: Connected to remote: 192.168.1.78 Feb 09 09:45:51 r-pi-400 systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... Feb 09 09:45:51 r-pi-400 systemd[1]: shairport-sync.service: Deactivated successfully. Feb 09 09:45:51 r-pi-400 systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Feb 09 09:45:51 r-pi-400 systemd[1]: shairport-sync.service: Consumed 1.385s CPU time. Feb 09 09:45:51 r-pi-400 systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Feb 09 09:45:51 r-pi-400 sudo[1674]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:51 r-pi-400 volumio[1233]: info: Discovery: this is already registered, 3b060cfb-be06-4ca8-89c6-9781fece782b Feb 09 09:45:51 r-pi-400 volumio[1233]: info: Discovery: Found device R-pi 400 Feb 09 09:45:51 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:45:51 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:45:51 r-pi-400 volumio[1233]: info: touch_display: File permissions for /etc/X11/xorg.conf.d/99-vc4.conf set. Feb 09 09:45:51 r-pi-400 sudo[1679]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:51 r-pi-400 sudo[1678]: pam_unix(sudo:session): session closed for user root Feb 09 09:45:51 r-pi-400 volumio[1233]: info: Discovery: this is already registered, 3b060cfb-be06-4ca8-89c6-9781fece782b Feb 09 09:45:51 r-pi-400 volumio[1233]: info: Discovery: Found device R-pi 400 Feb 09 09:45:51 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:45:51 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:45:51 r-pi-400 volumio[1233]: info: Shairport-Sync Started Feb 09 09:45:51 r-pi-400 volumio[1233]: Error adding Membership: Error: addMembership EINVAL Feb 09 09:45:51 r-pi-400 volumio[1233]: info: Shairport-Sync Started Feb 09 09:45:51 r-pi-400 volumio[1233]: info: Shairport-Sync Started Feb 09 09:45:51 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:45:51 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:45:51 r-pi-400 volumio[1233]: info: Discovery: this is already registered, 3f23b3db-8ce7-4b15-b32e-18f05c906b61 Feb 09 09:45:51 r-pi-400 volumio[1233]: info: Discovery: Found device BMW Volumio Feb 09 09:45:54 r-pi-400 volumio[1233]: error: Failed LSINFO: Error: [50@0] {lsinfo} No such directory Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan premium Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan premium Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan premium Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan premium Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan premium Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan premium Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan premium Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin tidal to plan premium Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan premium Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan premium Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin qobuzconnect to plan premium Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan superstar Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan superstar Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan superstar Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan superstar Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan superstar Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan superstar Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan superstar Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin tidal to plan superstar Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan superstar Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan superstar Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin qobuzconnect to plan superstar Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan virtuoso Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan virtuoso Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan virtuoso Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin tidal to plan virtuoso Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan virtuoso Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan virtuoso Feb 09 09:45:58 r-pi-400 volumio[1233]: info: Adding plugin bluetooth to MyMusic Plugins Feb 09 09:45:58 r-pi-400 volumio[1233]: info: Adding plugin multiroom to MyMusic Plugins Feb 09 09:45:58 r-pi-400 volumio[1233]: info: Adding plugin metavolumio to MyMusic Plugins Feb 09 09:45:58 r-pi-400 volumio[1233]: info: Adding plugin cd_controller to MyMusic Plugins Feb 09 09:45:58 r-pi-400 volumio[1233]: info: Adding plugin qobuzconnect to MyMusic Plugins Feb 09 09:45:58 r-pi-400 volumio[1233]: info: Adding plugin smart_inputs to MyMusic Plugins Feb 09 09:45:58 r-pi-400 volumio[1233]: info: Adding plugin tidalconnect to MyMusic Plugins Feb 09 09:45:58 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Loading plugin "my_volumio"... Feb 09 09:46:01 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] MyVolumio plugin successfully loaded Feb 09 09:46:01 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Starting plugin system_controller.my_volumio Feb 09 09:46:01 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:01 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:01 r-pi-400 volumio[1233]: info: Starting MyVolumio Remote Streaming Endpoints Feb 09 09:46:01 r-pi-400 volumio[1233]: info: MyVolumio login type: Token Feb 09 09:46:01 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] MyVolumio plugin successfully started Feb 09 09:46:01 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Loading plugin "streaming_services"... Feb 09 09:46:02 r-pi-400 systemd[1]: Starting setdatetime-helper.service - Time Synchronization Helper Service... Feb 09 09:46:03 r-pi-400 systemd[1]: upmpdcli.service: Scheduled restart job, restart counter is at 3. Feb 09 09:46:03 r-pi-400 systemd[1]: Stopped upmpdcli.service - UPnP Renderer front-end to MPD. Feb 09 09:46:03 r-pi-400 systemd[1]: Started upmpdcli.service - UPnP Renderer front-end to MPD. Feb 09 09:46:03 r-pi-400 sudo[1672]: pam_unix(sudo:session): session closed for user root Feb 09 09:46:05 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Streaming Services plugin successfully loaded Feb 09 09:46:05 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Starting plugin music_service.streaming_services Feb 09 09:46:05 r-pi-400 volumio[1233]: info: Streaming services startup Feb 09 09:46:05 r-pi-400 volumio[1233]: info: Starting Streaming Daemon Feb 09 09:46:05 r-pi-400 volumio[1233]: info: [MyVolumio PluginManager] Streaming Services plugin successfully started Feb 09 09:46:05 r-pi-400 sudo[1742]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Feb 09 09:46:05 r-pi-400 sudo[1742]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:46:05 r-pi-400 sudo[1742]: pam_unix(sudo:session): session closed for user root Feb 09 09:46:05 r-pi-400 volumio[1233]: error: Cannot start Volumio Streaming Daemon Feb 09 09:46:05 r-pi-400 volumio[1233]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service Feb 09 09:46:05 r-pi-400 volumio[1233]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. Feb 09 09:46:05 r-pi-400 volumio[1233]: info: Upmpdcli Daemon Started Feb 09 09:46:06 r-pi-400 systemd[1]: setdatetime-helper.service: Deactivated successfully. Feb 09 09:46:06 r-pi-400 systemd[1]: Finished setdatetime-helper.service - Time Synchronization Helper Service. Feb 09 09:46:07 r-pi-400 volumio[1233]: info: MYVOLUMIO SUCCESSFULLY LOGGED IN Feb 09 09:46:07 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 09 09:46:07 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 09 09:46:07 r-pi-400 volumio[1233]: info: Discovery: Getting this device information Feb 09 09:46:07 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:46:07 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:46:07 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 09 09:46:07 r-pi-400 volumio[1233]: verbose: New Socket.io Connection to 192.168.1.80:3000 from 192.168.1.73 UA: Dart/3.5 (dart:io) Engine version: 3 Transport: websocket Total Clients: 5 Feb 09 09:46:07 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:46:07 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:46:07 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Feb 09 09:46:07 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Feb 09 09:46:07 r-pi-400 volumio[1233]: info: MyVolumio token set successfully Feb 09 09:46:07 r-pi-400 volumio[1233]: info: MYVOLUMIO: Adding device Feb 09 09:46:07 r-pi-400 volumio[1233]: info: MYVOLUMIO: Evaluating Server Feb 09 09:46:08 r-pi-400 volumio[1233]: info: MyVolumio status changed Feb 09 09:46:08 r-pi-400 volumio[1233]: info: Streaming services startup Feb 09 09:46:08 r-pi-400 volumio[1233]: info: Starting Streaming Daemon Feb 09 09:46:08 r-pi-400 volumio[1233]: info: Removing browser output: myVolumio user plan is not superstar Feb 09 09:46:08 r-pi-400 volumio[1233]: info: Removing audio output: Feb 09 09:46:08 r-pi-400 volumio[1233]: info: Stoppping Tunnel 1 Feb 09 09:46:09 r-pi-400 sudo[1798]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Feb 09 09:46:09 r-pi-400 sudo[1798]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:46:09 r-pi-400 sudo[1798]: pam_unix(sudo:session): session closed for user root Feb 09 09:46:09 r-pi-400 sudo[1800]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop sshtunnel.service Feb 09 09:46:09 r-pi-400 sudo[1800]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:46:09 r-pi-400 volumio[1233]: info: Setting Geolocation for MyVolumio to eu5 Feb 09 09:46:09 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:09 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:09 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:09 r-pi-400 systemd[1]: /lib/systemd/system/sshtunnel.service:6: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. Feb 09 09:46:09 r-pi-400 systemd[1]: /lib/systemd/system/sshtunnel.service:7: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. Feb 09 09:46:09 r-pi-400 systemd[1]: /lib/systemd/system/sshtunnel.service:6: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. Feb 09 09:46:09 r-pi-400 systemd[1]: /lib/systemd/system/sshtunnel.service:7: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. Feb 09 09:46:09 r-pi-400 systemd[1]: /lib/systemd/system/sshtunnel.service:6: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. Feb 09 09:46:09 r-pi-400 systemd[1]: /lib/systemd/system/sshtunnel.service:7: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. Feb 09 09:46:09 r-pi-400 systemd[1]: /lib/systemd/system/sshtunnel.service:6: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. Feb 09 09:46:09 r-pi-400 systemd[1]: /lib/systemd/system/sshtunnel.service:7: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. Feb 09 09:46:09 r-pi-400 sudo[1800]: pam_unix(sudo:session): session closed for user root Feb 09 09:46:09 r-pi-400 volumio[1233]: error: Cannot start Volumio Streaming Daemon Feb 09 09:46:09 r-pi-400 volumio[1233]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service Feb 09 09:46:09 r-pi-400 volumio[1233]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. Feb 09 09:46:09 r-pi-400 volumio[1233]: info: Remote SSH Stopped Feb 09 09:46:09 r-pi-400 volumio[1233]: error: Failed to add MyVolumio device: {"message":"USER_NOT_FOUND"} Feb 09 09:46:10 r-pi-400 volumio[1233]: info: Updating MyVolumio device info Feb 09 09:46:10 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:10 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:10 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:10 r-pi-400 volumio[1233]: error: Failed to update MyVolumio device: {"message":"DEVICE_NOT_FOUND"} Feb 09 09:46:13 r-pi-400 volumio[1233]: info: MYVOLUMIO: Adding device Feb 09 09:46:13 r-pi-400 volumio[1233]: info: MYVOLUMIO: Evaluating Server Feb 09 09:46:13 r-pi-400 sudo[1804]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Feb 09 09:46:13 r-pi-400 sudo[1806]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Feb 09 09:46:13 r-pi-400 sudo[1806]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:46:13 r-pi-400 sudo[1806]: pam_unix(sudo:session): session closed for user root Feb 09 09:46:13 r-pi-400 sudo[1804]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:46:13 r-pi-400 sudo[1804]: pam_unix(sudo:session): session closed for user root Feb 09 09:46:14 r-pi-400 volumio[1233]: verbose: New Socket.io Connection to 192.168.1.80 from 192.168.1.73 UA: Mozilla/5.0 (Linux; Android 16; SM-F956B Build/BP2A.250605.031.A3; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/144.0.7559.109 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 6 Feb 09 09:46:14 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 09 09:46:14 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 09 09:46:14 r-pi-400 volumio[1233]: info: Discovery: Getting this device information Feb 09 09:46:14 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:46:14 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:46:14 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 09 09:46:14 r-pi-400 volumio[1233]: info: Setting Geolocation for MyVolumio to eu8 Feb 09 09:46:14 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:14 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:14 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:15 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Feb 09 09:46:15 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:15 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Feb 09 09:46:15 r-pi-400 sudo[1831]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Feb 09 09:46:15 r-pi-400 sudo[1833]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Feb 09 09:46:15 r-pi-400 sudo[1833]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:46:15 r-pi-400 sudo[1831]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:46:15 r-pi-400 sudo[1831]: pam_unix(sudo:session): session closed for user root Feb 09 09:46:15 r-pi-400 volumio-remote-updater[760]: Test mode disabled Feb 09 09:46:15 r-pi-400 volumio-remote-updater[760]: Alpha mode disabled Feb 09 09:46:15 r-pi-400 volumio-remote-updater[760]: Alpha legacy test mode disabled Feb 09 09:46:15 r-pi-400 sudo[1833]: pam_unix(sudo:session): session closed for user root Feb 09 09:46:15 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled Feb 09 09:46:15 r-pi-400 volumio[1233]: error: Failed to add MyVolumio device: {"message":"USER_NOT_FOUND"} Feb 09 09:46:15 r-pi-400 volumio[1233]: verbose: New Socket.io Connection to 192.168.1.80 from 192.168.1.73 UA: Mozilla/5.0 (Linux; Android 16; SM-F956B Build/BP2A.250605.031.A3; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/144.0.7559.109 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 7 Feb 09 09:46:15 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Feb 09 09:46:15 r-pi-400 volumio[1233]: info: Update Ready: {"changeLogLink":"","description":"You're already on the latest version","title":"No Updates Available","updateavailable":false} Feb 09 09:46:15 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache Feb 09 09:46:15 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetVisibleSources Feb 09 09:46:15 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Feb 09 09:46:15 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:46:15 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:46:15 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Feb 09 09:46:15 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Feb 09 09:46:15 r-pi-400 volumio[1233]: info: Received Get System Info Feb 09 09:46:15 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 09 09:46:15 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 09 09:46:16 r-pi-400 volumio[1233]: info: Discovery: Getting this device information Feb 09 09:46:16 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:46:16 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:46:16 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 09 09:46:16 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:46:16 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:46:16 r-pi-400 volumio[1233]: info: Listing playlists Feb 09 09:46:16 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Feb 09 09:46:16 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Feb 09 09:46:16 r-pi-400 volumio[1233]: info: Updating MyVolumio device info Feb 09 09:46:16 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:16 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:16 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 09 09:46:16 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Feb 09 09:46:16 r-pi-400 volumio[1233]: error: Failed to update MyVolumio device: {"message":"DEVICE_NOT_FOUND"} Feb 09 09:46:16 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Feb 09 09:46:16 r-pi-400 volumio[1233]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 8 Feb 09 09:46:17 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:46:17 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:46:17 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Feb 09 09:46:17 r-pi-400 volumio[1233]: info: Received Get System Info Feb 09 09:46:17 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 09 09:46:17 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 09 09:46:17 r-pi-400 volumio[1233]: info: Discovery: Getting this device information Feb 09 09:46:17 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:46:17 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:46:17 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 09 09:46:17 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Feb 09 09:46:18 r-pi-400 upmpdcli[1855]: writing RSA key Feb 09 09:46:19 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Feb 09 09:46:19 r-pi-400 volumio[1233]: info: Received Get System Info Feb 09 09:46:19 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 09 09:46:19 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 09 09:46:19 r-pi-400 volumio[1233]: info: Discovery: Getting this device information Feb 09 09:46:19 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetState Feb 09 09:46:19 r-pi-400 volumio[1233]: info: CorePlayQueue::getTrack 0 Feb 09 09:46:19 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 09 09:46:19 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Feb 09 09:46:19 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken Feb 09 09:46:21 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:46:21 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 09 09:46:21 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getConfigParam Feb 09 09:46:21 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getConfigParam Feb 09 09:46:21 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam Feb 09 09:46:21 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStatsObject Feb 09 09:46:21 r-pi-400 volumio[1233]: info: CoreCommandRouter::volumioGetBrowseSources Feb 09 09:46:21 r-pi-400 volumio[1233]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Feb 09 09:46:22 r-pi-400 volumio[1233]: info: Starting Uninstall of plugin user_interface - touch_display Feb 09 09:46:22 r-pi-400 volumio[1233]: info: Uninstalling plugin touch_display Feb 09 09:46:22 r-pi-400 sudo[1864]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start getty@tty1.service Feb 09 09:46:22 r-pi-400 sudo[1862]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod a+rw /etc/X11/xorg.conf.d/95-touch_display-plugin.conf Feb 09 09:46:22 r-pi-400 sudo[1866]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl enable getty@tty1.service Feb 09 09:46:22 r-pi-400 sudo[1864]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:46:22 r-pi-400 sudo[1862]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:46:22 r-pi-400 sudo[1866]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:46:22 r-pi-400 sudo[1862]: pam_unix(sudo:session): session closed for user root Feb 09 09:46:22 r-pi-400 sudo[1868]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumio-kiosk.service Feb 09 09:46:22 r-pi-400 sudo[1868]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 09 09:46:22 r-pi-400 systemd[1]: Created slice system-getty.slice - Slice /system/getty. Feb 09 09:46:22 r-pi-400 volumio[1233]: info: touch_display: File permissions for /etc/X11/xorg.conf.d/95-touch_display-plugin.conf set. Feb 09 09:46:22 r-pi-400 volumio[1233]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Feb 09 09:46:22 r-pi-400 volumio[1233]: TypeError: Cannot read properties of undefined (reading 'split') Feb 09 09:46:22 r-pi-400 volumio[1233]: at /data/plugins/user_interface/touch_display/index.js:1298:37 Feb 09 09:46:22 r-pi-400 volumio[1233]: at ChildProcess.exithandler (node:child_process:413:7) Feb 09 09:46:22 r-pi-400 volumio[1233]: at ChildProcess.emit (node:events:514:28) Feb 09 09:46:22 r-pi-400 volumio[1233]: at maybeClose (node:internal/child_process:1105:16) Feb 09 09:46:22 r-pi-400 volumio[1233]: at ChildProcess._handle.onexit (node:internal/child_process:305:5) Feb 09 09:46:22 r-pi-400 systemd[1]: Started getty@tty1.service - Getty on tty1. Feb 09 09:46:22 r-pi-400 systemd[1]: Reloading. Feb 09 09:46:22 r-pi-400 volumio[1233]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Feb 09 09:46:22 r-pi-400 sudo[1864]: pam_unix(sudo:session): session closed for user root Feb 09 09:46:23 r-pi-400 sudo[1868]: pam_unix(sudo:session): session closed for user root Feb 09 09:46:23 r-pi-400 sudo[1866]: pam_unix(sudo:session): session closed for user root Feb 09 09:46:25 r-pi-400 sudo[1905]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-02-09 09:45' Feb 09 09:46:25 r-pi-400 sudo[1905]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) 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="b05a530ca81d05eb9a84d0acf82089f0a60b8ee6" VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd" VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2" VOLUMIO_BE_VERSION="4ad85e2147d972f0b838d33c21382d2d813b2ae8" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Thu Dec 25 09:13:19 UTC 2025" VOLUMIO_VERSION="4.084" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="792f09af7488531aecd1aadcaa9b175e"