Feb 11 10:05:26 rpi5-freenove ntpd[1265]: CLOCK: time stepped by 2039275.950299 Feb 11 10:05:26 rpi5-freenove ntpd[1265]: CLOCK: time changed from 2026-01-18 to 2026-02-11 Feb 11 10:05:26 rpi5-freenove ntpd[1265]: INIT: MRU 13107 entries, 13 hash bits, 32768 bytes Feb 11 10:05:26 rpi5-freenove systemd[1]: Starting dpkg-db-backup.service - Daily dpkg database backup service... Feb 11 10:05:26 rpi5-freenove systemd[1]: Started ntpsec-rotate-stats.service - Rotate ntpd stats. Feb 11 10:05:26 rpi5-freenove systemd[1]: ntpsec-rotate-stats.service: Deactivated successfully. Feb 11 10:05:26 rpi5-freenove systemd[1]: dpkg-db-backup.service: Deactivated successfully. Feb 11 10:05:26 rpi5-freenove systemd[1]: Finished dpkg-db-backup.service - Daily dpkg database backup service. Feb 11 10:05:27 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:27 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan premium Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan premium Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan premium Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan premium Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan premium Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan premium Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan premium Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin tidal to plan premium Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan premium Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan premium Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin qobuzconnect to plan premium Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan superstar Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan superstar Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan superstar Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan superstar Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan superstar Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan superstar Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan superstar Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin tidal to plan superstar Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan superstar Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan superstar Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin qobuzconnect to plan superstar Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan virtuoso Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan virtuoso Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan virtuoso Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin tidal to plan virtuoso Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan virtuoso Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan virtuoso Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: Adding plugin bluetooth to MyMusic Plugins Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: Adding plugin multiroom to MyMusic Plugins Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: Adding plugin metavolumio to MyMusic Plugins Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: Adding plugin cd_controller to MyMusic Plugins Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: Adding plugin qobuzconnect to MyMusic Plugins Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: Adding plugin smart_inputs to MyMusic Plugins Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: Adding plugin tidalconnect to MyMusic Plugins Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Loading plugin "my_volumio"... Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] MyVolumio plugin successfully loaded Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Starting plugin system_controller.my_volumio Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: Starting MyVolumio Remote Streaming Endpoints Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: MyVolumio login type: Token Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] MyVolumio plugin successfully started Feb 11 10:05:28 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Loading plugin "streaming_services"... Feb 11 10:05:29 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Streaming Services plugin successfully loaded Feb 11 10:05:29 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Starting plugin music_service.streaming_services Feb 11 10:05:29 rpi5-freenove volumio[1457]: info: Streaming services startup Feb 11 10:05:29 rpi5-freenove volumio[1457]: info: Starting Streaming Daemon Feb 11 10:05:29 rpi5-freenove sudo[2418]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Feb 11 10:05:29 rpi5-freenove sudo[2418]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:29 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Streaming Services plugin successfully started Feb 11 10:05:29 rpi5-freenove sudo[2418]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:29 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:29 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:30 rpi5-freenove volumio[1457]: info: Discovery: A device disappeared from network Feb 11 10:05:30 rpi5-freenove volumio[1457]: info: Discovery: Device rpi5-freenove disappeared from network Feb 11 10:05:30 rpi5-freenove volumio[1457]: error: Cannot start Volumio Streaming Daemon Feb 11 10:05:30 rpi5-freenove volumio[1457]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service Feb 11 10:05:30 rpi5-freenove volumio[1457]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. Feb 11 10:05:31 rpi5-freenove volumio[1457]: info: Discovery: A device disappeared from network Feb 11 10:05:31 rpi5-freenove volumio[1457]: info: Discovery: Device primo disappeared from network Feb 11 10:05:31 rpi5-freenove volumio[1457]: info: Discovery: Disconnected from remote: 192.168.1.96 Feb 11 10:05:31 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Feb 11 10:05:31 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:31 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:32 rpi5-freenove volumio[1457]: info: Discovery: A device disappeared from network Feb 11 10:05:32 rpi5-freenove volumio[1457]: info: Discovery: A device disappeared from network Feb 11 10:05:32 rpi5-freenove volumio[1457]: info: Discovery: Device rivo disappeared from network Feb 11 10:05:32 rpi5-freenove volumio[1457]: info: Discovery: Disconnected from remote: 192.168.1.140 Feb 11 10:05:32 rpi5-freenove volumio[1457]: info: Discovery: A device disappeared from network Feb 11 10:05:32 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:32 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:34 rpi5-freenove volumio[1457]: (node:1457) MaxListenersExceededWarning: Possible EventEmitter memory leak detected. 11 close listeners added to [TLSSocket]. Use emitter.setMaxListeners() to increase limit Feb 11 10:05:34 rpi5-freenove volumio[1457]: (Use `node --trace-warnings ...` to show where the warning was created) Feb 11 10:05:34 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:34 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:35 rpi5-freenove systemd[1]: systemd-fsckd.service: Deactivated successfully. Feb 11 10:05:35 rpi5-freenove volumio[1457]: info: Discovery: adding cff91f1e-0e1e-4b7e-9970-47c96d8efd0c Feb 11 10:05:35 rpi5-freenove volumio[1457]: info: Discovery: Found device Primo Plus Feb 11 10:05:35 rpi5-freenove volumio[1457]: info: Discovery: adding c5cdc95c-b627-4cfc-9541-d2dbd0294f3d Feb 11 10:05:35 rpi5-freenove volumio[1457]: info: Discovery: Found device Primo Feb 11 10:05:35 rpi5-freenove volumio[1457]: info: Discovery: Connecting to remote: 192.168.1.96 Feb 11 10:05:35 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:35 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:36 rpi5-freenove systemd[1]: systemd-hostnamed.service: Deactivated successfully. Feb 11 10:05:37 rpi5-freenove systemd[1]: upmpdcli.service: Scheduled restart job, restart counter is at 2. Feb 11 10:05:37 rpi5-freenove systemd[1]: Stopped upmpdcli.service - UPnP Renderer front-end to MPD. Feb 11 10:05:37 rpi5-freenove systemd[1]: Started upmpdcli.service - UPnP Renderer front-end to MPD. Feb 11 10:05:37 rpi5-freenove sudo[2382]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: Discovery: adding b26ec725-6d05-4b1b-b8e7-e6e4d3ae1fa8 Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: Discovery: Found device rPi5-Freenove Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: Discovery: this is already registered, b26ec725-6d05-4b1b-b8e7-e6e4d3ae1fa8 Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: Discovery: Found device rPi5-Freenove Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: Discovery: Connected to remote: 192.168.1.96 Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: Upmpdcli Daemon Started Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: Discovery: adding c6ef1162-0e8a-4f8a-8f5b-0d8e3b5f669f Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: Discovery: Found device Rivo Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: Discovery: Connecting to remote: 192.168.1.140 Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: Discovery: Connected to remote: 192.168.1.140 Feb 11 10:05:37 rpi5-freenove volumio[1457]: error: MyVolumio Custom Token format not valid, refreshing it Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:37 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: Received Get System Version Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: Received Get System Info Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: Discovery: Getting this device information Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: MyVolumio login type: Token Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:38 rpi5-freenove volumio[1457]: info: MYVOLUMIO SUCCESSFULLY LOGGED IN Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: MyVolumio token set successfully Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: MYVOLUMIO: Adding device Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: MYVOLUMIO: Evaluating Server Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: MyVolumio Plan changed: premium Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Subscribed plan changed to premium Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: Removing browser output: myVolumio user plan is not superstar Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: Removing audio output: Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: MYVOLUMIO: Adding device Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: MYVOLUMIO: Evaluating Server Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: Remote config written successfully Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: Starting Tunnel 1 Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: Starting Tunnel Connection Checker Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: Completed starting MyVolumio Plugin Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: MYVolumio Device enabled Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Device activated, enabling myvolumio plugins... Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: MyVolumio status changed Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: Streaming services startup Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: Starting Streaming Daemon Feb 11 10:05:39 rpi5-freenove sudo[2503]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Feb 11 10:05:39 rpi5-freenove sudo[2503]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getHwuuid Feb 11 10:05:39 rpi5-freenove volumio[1457]: error: [MyVolumio PluginManager] Cache data is invalid! Feb 11 10:05:39 rpi5-freenove systemd[1]: Starting e2scrub_all.service - Online ext4 Metadata Check for All Filesystems... Feb 11 10:05:39 rpi5-freenove systemd[1]: e2scrub_all.service: Deactivated successfully. Feb 11 10:05:39 rpi5-freenove sudo[2503]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:39 rpi5-freenove systemd[1]: Finished e2scrub_all.service - Online ext4 Metadata Check for All Filesystems. Feb 11 10:05:39 rpi5-freenove volumio[1457]: error: Cannot start Volumio Streaming Daemon Feb 11 10:05:39 rpi5-freenove volumio[1457]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service Feb 11 10:05:39 rpi5-freenove volumio[1457]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: Setting Geolocation for MyVolumio to eu2 Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:39 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Loading plugin "bluetooth"... Feb 11 10:05:40 rpi5-freenove volumio[1457]: ------------------------------------ BT MESSAGE: [FUNC] onVolumioStart Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Loading plugin "multiroom"... Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Applying required configuration parameters for plugin multiroom Feb 11 10:05:40 rpi5-freenove sudo[2509]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/rm -rf /tmp/multiroom Feb 11 10:05:40 rpi5-freenove sudo[2509]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:40 rpi5-freenove sudo[2509]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: MRS: MultiRoom plugin initialized Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: MRS: STOPPING SNAPCLIENT Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: MRS: Snap server stop Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: MRS: STOPPING volumioStreaming Feb 11 10:05:40 rpi5-freenove sudo[2526]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioSnapclient Feb 11 10:05:40 rpi5-freenove sudo[2526]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:40 rpi5-freenove sudo[2528]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioSnapserver Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Loading plugin "metavolumio"... Feb 11 10:05:40 rpi5-freenove sudo[2528]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:40 rpi5-freenove sudo[2530]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioStreaming Feb 11 10:05:40 rpi5-freenove sudo[2530]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Loading plugin "manifestui"... Feb 11 10:05:40 rpi5-freenove sudo[2532]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/rm -f /tmp/hls/* Feb 11 10:05:40 rpi5-freenove sudo[2532]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Loading plugin "cd_controller"... Feb 11 10:05:40 rpi5-freenove sudo[2532]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Loading plugin "smart_inputs"... Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Loading plugin "hi_res_audio"... Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Applying required configuration parameters for plugin hi_res_audio Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Loading plugin "tidal"... Feb 11 10:05:40 rpi5-freenove sudo[2526]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:40 rpi5-freenove sudo[2530]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:40 rpi5-freenove sudo[2528]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Loading plugin "qobuz"... Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Loading plugin "tidalconnect"... Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Loading plugin "qobuzconnect"... Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Preparing to generate the ALSA configuration file Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getHwuuid Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Setting Geolocation for MyVolumio to eu10 Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: The plugin mpd_oled has an ALSA contribution file volumioalsa.postalsa.5.conf Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: The plugin peppy_screensaver has an ALSA contribution file Peppyalsa.postPeppyalsa.5.conf Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Reading ALSA contributions from plugins. Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Successfully Added MyVolumio device Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: MRS: Removed streaming files Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: MRS: volumioStreaming STOPPED Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: MRS: SNAPSERVER STOPPED Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: MRS: SNAPCLIENT STOPPED Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Asound.conf file written Feb 11 10:05:40 rpi5-freenove sudo[2540]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/mv /home/volumio/.asoundrc /etc/asound.conf Feb 11 10:05:40 rpi5-freenove sudo[2540]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:40 rpi5-freenove sudo[2540]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:40 rpi5-freenove volumio[1457]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:0 use case configuration -2 Feb 11 10:05:40 rpi5-freenove volumio[1457]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:1 use case configuration -2 Feb 11 10:05:40 rpi5-freenove volumio[1457]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:2 use case configuration -2 Feb 11 10:05:40 rpi5-freenove volumio[1457]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:3 use case configuration -2 Feb 11 10:05:40 rpi5-freenove volumio[1457]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:7 use case configuration -2 Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Output device has changed, restarting MPD Feb 11 10:05:40 rpi5-freenove sudo[2546]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Feb 11 10:05:40 rpi5-freenove sudo[2546]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Output device has changed, restarting Shairport Sync Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:40 rpi5-freenove sudo[2546]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:40 rpi5-freenove sudo[2548]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Feb 11 10:05:40 rpi5-freenove sudo[2548]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:40 rpi5-freenove systemd[1]: Stopping mpd_oled_plugin.service - MPD OLED Plugin... Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Starting plugin audio_interface.bluetooth Feb 11 10:05:40 rpi5-freenove volumio[1457]: ------------------------------------ BT MESSAGE: [FUNC] onStart Feb 11 10:05:40 rpi5-freenove volumio[1457]: ------------------------------------ BT MESSAGE: Starting Volumio Bluetooth Service Feb 11 10:05:40 rpi5-freenove volumio[1457]: ------------------------------------ BT MESSAGE: Boot config /etc/bluetooth/volumio.conf: cache mode = tmp Feb 11 10:05:40 rpi5-freenove volumio[1457]: ------------------------------------ BT MESSAGE: [metaCache] Created directory: /tmp/bluetooth-cache/ Feb 11 10:05:40 rpi5-freenove volumio[1457]: ------------------------------------ BT MESSAGE: [metaCache] Directory exists and is ready. Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Starting plugin audio_interface.multiroom Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , pushMultiRoomStatus Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: MRS: Pushing multiroomSync output for this device Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: MRS: Pushing multiroomSync output Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Adding audio output: Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Adding audio output: Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Starting plugin miscellanea.metavolumio Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Adding METAVOLUMIO REST API Endpoints Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Adding metavolumio REST Endpoint for plugin: miscellanea/metavolumio Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Adding getSimilarArtists REST Endpoint for plugin: miscellanea/metavolumio Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Adding getSimilarAlbums REST Endpoint for plugin: miscellanea/metavolumio Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Adding getSimilarTracks REST Endpoint for plugin: miscellanea/metavolumio Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Starting plugin miscellanea.manifestui Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Starting plugin music_service.cd_controller Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Preparing CD Folders Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Adding CD REST API Endpoints Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Adding cdPostRip REST Endpoint for plugin: music_service/cd_controller Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Starting UDEV Watcher for CD Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: Detecting CD presence with UDEV Feb 11 10:05:40 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: networkfs , getUdevDevices Feb 11 10:05:40 rpi5-freenove bluetoothd[1029]: Path / reserved for Adv Monitor app :1.31 Feb 11 10:05:40 rpi5-freenove systemd[1]: mpd_oled_plugin.service: Deactivated successfully. Feb 11 10:05:40 rpi5-freenove systemd[1]: Stopped mpd_oled_plugin.service - MPD OLED Plugin. Feb 11 10:05:40 rpi5-freenove systemd[1]: Stopping mpd.service - Music Player Daemon... Feb 11 10:05:40 rpi5-freenove bluetoothd[1029]: Adv Monitor app :1.31 disconnected from D-Bus Feb 11 10:05:40 rpi5-freenove upmpdcli[2565]: writing RSA key Feb 11 10:05:40 rpi5-freenove systemd[1]: mpd.service: Deactivated successfully. Feb 11 10:05:40 rpi5-freenove systemd[1]: Stopped mpd.service - Music Player Daemon. Feb 11 10:05:40 rpi5-freenove systemd[1]: mpd.service: Consumed 1.506s CPU time. Feb 11 10:05:40 rpi5-freenove systemd[1]: mpd.socket: Deactivated successfully. Feb 11 10:05:40 rpi5-freenove systemd[1]: Closed mpd.socket - Music Player Daemon Socket. Feb 11 10:05:40 rpi5-freenove systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... Feb 11 10:05:40 rpi5-freenove systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. Feb 11 10:05:40 rpi5-freenove systemd[1]: Starting mpd.service - Music Player Daemon... Feb 11 10:05:40 rpi5-freenove sudo[2572]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Feb 11 10:05:40 rpi5-freenove sudo[2572]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Feb 11 10:05:40 rpi5-freenove sudo[2572]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:41 rpi5-freenove mpd[2574]: 2026-02-11T10:05:41 decoder: Decoder plugin "wildmidi" is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Feb 11 10:05:41 rpi5-freenove systemd[1]: Started mpd.service - Music Player Daemon. Feb 11 10:05:41 rpi5-freenove sudo[2548]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:41 rpi5-freenove systemd[1]: Started mpd_oled_plugin.service - MPD OLED Plugin. Feb 11 10:05:45 rpi5-freenove volumio[1457]: warn: [cd-plugin] cdspeedctl: device or media not ready Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Starting plugin music_service.smart_inputs Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Adding inputs REST Endpoints Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Adding scanAudioInputs REST Endpoint for plugin: music_service/smart_inputs Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Scanning Audio Inputs Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Checking against Known Cards name Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: [1770800745750] CoreMusicLibrary::Adding element Loopback Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Feb 11 10:05:45 rpi5-freenove volumio[1457]: Cannot find translation for source 80s80s Radio Feb 11 10:05:45 rpi5-freenove volumio[1457]: Cannot find translation for source Randomizer Feb 11 10:05:45 rpi5-freenove volumio[1457]: Cannot find translation for source FM/DAB Radio Feb 11 10:05:45 rpi5-freenove volumio[1457]: Cannot find translation for source Loopback Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Checking against Known Cards name Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Checking against Known Cards name Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Checking against Known Cards name Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Checking against Known Cards name Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Checking against Known Cards name Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Checking against Known Cards name Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Checking against Known Cards name Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Adding Server instance for streaming Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Starting plugin music_service.hi_res_audio Feb 11 10:05:45 rpi5-freenove volumio[1457]: error: Hi Res Audio Failed Login: Missing Login Data Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Adding HIGHRESAUDIO REST API Endpoints Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Adding saveAccountData_hi_res_audio REST Endpoint for plugin: music_service/hi_res_audio Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Starting plugin music_service.tidal Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Refreshing TIDAL token Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Starting plugin music_service.qobuz Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Refreshing QOBUZ token Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Starting plugin music_service.tidalconnect Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: [MyVolumio PluginManager] Starting plugin music_service.qobuzconnect Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Adding qc_getconfig REST Endpoint for plugin: music_service/qobuzconnect Feb 11 10:05:45 rpi5-freenove sudo[2601]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Feb 11 10:05:45 rpi5-freenove sudo[2601]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: QobuzConnect: Starting Qobuz Connect socket and service Feb 11 10:05:45 rpi5-freenove sudo[2608]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service Feb 11 10:05:45 rpi5-freenove sudo[2608]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: QobuzConnect: Opened /tmp/qbz-connect.socket socket, listening for connections Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Updating MyVolumio device info Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Updating MyVolumio device info Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:45 rpi5-freenove sudo[2608]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:45 rpi5-freenove sudo[2612]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service Feb 11 10:05:45 rpi5-freenove sudo[2612]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:45 rpi5-freenove sudo[2601]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: MRS: Getting audio outputs on start Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: MRS: Requesting all other devices output Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Successfully Added MyVolumio device Feb 11 10:05:45 rpi5-freenove volumio[1457]: ------------------------------------ BT MESSAGE: Bluetooth adapter powered on Feb 11 10:05:45 rpi5-freenove systemd[1]: Started qobuz-connect.service - Volumio Qobuz Connect Service. Feb 11 10:05:45 rpi5-freenove sudo[2612]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: MPD Permissions set Feb 11 10:05:45 rpi5-freenove sudo[2618]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start volumiobt.service Feb 11 10:05:45 rpi5-freenove sudo[2618]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:45 rpi5-freenove systemd[1]: Started volumiobt.service - Volumio Bluetooth Module. Feb 11 10:05:45 rpi5-freenove sudo[2618]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:45 rpi5-freenove volumiobt[2624]: INFO [BTSTART] Ensuring Bluetooth directory exists... Feb 11 10:05:45 rpi5-freenove sudo[2625]: volumio : PWD=/ ; USER=root ; COMMAND=/usr/bin/mkdir -p /var/lib/bluetooth Feb 11 10:05:45 rpi5-freenove sudo[2625]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:45 rpi5-freenove sudo[2625]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:45 rpi5-freenove sudo[2628]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod -R 777 /var/lib/bluetooth Feb 11 10:05:45 rpi5-freenove sudo[2628]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:45 rpi5-freenove sudo[2628]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:45 rpi5-freenove volumiobt[2638]: INFO [BTSTART] Powering on Bluetooth if needed... Feb 11 10:05:45 rpi5-freenove volumio[1457]: error: updateQueue error: null Feb 11 10:05:45 rpi5-freenove volumio[1457]: ------------------------------------ BT MESSAGE: volumiobt.service started successfully Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioStop Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreStateMachine::stop Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 11 10:05:45 rpi5-freenove volumio[1457]: ------------------------------------ BT MESSAGE: [FUNC] dbusStart Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:45 rpi5-freenove volumio[1457]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 14 Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Executing endpoint qc_getconfig Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: qobuzconnect , onGetConfig Feb 11 10:05:45 rpi5-freenove bluetoothd[1029]: Path / reserved for Adv Monitor app :1.32 Feb 11 10:05:45 rpi5-freenove bluetoothd[1029]: Adv Monitor app :1.32 disconnected from D-Bus Feb 11 10:05:45 rpi5-freenove volumiobt[2646]: INFO [BTSTART] Making Bluetooth discoverable and pairable... Feb 11 10:05:45 rpi5-freenove qobuz-connect[2616]: 20260211 10:05:45.929 [2616.2616] INFO SampleApp: Started connection to /tmp/qbz-connect.socket UNIX socket Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Starting Shairport Sync Feb 11 10:05:45 rpi5-freenove volumio-remote-updater[1050]: Test mode enabled Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: QobuzConnect: Qobuz Connect socket /tmp/qbz-connect.socket connected to client [object Object] Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: QobuzConnect: QOBUZ Connect daemon connected Feb 11 10:05:45 rpi5-freenove volumio-remote-updater[1050]: Alpha mode disabled Feb 11 10:05:45 rpi5-freenove volumio-remote-updater[1050]: Alpha legacy test mode disabled Feb 11 10:05:45 rpi5-freenove sudo[2649]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Feb 11 10:05:45 rpi5-freenove sudo[2649]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:45 rpi5-freenove systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... Feb 11 10:05:45 rpi5-freenove systemd[1]: shairport-sync.service: Deactivated successfully. Feb 11 10:05:45 rpi5-freenove systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Feb 11 10:05:45 rpi5-freenove systemd[1]: shairport-sync.service: Consumed 1.550s CPU time. Feb 11 10:05:45 rpi5-freenove sudo[2653]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart sshtunnel.service Feb 11 10:05:45 rpi5-freenove sudo[2653]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:45 rpi5-freenove qobuz-connect[2616]: 20260211 10:05:45.979 [2616.2616] INFO VolumeManager: [0xc74408]: Setting new playback volume: 75 Feb 11 10:05:45 rpi5-freenove qobuz-connect[2616]: 20260211 10:05:45.979 [2616.2616] INFO VolumeManager: [0xc74408]: Setting new mute state: 0 Feb 11 10:05:45 rpi5-freenove qobuz-connect[2616]: 20260211 10:05:45.979 [2616.2616] INFO QobuzConnect: [0xc74dd8]: Client initialized! Feb 11 10:05:45 rpi5-freenove qobuz-connect[2616]: 20260211 10:05:45.979 [2616.2616] INFO SampleApp: Starting Avahi advertising, name: rPi5-Freenove, service name: _qobuz-connect._tcp Feb 11 10:05:45 rpi5-freenove volumiobt[2647]: [176B blob data] Feb 11 10:05:45 rpi5-freenove volumiobt[2647]: [157B blob data] Feb 11 10:05:45 rpi5-freenove volumiobt[2647]: [157B blob data] Feb 11 10:05:45 rpi5-freenove volumiobt[2647]: [157B blob data] Feb 11 10:05:45 rpi5-freenove volumiobt[2647]: [113B blob data] Feb 11 10:05:45 rpi5-freenove volumiobt[2647]: [bluetoothctl]> discoverable on Feb 11 10:05:45 rpi5-freenove volumiobt[2647]: Warning: setting discoverable while discoverable-timeout not set(0) is not recommended Feb 11 10:05:45 rpi5-freenove volumiobt[2647]: [bluetoothctl]> pairable on Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Access Token successfully retrieved Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: [1770800745984] CoreMusicLibrary::Adding element QOBUZ Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Feb 11 10:05:45 rpi5-freenove volumio[1457]: Cannot find translation for source 80s80s Radio Feb 11 10:05:45 rpi5-freenove volumio[1457]: Cannot find translation for source Randomizer Feb 11 10:05:45 rpi5-freenove volumio[1457]: Cannot find translation for source FM/DAB Radio Feb 11 10:05:45 rpi5-freenove volumio[1457]: Cannot find translation for source Loopback Feb 11 10:05:45 rpi5-freenove volumio[1457]: Cannot find translation for source QOBUZ Feb 11 10:05:45 rpi5-freenove bluetoothd[1029]: Adv Monitor app :1.33 disconnected from D-Bus Feb 11 10:05:45 rpi5-freenove volumio[1457]: info: Stopping AccessToken refresher cron for QOBUZ Feb 11 10:05:45 rpi5-freenove volumiobt[2647]: [bluetoothctl]> Feb 11 10:05:45 rpi5-freenove volumiobt[2657]: INFO [BTSTART] Registering Bluetooth agent... Feb 11 10:05:45 rpi5-freenove qobuz-connect[2616]: 20260211 10:05:45.990 [2616.2616] INFO LocalConfigManager: [0xc73ce8]: Starting Local Configuration server Feb 11 10:05:45 rpi5-freenove qobuz-connect[2616]: 20260211 10:05:45.990 [2616.2616] INFO SampleApp: Starting Local configuration server Feb 11 10:05:45 rpi5-freenove qobuz-connect[2616]: 20260211 10:05:45.991 [2616.2616] INFO SampleApp: Connected to UNIX socket client 0xc5e818 Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: AccessToken refresher cron started for QOBUZ Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: Adding QOBUZ REST API Endpoints Feb 11 10:05:45 rpi5-freenove systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Feb 11 10:05:46 rpi5-freenove volumiobt[2658]: [NEW] Media /org/bluez/hci0 Feb 11 10:05:46 rpi5-freenove volumiobt[2658]: SupportedUUIDs: 0000110a-0000-1000-8000-00805f9b34fb Feb 11 10:05:46 rpi5-freenove volumiobt[2658]: SupportedUUIDs: 0000110b-0000-1000-8000-00805f9b34fb Feb 11 10:05:46 rpi5-freenove volumiobt[2658]: SupportedUUIDs: 0000FDF0-0000-1000-8000-00805f9b34fb Feb 11 10:05:46 rpi5-freenove bluetoothd[1029]: Adv Monitor app :1.35 disconnected from D-Bus Feb 11 10:05:46 rpi5-freenove 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 11 10:05:46 rpi5-freenove 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 11 10:05:46 rpi5-freenove sudo[2649]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:46 rpi5-freenove systemd[1]: Started sshtunnel.service - MyVolumio SSH Tunnel. Feb 11 10:05:46 rpi5-freenove sudo[2653]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:46 rpi5-freenove volumiobt[2661]: No agent is registered Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:46 rpi5-freenove bluetoothd[1029]: Adv Monitor app :1.36 disconnected from D-Bus Feb 11 10:05:46 rpi5-freenove volumiobt[2674]: INFO [BTSTART] Agent registered successfully. Feb 11 10:05:46 rpi5-freenove autossh[2663]: port set to 0, monitoring disabled Feb 11 10:05:46 rpi5-freenove autossh[2663]: starting ssh (count 1) Feb 11 10:05:46 rpi5-freenove autossh[2663]: ssh child pid is 2677 Feb 11 10:05:46 rpi5-freenove volumiobt[2676]: INFO [BTSTART] Starting A2DP agent (a2dp-agent)... Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: Remote SSH Started Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: Shairport-Sync Started Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: Update Ready: {"changeLogLink":"http://volumio.org","description":"

FIXES

\n\n

NEW ADDITIONS

\n\n","title":"Update v4.097","updateavailable":true} Feb 11 10:05:46 rpi5-freenove qobuz-connect[2616]: 20260211 10:05:46.079 [2616.2616] INFO SampleApp: Playback volume changed: 75 Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: Successfully Updated MyVolumio device Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:46 rpi5-freenove volumiossh-tunnel[2677]: ssh: connect to host eu10.myvolumio.org port 2222: Connection refused Feb 11 10:05:46 rpi5-freenove autossh[2663]: ssh exited prematurely with status 255; autossh exiting Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:46 rpi5-freenove systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Feb 11 10:05:46 rpi5-freenove systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Feb 11 10:05:46 rpi5-freenove volumio[1457]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 15 Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:46 rpi5-freenove volumio[1457]: error: Cannot update RT Device info: Error: Reference.set failed: First argument contains undefined in property 'user_devices.Xcif8gt3U4YVmbitb0UO4zv3Gom2.c0f280231580ac4a466b8d78bc11c6a8.state.status' Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: Access Token successfully retrieved Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: Successfully Updated MyVolumio device Feb 11 10:05:46 rpi5-freenove volumiobt[2682]: INFO:a2dp-agent:Connecting to system bus. Feb 11 10:05:46 rpi5-freenove volumiobt[2682]: INFO:a2dp-agent:Found Bluetooth adapter at: /org/bluez/hci0 Feb 11 10:05:46 rpi5-freenove volumiobt[2682]: INFO:a2dp-agent:Enabling infinite discovery on adapter. Feb 11 10:05:46 rpi5-freenove systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 1. Feb 11 10:05:46 rpi5-freenove systemd[1]: Stopped sshtunnel.service - MyVolumio SSH Tunnel. Feb 11 10:05:46 rpi5-freenove systemd[1]: Started sshtunnel.service - MyVolumio SSH Tunnel. Feb 11 10:05:46 rpi5-freenove volumiobt[2682]: INFO:a2dp-agent:Registering agent. Feb 11 10:05:46 rpi5-freenove volumiobt[2682]: INFO:a2dp-agent:Searching for MediaPlayer1 interface... Feb 11 10:05:46 rpi5-freenove autossh[2688]: port set to 0, monitoring disabled Feb 11 10:05:46 rpi5-freenove autossh[2688]: starting ssh (count 1) Feb 11 10:05:46 rpi5-freenove autossh[2688]: ssh child pid is 2691 Feb 11 10:05:46 rpi5-freenove volumiobt[2682]: WARNING:a2dp-agent:No active MediaPlayer1 found. Metadata updates won't work. Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: Successfully retrieved User Session From TIDAL Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:46 rpi5-freenove volumiossh-tunnel[2691]: ssh: connect to host eu10.myvolumio.org port 2222: Connection refused Feb 11 10:05:46 rpi5-freenove autossh[2688]: ssh exited prematurely with status 255; autossh exiting Feb 11 10:05:46 rpi5-freenove systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Feb 11 10:05:46 rpi5-freenove systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: Successfully retrieved User Subscription From TIDAL Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: Adding TIDAL to Browse Sources Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: [1770800746551] CoreMusicLibrary::Adding element TIDAL Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Feb 11 10:05:46 rpi5-freenove volumio[1457]: Cannot find translation for source 80s80s Radio Feb 11 10:05:46 rpi5-freenove volumio[1457]: Cannot find translation for source Randomizer Feb 11 10:05:46 rpi5-freenove volumio[1457]: Cannot find translation for source FM/DAB Radio Feb 11 10:05:46 rpi5-freenove volumio[1457]: Cannot find translation for source Loopback Feb 11 10:05:46 rpi5-freenove volumio[1457]: Cannot find translation for source QOBUZ Feb 11 10:05:46 rpi5-freenove volumio[1457]: Cannot find translation for source TIDAL Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: Adding TIDAL REST API Endpoints Feb 11 10:05:46 rpi5-freenove systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 2. Feb 11 10:05:46 rpi5-freenove systemd[1]: Stopped sshtunnel.service - MyVolumio SSH Tunnel. Feb 11 10:05:46 rpi5-freenove systemd[1]: Started sshtunnel.service - MyVolumio SSH Tunnel. Feb 11 10:05:46 rpi5-freenove autossh[2693]: port set to 0, monitoring disabled Feb 11 10:05:46 rpi5-freenove autossh[2693]: starting ssh (count 1) Feb 11 10:05:46 rpi5-freenove autossh[2693]: ssh child pid is 2696 Feb 11 10:05:46 rpi5-freenove sudo[2698]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Feb 11 10:05:46 rpi5-freenove sudo[2698]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:46 rpi5-freenove sudo[2698]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:46 rpi5-freenove sudo[2700]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Feb 11 10:05:46 rpi5-freenove sudo[2700]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:46 rpi5-freenove sudo[2700]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:46 rpi5-freenove volumio[1457]: verbose: New Socket.io Connection to 192.168.1.93 from 192.168.1.150 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/144.0.0.0 Safari/537.36 Engine version: 3 Transport: polling Total Clients: 16 Feb 11 10:05:46 rpi5-freenove volumiossh-tunnel[2696]: ssh: connect to host eu10.myvolumio.org port 2222: Connection refused Feb 11 10:05:46 rpi5-freenove autossh[2693]: ssh exited prematurely with status 255; autossh exiting Feb 11 10:05:46 rpi5-freenove systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Feb 11 10:05:46 rpi5-freenove systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:46 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:46 rpi5-freenove systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 3. Feb 11 10:05:46 rpi5-freenove systemd[1]: Stopped sshtunnel.service - MyVolumio SSH Tunnel. Feb 11 10:05:46 rpi5-freenove systemd[1]: Started sshtunnel.service - MyVolumio SSH Tunnel. Feb 11 10:05:46 rpi5-freenove autossh[2707]: port set to 0, monitoring disabled Feb 11 10:05:46 rpi5-freenove autossh[2707]: starting ssh (count 1) Feb 11 10:05:46 rpi5-freenove autossh[2707]: ssh child pid is 2710 Feb 11 10:05:46 rpi5-freenove volumiossh-tunnel[2710]: ssh: connect to host eu10.myvolumio.org port 2222: Connection refused Feb 11 10:05:46 rpi5-freenove autossh[2707]: ssh exited prematurely with status 255; autossh exiting Feb 11 10:05:46 rpi5-freenove systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Feb 11 10:05:46 rpi5-freenove systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Feb 11 10:05:46 rpi5-freenove sudo[2712]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Feb 11 10:05:46 rpi5-freenove sudo[2712]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:46 rpi5-freenove sudo[2712]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:46 rpi5-freenove sudo[2714]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Feb 11 10:05:46 rpi5-freenove sudo[2714]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:46 rpi5-freenove sudo[2714]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:46 rpi5-freenove volumio[1457]: verbose: New Socket.io Connection to 192.168.1.93 from 192.168.1.150 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/144.0.0.0 Safari/537.36 Engine version: 3 Transport: polling Total Clients: 17 Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:47 rpi5-freenove systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 4. Feb 11 10:05:47 rpi5-freenove systemd[1]: Stopped sshtunnel.service - MyVolumio SSH Tunnel. Feb 11 10:05:47 rpi5-freenove systemd[1]: Started sshtunnel.service - MyVolumio SSH Tunnel. Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Feb 11 10:05:47 rpi5-freenove autossh[2718]: port set to 0, monitoring disabled Feb 11 10:05:47 rpi5-freenove autossh[2718]: starting ssh (count 1) Feb 11 10:05:47 rpi5-freenove autossh[2718]: ssh child pid is 2721 Feb 11 10:05:47 rpi5-freenove volumiossh-tunnel[2721]: ssh: connect to host eu10.myvolumio.org port 2222: Connection refused Feb 11 10:05:47 rpi5-freenove autossh[2718]: ssh exited prematurely with status 255; autossh exiting Feb 11 10:05:47 rpi5-freenove systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Feb 11 10:05:47 rpi5-freenove systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetVisibleSources Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: Received Get System Info Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: Discovery: Getting this device information Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: Listing playlists Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Feb 11 10:05:47 rpi5-freenove systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 5. Feb 11 10:05:47 rpi5-freenove systemd[1]: Stopped sshtunnel.service - MyVolumio SSH Tunnel. Feb 11 10:05:47 rpi5-freenove systemd[1]: sshtunnel.service: Start request repeated too quickly. Feb 11 10:05:47 rpi5-freenove systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Feb 11 10:05:47 rpi5-freenove systemd[1]: Failed to start sshtunnel.service - MyVolumio SSH Tunnel. Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:47 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: TidalConnect service stoped! Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: Adding tc_getconfig REST Endpoint for plugin: music_service/tidalconnect Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: Adding tc_connect REST Endpoint for plugin: music_service/tidalconnect Feb 11 10:05:48 rpi5-freenove sudo[2731]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service Feb 11 10:05:48 rpi5-freenove sudo[2731]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getConfigParam Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStatsObject Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetBrowseSources Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:48 rpi5-freenove systemd[1]: Started vtcs.service - Volumio Tidal Connect Service. Feb 11 10:05:48 rpi5-freenove sudo[2731]: pam_unix(sudo:session): session closed for user root Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: Received Get System Info Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: Discovery: Getting this device information Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: Executing endpoint tc_getconfig Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: tidalconnect , onGetConfig Feb 11 10:05:48 rpi5-freenove vtcs[2734]: STARTING TidalConnect services, version: 1.5.2.56 Feb 11 10:05:48 rpi5-freenove vtcs[2734]: STARTED TidalConnect services. Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: Executing endpoint tc_connect Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: tidalconnect , onConnect Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: Connecting to TidalConnect Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::servicePushState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreStateMachine::pushState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioPushState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: MRS: Pushing multiroomSync output update for this device Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: MRS: Pushing multiroomSync output Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current mpd Received tidalconnect Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::servicePushState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreStateMachine::pushState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioPushState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: MRS: Pushing multiroomSync output update for this device Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: MRS: Pushing multiroomSync output Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: CorePlayQueue::getTrack 0 Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current mpd Received tidalconnect Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: peppy_screensaver: pushState - status= service=undefined volatile=true Feb 11 10:05:48 rpi5-freenove volumio[1457]: info: peppy_screensaver: pushState - status=undefined service=undefined volatile=true Feb 11 10:05:49 rpi5-freenove volumio[1457]: error: Cannot update RT Device info: Error: Reference.set failed: First argument contains undefined in property 'user_devices.Xcif8gt3U4YVmbitb0UO4zv3Gom2.c0f280231580ac4a466b8d78bc11c6a8.state.status' Feb 11 10:05:49 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:49 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:49 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:49 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:49 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:49 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: Received Get System Info Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: Discovery: Getting this device information Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:50 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: Executing endpoint metavolumio Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: Executing endpoint metavolumio Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: TidalConnect service started! Feb 11 10:05:51 rpi5-freenove volumio[1457]: [Metrics] CommandRouter: 40s 63.35ms Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumiosetStartupVolume Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: CoreCommandRouter::Close All Modals sent Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: CoreCommandRouter::Close All Modals sent Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:51 rpi5-freenove kernel: ------------[ cut here ]------------ Feb 11 10:05:51 rpi5-freenove kernel: Packet RAM has to be on to store the packet. Feb 11 10:05:51 rpi5-freenove kernel: WARNING: CPU: 1 PID: 2751 at drivers/gpu/drm/vc4/vc4_hdmi.c:726 vc4_hdmi_write_infoframe+0x3ec/0x468 [vc4] Feb 11 10:05:51 rpi5-freenove kernel: Modules linked in: snd_dummy algif_hash algif_skcipher af_alg nft_chain_nat xt_REDIRECT nf_nat nf_conntrack nf_defrag_ipv6 nf_defrag_ipv4 bnep xt_tcpudp nft_compat nf_tables nfnetlink 8021q garp stp llc binfmt_misc brcmfmac_wcc snd_usb_audio brcmfmac hci_uart btbcm bluetooth brcmutil snd_hwdep snd_usbmidi_lib snd_seq_midi snd_seq_midi_event cfg80211 snd_seq aes_ce_blk aes_ce_cipher ghash_ce gf128mul ecdh_generic sha2_ce joydev rpi_hevc_dec pisp_be snd_rawmidi v4l2_mem2mem sha256_arm64 videobuf2_dma_contig ecc videobuf2_memops sha1_ce sha1_generic libaes snd_soc_rpi_simple_soundcard raspberrypi_hwmon rfkill snd_seq_device videobuf2_v4l2 videodev snd_soc_pcm5102a pwm_fan edt_ft5x06 videobuf2_common mc raspberrypi_gpiomem designware_i2s rp1_adc nvmem_rmem uio_pdrv_genirq uio snd_aloop i2c_dev dm_mod ip_tables x_tables ipv6 ads7846 fb_hx8357d(C) fb_st7789v(C) fb_st7735r(C) fb_ili9341(C) fb_ili9340(C) fbtft(C) panel_waveshare_dsi_v2 panel_waveshare_dsi panel_ilitek_ili9881c panel_raspberrypi_touchscreen Feb 11 10:05:51 rpi5-freenove kernel: i2c_bcm2835 snd_soc_bcm2835_i2s snd_bcm2835(C) squashfs overlay nls_iso8859_1 fuse rpi_panel_attiny_regulator regmap_i2c tc358762 vc4 snd_soc_hdmi_codec spidev drm_display_helper i2c_brcmstb cec snd_soc_core snd_compress drm_rp1_dsi snd_pcm_dmaengine drm_ttm_helper spi_bcm2835 snd_pcm v3d snd_timer gpu_sched drm_shmem_helper gpio_keys snd rp1_pio ttm drm_dma_helper i2c_designware_platform spi_dw_mmio drm_kms_helper rp1_fw panel_simple i2c_designware_core spi_dw rp1_mailbox drm drm_panel_orientation_quirks backlight Feb 11 10:05:51 rpi5-freenove kernel: CPU: 1 UID: 1000 PID: 2751 Comm: aplay Tainted: G C 6.12.47-v8+ #1904 Feb 11 10:05:51 rpi5-freenove kernel: Tainted: [C]=CRAP Feb 11 10:05:51 rpi5-freenove kernel: Hardware name: Raspberry Pi 5 Model B Rev 1.1 (DT) Feb 11 10:05:51 rpi5-freenove kernel: pstate: 60400009 (nZCv daif +PAN -UAO -TCO -DIT -SSBS BTYPE=--) Feb 11 10:05:51 rpi5-freenove kernel: pc : vc4_hdmi_write_infoframe+0x3ec/0x468 [vc4] Feb 11 10:05:51 rpi5-freenove kernel: lr : vc4_hdmi_write_infoframe+0x3ec/0x468 [vc4] Feb 11 10:05:51 rpi5-freenove kernel: sp : ffffffc0857e3850 Feb 11 10:05:51 rpi5-freenove kernel: x29: ffffffc0857e3850 x28: ffffff8040284200 x27: ffffffc08272f800 Feb 11 10:05:51 rpi5-freenove kernel: x26: ffffffc0857e3939 x25: 0000000000000000 x24: 0000000000000084 Feb 11 10:05:51 rpi5-freenove kernel: x23: 00000000fffffff4 x22: ffffff8100be9000 x21: ffffff8003332080 Feb 11 10:05:51 rpi5-freenove kernel: x20: 000000000000000e x19: ffffff80033325c0 x18: 0000000000000000 Feb 11 10:05:51 rpi5-freenove kernel: x17: 0000000000000000 x16: ffffffd08c49aaf8 x15: 0000000000000000 Feb 11 10:05:51 rpi5-freenove kernel: x14: 0000000000000000 x13: 2e74656b63617020 x12: 6568742065726f74 Feb 11 10:05:51 rpi5-freenove kernel: x11: 73206f74206e6f20 x10: ffffffd08dc814d8 x9 : ffffffd08c51c760 Feb 11 10:05:51 rpi5-freenove kernel: x8 : 00000000ffffefff x7 : ffffffd08dc7d4e8 x6 : 0000000000003ff0 Feb 11 10:05:51 rpi5-freenove kernel: x5 : ffffff803b79b408 x4 : 0000000000000fff x3 : ffffffafadfb0000 Feb 11 10:05:51 rpi5-freenove kernel: x2 : 0000000000000000 x1 : 0000000000000000 x0 : ffffff8040284200 Feb 11 10:05:51 rpi5-freenove kernel: Call trace: Feb 11 10:05:51 rpi5-freenove kernel: vc4_hdmi_write_infoframe+0x3ec/0x468 [vc4] Feb 11 10:05:51 rpi5-freenove kernel: write_device_infoframe+0x98/0x158 [drm_display_helper] Feb 11 10:05:51 rpi5-freenove kernel: drm_atomic_helper_connector_hdmi_update_audio_infoframe+0x8c/0xb8 [drm_display_helper] Feb 11 10:05:51 rpi5-freenove kernel: vc4_hdmi_audio_prepare+0x544/0xf70 [vc4] Feb 11 10:05:51 rpi5-freenove kernel: hdmi_codec_prepare+0xd8/0x138 [snd_soc_hdmi_codec] Feb 11 10:05:51 rpi5-freenove kernel: snd_soc_pcm_dai_prepare+0x80/0x120 [snd_soc_core] Feb 11 10:05:51 rpi5-freenove kernel: __soc_pcm_prepare+0x4c/0x120 [snd_soc_core] Feb 11 10:05:51 rpi5-freenove kernel: soc_pcm_prepare+0x38/0x68 [snd_soc_core] Feb 11 10:05:51 rpi5-freenove kernel: snd_pcm_do_prepare+0x38/0x60 [snd_pcm] Feb 11 10:05:51 rpi5-freenove kernel: snd_pcm_action_single+0x50/0xb8 [snd_pcm] Feb 11 10:05:51 rpi5-freenove kernel: snd_pcm_action_nonatomic+0xa8/0xb8 [snd_pcm] Feb 11 10:05:51 rpi5-freenove kernel: snd_pcm_prepare+0x94/0xf8 [snd_pcm] Feb 11 10:05:51 rpi5-freenove kernel: snd_pcm_common_ioctl+0xdb8/0x16b0 [snd_pcm] Feb 11 10:05:51 rpi5-freenove kernel: snd_pcm_ioctl_compat+0x368/0x638 [snd_pcm] Feb 11 10:05:51 rpi5-freenove kernel: __arm64_compat_sys_ioctl+0x154/0x180 Feb 11 10:05:51 rpi5-freenove kernel: invoke_syscall+0x50/0x120 Feb 11 10:05:51 rpi5-freenove kernel: el0_svc_common.constprop.0+0x48/0xf8 Feb 11 10:05:51 rpi5-freenove kernel: do_el0_svc_compat+0x28/0x48 Feb 11 10:05:51 rpi5-freenove kernel: el0_svc_compat+0x2c/0x80 Feb 11 10:05:51 rpi5-freenove kernel: el0t_32_sync_handler+0x98/0x148 Feb 11 10:05:51 rpi5-freenove kernel: el0t_32_sync+0x194/0x198 Feb 11 10:05:51 rpi5-freenove kernel: ---[ end trace 0000000000000000 ]--- Feb 11 10:05:51 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:52 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:52 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:52 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Feb 11 10:05:52 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken Feb 11 10:05:52 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:52 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:52 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:52 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:52 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkAudioDeviceAvailable Feb 11 10:05:52 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Feb 11 10:05:52 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , versionChangeDetect Feb 11 10:05:53 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:53 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:53 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:53 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:53 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:53 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:54 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:54 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:54 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:54 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:54 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:54 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:54 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:54 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:55 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:55 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:55 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:55 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:55 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:55 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:56 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:56 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:56 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:56 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:56 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:56 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:56 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Feb 11 10:05:57 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:57 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:57 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:57 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:57 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:57 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:57 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:57 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:58 rpi5-freenove systemd[1]: Starting setdatetime-helper.service - Time Synchronization Helper Service... Feb 11 10:05:58 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:58 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:58 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:58 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:58 rpi5-freenove systemd[1]: setdatetime-helper.service: Deactivated successfully. Feb 11 10:05:58 rpi5-freenove systemd[1]: Finished setdatetime-helper.service - Time Synchronization Helper Service. Feb 11 10:05:58 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:58 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:58 rpi5-freenove volumio[1457]: info: BOOT COMPLETED Feb 11 10:05:59 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:59 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:59 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:59 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:59 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:05:59 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: Starting Uninstall of plugin user_interface - peppy_screensaver Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: Uninstalling plugin peppy_screensaver Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: CoreStateMachine::stop Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: CoreStateMachine::serviceStop Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: Received STOP, but no service to execute it Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: Disabling plugin peppy_screensaver Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: Preparing to generate the ALSA configuration file Feb 11 10:06:00 rpi5-freenove sudo[2799]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/umount /volumio/app/plugins/music_service/mpd/mpd.conf.tmpl Feb 11 10:06:00 rpi5-freenove sudo[2799]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: The plugin mpd_oled has an ALSA contribution file volumioalsa.postalsa.5.conf Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: Reading ALSA contributions from plugins. Feb 11 10:06:00 rpi5-freenove systemd[1]: volumio-app-plugins-music_service-mpd-mpd.conf.tmpl.mount: Deactivated successfully. Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: spop , initializeLibrespotDaemon Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: Creating Spotify config file Feb 11 10:06:00 rpi5-freenove sudo[2799]: pam_unix(sudo:session): session closed for user root Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: Spotify config file written Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: Asound.conf file written Feb 11 10:06:00 rpi5-freenove sudo[2802]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart go-librespot-daemon.service Feb 11 10:06:00 rpi5-freenove sudo[2802]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:06:00 rpi5-freenove sudo[2805]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/mv /home/volumio/.asoundrc /etc/asound.conf Feb 11 10:06:00 rpi5-freenove sudo[2805]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:06:00 rpi5-freenove sudo[2805]: pam_unix(sudo:session): session closed for user root Feb 11 10:06:00 rpi5-freenove systemd[1]: Stopping go-librespot-daemon.service - go-librespot Daemon... Feb 11 10:06:00 rpi5-freenove systemd[1]: go-librespot-daemon.service: Deactivated successfully. Feb 11 10:06:00 rpi5-freenove systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon. Feb 11 10:06:00 rpi5-freenove volumio[1457]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:0 use case configuration -2 Feb 11 10:06:00 rpi5-freenove volumio[1457]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:1 use case configuration -2 Feb 11 10:06:00 rpi5-freenove volumio[1457]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:2 use case configuration -2 Feb 11 10:06:00 rpi5-freenove volumio[1457]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:3 use case configuration -2 Feb 11 10:06:00 rpi5-freenove volumio[1457]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:7 use case configuration -2 Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: Output device has changed, restarting MPD Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: Output device has changed, restarting Shairport Sync Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 11 10:06:00 rpi5-freenove sudo[2815]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Feb 11 10:06:00 rpi5-freenove sudo[2815]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:06:00 rpi5-freenove systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon. Feb 11 10:06:00 rpi5-freenove go-librespot[2811]: go-librespot daemon starting... Feb 11 10:06:00 rpi5-freenove sudo[2813]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Feb 11 10:06:00 rpi5-freenove sudo[2813]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:06:00 rpi5-freenove sudo[2813]: pam_unix(sudo:session): session closed for user root Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 11 10:06:00 rpi5-freenove systemd[1]: Stopping mpd_oled_plugin.service - MPD OLED Plugin... Feb 11 10:06:00 rpi5-freenove sudo[2802]: pam_unix(sudo:session): session closed for user root Feb 11 10:06:00 rpi5-freenove go-librespot[2821]: time="2026-02-11T10:06:00+01:00" level=info msg="running go-librespot 0.6.2" Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: QobuzConnect: setDeactiveState invoked Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: CoreCommandRouter::volumioGetState Feb 11 10:06:00 rpi5-freenove vtcs[2734]: [2026-02-11 10:06:00.960] [tisoc] [warning] [SessionManagerImpl.cpp:240] Illegal State: IDLE Feb 11 10:06:00 rpi5-freenove vtcs[2734]: [2026-02-11 10:06:00.960] [tisoc] [error] [SpkconServer.cpp:375] recv error. socket disconnected Feb 11 10:06:00 rpi5-freenove go-librespot[2821]: time="2026-02-11T10:06:00+01:00" level=debug msg="app state loaded" Feb 11 10:06:00 rpi5-freenove go-librespot[2821]: time="2026-02-11T10:06:00+01:00" level=info msg="api server listening on 127.0.0.1:9879" Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: Checking if uninstall.sh is present Feb 11 10:06:00 rpi5-freenove sudo[2831]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Feb 11 10:06:00 rpi5-freenove sudo[2831]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:06:00 rpi5-freenove systemd[1]: Stopping vtcs.service - Volumio Tidal Connect Service... Feb 11 10:06:00 rpi5-freenove systemd[1]: vtcs.service: Killing process 2741 (vtcs) with signal SIGKILL. Feb 11 10:06:00 rpi5-freenove systemd[1]: vtcs.service: Deactivated successfully. Feb 11 10:06:00 rpi5-freenove sudo[2836]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Feb 11 10:06:00 rpi5-freenove systemd[1]: Stopped vtcs.service - Volumio Tidal Connect Service. Feb 11 10:06:00 rpi5-freenove sudo[2836]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:06:00 rpi5-freenove sudo[2831]: pam_unix(sudo:session): session closed for user root Feb 11 10:06:00 rpi5-freenove volumio[1457]: info: Executing uninstall.sh Feb 11 10:06:00 rpi5-freenove systemd[1]: mpd_oled_plugin.service: Deactivated successfully. Feb 11 10:06:00 rpi5-freenove systemd[1]: Stopped mpd_oled_plugin.service - MPD OLED Plugin. Feb 11 10:06:00 rpi5-freenove volumio[1457]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Feb 11 10:06:01 rpi5-freenove systemd[1]: Stopping mpd.service - Music Player Daemon... Feb 11 10:06:01 rpi5-freenove volumio[1457]: Error: socket hang up Feb 11 10:06:01 rpi5-freenove volumio[1457]: at connResetException (node:internal/errors:720:14) Feb 11 10:06:01 rpi5-freenove volumio[1457]: at Socket.socketOnEnd (node:_http_client:519:23) Feb 11 10:06:01 rpi5-freenove volumio[1457]: at Socket.emit (node:events:526:35) Feb 11 10:06:01 rpi5-freenove volumio[1457]: at endReadableNT (node:internal/streams/readable:1376:12) Feb 11 10:06:01 rpi5-freenove volumio[1457]: at process.processTicksAndRejections (node:internal/process/task_queues:82:21) { Feb 11 10:06:01 rpi5-freenove volumio[1457]: code: 'ECONNRESET', Feb 11 10:06:01 rpi5-freenove volumio[1457]: response: undefined Feb 11 10:06:01 rpi5-freenove volumio[1457]: } Feb 11 10:06:01 rpi5-freenove volumio[1457]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Feb 11 10:06:01 rpi5-freenove sudo[2841]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service Feb 11 10:06:01 rpi5-freenove sudo[2841]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:06:01 rpi5-freenove sudo[2836]: pam_unix(sudo:session): session closed for user root Feb 11 10:06:01 rpi5-freenove sudo[2841]: pam_unix(sudo:session): session closed for user root Feb 11 10:06:01 rpi5-freenove sudo[2845]: volumio : PWD=/ ; USER=root ; COMMAND=/usr/bin/sh /data/plugins/user_interface/peppy_screensaver/uninstall.sh Feb 11 10:06:01 rpi5-freenove sudo[2845]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:06:01 rpi5-freenove sudo[2859]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service Feb 11 10:06:01 rpi5-freenove sudo[2859]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:06:01 rpi5-freenove systemd[1]: Stopping qobuz-connect.service - Volumio Qobuz Connect Service... Feb 11 10:06:01 rpi5-freenove qobuz-connect[2616]: 20260211 10:06:01.062 [2616.2616] INFO SampleApp: Stopping Local configuration server Feb 11 10:06:01 rpi5-freenove systemd[1]: mpd.service: Deactivated successfully. Feb 11 10:06:01 rpi5-freenove systemd[1]: Stopped mpd.service - Music Player Daemon. Feb 11 10:06:01 rpi5-freenove systemd[1]: mpd.socket: Deactivated successfully. Feb 11 10:06:01 rpi5-freenove systemd[1]: Closed mpd.socket - Music Player Daemon Socket. Feb 11 10:06:01 rpi5-freenove systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... Feb 11 10:06:01 rpi5-freenove go-librespot[2821]: time="2026-02-11T10:06:01+01:00" level=debug msg="fetched new accesspoints: [ap-gew4.spotify.com:4070 ap-gew4.spotify.com:443 ap-gew4.spotify.com:80 ap-guc3.spotify.com:4070 ap-gew1.spotify.com:443 ap-gae2.spotify.com:80]" Feb 11 10:06:01 rpi5-freenove go-librespot[2821]: time="2026-02-11T10:06:01+01:00" level=debug msg="fetched new dealers: [gew4-dealer.spotify.com:443 guc3-dealer.spotify.com:443 gew1-dealer.spotify.com:443 gae2-dealer.spotify.com:443]" Feb 11 10:06:01 rpi5-freenove go-librespot[2821]: time="2026-02-11T10:06:01+01:00" level=debug msg="fetched new spclients: [gew4-spclient.spotify.com:443 guc3-spclient.spotify.com:443 gew1-spclient.spotify.com:443 gae2-spclient.spotify.com:443]" Feb 11 10:06:01 rpi5-freenove go-librespot[2821]: time="2026-02-11T10:06:01+01:00" level=info msg="zeroconf server listening on port 34259" Feb 11 10:06:01 rpi5-freenove systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. Feb 11 10:06:01 rpi5-freenove systemd[1]: Starting mpd.service - Music Player Daemon... Feb 11 10:06:01 rpi5-freenove sudo[2882]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Feb 11 10:06:01 rpi5-freenove sudo[2882]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Feb 11 10:06:01 rpi5-freenove sudo[2882]: pam_unix(sudo:session): session closed for user root Feb 11 10:06:01 rpi5-freenove sudo[2887]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-02-11 10:05' Feb 11 10:06:01 rpi5-freenove sudo[2887]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 11 10:06:01 rpi5-freenove go-librespot[2821]: time="2026-02-11T10:06:01+01:00" level=debug msg="obtained new client token: AAB9WsBCq3x8CCnC4rH41DSvZMysnh9OM8CAudb3ObRderTAHdNR3tpdhy71LzeYNNpE8JmW7v/WBTkxl8iiguLa1av8ONT9btNEc/zUBydJ6RrX8y0iMXyu+5puVu/XPrHuqIR5XsgDfoakcajWMknKTTvki1c5G/kEOcmnEea9GbTuYY4JSUCNN47/mxPIOOcwVFyUUA0yFr5RGQrVq9JEf8AwdfANgG/JTIedprYblCEgMXl/Aks=" 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"