-- Logs begin at Thu 2019-02-14 11:12:00 CET, end at Sun 2025-01-12 22:12:19 CET. -- Jan 12 22:11:12 volumio ntpd[670]: receive: Unexpected origin timestamp 0xea9419e1.7682ec9a does not match aorg 0000000000.00000000 from server@148.251.5.46 xmt 0xeb2eae70.db1b4050 Jan 12 22:11:12 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Jan 12 22:11:12 volumio volumio[699]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Jan 12 22:11:12 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Jan 12 22:11:12 volumio volumio[699]: info: Received Get System Version Jan 12 22:11:12 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Jan 12 22:11:12 volumio volumio[699]: info: Received Get System Info Jan 12 22:11:12 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Jan 12 22:11:12 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Jan 12 22:11:12 volumio volumio[699]: info: Discovery: Getting this device information Jan 12 22:11:12 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:11:12 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:11:12 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Jan 12 22:11:12 volumio systemd[1]: Starting Daily apt download activities... Jan 12 22:11:13 volumio volumio[699]: info: Discovery: A device disappeared from network Jan 12 22:11:13 volumio volumio[699]: info: Discovery: Device volumio disappeared from network Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan premium Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan premium Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan premium Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan premium Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan premium Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan premium Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan premium Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin tidal to plan premium Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan premium Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan premium Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan superstar Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan superstar Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan superstar Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan superstar Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan superstar Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan superstar Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan superstar Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin tidal to plan superstar Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan superstar Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan superstar Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan virtuoso Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan virtuoso Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan virtuoso Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin tidal to plan virtuoso Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan virtuoso Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan virtuoso Jan 12 22:11:13 volumio volumio[699]: info: Adding plugin bluetooth to MyMusic Plugins Jan 12 22:11:13 volumio volumio[699]: info: Adding plugin multiroom to MyMusic Plugins Jan 12 22:11:13 volumio volumio[699]: info: Adding plugin metavolumio to MyMusic Plugins Jan 12 22:11:13 volumio volumio[699]: info: Adding plugin cd_controller to MyMusic Plugins Jan 12 22:11:13 volumio volumio[699]: info: Adding plugin smart_inputs to MyMusic Plugins Jan 12 22:11:13 volumio volumio[699]: info: Adding plugin tidalconnect to MyMusic Plugins Jan 12 22:11:13 volumio volumio[699]: info: [MyVolumio PluginManager] Loading plugin "my_volumio"... Jan 12 22:11:13 volumio ntpd[670]: Soliciting pool server 62.169.23.198 Jan 12 22:11:14 volumio systemd[1]: apt-daily.service: Succeeded. Jan 12 22:11:14 volumio systemd[1]: Started Daily apt download activities. Jan 12 22:11:14 volumio systemd[1]: Starting Daily apt upgrade and clean activities... Jan 12 22:11:16 volumio systemd[1]: apt-daily-upgrade.service: Succeeded. Jan 12 22:11:16 volumio systemd[1]: Started Daily apt upgrade and clean activities. Jan 12 22:11:16 volumio volumio[699]: info: [MyVolumio PluginManager] MyVolumio plugin successfully loaded Jan 12 22:11:16 volumio volumio[699]: info: [MyVolumio PluginManager] Starting plugin system_controller.my_volumio Jan 12 22:11:16 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:16 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:16 volumio volumio[699]: info: Starting MyVolumio Remote Streaming Endpoints Jan 12 22:11:16 volumio volumio[699]: info: MyVolumio not started Jan 12 22:11:16 volumio volumio[699]: info: Initializing device activation check Jan 12 22:11:16 volumio volumio[699]: info: [MyVolumio PluginManager] MyVolumio plugin successfully started Jan 12 22:11:16 volumio volumio[699]: info: [MyVolumio PluginManager] Loading plugin "streaming_services"... Jan 12 22:11:18 volumio volumio[1192]: ...........................................................................................++++ Jan 12 22:11:18 volumio volumio[1192]: e is 65537 (0x010001) Jan 12 22:11:19 volumio volumio[699]: info: Starting Streaming Service Transparent Proxy Jan 12 22:11:19 volumio volumio[699]: info: [MyVolumio PluginManager] Streaming Services plugin successfully loaded Jan 12 22:11:19 volumio volumio[699]: info: [MyVolumio PluginManager] Starting plugin music_service.streaming_services Jan 12 22:11:19 volumio volumio[699]: info: Streaming services startup Jan 12 22:11:19 volumio volumio[699]: info: Starting Streaming Daemon Jan 12 22:11:19 volumio sudo[1513]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Jan 12 22:11:19 volumio sudo[1513]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:19 volumio volumio[699]: info: [MyVolumio PluginManager] Streaming Services plugin successfully started Jan 12 22:11:19 volumio sudo[1513]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:19 volumio volumio[699]: error: Cannot start Volumio Streaming Daemon Jan 12 22:11:19 volumio volumio[699]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service Jan 12 22:11:19 volumio volumio[699]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. Jan 12 22:11:20 volumio volumio[699]: info: Discovery: adding ea26886b-fd8c-488d-8b19-03486197cdb1 Jan 12 22:11:20 volumio volumio[699]: info: Discovery: Found device Volumio Jan 12 22:11:20 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:11:20 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:11:21 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , saveGeneralSettings Jan 12 22:11:21 volumio volumio[699]: info: System name has changed, restarting Shairport Sync Jan 12 22:11:21 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:21 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:21 volumio volumio[699]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Jan 12 22:11:21 volumio volumio[699]: info: Discovery: Restarting Advertising due to device name change Jan 12 22:11:21 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getAudioDevices Jan 12 22:11:21 volumio sudo[1528]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/killall upmpdcli Jan 12 22:11:21 volumio sudo[1528]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:21 volumio sudo[1528]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:21 volumio systemd[1]: upmpdcli.service: Succeeded. Jan 12 22:11:21 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sOptions Jan 12 22:11:21 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:21 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Jan 12 22:11:21 volumio volumio[699]: STREAMING PROXY: Starting server on port 3245 Jan 12 22:11:21 volumio volumio[699]: Node JS runtime: 14 Jan 12 22:11:22 volumio volumio[699]: info: Starting Shairport Sync Jan 12 22:11:22 volumio sudo[1533]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/hosts Jan 12 22:11:22 volumio sudo[1533]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:22 volumio sudo[1535]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Jan 12 22:11:22 volumio sudo[1535]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:22 volumio sudo[1533]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:22 volumio volumio[699]: info: Permissions for /etc/hosts set Jan 12 22:11:22 volumio systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Jan 12 22:11:22 volumio systemd[1]: shairport-sync.service: Succeeded. Jan 12 22:11:22 volumio systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Jan 12 22:11:22 volumio volumio[699]: info: Hostname now is hb_dac2hd Jan 12 22:11:22 volumio systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Jan 12 22:11:22 volumio sudo[1535]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:22 volumio sudo[1540]: volumio : unable to resolve host volumio Jan 12 22:11:22 volumio sudo[1540]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:22 volumio volumio[699]: info: Shairport-Sync Started Jan 12 22:11:22 volumio sudo[1540]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/hostname hb_dac2hd Jan 12 22:11:22 volumio sudo[1540]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:22 volumio sudo[1540]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:22 volumio sudo[1542]: volumio : unable to resolve host volumio Jan 12 22:11:22 volumio sudo[1542]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:22 volumio volumio[699]: error: Cannot set new hostname: Error: Command failed: /usr/bin/sudo /bin/hostname hb_dac2hd Jan 12 22:11:22 volumio volumio[699]: sudo: unable to resolve host volumio: System error Jan 12 22:11:22 volumio volumio[699]: hostname: the specified hostname is invalid Jan 12 22:11:22 volumio sudo[1542]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod -R 777 /etc/avahi/services/ Jan 12 22:11:22 volumio sudo[1542]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:22 volumio sudo[1542]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:22 volumio volumio[699]: info: Permissions for /etc/avahi/services/volumio.service Jan 12 22:11:22 volumio avahi-daemon[494]: Files changed, reloading. Jan 12 22:11:22 volumio avahi-daemon[494]: Loading service file /services/volumio.service. Jan 12 22:11:22 volumio volumio[699]: info: Avahi name changed to hb_dac2hd Jan 12 22:11:22 volumio volumio[699]: info: Discovery: A device disappeared from network Jan 12 22:11:22 volumio volumio[699]: info: Discovery: Device volumio disappeared from network Jan 12 22:11:23 volumio avahi-daemon[494]: Service "hb_DAC2HD" (/services/volumio.service) successfully established. Jan 12 22:11:26 volumio volumio[699]: info: Discovery: Started advertising with name: hb_DAC2HD Jan 12 22:11:27 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: updater_comm , clearUpdateSchedule Jan 12 22:11:27 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Jan 12 22:11:27 volumio volumio-remote-updater[485]: No test mode Jan 12 22:11:27 volumio volumio-remote-updater[485]: No alpha test mode Jan 12 22:11:27 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled Jan 12 22:11:27 volumio volumio[699]: info: Update Ready: {"changeLogLink":"http://volumio.org","description":"

FIXES

 

NEW ADDITIONS

 

","title":"Update v3.785","updateavailable":true} Jan 12 22:11:27 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache Jan 12 22:11:27 volumio volumio[699]: info: Discovery: adding ea26886b-fd8c-488d-8b19-03486197cdb1 Jan 12 22:11:27 volumio volumio[699]: info: Discovery: Found device hb_DAC2HD Jan 12 22:11:27 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:11:27 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:11:31 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Jan 12 22:11:31 volumio volumio[699]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 4 Jan 12 22:11:31 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:11:31 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:11:31 volumio sudo[1552]: volumio : unable to resolve host volumio Jan 12 22:11:31 volumio sudo[1552]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:31 volumio sudo[1552]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/samba/smb.conf Jan 12 22:11:31 volumio sudo[1552]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:31 volumio sudo[1554]: volumio : unable to resolve host volumio Jan 12 22:11:31 volumio sudo[1554]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:31 volumio sudo[1554]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /data/INTERNAL Jan 12 22:11:31 volumio sudo[1554]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:31 volumio sudo[1552]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:31 volumio sudo[1554]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:31 volumio volumio[699]: info: smb.conf Permissions set Jan 12 22:11:31 volumio volumio[699]: info: Internal perms successfully set Jan 12 22:11:31 volumio sudo[1558]: volumio : unable to resolve host volumio Jan 12 22:11:31 volumio sudo[1558]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:32 volumio sudo[1558]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart nmbd.service Jan 12 22:11:32 volumio sudo[1558]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:32 volumio sudo[1560]: volumio : unable to resolve host volumio Jan 12 22:11:32 volumio sudo[1560]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:32 volumio sudo[1560]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Jan 12 22:11:32 volumio sudo[1560]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:32 volumio nmbd[626]: [2025/01/12 22:11:32.065350, 0] ../source3/nmbd/nmbd.c:58(terminate) Jan 12 22:11:32 volumio nmbd[626]: Got SIGTERM: going down... Jan 12 22:11:32 volumio sudo[1560]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:32 volumio systemd[1]: Stopping Samba NMB Daemon... Jan 12 22:11:32 volumio systemd[1]: nmbd.service: Succeeded. Jan 12 22:11:32 volumio systemd[1]: Stopped Samba NMB Daemon. Jan 12 22:11:32 volumio sudo[1563]: volumio : unable to resolve host volumio Jan 12 22:11:32 volumio sudo[1563]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:32 volumio sudo[1563]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Jan 12 22:11:32 volumio sudo[1563]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:32 volumio sudo[1568]: volumio : unable to resolve host volumio Jan 12 22:11:32 volumio sudo[1568]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:32 volumio sudo[1563]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:32 volumio sudo[1568]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service Jan 12 22:11:32 volumio systemd[1]: Starting Samba NMB Daemon... Jan 12 22:11:32 volumio sudo[1568]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:32 volumio systemd[1]: Started UPnP Renderer front-end to MPD. Jan 12 22:11:32 volumio sudo[1568]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:32 volumio volumio[699]: info: Upmpdcli Daemon Started Jan 12 22:11:32 volumio volumio[1573]: writing RSA key Jan 12 22:11:32 volumio nmbd[1572]: [2025/01/12 22:11:32.457237, 0] ../source3/nmbd/asyncdns.c:158(start_async_dns) Jan 12 22:11:32 volumio nmbd[1572]: started asyncdns process 1600 Jan 12 22:11:32 volumio nmbd[1572]: [2025/01/12 22:11:32.466756, 0] ../lib/util/become_daemon.c:138(daemon_ready) Jan 12 22:11:32 volumio systemd[1]: Started Samba NMB Daemon. Jan 12 22:11:32 volumio nmbd[1572]: daemon_ready: STATUS=daemon 'nmbd' finished starting up and ready to serve connections Jan 12 22:11:32 volumio sudo[1558]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:32 volumio sudo[1601]: volumio : unable to resolve host volumio Jan 12 22:11:32 volumio sudo[1601]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:32 volumio sudo[1601]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart smbd.service Jan 12 22:11:32 volumio sudo[1601]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:32 volumio systemd[1]: Stopping Samba SMB Daemon... Jan 12 22:11:32 volumio systemd[1]: smbd.service: Main process exited, code=killed, status=15/TERM Jan 12 22:11:32 volumio systemd[1]: smbd.service: Succeeded. Jan 12 22:11:32 volumio systemd[1]: Stopped Samba SMB Daemon. Jan 12 22:11:32 volumio systemd[1]: Starting Samba SMB Daemon... Jan 12 22:11:33 volumio winbindd[838]: [2025/01/12 22:11:33.173806, 0] ../source3/winbindd/winbindd_samr.c:672(sam_sid_to_name) Jan 12 22:11:33 volumio winbindd[838]: sam_sid_to_name: possible deadlock - trying to lookup SID S-1-5-21-1134591212-4101336875-2418538832-501 Jan 12 22:11:33 volumio winbindd[838]: [2025/01/12 22:11:33.175352, 0] ../source3/winbindd/winbindd_samr.c:672(sam_sid_to_name) Jan 12 22:11:33 volumio winbindd[838]: sam_sid_to_name: possible deadlock - trying to lookup SID S-1-5-21-1134591212-4101336875-2418538832-514 Jan 12 22:11:33 volumio smbd[1619]: [2025/01/12 22:11:33.210389, 0] ../lib/util/become_daemon.c:138(daemon_ready) Jan 12 22:11:33 volumio smbd[1619]: daemon_ready: STATUS=daemon 'smbd' finished starting up and ready to serve connections Jan 12 22:11:33 volumio systemd[1]: Started Samba SMB Daemon. Jan 12 22:11:33 volumio sudo[1601]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:33 volumio volumio[699]: info: SAMBA Restarted Jan 12 22:11:34 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: updater_comm , clearUpdateSchedule Jan 12 22:11:34 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Jan 12 22:11:34 volumio systemd[1]: systemd-timedated.service: Succeeded. Jan 12 22:11:34 volumio volumio-remote-updater[485]: No test mode Jan 12 22:11:34 volumio volumio-remote-updater[485]: No alpha test mode Jan 12 22:11:34 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled Jan 12 22:11:34 volumio volumio[699]: info: Update Ready: {"changeLogLink":"http://volumio.org","description":"

FIXES

 

NEW ADDITIONS

 

","title":"Update v3.785","updateavailable":true} Jan 12 22:11:34 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache Jan 12 22:11:36 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:36 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:36 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getConfigParam Jan 12 22:11:36 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam Jan 12 22:11:36 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStatsObject Jan 12 22:11:36 volumio volumio[699]: info: CoreCommandRouter::volumioGetBrowseSources Jan 12 22:11:36 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , saveAlsaOptions Jan 12 22:11:38 volumio volumio[699]: info: Preparing to save Alsa Options, stopping services first Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:11:38 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::volumioPause Jan 12 22:11:38 volumio volumio[699]: info: CoreStateMachine::pause Jan 12 22:11:38 volumio volumio[699]: info: Saving Audio Output to: {"i2s":true,"i2sid":{"value":"hifiberry-dac2hd","label":"HiFiBerry DAC2 HD"},"output_device":{"value":1,"label":"HiFiBerry DAC2 HD"},"disallowPush":true} Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2SNumber Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:38 volumio volumio[699]: info: Enabling I2S DAC: HiFiBerry DAC2 HD Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , enableI2SDAC Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:38 volumio sudo[1629]: volumio : unable to resolve host volumio Jan 12 22:11:38 volumio sudo[1629]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:38 volumio sudo[1629]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/dtoverlay -l Jan 12 22:11:38 volumio sudo[1629]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:38 volumio sudo[1629]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:38 volumio volumio[699]: sudo: unable to resolve host volumio: System error Jan 12 22:11:38 volumio volumio[699]: info: No Overlays Loaded Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2SAlsaName Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:38 volumio sudo[1632]: volumio : unable to resolve host volumio Jan 12 22:11:38 volumio sudo[1632]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:38 volumio sudo[1632]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/dtoverlay hifiberry-dacplushd Jan 12 22:11:38 volumio sudo[1632]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:38 volumio kernel: OF: overlay: WARNING: memory leak will occur if overlay removed, property: /soc/i2s@7e203000/status Jan 12 22:11:38 volumio kernel: OF: overlay: WARNING: memory leak will occur if overlay removed, property: /soc/i2c@7e804000/status Jan 12 22:11:38 volumio kernel: OF: overlay: WARNING: memory leak will occur if overlay removed, property: /soc/sound/compatible Jan 12 22:11:38 volumio kernel: OF: overlay: WARNING: memory leak will occur if overlay removed, property: /soc/sound/i2s-controller Jan 12 22:11:38 volumio kernel: OF: overlay: WARNING: memory leak will occur if overlay removed, property: /soc/sound/clocks Jan 12 22:11:38 volumio kernel: OF: overlay: WARNING: memory leak will occur if overlay removed, property: /soc/sound/reset-gpio Jan 12 22:11:38 volumio kernel: OF: overlay: WARNING: memory leak will occur if overlay removed, property: /soc/sound/status Jan 12 22:11:38 volumio volumio[699]: warn: Unable to locate the device HiFiBerry DAC2 HD a reboot may be required. Jan 12 22:11:38 volumio sudo[1632]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2SMixer Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:38 volumio volumio[699]: info: Found match in i2s Card Database: setting mixer DAC for card HiFiBerry DAC2 HD Jan 12 22:11:38 volumio kernel: dachd-clk: probe of 1-0062 failed with error -5 Jan 12 22:11:38 volumio kernel: pcm179x 1-004c: No cache used with register defaults set! Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::volumioUpdateVolumeSettings Jan 12 22:11:38 volumio volumio[699]: info: Updating Volume Controller Parameters: Device: 2 Name: HiFiBerry DAC2 HD Mixer: DAC Max Vol: 100 Vol Curve; logarithmic Vol Steps: 1 Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume Jan 12 22:11:38 volumio volumio[699]: info: Disabling external Volume Control Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::getUIConfigOnPlugin Jan 12 22:11:38 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: wizard , setWizardAction Jan 12 22:11:38 volumio volumio[699]: info: Preparing to generate the ALSA configuration file Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::getUIConfigOnPlugin Jan 12 22:11:39 volumio volumio[699]: info: Retrieving Cloud Streaming UI Jan 12 22:11:39 volumio volumio[699]: error: Cannot get ALSA Volume: Error: Alsa Mixer Error: Invalid card number. Jan 12 22:11:39 volumio volumio[699]: info: I2S Param [object Object] successfully enabled Jan 12 22:11:39 volumio volumio[699]: info: VolumeController:: Volume=undefined Mute =false Jan 12 22:11:39 volumio volumio[699]: info: CoreStateMachine::pushState Jan 12 22:11:39 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::volumioPushState Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sOptions Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Jan 12 22:11:39 volumio volumio[699]: info: Getting Alsa Cards List without I2S DAC Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2SNumber Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:39 volumio volumio[699]: Invalid card number. Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: mpd , getPlaybackMode Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Jan 12 22:11:39 volumio volumio[699]: info: Getting Tidal Cloud Configuration Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::getUIConfigOnPlugin Jan 12 22:11:39 volumio volumio[699]: info: Getting Qobuz Cloud Configuration Jan 12 22:11:39 volumio volumio[699]: info: Asking plugin for UI Config Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::getUIConfigOnPlugin Jan 12 22:11:39 volumio volumio[699]: info: Getting Spotify Cloud Configuration Jan 12 22:11:39 volumio volumio[699]: info: Asking plugin for UI Config Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::getUIConfigOnPlugin Jan 12 22:11:39 volumio volumio[699]: info: Saving Spotify Acccount Jan 12 22:11:39 volumio volumio[699]: info: Got Tidal Cloud Configuration Jan 12 22:11:39 volumio volumio[699]: info: Got it Jan 12 22:11:39 volumio volumio[699]: info: Got it Jan 12 22:11:39 volumio volumio[699]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Jan 12 22:11:39 volumio volumio[699]: info: Asound.conf file written Jan 12 22:11:39 volumio sudo[1691]: volumio : unable to resolve host volumio Jan 12 22:11:39 volumio sudo[1691]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:39 volumio sudo[1691]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mv /home/volumio/.asoundrc /etc/asound.conf Jan 12 22:11:39 volumio sudo[1691]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:39 volumio sudo[1691]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:39 volumio volumio[699]: sudo: unable to resolve host volumio: System error Jan 12 22:11:39 volumio volumio[699]: No state is present for card b1 Jan 12 22:11:39 volumio volumio[699]: /usr/share/alsa/init/bcm2835:14: control element not found Jan 12 22:11:39 volumio volumio[699]: No state is present for card b1 Jan 12 22:11:39 volumio volumio[699]: No state is present for card Headphones Jan 12 22:11:39 volumio volumio[699]: /usr/share/alsa/init/bcm2835:20: control element not found Jan 12 22:11:39 volumio volumio[699]: No state is present for card Headphones Jan 12 22:11:39 volumio volumio[699]: info: Output device has changed, restarting MPD Jan 12 22:11:39 volumio volumio[699]: info: Output device has changed, restarting Shairport Sync Jan 12 22:11:39 volumio sudo[1696]: volumio : unable to resolve host volumio Jan 12 22:11:39 volumio sudo[1696]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:39 volumio sudo[1696]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Jan 12 22:11:39 volumio sudo[1696]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:39 volumio sudo[1696]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:39 volumio sudo[1698]: volumio : unable to resolve host volumio Jan 12 22:11:39 volumio sudo[1698]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:39 volumio sudo[1698]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Jan 12 22:11:39 volumio sudo[1698]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:39 volumio systemd[1]: Stopping Music Player Daemon... Jan 12 22:11:39 volumio volumio[699]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Jan 12 22:11:39 volumio volumio[699]: info: Output device has changed, restarting MPD Jan 12 22:11:39 volumio volumio[699]: info: Output device has changed, restarting Shairport Sync Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:39 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:39 volumio sudo[1705]: volumio : unable to resolve host volumio Jan 12 22:11:40 volumio sudo[1705]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:40 volumio sudo[1705]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Jan 12 22:11:40 volumio sudo[1705]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:40 volumio sudo[1705]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:40 volumio sudo[1707]: volumio : unable to resolve host volumio Jan 12 22:11:40 volumio sudo[1707]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:40 volumio sudo[1707]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Jan 12 22:11:40 volumio sudo[1707]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:40 volumio volumio[699]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::getUIConfigOnPlugin Jan 12 22:11:40 volumio volumio[699]: error: Error retrieving Highresaudio conf: TypeError: Cannot read property 'onSave' of undefined Jan 12 22:11:40 volumio systemd[1]: mpd.service: Succeeded. Jan 12 22:11:40 volumio systemd[1]: Stopped Music Player Daemon. Jan 12 22:11:40 volumio volumio[699]: info: MPD Permissions set Jan 12 22:11:40 volumio volumio[699]: info: MPD Permissions set Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio systemd[1]: Starting Music Player Daemon... Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:40 volumio volumio[699]: info: Starting Shairport Sync Jan 12 22:11:40 volumio volumio[699]: info: Starting Shairport Sync Jan 12 22:11:40 volumio sudo[1725]: volumio : unable to resolve host volumio Jan 12 22:11:40 volumio sudo[1725]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:40 volumio sudo[1725]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Jan 12 22:11:40 volumio sudo[1725]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:40 volumio sudo[1727]: volumio : unable to resolve host volumio Jan 12 22:11:40 volumio sudo[1727]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:40 volumio sudo[1727]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Jan 12 22:11:40 volumio sudo[1727]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:40 volumio systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Jan 12 22:11:40 volumio systemd[1]: shairport-sync.service: Succeeded. Jan 12 22:11:40 volumio systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Jan 12 22:11:40 volumio sudo[1713]: root : unable to resolve host volumio Jan 12 22:11:40 volumio sudo[1713]: root : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:40 volumio sudo[1713]: sudo: unable to resolve host volumio: System error Jan 12 22:11:40 volumio sudo[1713]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Jan 12 22:11:40 volumio sudo[1713]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:40 volumio sudo[1713]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:40 volumio systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Jan 12 22:11:40 volumio sudo[1725]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:40 volumio volumio[699]: info: Shairport-Sync Started Jan 12 22:11:40 volumio systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Jan 12 22:11:40 volumio systemd[1]: shairport-sync.service: Main process exited, code=killed, status=15/TERM Jan 12 22:11:40 volumio systemd[1]: shairport-sync.service: Succeeded. Jan 12 22:11:40 volumio systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Jan 12 22:11:40 volumio systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Jan 12 22:11:40 volumio sudo[1727]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:40 volumio volumio[699]: info: Shairport-Sync Started Jan 12 22:11:41 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: wizard , getDonation Jan 12 22:11:41 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , detectVolumioHardware Jan 12 22:11:41 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: wizard , getDonationsArray Jan 12 22:11:41 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: wizard , getDoneMessage Jan 12 22:11:41 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , detectVolumioHardware Jan 12 22:11:42 volumio mpd[1733]: Jan 12 22:11 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Jan 12 22:11:42 volumio systemd[1]: Started Music Player Daemon. Jan 12 22:11:42 volumio sudo[1707]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:42 volumio sudo[1698]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:42 volumio volumio[699]: info: CoreCommandRouter::volumioRetrieveVolumeLevels Jan 12 22:11:42 volumio volumio[699]: info: CoreStateMachine::getcurrentVolume Jan 12 22:11:42 volumio volumio[699]: info: CoreCommandRouter::volumioRetrievevolume Jan 12 22:11:42 volumio volumio[699]: error: MPD error: The expression evaluated to a falsy value: Jan 12 22:11:42 volumio volumio[699]: assert.ok(self.idling) Jan 12 22:11:42 volumio volumio[699]: error: The expression evaluated to a falsy value: Jan 12 22:11:42 volumio volumio[699]: assert.ok(self.idling) Jan 12 22:11:42 volumio volumio[699]: error: Cannot get ALSA Volume: Error: Alsa Mixer Error: Invalid card number. Jan 12 22:11:43 volumio volumio[699]: error: updateQueue error: null Jan 12 22:11:43 volumio volumio[699]: info: VolumeController:: Volume=undefined Mute =false Jan 12 22:11:43 volumio volumio[699]: info: CoreStateMachine::pushState Jan 12 22:11:43 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:11:43 volumio volumio[699]: info: CoreCommandRouter::volumioPushState Jan 12 22:11:43 volumio volumio[699]: info: CoreStateMachine::updateTrackBlock Jan 12 22:11:43 volumio volumio[699]: info: CorePlayQueue::getTrackBlock Jan 12 22:11:43 volumio volumio[699]: info: CoreCommandRouter::volumioRetrievevolume Jan 12 22:11:43 volumio volumio[699]: error: Cannot get ALSA Volume: Error: Alsa Mixer Error: Invalid card number. Jan 12 22:11:43 volumio volumio[699]: info: VolumeController:: Volume=undefined Mute =false Jan 12 22:11:43 volumio volumio[699]: info: CoreStateMachine::pushState Jan 12 22:11:43 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:11:43 volumio volumio[699]: info: CoreCommandRouter::volumioPushState Jan 12 22:11:45 volumio volumio[699]: info: CoreCommandRouter::getUIConfigOnPlugin Jan 12 22:11:45 volumio volumio[699]: info: Retrieving Cloud Streaming UI Jan 12 22:11:45 volumio volumio[699]: info: Getting Tidal Cloud Configuration Jan 12 22:11:45 volumio volumio[699]: info: CoreCommandRouter::getUIConfigOnPlugin Jan 12 22:11:45 volumio volumio[699]: info: Getting Qobuz Cloud Configuration Jan 12 22:11:45 volumio volumio[699]: info: Asking plugin for UI Config Jan 12 22:11:45 volumio volumio[699]: info: CoreCommandRouter::getUIConfigOnPlugin Jan 12 22:11:45 volumio volumio[699]: info: Getting Spotify Cloud Configuration Jan 12 22:11:45 volumio volumio[699]: info: Asking plugin for UI Config Jan 12 22:11:45 volumio volumio[699]: info: CoreCommandRouter::getUIConfigOnPlugin Jan 12 22:11:45 volumio volumio[699]: info: Saving Spotify Acccount Jan 12 22:11:45 volumio volumio[699]: info: Got Tidal Cloud Configuration Jan 12 22:11:45 volumio volumio[699]: info: Got it Jan 12 22:11:45 volumio volumio[699]: info: Got it Jan 12 22:11:45 volumio volumio[699]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Jan 12 22:11:45 volumio volumio[699]: info: CoreCommandRouter::getUIConfigOnPlugin Jan 12 22:11:45 volumio volumio[699]: error: Error retrieving Highresaudio conf: TypeError: Cannot read property 'onSave' of undefined Jan 12 22:11:48 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: wizard , getDonation Jan 12 22:11:48 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , detectVolumioHardware Jan 12 22:11:48 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: wizard , getDonationsArray Jan 12 22:11:48 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: wizard , getDoneMessage Jan 12 22:11:48 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , detectVolumioHardware Jan 12 22:11:49 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: wizard , setWizardAction Jan 12 22:11:49 volumio volumio[699]: info: CoreCommandRouter::Reload Ui Jan 12 22:11:49 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , setShowWizard Jan 12 22:11:49 volumio volumio[699]: info: Wizard terminated Successfully Jan 12 22:11:49 volumio volumio[699]: info: CoreCommandRouter::volumiosetStartupVolume Jan 12 22:11:49 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 22:11:49 volumio volumio[699]: info: Player Reboot required after I2S DAC has been enabled in wizard Jan 12 22:11:51 volumio sudo[1756]: volumio : unable to resolve host volumio Jan 12 22:11:51 volumio sudo[1756]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:51 volumio sudo[1756]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Jan 12 22:11:51 volumio sudo[1756]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:51 volumio sudo[1756]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:51 volumio sudo[1758]: volumio : unable to resolve host volumio Jan 12 22:11:51 volumio sudo[1758]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:51 volumio sudo[1758]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Jan 12 22:11:51 volumio sudo[1758]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:51 volumio sudo[1758]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:51 volumio volumio[699]: verbose: New Socket.io Connection to 192.168.2.133 from 192.168.2.244 UA: Mozilla/5.0 (Macintosh; Intel Mac OS X 10_15_7) AppleWebKit/605.1.15 (KHTML, like Gecko) Version/18.1.1 Safari/605.1.15 Engine version: 3 Transport: polling Total Clients: 4 Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Jan 12 22:11:51 volumio sudo[1764]: volumio : unable to resolve host volumio Jan 12 22:11:51 volumio sudo[1764]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:51 volumio sudo[1764]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Jan 12 22:11:51 volumio sudo[1764]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:51 volumio sudo[1766]: volumio : unable to resolve host volumio Jan 12 22:11:51 volumio sudo[1766]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:11:51 volumio sudo[1764]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:51 volumio sudo[1766]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Jan 12 22:11:51 volumio sudo[1766]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:11:51 volumio sudo[1766]: pam_unix(sudo:session): session closed for user root Jan 12 22:11:51 volumio volumio[699]: verbose: New Socket.io Connection to 192.168.2.133 from 192.168.2.244 UA: Mozilla/5.0 (Macintosh; Intel Mac OS X 10_15_7) AppleWebKit/605.1.15 (KHTML, like Gecko) Version/18.1.1 Safari/605.1.15 Engine version: 3 Transport: polling Total Clients: 4 Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::volumioGetVisibleSources Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:11:51 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Jan 12 22:11:51 volumio volumio[699]: info: Received Get System Info Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Jan 12 22:11:51 volumio volumio[699]: info: Discovery: Getting this device information Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:11:51 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:11:51 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:11:51 volumio volumio[699]: info: Listing playlists Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Jan 12 22:11:51 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Jan 12 22:11:52 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:11:52 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:11:53 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Jan 12 22:11:53 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Jan 12 22:11:53 volumio volumio[699]: info: Received Get System Info Jan 12 22:11:53 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Jan 12 22:11:53 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Jan 12 22:11:53 volumio volumio[699]: info: Discovery: Getting this device information Jan 12 22:11:53 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:11:53 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:11:53 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Jan 12 22:11:54 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Jan 12 22:11:54 volumio volumio[699]: info: Received Get System Info Jan 12 22:11:54 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Jan 12 22:11:54 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Jan 12 22:11:54 volumio volumio[699]: info: Discovery: Getting this device information Jan 12 22:11:54 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:11:54 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:11:54 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Jan 12 22:11:56 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: wizard , setOnboardingWizardFalse Jan 12 22:11:59 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Jan 12 22:12:01 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Jan 12 22:12:03 volumio volumio[699]: info: CoreCommandRouter::Close All Modals sent Jan 12 22:12:03 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: appearance , setTOSAccepted Jan 12 22:12:06 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , setMyVolumioToken Jan 12 22:12:06 volumio volumio[699]: info: MyVolumio login type: Token Jan 12 22:12:06 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , setMyVolumioToken Jan 12 22:12:06 volumio volumio[699]: info: MyVolumio login type: Token Jan 12 22:12:06 volumio volumio[699]: info: MYVOLUMIO SUCCESSFULLY LOGGED IN Jan 12 22:12:07 volumio kernel: mmc0: fsm 1, hsts 1 Jan 12 22:12:07 volumio kernel: mmc0: fsm 1, hsts 1 Jan 12 22:12:07 volumio kernel: mmc0: Problem switching card into high-speed mode! Jan 12 22:12:07 volumio kernel: I/O error, dev mmcblk0, sector 138808 op 0x1:(WRITE) flags 0x0 phys_seg 1 prio class 2 Jan 12 22:12:07 volumio kernel: I/O error, dev mmcblk0, sector 1094 op 0x1:(WRITE) flags 0x0 phys_seg 1 prio class 2 Jan 12 22:12:07 volumio kernel: Buffer I/O error on dev mmcblk0p1, logical block 1093, lost async page write Jan 12 22:12:07 volumio kernel: I/O error, dev mmcblk0, sector 2537 op 0x1:(WRITE) flags 0x0 phys_seg 1 prio class 2 Jan 12 22:12:07 volumio kernel: Buffer I/O error on dev mmcblk0p1, logical block 2536, lost async page write Jan 12 22:12:07 volumio volumio[699]: info: MyVolumio token set successfully Jan 12 22:12:07 volumio volumio[699]: info: MYVOLUMIO: Adding device Jan 12 22:12:07 volumio volumio[699]: info: MYVOLUMIO: Evaluating Server Jan 12 22:12:07 volumio kernel: SQUASHFS error: zlib decompression failed, data probably corrupt Jan 12 22:12:07 volumio kernel: SQUASHFS error: Failed to read block 0x2befb1: -5 Jan 12 22:12:07 volumio kernel: SQUASHFS error: Unable to read fragment cache entry [2befb1] Jan 12 22:12:07 volumio kernel: SQUASHFS error: Unable to read fragment cache entry [2befb1] Jan 12 22:12:07 volumio kernel: SQUASHFS error: Unable to read page, block 2befb1, size f53a Jan 12 22:12:07 volumio volumio[699]: error: Could not find ideal Myvolumio endpoint, defaulting to eu1 Jan 12 22:12:07 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:12:07 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:12:07 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:12:07 volumio volumio[699]: info: MyVolumio status changed Jan 12 22:12:07 volumio volumio[699]: info: Streaming services startup Jan 12 22:12:07 volumio volumio[699]: info: Starting Streaming Daemon Jan 12 22:12:07 volumio volumio[699]: info: Removing browser output: myVolumio user plan is not superstar Jan 12 22:12:07 volumio volumio[699]: info: Removing audio output: Jan 12 22:12:07 volumio volumio[699]: info: Stoppping Tunnel 1 Jan 12 22:12:07 volumio sudo[1819]: volumio : unable to resolve host volumio Jan 12 22:12:07 volumio sudo[1819]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:12:07 volumio sudo[1819]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Jan 12 22:12:07 volumio sudo[1819]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:12:07 volumio sudo[1821]: volumio : unable to resolve host volumio Jan 12 22:12:07 volumio sudo[1821]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:12:07 volumio sudo[1819]: pam_unix(sudo:session): session closed for user root Jan 12 22:12:08 volumio volumio[699]: error: Cannot start Volumio Streaming Daemon Jan 12 22:12:08 volumio volumio[699]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service Jan 12 22:12:08 volumio volumio[699]: sudo: unable to resolve host volumio: System error Jan 12 22:12:08 volumio volumio[699]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. Jan 12 22:12:08 volumio sudo[1821]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop sshtunnel.service Jan 12 22:12:08 volumio sudo[1821]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 12 22:12:08 volumio sudo[1821]: pam_unix(sudo:session): session closed for user root Jan 12 22:12:08 volumio volumio[699]: info: Remote SSH Stopped Jan 12 22:12:08 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Jan 12 22:12:08 volumio volumio[699]: info: Received Get System Info Jan 12 22:12:08 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Jan 12 22:12:08 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Jan 12 22:12:08 volumio volumio[699]: info: Discovery: Getting this device information Jan 12 22:12:08 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:12:08 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:12:08 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Jan 12 22:12:08 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Jan 12 22:12:08 volumio volumio[699]: info: Received Get System Info Jan 12 22:12:08 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Jan 12 22:12:08 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Jan 12 22:12:08 volumio volumio[699]: info: Discovery: Getting this device information Jan 12 22:12:08 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:12:08 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:12:08 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Jan 12 22:12:08 volumio volumio[699]: error: Failed to add MyVolumio device: {"message":"USER_NOT_FOUND"} Jan 12 22:12:08 volumio volumio[699]: info: Updating MyVolumio device info Jan 12 22:12:08 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:12:08 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:12:08 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:12:09 volumio volumio[699]: error: Failed to update MyVolumio device: {"message":"DEVICE_NOT_FOUND"} Jan 12 22:12:09 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Jan 12 22:12:09 volumio volumio[699]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Jan 12 22:12:09 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Jan 12 22:12:09 volumio volumio[699]: info: Received Get System Version Jan 12 22:12:09 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Jan 12 22:12:09 volumio volumio[699]: info: Received Get System Info Jan 12 22:12:09 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Jan 12 22:12:09 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Jan 12 22:12:09 volumio volumio[699]: info: Discovery: Getting this device information Jan 12 22:12:09 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:12:09 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:12:09 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Jan 12 22:12:12 volumio volumio[699]: info: MYVOLUMIO: Adding device Jan 12 22:12:12 volumio volumio[699]: info: MYVOLUMIO: Evaluating Server Jan 12 22:12:12 volumio kernel: SQUASHFS error: Unable to read fragment cache entry [2befb1] Jan 12 22:12:12 volumio kernel: SQUASHFS error: Unable to read page, block 2befb1, size f53a Jan 12 22:12:12 volumio volumio[699]: error: Could not find ideal Myvolumio endpoint, defaulting to eu1 Jan 12 22:12:12 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:12:12 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:12:12 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:12:13 volumio volumio[699]: info: Updating MyVolumio device info Jan 12 22:12:13 volumio volumio[699]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 22:12:13 volumio volumio[699]: error: Failed to add MyVolumio device: {"message":"USER_NOT_FOUND"} Jan 12 22:12:14 volumio volumio[699]: error: Failed to update MyVolumio device: {"message":"DEVICE_NOT_FOUND"} Jan 12 22:12:16 volumio kernel: mmc0: card aaaa removed Jan 12 22:12:16 volumio systemd[1]: Stopped target Local File Systems. Jan 12 22:12:16 volumio volumio[699]: info: Partition removed: {"syspath":"/sys/devices/platform/soc/3f202000.mmc/mmc_host/mmc0/mmc0:aaaa/block/mmcblk0/mmcblk0p1","ACTION":"remove","DEVLINKS":"/dev/disk/by-partuuid/11f12c05-01 /dev/disk/by-uuid/9C48-E5A3 /dev/disk/by-id/mmc-SC32G_0xa0b6a051-part1 /dev/disk/by-path/platform-3f202000.mmc-part1 /dev/disk/by-label/boot","DEVNAME":"/dev/mmcblk0p1","DEVPATH":"/devices/platform/soc/3f202000.mmc/mmc_host/mmc0/mmc0:aaaa/block/mmcblk0/mmcblk0p1","DEVTYPE":"partition","DISKSEQ":"25","ID_FS_LABEL":"boot","ID_FS_LABEL_ENC":"boot","ID_FS_TYPE":"vfat","ID_FS_USAGE":"filesystem","ID_FS_UUID":"9C48-E5A3","ID_FS_UUID_ENC":"9C48-E5A3","ID_FS_VERSION":"FAT32","ID_NAME":"SC32G","ID_PART_ENTRY_DISK":"179:0","ID_PART_ENTRY_FLAGS":"0x80","ID_PART_ENTRY_NUMBER":"1","ID_PART_ENTRY_OFFSET":"1","ID_PART_ENTRY_SCHEME":"dos","ID_PART_ENTRY_SIZE":"187500","ID_PART_ENTRY_TYPE":"0xc","ID_PART_ENTRY_UUID":"11f12c05-01","ID_PART_TABLE_TYPE":"dos","ID_PART_TABLE_UUID":"11f12c05","ID_PATH":"platform-3f202000.mmc","ID_PATH_TAG":"platform-3f202000_mmc","ID_SERIAL":"0xa0b6a051","MAJOR":"179","MINOR":"1","PARTN":"1","SEQNUM":"1831","SUBSYSTEM":"block","TAGS":":systemd:","USEC_INITIALIZED":"4467765"} Jan 12 22:12:16 volumio systemd[1]: Unmounting /boot... Jan 12 22:12:16 volumio kernel: FAT-fs (mmcblk0p1): unable to read boot sector to mark fs as dirty Jan 12 22:12:16 volumio kernel: Aborting journal on device mmcblk0p3-8. Jan 12 22:12:16 volumio kernel: JBD2: I/O error when updating journal superblock for mmcblk0p3-8. Jan 12 22:12:16 volumio volumio[699]: info: Partition removed: {"syspath":"/sys/devices/platform/soc/3f202000.mmc/mmc_host/mmc0/mmc0:aaaa/block/mmcblk0/mmcblk0p2","ACTION":"remove","DEVLINKS":"/dev/disk/by-path/platform-3f202000.mmc-part2 /dev/disk/by-partuuid/11f12c05-02 /dev/disk/by-id/mmc-SC32G_0xa0b6a051-part2 /dev/disk/by-label/volumio /dev/disk/by-uuid/8543fa12-4125-4451-a534-cec5480e0606","DEVNAME":"/dev/mmcblk0p2","DEVPATH":"/devices/platform/soc/3f202000.mmc/mmc_host/mmc0/mmc0:aaaa/block/mmcblk0/mmcblk0p2","DEVTYPE":"partition","DISKSEQ":"25","ID_FS_LABEL":"volumio","ID_FS_LABEL_ENC":"volumio","ID_FS_TYPE":"ext4","ID_FS_USAGE":"filesystem","ID_FS_UUID":"8543fa12-4125-4451-a534-cec5480e0606","ID_FS_UUID_ENC":"8543fa12-4125-4451-a534-cec5480e0606","ID_FS_VERSION":"1.0","ID_NAME":"SC32G","ID_PART_ENTRY_DISK":"179:0","ID_PART_ENTRY_NUMBER":"2","ID_PART_ENTRY_OFFSET":"188416","ID_PART_ENTRY_SCHEME":"dos","ID_PART_ENTRY_SIZE":"5279744","ID_PART_ENTRY_TYPE":"0x83","ID_PART_ENTRY_UUID":"11f12c05-02","ID_PART_TABLE_TYPE":"dos","ID_PART_TABLE_UUID":"11f12c05","ID_PATH":"platform-3f202000.mmc","ID_PATH_TAG":"platform-3f202000_mmc","ID_SERIAL":"0xa0b6a051","MAJOR":"179","MINOR":"2","PARTN":"2","SEQNUM":"1832","SUBSYSTEM":"block","TAGS":":systemd:","USEC_INITIALIZED":"4458027"} Jan 12 22:12:16 volumio volumio[699]: info: Partition removed: {"syspath":"/sys/devices/platform/soc/3f202000.mmc/mmc_host/mmc0/mmc0:aaaa/block/mmcblk0/mmcblk0p3","ACTION":"remove","DEVLINKS":"/dev/disk/by-partuuid/11f12c05-03 /dev/disk/by-uuid/f7cca1c6-391b-47a8-9c19-3b1948539def /dev/disk/by-path/platform-3f202000.mmc-part3 /dev/disk/by-id/mmc-SC32G_0xa0b6a051-part3 /dev/disk/by-label/volumio_data","DEVNAME":"/dev/mmcblk0p3","DEVPATH":"/devices/platform/soc/3f202000.mmc/mmc_host/mmc0/mmc0:aaaa/block/mmcblk0/mmcblk0p3","DEVTYPE":"partition","DISKSEQ":"25","ID_FS_LABEL":"volumio_data","ID_FS_LABEL_ENC":"volumio_data","ID_FS_TYPE":"ext4","ID_FS_USAGE":"filesystem","ID_FS_UUID":"f7cca1c6-391b-47a8-9c19-3b1948539def","ID_FS_UUID_ENC":"f7cca1c6-391b-47a8-9c19-3b1948539def","ID_FS_VERSION":"1.0","ID_NAME":"SC32G","ID_PART_ENTRY_DISK":"179:0","ID_PART_ENTRY_NUMBER":"3","ID_PART_ENTRY_OFFSET":"5468160","ID_PART_ENTRY_SCHEME":"dos","ID_PART_ENTRY_SIZE":"56865792","ID_PART_ENTRY_TYPE":"0x83","ID_PART_ENTRY_UUID":"11f12c05-03","ID_PART_TABLE_TYPE":"dos","ID_PART_TABLE_UUID":"11f12c05","ID_PATH":"platform-3f202000.mmc","ID_PATH_TAG":"platform-3f202000_mmc","ID_SERIAL":"0xa0b6a051","MAJOR":"179","MINOR":"3","PARTN":"3","SEQNUM":"1833","SUBSYSTEM":"block","TAGS":":systemd:","USEC_INITIALIZED":"4388444"} Jan 12 22:12:16 volumio systemd[1]: boot.mount: Succeeded. Jan 12 22:12:16 volumio systemd[1]: Unmounted /boot. Jan 12 22:12:16 volumio systemd[1]: systemd-fsck@dev-disk-by\x2duuid-9C48\x2dE5A3.service: Succeeded. Jan 12 22:12:16 volumio systemd[1]: Stopped File System Check on /dev/disk/by-uuid/9C48-E5A3. Jan 12 22:12:16 volumio kernel: EXT4-fs error (device mmcblk0p3): ext4_journal_check_start:83: comm ext4lazyinit: Detected aborted journal Jan 12 22:12:16 volumio kernel: EXT4-fs (mmcblk0p3): Remounting filesystem read-only Jan 12 22:12:17 volumio volumio[699]: info: CoreCommandRouter::volumioGetState Jan 12 22:12:17 volumio volumio[699]: info: CorePlayQueue::getTrack 0 Jan 12 22:12:18 volumio volumio[699]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jan 12 22:12:18 volumio kernel: EXT4-fs warning (device mmcblk0p3): htree_dirblock_to_tree:1082: inode #2263001: lblock 0: comm node: error -5 reading directory block Jan 12 22:12:18 volumio volumio[699]: Error: EIO: i/o error, scandir '/data/plugins/' Jan 12 22:12:18 volumio volumio[699]: at Object.readdirSync (fs.js:1021:3) Jan 12 22:12:18 volumio volumio[699]: at PluginManager.getInstalledPlugins (/volumio/app/pluginmanager.js:1627:30) Jan 12 22:12:18 volumio volumio[699]: at CoreCommandRouter.getInstalledPlugins (/volumio/app/index.js:1521:29) Jan 12 22:12:18 volumio volumio[699]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:1328:45) Jan 12 22:12:18 volumio volumio[699]: at Socket.emit (events.js:315:20) Jan 12 22:12:18 volumio volumio[699]: at /volumio/node_modules/socket.io/lib/socket.js:528:12 Jan 12 22:12:18 volumio volumio[699]: at processTicksAndRejections (internal/process/task_queues.js:75:11) { Jan 12 22:12:18 volumio volumio[699]: errno: -5, Jan 12 22:12:18 volumio volumio[699]: syscall: 'scandir', Jan 12 22:12:18 volumio volumio[699]: code: 'EIO', Jan 12 22:12:18 volumio volumio[699]: path: '/data/plugins/' Jan 12 22:12:18 volumio volumio[699]: } Jan 12 22:12:18 volumio volumio[699]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jan 12 22:12:19 volumio sudo[1837]: volumio : unable to resolve host volumio Jan 12 22:12:19 volumio sudo[1837]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 12 22:12:19 volumio sudo[1837]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-01-12 22:11 Jan 12 22:12:19 volumio sudo[1837]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Raspbian GNU/Linux 10 (buster)" NAME="Raspbian GNU/Linux" VERSION_ID="10" VERSION="10 (buster)" VERSION_CODENAME=buster 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="bba9e3185e150dd0995f9a49355b34fc6218d5a2" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="8aa57e3ae5b742ea1069404608336a9884ccfb4e" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 17 Sep 2024 05:01:09 PM CEST" VOLUMIO_VERSION="3.757" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="e0a6dc7e914e3fb93cbf2123f2f73eac"