-- Logs begin at Thu 2019-02-14 10:11:58 GMT, end at Sat 2025-12-20 18:22:42 GMT. -- Dec 20 18:21:00 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , setTestSystem Dec 20 18:21:00 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: updater_comm , checkUpdates Dec 20 18:21:00 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 20 18:21:00 volumio volumio-remote-updater[582]: PROGRESS: 0, STATUS: "Starting update", ETA: "6m" Dec 20 18:21:00 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: updater_comm , notifyProgress Dec 20 18:21:00 volumio volumio-remote-updater[582]: /bin/rm: cannot remove '/imgpart/rck*': No such file or directory Dec 20 18:21:00 volumio volumio-remote-updater[582]: /bin/rm: cannot remove '/imgpart/*.part': No such file or directory Dec 20 18:21:00 volumio volumio-remote-updater[582]: /bin/rm: cannot remove '/imgpart/*.zs-old': No such file or directory Dec 20 18:21:00 volumio volumio-remote-updater[582]: PROGRESS: 5, STATUS: "Preparing update", ETA: "5m" Dec 20 18:21:00 volumio volumio[1175]: info: Killing processes that might interfere with OTA Updates Dec 20 18:21:00 volumio sudo[29299]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/killall matchbox-keyboard Dec 20 18:21:00 volumio sudo[29299]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:00 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:00 volumio volumio[1175]: updateProgress Dec 20 18:21:00 volumio volumio[1175]: { Dec 20 18:21:00 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:00 volumio volumio[1175]: eta: '5m', Dec 20 18:21:00 volumio volumio[1175]: progress: 5, Dec 20 18:21:00 volumio volumio[1175]: status: 'Préparation de la mise à jour' Dec 20 18:21:00 volumio volumio[1175]: } Dec 20 18:21:00 volumio sudo[29299]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:00 volumio volumio[1175]: error: Cannot kill process: Error: Command failed: /usr/bin/sudo /usr/bin/killall matchbox-keyboard Dec 20 18:21:00 volumio volumio[1175]: matchbox-keyboard: no process found Dec 20 18:21:00 volumio sudo[29302]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/killall matchbox-window-manager Dec 20 18:21:00 volumio sudo[29302]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:00 volumio sudo[29302]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:00 volumio volumio[1175]: error: Cannot kill process: Error: Command failed: /usr/bin/sudo /usr/bin/killall matchbox-window-manager Dec 20 18:21:00 volumio volumio[1175]: matchbox-window-manager: no process found Dec 20 18:21:00 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled Dec 20 18:21:00 volumio volumio-remote-updater[582]: PROGRESS: 5, STATUS: "Preparing update", ETA: "5m" Dec 20 18:21:00 volumio volumio-remote-updater[582]: PROGRESS: 5, STATUS: "Preparing update", ETA: "5m" Dec 20 18:21:00 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:00 volumio volumio[1175]: updateProgress Dec 20 18:21:00 volumio volumio[1175]: { Dec 20 18:21:00 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:00 volumio volumio[1175]: eta: '5m', Dec 20 18:21:00 volumio volumio[1175]: progress: 5, Dec 20 18:21:00 volumio volumio[1175]: status: 'Préparation de la mise à jour' Dec 20 18:21:00 volumio volumio[1175]: } Dec 20 18:21:01 volumio sudo[29288]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:02 volumio volumio-remote-updater[582]: PROGRESS: 10, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:02 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:02 volumio volumio[1175]: updateProgress Dec 20 18:21:02 volumio volumio[1175]: { Dec 20 18:21:02 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:02 volumio volumio[1175]: eta: '5m', Dec 20 18:21:02 volumio volumio[1175]: progress: 10, Dec 20 18:21:02 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:02 volumio volumio[1175]: } Dec 20 18:21:02 volumio volumio-remote-updater[582]: PROGRESS: 10, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:02 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:02 volumio volumio[1175]: updateProgress Dec 20 18:21:02 volumio volumio[1175]: { Dec 20 18:21:02 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:02 volumio volumio[1175]: eta: '5m', Dec 20 18:21:02 volumio volumio[1175]: progress: 10, Dec 20 18:21:02 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:02 volumio volumio[1175]: } Dec 20 18:21:02 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:02 volumio volumio[1175]: updateProgress Dec 20 18:21:02 volumio volumio[1175]: { Dec 20 18:21:02 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:02 volumio volumio[1175]: eta: '5m', Dec 20 18:21:02 volumio volumio[1175]: progress: 10, Dec 20 18:21:02 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:02 volumio volumio[1175]: } Dec 20 18:21:02 volumio volumio-remote-updater[582]: PROGRESS: 10, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:02 volumio volumio-remote-updater[582]: PROGRESS: 10, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:02 volumio volumio-remote-updater[582]: PROGRESS: 10, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:02 volumio volumio-remote-updater[582]: PROGRESS: 10, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:02 volumio volumio-remote-updater[582]: PROGRESS: 10, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:02 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:02 volumio volumio[1175]: updateProgress Dec 20 18:21:02 volumio volumio[1175]: { Dec 20 18:21:02 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:02 volumio volumio[1175]: eta: '5m', Dec 20 18:21:02 volumio volumio[1175]: progress: 10, Dec 20 18:21:02 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:02 volumio volumio[1175]: } Dec 20 18:21:02 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:02 volumio volumio[1175]: updateProgress Dec 20 18:21:02 volumio volumio[1175]: { Dec 20 18:21:02 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:02 volumio volumio[1175]: eta: '5m', Dec 20 18:21:02 volumio volumio[1175]: progress: 10, Dec 20 18:21:02 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:02 volumio volumio[1175]: } Dec 20 18:21:02 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:02 volumio volumio[1175]: updateProgress Dec 20 18:21:02 volumio volumio[1175]: { Dec 20 18:21:02 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:02 volumio volumio[1175]: eta: '5m', Dec 20 18:21:02 volumio volumio[1175]: progress: 10, Dec 20 18:21:02 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:02 volumio volumio[1175]: } Dec 20 18:21:03 volumio volumio-remote-updater[582]: PROGRESS: 10, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:03 volumio volumio-remote-updater[582]: PROGRESS: 11, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:03 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:03 volumio volumio[1175]: updateProgress Dec 20 18:21:03 volumio volumio[1175]: { Dec 20 18:21:03 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:03 volumio volumio[1175]: eta: '5m', Dec 20 18:21:03 volumio volumio[1175]: progress: 11, Dec 20 18:21:03 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:03 volumio volumio[1175]: } Dec 20 18:21:03 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:03 volumio volumio[1175]: updateProgress Dec 20 18:21:03 volumio volumio[1175]: { Dec 20 18:21:03 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:03 volumio volumio[1175]: eta: '5m', Dec 20 18:21:03 volumio volumio[1175]: progress: 11, Dec 20 18:21:03 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:03 volumio volumio[1175]: } Dec 20 18:21:05 volumio volumio-remote-updater[582]: PROGRESS: 11, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:05 volumio volumio-remote-updater[582]: PROGRESS: 11, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:05 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:05 volumio volumio[1175]: updateProgress Dec 20 18:21:05 volumio volumio[1175]: { Dec 20 18:21:05 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:05 volumio volumio[1175]: eta: '5m', Dec 20 18:21:05 volumio volumio[1175]: progress: 11, Dec 20 18:21:05 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:05 volumio volumio[1175]: } Dec 20 18:21:05 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:05 volumio volumio[1175]: updateProgress Dec 20 18:21:05 volumio volumio[1175]: { Dec 20 18:21:05 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:05 volumio volumio[1175]: eta: '5m', Dec 20 18:21:05 volumio volumio[1175]: progress: 11, Dec 20 18:21:05 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:05 volumio volumio[1175]: } Dec 20 18:21:05 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 20 18:21:05 volumio volumio[1175]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Dec 20 18:21:05 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Dec 20 18:21:05 volumio volumio[1175]: info: Received Get System Version Dec 20 18:21:05 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Dec 20 18:21:05 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:05 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:05 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:05 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:05 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:05 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:06 volumio volumio-remote-updater[582]: PROGRESS: 11, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:06 volumio volumio-remote-updater[582]: PROGRESS: 13, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:06 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:06 volumio volumio[1175]: updateProgress Dec 20 18:21:06 volumio volumio[1175]: { Dec 20 18:21:06 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:06 volumio volumio[1175]: eta: '5m', Dec 20 18:21:06 volumio volumio[1175]: progress: 13, Dec 20 18:21:06 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:06 volumio volumio[1175]: } Dec 20 18:21:06 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:06 volumio volumio[1175]: updateProgress Dec 20 18:21:06 volumio volumio[1175]: { Dec 20 18:21:06 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:06 volumio volumio[1175]: eta: '5m', Dec 20 18:21:06 volumio volumio[1175]: progress: 13, Dec 20 18:21:06 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:06 volumio volumio[1175]: } Dec 20 18:21:07 volumio volumio-remote-updater[582]: PROGRESS: 13, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:07 volumio volumio-remote-updater[582]: PROGRESS: 13, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:07 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:07 volumio volumio[1175]: updateProgress Dec 20 18:21:07 volumio volumio[1175]: { Dec 20 18:21:07 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:07 volumio volumio[1175]: eta: '5m', Dec 20 18:21:07 volumio volumio[1175]: progress: 13, Dec 20 18:21:07 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:07 volumio volumio[1175]: } Dec 20 18:21:07 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:07 volumio volumio[1175]: updateProgress Dec 20 18:21:07 volumio volumio[1175]: { Dec 20 18:21:07 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:07 volumio volumio[1175]: eta: '5m', Dec 20 18:21:07 volumio volumio[1175]: progress: 13, Dec 20 18:21:07 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:07 volumio volumio[1175]: } Dec 20 18:21:08 volumio volumio-remote-updater[582]: PROGRESS: 13, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:08 volumio volumio-remote-updater[582]: PROGRESS: 13, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:08 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:08 volumio volumio[1175]: updateProgress Dec 20 18:21:08 volumio volumio[1175]: { Dec 20 18:21:08 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:08 volumio volumio[1175]: eta: '5m', Dec 20 18:21:08 volumio volumio[1175]: progress: 13, Dec 20 18:21:08 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:08 volumio volumio[1175]: } Dec 20 18:21:09 volumio volumio-remote-updater[582]: PROGRESS: 13, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:09 volumio volumio-remote-updater[582]: PROGRESS: 14, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:09 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:09 volumio volumio[1175]: updateProgress Dec 20 18:21:09 volumio volumio[1175]: { Dec 20 18:21:09 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:09 volumio volumio[1175]: eta: '5m', Dec 20 18:21:09 volumio volumio[1175]: progress: 14, Dec 20 18:21:09 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:09 volumio volumio[1175]: } Dec 20 18:21:10 volumio volumio-remote-updater[582]: PROGRESS: 14, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:10 volumio volumio-remote-updater[582]: PROGRESS: 14, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:10 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:10 volumio volumio[1175]: updateProgress Dec 20 18:21:10 volumio volumio[1175]: { Dec 20 18:21:10 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:10 volumio volumio[1175]: eta: '5m', Dec 20 18:21:10 volumio volumio[1175]: progress: 14, Dec 20 18:21:10 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:10 volumio volumio[1175]: } Dec 20 18:21:12 volumio volumio-remote-updater[582]: PROGRESS: 14, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:12 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:12 volumio volumio[1175]: updateProgress Dec 20 18:21:12 volumio volumio[1175]: { Dec 20 18:21:12 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:12 volumio volumio[1175]: eta: '5m', Dec 20 18:21:12 volumio volumio[1175]: progress: 14, Dec 20 18:21:12 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:12 volumio volumio[1175]: } Dec 20 18:21:14 volumio volumio-remote-updater[582]: PROGRESS: 14, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:14 volumio volumio-remote-updater[582]: PROGRESS: 16, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:14 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:14 volumio volumio[1175]: updateProgress Dec 20 18:21:14 volumio volumio[1175]: { Dec 20 18:21:14 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:14 volumio volumio[1175]: eta: '5m', Dec 20 18:21:14 volumio volumio[1175]: progress: 16, Dec 20 18:21:14 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:14 volumio volumio[1175]: } Dec 20 18:21:16 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , saveGeneralSettings Dec 20 18:21:16 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getAudioDevices Dec 20 18:21:17 volumio volumio-remote-updater[582]: PROGRESS: 16, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:17 volumio volumio-remote-updater[582]: PROGRESS: 16, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:17 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:21:17 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sOptions Dec 20 18:21:17 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 20 18:21:17 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Dec 20 18:21:17 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:17 volumio volumio[1175]: updateProgress Dec 20 18:21:17 volumio volumio[1175]: { Dec 20 18:21:17 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:17 volumio volumio[1175]: eta: '5m', Dec 20 18:21:17 volumio volumio[1175]: progress: 16, Dec 20 18:21:17 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:17 volumio volumio[1175]: } Dec 20 18:21:18 volumio volumio-remote-updater[582]: PROGRESS: 16, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:18 volumio volumio-remote-updater[582]: PROGRESS: 17, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:18 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:18 volumio volumio[1175]: updateProgress Dec 20 18:21:18 volumio volumio[1175]: { Dec 20 18:21:18 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:18 volumio volumio[1175]: eta: '5m', Dec 20 18:21:18 volumio volumio[1175]: progress: 17, Dec 20 18:21:18 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:18 volumio volumio[1175]: } Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , saveAlsaOptions Dec 20 18:21:19 volumio volumio[1175]: info: Preparing to save Alsa Options, stopping services first Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::volumioPause Dec 20 18:21:19 volumio volumio[1175]: info: CoreStateMachine::pause Dec 20 18:21:19 volumio volumio[1175]: info: Saving Audio Output to: {"i2s":true,"i2sid":{"label":"HiFiBerry Digi"},"output_device":{"value":1,"label":"HiFiBerry Digi"},"disallowPush":true} Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2SNumber Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2SAlsaName Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:21:19 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2SMixer Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:21:19 volumio volumio[1175]: info: Device 2 does not have any Mixer Control Available Dec 20 18:21:19 volumio volumio[1175]: info: QobuzConnect: setDeactiveState invoked Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:19 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::volumioUpdateVolumeSettings Dec 20 18:21:19 volumio volumio[1175]: info: Updating Volume Controller Parameters: Device: 2 Name: HiFiBerry Digi Mixer: Max Vol: 100 Vol Curve; logarithmic Vol Steps: 1 Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume Dec 20 18:21:19 volumio volumio[1175]: info: Disabling external Volume Control Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:21:19 volumio volumio[1175]: info: CoreStateMachine::pushState Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::volumioPushState Dec 20 18:21:19 volumio volumio[1175]: info: MRS: Pushing multiroomSync output update for this device Dec 20 18:21:19 volumio volumio[1175]: info: MRS: Pushing multiroomSync output Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:19 volumio volumio[1175]: info: Preparing to generate the ALSA configuration file Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworksScanCache Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworks Dec 20 18:21:19 volumio sudo[29382]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service Dec 20 18:21:19 volumio sudo[29382]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworksScanCache Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworks Dec 20 18:21:19 volumio sudo[29382]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:19 volumio sudo[29391]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Dec 20 18:21:19 volumio sudo[29391]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:19 volumio volumio[1175]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf Dec 20 18:21:19 volumio volumio[1175]: info: Reading ALSA contributions from plugins. Dec 20 18:21:19 volumio sudo[29400]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service Dec 20 18:21:19 volumio sudo[29400]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:19 volumio sudo[29404]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Dec 20 18:21:19 volumio sudo[29404]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:19 volumio qobuz-connect[29144]: 20251220 18:21:19.304 [29144.29144] INFO SampleApp: Stopping Local configuration server Dec 20 18:21:19 volumio sudo[29404]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:19 volumio systemd[1]: Stopping Volumio Qobuz Connect Service... Dec 20 18:21:19 volumio qobuz-connect[29144]: 20251220 18:21:19.315 [29144.29144] INFO SampleApp: shat down connection on UNIX socket Dec 20 18:21:19 volumio systemd[1]: qobuz-connect.service: Succeeded. Dec 20 18:21:19 volumio systemd[1]: Stopped Volumio Qobuz Connect Service. Dec 20 18:21:19 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sOptions Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Dec 20 18:21:19 volumio volumio[1175]: info: Getting Alsa Cards List without I2S DAC Dec 20 18:21:19 volumio volumio-remote-updater[582]: PROGRESS: 17, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:19 volumio volumio-remote-updater[582]: PROGRESS: 18, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:19 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2SNumber Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 20 18:21:19 volumio systemd[1]: Started Volumio Qobuz Connect Service. Dec 20 18:21:19 volumio sudo[29400]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:19 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:21:19 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: mpd , getPlaybackMode Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Dec 20 18:21:19 volumio volumio[1175]: ------------------------------------ BT MESSAGE: BT STATUS: running Dec 20 18:21:19 volumio volumio[1175]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Dec 20 18:21:19 volumio volumio[1175]: info: QobuzConnect: Qobuz Connect client [object Object] disconnected Dec 20 18:21:19 volumio volumio[1175]: info: QobuzConnect: setDeactiveState invoked Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:19 volumio volumio[1175]: error: An error occurred while scanning: Error: Command failed: sudo /sbin/iwlist wlan0 scan Dec 20 18:21:19 volumio volumio[1175]: wlan0 Interface doesn't support scanning : Device or resource busy Dec 20 18:21:19 volumio volumio[1175]: info: Cannot use regular scanning, forcing with ap-force Dec 20 18:21:19 volumio sudo[29434]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw dev wlan0 scan ap-force Dec 20 18:21:19 volumio sudo[29434]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:19 volumio sudo[29434]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:19 volumio volumio[1175]: command failed: Device or resource busy (-16) Dec 20 18:21:19 volumio volumio[1175]: error: Cannot use fallback scanning method: Error: Command failed: /usr/bin/sudo /sbin/iw dev wlan0 scan ap-force Dec 20 18:21:19 volumio volumio[1175]: command failed: Device or resource busy (-16) Dec 20 18:21:19 volumio volumio[1175]: info: Executing endpoint qc_getconfig Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: qobuzconnect , onGetConfig Dec 20 18:21:19 volumio qobuz-connect[29424]: 20251220 18:21:19.549 [29424.29424] INFO SampleApp: Started connection to /tmp/qbz-connect.socket UNIX socket Dec 20 18:21:19 volumio volumio[1175]: info: QobuzConnect: Qobuz Connect socket /tmp/qbz-connect.socket connected to client [object Object] Dec 20 18:21:19 volumio volumio[1175]: info: QobuzConnect: QOBUZ Connect daemon connected Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:19 volumio volumio[1175]: updateProgress Dec 20 18:21:19 volumio qobuz-connect[29424]: 20251220 18:21:19.553 [29424.29424] INFO VolumeManager: [0xe58bc8]: Setting new playback volume: 75 Dec 20 18:21:19 volumio qobuz-connect[29424]: 20251220 18:21:19.553 [29424.29424] INFO VolumeManager: [0xe58bc8]: Setting new mute state: 0 Dec 20 18:21:19 volumio qobuz-connect[29424]: 20251220 18:21:19.553 [29424.29424] INFO QobuzConnect: [0xe59598]: Client initialized! Dec 20 18:21:19 volumio qobuz-connect[29424]: 20251220 18:21:19.553 [29424.29424] INFO SampleApp: Starting Avahi advertising, name: Volumio, service name: _qobuz-connect._tcp Dec 20 18:21:19 volumio volumio[1175]: { Dec 20 18:21:19 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:19 volumio volumio[1175]: eta: '5m', Dec 20 18:21:19 volumio volumio[1175]: progress: 18, Dec 20 18:21:19 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:19 volumio volumio[1175]: } Dec 20 18:21:19 volumio volumio[1175]: info: Asound.conf file unchanged, so no further update is needed Dec 20 18:21:19 volumio volumio[1175]: info: Output device has changed, restarting MPD Dec 20 18:21:19 volumio qobuz-connect[29424]: 20251220 18:21:19.560 [29424.29424] INFO LocalConfigManager: [0xe584a8]: Starting Local Configuration server Dec 20 18:21:19 volumio qobuz-connect[29424]: 20251220 18:21:19.560 [29424.29424] INFO SampleApp: Starting Local configuration server Dec 20 18:21:19 volumio qobuz-connect[29424]: 20251220 18:21:19.560 [29424.29424] INFO SampleApp: Connected to UNIX socket client 0xe4df60 Dec 20 18:21:19 volumio sudo[29441]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Dec 20 18:21:19 volumio sudo[29441]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:19 volumio volumio[1175]: info: Output device has changed, restarting Shairport Sync Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 20 18:21:19 volumio sudo[29441]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:19 volumio sudo[29444]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Dec 20 18:21:19 volumio sudo[29444]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:19 volumio systemd[1]: Stopping Music Player Daemon... Dec 20 18:21:19 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:21:19 volumio volumio[1175]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Dec 20 18:21:19 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:21:19 volumio volumio[1175]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 20 18:21:19 volumio systemd[1]: mpd.service: Succeeded. Dec 20 18:21:19 volumio systemd[1]: Stopped Music Player Daemon. Dec 20 18:21:19 volumio volumio[1175]: info: QobuzConnect: setDeactiveState invoked Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: updater_comm , clearUpdateSchedule Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 20 18:21:19 volumio volumio[1175]: ------------------------------------ BT MESSAGE: BT STATUS: running Dec 20 18:21:19 volumio volumio[1175]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Dec 20 18:21:19 volumio systemd[1]: Starting Music Player Daemon... Dec 20 18:21:19 volumio volumio[1175]: info: MPD Permissions set Dec 20 18:21:19 volumio sudo[29456]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service Dec 20 18:21:19 volumio sudo[29456]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:19 volumio volumio[1175]: ------------------------------------ BT MESSAGE: BT STATUS: running Dec 20 18:21:19 volumio qobuz-connect[29424]: 20251220 18:21:19.701 [29424.29424] INFO SampleApp: Playback volume changed: 75 Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 20 18:21:19 volumio sudo[29456]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:19 volumio sudo[29459]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service Dec 20 18:21:19 volumio volumio[1175]: info: Starting Shairport Sync Dec 20 18:21:19 volumio sudo[29459]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:19 volumio systemd[1]: Stopping Volumio Qobuz Connect Service... Dec 20 18:21:19 volumio qobuz-connect[29424]: 20251220 18:21:19.752 [29424.29424] INFO SampleApp: Stopping Local configuration server Dec 20 18:21:19 volumio volumio[1175]: ------------------------------------ BT MESSAGE: BT STATUS: running Dec 20 18:21:19 volumio sudo[29450]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Dec 20 18:21:19 volumio sudo[29450]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:19 volumio qobuz-connect[29424]: 20251220 18:21:19.762 [29424.29424] INFO SampleApp: shat down connection on UNIX socket Dec 20 18:21:19 volumio sudo[29450]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:19 volumio volumio[1175]: info: QobuzConnect: Qobuz Connect client [object Object] disconnected Dec 20 18:21:19 volumio volumio[1175]: info: QobuzConnect: setDeactiveState invoked Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:19 volumio sudo[29465]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Dec 20 18:21:19 volumio sudo[29465]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:19 volumio systemd[1]: qobuz-connect.service: Succeeded. Dec 20 18:21:19 volumio systemd[1]: Stopped Volumio Qobuz Connect Service. Dec 20 18:21:19 volumio volumio[1175]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Dec 20 18:21:19 volumio systemd[1]: Started Volumio Qobuz Connect Service. Dec 20 18:21:19 volumio sudo[29459]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:19 volumio systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Dec 20 18:21:19 volumio systemd[1]: shairport-sync.service: Succeeded. Dec 20 18:21:19 volumio systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Dec 20 18:21:19 volumio systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Dec 20 18:21:19 volumio volumio[1175]: ------------------------------------ BT MESSAGE: BT STATUS: running Dec 20 18:21:19 volumio volumio[1175]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Dec 20 18:21:19 volumio sudo[29465]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled Dec 20 18:21:19 volumio volumio[1175]: info: Shairport-Sync Started Dec 20 18:21:19 volumio volumio[1175]: info: Executing endpoint qc_getconfig Dec 20 18:21:19 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: qobuzconnect , onGetConfig Dec 20 18:21:19 volumio qobuz-connect[29469]: 20251220 18:21:19.863 [29469.29469] INFO SampleApp: Started connection to /tmp/qbz-connect.socket UNIX socket Dec 20 18:21:19 volumio volumio[1175]: info: QobuzConnect: Qobuz Connect socket /tmp/qbz-connect.socket connected to client [object Object] Dec 20 18:21:19 volumio volumio[1175]: info: QobuzConnect: QOBUZ Connect daemon connected Dec 20 18:21:19 volumio qobuz-connect[29469]: 20251220 18:21:19.869 [29469.29469] INFO VolumeManager: [0x96cbc8]: Setting new playback volume: 75 Dec 20 18:21:19 volumio qobuz-connect[29469]: 20251220 18:21:19.869 [29469.29469] INFO VolumeManager: [0x96cbc8]: Setting new mute state: 0 Dec 20 18:21:19 volumio qobuz-connect[29469]: 20251220 18:21:19.869 [29469.29469] INFO QobuzConnect: [0x96d598]: Client initialized! Dec 20 18:21:19 volumio qobuz-connect[29469]: 20251220 18:21:19.869 [29469.29469] INFO SampleApp: Starting Avahi advertising, name: Volumio, service name: _qobuz-connect._tcp Dec 20 18:21:19 volumio qobuz-connect[29469]: 20251220 18:21:19.877 [29469.29469] INFO LocalConfigManager: [0x96c4a8]: Starting Local Configuration server Dec 20 18:21:19 volumio qobuz-connect[29469]: 20251220 18:21:19.877 [29469.29469] INFO SampleApp: Starting Local configuration server Dec 20 18:21:19 volumio qobuz-connect[29469]: 20251220 18:21:19.878 [29469.29469] INFO SampleApp: Connected to UNIX socket client 0x961f60 Dec 20 18:21:20 volumio qobuz-connect[29469]: 20251220 18:21:20.012 [29469.29469] INFO SampleApp: Playback volume changed: 75 Dec 20 18:21:20 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:20 volumio mpd[29467]: Dec 20 18:21 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Dec 20 18:21:20 volumio systemd[1]: Started Music Player Daemon. Dec 20 18:21:20 volumio sudo[29444]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:20 volumio volumio[1175]: error: updateQueue error: null Dec 20 18:21:21 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:21:21 volumio volumio[1175]: info: Retrieving Cloud Streaming UI Dec 20 18:21:21 volumio volumio[1175]: info: Getting Tidal Cloud Configuration Dec 20 18:21:21 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:21:21 volumio volumio[1175]: info: Getting Qobuz Cloud Configuration Dec 20 18:21:21 volumio volumio[1175]: info: Asking plugin for UI Config Dec 20 18:21:21 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:21:21 volumio volumio[1175]: info: Getting Spotify Cloud Configuration Dec 20 18:21:21 volumio volumio[1175]: info: Asking plugin for UI Config Dec 20 18:21:21 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:21:21 volumio volumio[1175]: info: Saving Spotify Acccount Dec 20 18:21:21 volumio volumio[1175]: info: Got it Dec 20 18:21:21 volumio volumio[1175]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Dec 20 18:21:21 volumio volumio[1175]: info: Got Tidal Cloud Configuration Dec 20 18:21:21 volumio volumio[1175]: info: Got it Dec 20 18:21:21 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:21:21 volumio volumio-remote-updater[582]: PROGRESS: 18, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:21 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:21 volumio volumio[1175]: updateProgress Dec 20 18:21:21 volumio volumio[1175]: { Dec 20 18:21:21 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:21 volumio volumio[1175]: eta: '5m', Dec 20 18:21:21 volumio volumio[1175]: progress: 18, Dec 20 18:21:21 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:21 volumio volumio[1175]: } Dec 20 18:21:21 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:21 volumio volumio[1175]: updateProgress Dec 20 18:21:21 volumio volumio[1175]: { Dec 20 18:21:21 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:21 volumio volumio[1175]: eta: '5m', Dec 20 18:21:21 volumio volumio[1175]: progress: 18, Dec 20 18:21:21 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:21 volumio volumio[1175]: } Dec 20 18:21:22 volumio volumio-remote-updater[582]: PROGRESS: 18, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:22 volumio volumio-remote-updater[582]: PROGRESS: 19, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:22 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:22 volumio volumio[1175]: updateProgress Dec 20 18:21:22 volumio volumio[1175]: { Dec 20 18:21:22 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:22 volumio volumio[1175]: eta: '5m', Dec 20 18:21:22 volumio volumio[1175]: progress: 19, Dec 20 18:21:22 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:22 volumio volumio[1175]: } Dec 20 18:21:22 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:22 volumio volumio[1175]: updateProgress Dec 20 18:21:22 volumio volumio[1175]: { Dec 20 18:21:22 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:22 volumio volumio[1175]: eta: '5m', Dec 20 18:21:22 volumio volumio[1175]: progress: 19, Dec 20 18:21:22 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:22 volumio volumio[1175]: } Dec 20 18:21:23 volumio sudo[29391]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:23 volumio volumio[1175]: info: CoreCommandRouter::volumioRetrieveVolumeLevels Dec 20 18:21:23 volumio volumio[1175]: info: CoreStateMachine::getcurrentVolume Dec 20 18:21:23 volumio volumio[1175]: info: CoreCommandRouter::volumioRetrievevolume Dec 20 18:21:23 volumio volumio[1175]: info: CoreStateMachine::pushState Dec 20 18:21:23 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Dec 20 18:21:23 volumio volumio[1175]: info: CoreCommandRouter::volumioPushState Dec 20 18:21:23 volumio volumio[1175]: info: MRS: Pushing multiroomSync output update for this device Dec 20 18:21:23 volumio volumio[1175]: info: MRS: Pushing multiroomSync output Dec 20 18:21:23 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:23 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: wizard , getDonation Dec 20 18:21:23 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , detectVolumioHardware Dec 20 18:21:23 volumio volumio-remote-updater[582]: PROGRESS: 19, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:23 volumio volumio-remote-updater[582]: PROGRESS: 19, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:25 volumio volumio-remote-updater[582]: PROGRESS: 19, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:25 volumio volumio-remote-updater[582]: PROGRESS: 19, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:25 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:21:25 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: wizard , getDonationsArray Dec 20 18:21:25 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: wizard , getDoneMessage Dec 20 18:21:25 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , detectVolumioHardware Dec 20 18:21:25 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:21:25 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: updater_comm , clearUpdateSchedule Dec 20 18:21:25 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 20 18:21:25 volumio volumio[1175]: verbose: New Socket.io Connection to 192.168.1.26 from 192.168.1.23 UA: Mozilla/5.0 (Linux; Android 10; K) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/143.0.0.0 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 7 Dec 20 18:21:25 volumio volumio[1175]: verbose: New Socket.io Connection to 192.168.1.26 from 192.168.1.23 UA: Mozilla/5.0 (Linux; Android 10; K) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/143.0.0.0 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 8 Dec 20 18:21:25 volumio sudo[29503]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd_monitor.service Dec 20 18:21:25 volumio sudo[29503]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:25 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:25 volumio volumio[1175]: updateProgress Dec 20 18:21:25 volumio volumio[1175]: { Dec 20 18:21:25 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:25 volumio volumio[1175]: eta: '5m', Dec 20 18:21:25 volumio volumio[1175]: progress: 19, Dec 20 18:21:25 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:25 volumio volumio[1175]: } Dec 20 18:21:25 volumio systemd[1]: Stopping MPD Monitor Service... Dec 20 18:21:25 volumio systemd[1]: mpd_monitor.service: Main process exited, code=killed, status=15/TERM Dec 20 18:21:25 volumio systemd[1]: mpd_monitor.service: Succeeded. Dec 20 18:21:25 volumio systemd[1]: Stopped MPD Monitor Service. Dec 20 18:21:25 volumio volumio[1175]: ------------------------------------ BT MESSAGE: BT STATUS: running Dec 20 18:21:25 volumio volumio[1175]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Dec 20 18:21:25 volumio systemd[1]: Started MPD Monitor Service. Dec 20 18:21:25 volumio sudo[29503]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:25 volumio mpd_monitor.sh[29505]: MPD Monitor Service: Starting MPD Monitor Service Dec 20 18:21:25 volumio volumio[1175]: info: Successfully started MPD Monitor Dec 20 18:21:25 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled Dec 20 18:21:25 volumio volumio[1175]: verbose: New Socket.io Connection to 192.168.1.26 from 192.168.1.23 UA: Mozilla/5.0 (Linux; Android 10; K) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/143.0.0.0 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 9 Dec 20 18:21:26 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:26 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::volumioGetVisibleSources Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::volumioGetQueue Dec 20 18:21:26 volumio volumio[1175]: info: CoreStateMachine::getQueue Dec 20 18:21:26 volumio volumio[1175]: info: CorePlayQueue::getQueue Dec 20 18:21:26 volumio volumio[1175]: info: Listing playlists Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Dec 20 18:21:26 volumio volumio[1175]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom Dec 20 18:21:26 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:26 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Dec 20 18:21:26 volumio volumio-remote-updater[582]: PROGRESS: 19, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:26 volumio volumio-remote-updater[582]: PROGRESS: 21, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:26 volumio volumio[1175]: updateProgress Dec 20 18:21:26 volumio volumio[1175]: { Dec 20 18:21:26 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:26 volumio volumio[1175]: eta: '5m', Dec 20 18:21:26 volumio volumio[1175]: progress: 21, Dec 20 18:21:26 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:26 volumio volumio[1175]: } Dec 20 18:21:26 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:26 volumio volumio[1175]: updateProgress Dec 20 18:21:26 volumio volumio[1175]: { Dec 20 18:21:26 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:26 volumio volumio[1175]: eta: '5m', Dec 20 18:21:26 volumio volumio[1175]: progress: 21, Dec 20 18:21:26 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:26 volumio volumio[1175]: } Dec 20 18:21:28 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: updater_comm , clearUpdateSchedule Dec 20 18:21:28 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 20 18:21:28 volumio systemd[1]: systemd-timedated.service: Succeeded. Dec 20 18:21:28 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled Dec 20 18:21:28 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: wizard , setWizardAction Dec 20 18:21:28 volumio volumio[1175]: info: CoreCommandRouter::Reload Ui Dec 20 18:21:28 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , setShowWizard Dec 20 18:21:28 volumio volumio[1175]: info: Wizard terminated Successfully Dec 20 18:21:28 volumio volumio[1175]: info: CoreCommandRouter::volumiosetStartupVolume Dec 20 18:21:28 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 20 18:21:30 volumio volumio-remote-updater[582]: PROGRESS: 21, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:30 volumio volumio-remote-updater[582]: PROGRESS: 21, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:30 volumio volumio[1175]: updateProgress Dec 20 18:21:30 volumio volumio[1175]: { Dec 20 18:21:30 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:30 volumio volumio[1175]: eta: '5m', Dec 20 18:21:30 volumio volumio[1175]: progress: 21, Dec 20 18:21:30 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:30 volumio volumio[1175]: } Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:30 volumio volumio[1175]: updateProgress Dec 20 18:21:30 volumio volumio[1175]: { Dec 20 18:21:30 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:30 volumio volumio[1175]: eta: '5m', Dec 20 18:21:30 volumio volumio[1175]: progress: 21, Dec 20 18:21:30 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:30 volumio volumio[1175]: } Dec 20 18:21:30 volumio sudo[29514]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 20 18:21:30 volumio sudo[29512]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 20 18:21:30 volumio sudo[29512]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:30 volumio sudo[29514]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:30 volumio sudo[29512]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:30 volumio sudo[29514]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:30 volumio sudo[29519]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 20 18:21:30 volumio sudo[29519]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:30 volumio sudo[29519]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:30 volumio sudo[29522]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 20 18:21:30 volumio sudo[29522]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:30 volumio sudo[29522]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:30 volumio sudo[29525]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 20 18:21:30 volumio sudo[29525]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:30 volumio volumio[1175]: verbose: New Socket.io Connection to 192.168.1.26 from 192.168.1.51 UA: Mozilla/5.0 (X11; Linux x86_64; rv:140.0) Gecko/20100101 Firefox/140.0 Engine version: 3 Transport: polling Total Clients: 6 Dec 20 18:21:30 volumio sudo[29525]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:30 volumio sudo[29528]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 20 18:21:30 volumio sudo[29528]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:30 volumio sudo[29528]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:30 volumio volumio[1175]: verbose: New Socket.io Connection to 192.168.1.26 from 192.168.1.23 UA: Mozilla/5.0 (Linux; Android 10; K) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/143.0.0.0 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 7 Dec 20 18:21:30 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:30 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::volumioGetVisibleSources Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::volumioGetQueue Dec 20 18:21:30 volumio volumio[1175]: info: CoreStateMachine::getQueue Dec 20 18:21:30 volumio volumio[1175]: info: CorePlayQueue::getQueue Dec 20 18:21:30 volumio volumio[1175]: info: Listing playlists Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Dec 20 18:21:30 volumio volumio[1175]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom Dec 20 18:21:30 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:30 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:30 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Dec 20 18:21:31 volumio volumio-remote-updater[582]: PROGRESS: 21, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:31 volumio volumio-remote-updater[582]: PROGRESS: 22, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:31 volumio volumio-remote-updater[582]: PROGRESS: 22, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:31 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:31 volumio volumio[1175]: updateProgress Dec 20 18:21:31 volumio volumio[1175]: { Dec 20 18:21:31 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:31 volumio volumio[1175]: eta: '5m', Dec 20 18:21:31 volumio volumio[1175]: progress: 22, Dec 20 18:21:31 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:31 volumio volumio[1175]: } Dec 20 18:21:31 volumio volumio[1175]: verbose: New Socket.io Connection to 192.168.1.26 from 192.168.1.51 UA: Mozilla/5.0 (X11; Linux x86_64; rv:140.0) Gecko/20100101 Firefox/140.0 Engine version: 3 Transport: polling Total Clients: 8 Dec 20 18:21:31 volumio sudo[29532]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 20 18:21:31 volumio sudo[29532]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:31 volumio sudo[29532]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:31 volumio sudo[29535]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 20 18:21:31 volumio sudo[29535]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:31 volumio sudo[29535]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:31 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:21:31 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:31 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:31 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:31 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:31 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:31 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:32 volumio volumio[1175]: verbose: New Socket.io Connection to 192.168.1.26 from 192.168.1.51 UA: Mozilla/5.0 (X11; Linux x86_64; rv:140.0) Gecko/20100101 Firefox/140.0 Engine version: 3 Transport: polling Total Clients: 9 Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::volumioGetVisibleSources Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Dec 20 18:21:32 volumio volumio[1175]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom Dec 20 18:21:32 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:32 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:32 volumio volumio[1175]: info: Listing playlists Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Dec 20 18:21:32 volumio volumio-remote-updater[582]: PROGRESS: 22, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:32 volumio volumio-remote-updater[582]: PROGRESS: 23, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:32 volumio volumio-remote-updater[582]: PROGRESS: 23, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:32 volumio volumio[1175]: updateProgress Dec 20 18:21:32 volumio volumio[1175]: { Dec 20 18:21:32 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:32 volumio volumio[1175]: eta: '5m', Dec 20 18:21:32 volumio volumio[1175]: progress: 23, Dec 20 18:21:32 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:32 volumio volumio[1175]: } Dec 20 18:21:32 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:32 volumio volumio[1175]: updateProgress Dec 20 18:21:32 volumio volumio[1175]: { Dec 20 18:21:32 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:32 volumio volumio[1175]: eta: '5m', Dec 20 18:21:32 volumio volumio[1175]: progress: 23, Dec 20 18:21:32 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:32 volumio volumio[1175]: } Dec 20 18:21:32 volumio sudo[29538]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 20 18:21:32 volumio sudo[29538]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:32 volumio sudo[29538]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:32 volumio sudo[29541]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 20 18:21:32 volumio sudo[29541]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:21:32 volumio sudo[29541]: pam_unix(sudo:session): session closed for user root Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:21:33 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:33 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:21:33 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:33 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:33 volumio volumio[1175]: verbose: New Socket.io Connection to 192.168.1.26 from 192.168.1.51 UA: Mozilla/5.0 (X11; Linux x86_64; rv:140.0) Gecko/20100101 Firefox/140.0 Engine version: 3 Transport: polling Total Clients: 10 Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::volumioGetVisibleSources Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Dec 20 18:21:33 volumio volumio[1175]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom Dec 20 18:21:33 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:33 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:33 volumio volumio[1175]: info: Listing playlists Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Dec 20 18:21:33 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 20 18:21:34 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Dec 20 18:21:34 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Dec 20 18:21:34 volumio volumio-remote-updater[582]: PROGRESS: 23, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:34 volumio volumio-remote-updater[582]: PROGRESS: 23, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:35 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:35 volumio volumio[1175]: updateProgress Dec 20 18:21:35 volumio volumio[1175]: { Dec 20 18:21:35 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:35 volumio volumio[1175]: eta: '5m', Dec 20 18:21:35 volumio volumio[1175]: progress: 23, Dec 20 18:21:35 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:35 volumio volumio[1175]: } Dec 20 18:21:35 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:35 volumio volumio[1175]: updateProgress Dec 20 18:21:35 volumio volumio[1175]: { Dec 20 18:21:35 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:35 volumio volumio[1175]: eta: '5m', Dec 20 18:21:35 volumio volumio[1175]: progress: 23, Dec 20 18:21:35 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:35 volumio volumio[1175]: } Dec 20 18:21:35 volumio volumio[1175]: info: Executing endpoint metavolumio Dec 20 18:21:35 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Dec 20 18:21:35 volumio volumio[1175]: info: Executing endpoint metavolumio Dec 20 18:21:35 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Dec 20 18:21:35 volumio volumio[1175]: info: Executing endpoint metavolumio Dec 20 18:21:35 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Dec 20 18:21:35 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:21:35 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:35 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:35 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:35 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:35 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:35 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:35 volumio volumio-remote-updater[582]: PROGRESS: 23, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:35 volumio volumio-remote-updater[582]: PROGRESS: 25, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:35 volumio volumio-remote-updater[582]: PROGRESS: 25, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:35 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:35 volumio volumio[1175]: updateProgress Dec 20 18:21:35 volumio volumio[1175]: { Dec 20 18:21:35 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:35 volumio volumio[1175]: eta: '5m', Dec 20 18:21:35 volumio volumio[1175]: progress: 25, Dec 20 18:21:35 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:35 volumio volumio[1175]: } Dec 20 18:21:35 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:35 volumio volumio[1175]: updateProgress Dec 20 18:21:35 volumio volumio[1175]: { Dec 20 18:21:35 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:35 volumio volumio[1175]: eta: '5m', Dec 20 18:21:35 volumio volumio[1175]: progress: 25, Dec 20 18:21:35 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:35 volumio volumio[1175]: } Dec 20 18:21:38 volumio volumio-remote-updater[582]: PROGRESS: 25, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:38 volumio volumio-remote-updater[582]: PROGRESS: 25, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:38 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:38 volumio volumio[1175]: updateProgress Dec 20 18:21:38 volumio volumio[1175]: { Dec 20 18:21:38 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:38 volumio volumio[1175]: eta: '5m', Dec 20 18:21:38 volumio volumio[1175]: progress: 25, Dec 20 18:21:38 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:38 volumio volumio[1175]: } Dec 20 18:21:38 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:38 volumio volumio[1175]: updateProgress Dec 20 18:21:38 volumio volumio-remote-updater[582]: PROGRESS: 25, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:38 volumio volumio[1175]: { Dec 20 18:21:38 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:38 volumio volumio[1175]: eta: '5m', Dec 20 18:21:38 volumio volumio[1175]: progress: 25, Dec 20 18:21:38 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:38 volumio volumio[1175]: } Dec 20 18:21:38 volumio volumio-remote-updater[582]: PROGRESS: 25, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:38 volumio volumio-remote-updater[582]: PROGRESS: 25, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:38 volumio volumio-remote-updater[582]: PROGRESS: 25, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:38 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:38 volumio volumio[1175]: updateProgress Dec 20 18:21:38 volumio volumio[1175]: { Dec 20 18:21:38 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:38 volumio volumio[1175]: eta: '5m', Dec 20 18:21:38 volumio volumio[1175]: progress: 25, Dec 20 18:21:38 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:38 volumio volumio[1175]: } Dec 20 18:21:39 volumio volumio-remote-updater[582]: PROGRESS: 25, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:39 volumio volumio-remote-updater[582]: PROGRESS: 30, STATUS: "Creating backup", ETA: "5m" Dec 20 18:21:39 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:39 volumio volumio[1175]: updateProgress Dec 20 18:21:39 volumio volumio[1175]: { Dec 20 18:21:39 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:39 volumio volumio[1175]: eta: '5m', Dec 20 18:21:39 volumio volumio[1175]: progress: 30, Dec 20 18:21:39 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:39 volumio volumio[1175]: } Dec 20 18:21:39 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:39 volumio volumio[1175]: updateProgress Dec 20 18:21:39 volumio volumio[1175]: { Dec 20 18:21:39 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:39 volumio volumio[1175]: eta: '5m', Dec 20 18:21:39 volumio volumio[1175]: progress: 30, Dec 20 18:21:39 volumio volumio[1175]: status: "Création d'une sauvegarde" Dec 20 18:21:39 volumio volumio[1175]: } Dec 20 18:21:39 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: wizard , setOnboardingWizardFalse Dec 20 18:21:40 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:21:40 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Dec 20 18:21:40 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Dec 20 18:21:41 volumio volumio[1175]: info: CoreCommandRouter::volumioNext Dec 20 18:21:41 volumio volumio[1175]: info: CoreStateMachine::next Dec 20 18:21:41 volumio volumio[1175]: info: ControllerMpd::next Dec 20 18:21:41 volumio volumio[1175]: verbose: ControllerMpd::sendMpdCommand next Dec 20 18:21:42 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Dec 20 18:21:42 volumio volumio[1175]: info: CoreCommandRouter::volumioPlay Dec 20 18:21:42 volumio volumio[1175]: info: CoreStateMachine::play index undefined Dec 20 18:21:42 volumio volumio[1175]: info: CoreStateMachine::setConsumeUpdateService undefined Dec 20 18:21:42 volumio volumio[1175]: info: CorePlayQueue::getTrack 6 Dec 20 18:21:42 volumio volumio[1175]: info: CoreStateMachine::startPlaybackTimer Dec 20 18:21:42 volumio volumio[1175]: info: CorePlayQueue::getTrack 6 Dec 20 18:21:42 volumio volumio[1175]: info: [1766254902508] ControllerQobuz::resume Dec 20 18:21:42 volumio volumio[1175]: info: CoreStateMachine::setConsumeUpdateService mpd Dec 20 18:21:42 volumio volumio[1175]: info: ControllerMpd::resume Dec 20 18:21:42 volumio volumio[1175]: verbose: ControllerMpd::sendMpdCommand play Dec 20 18:21:42 volumio volumio[1175]: info: sendMpdCommand play took 1 milliseconds Dec 20 18:21:43 volumio volumio-remote-updater[582]: PROGRESS: 30, STATUS: "Downloading new update", ETA: "4m" Dec 20 18:21:43 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:21:43 volumio volumio[1175]: updateProgress Dec 20 18:21:43 volumio volumio[1175]: { Dec 20 18:21:43 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:21:43 volumio volumio[1175]: eta: '4m', Dec 20 18:21:43 volumio volumio[1175]: progress: 30, Dec 20 18:21:43 volumio volumio[1175]: status: 'Téléchargement de la mise à jour' Dec 20 18:21:43 volumio volumio[1175]: } Dec 20 18:21:44 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:44 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:44 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:44 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:44 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:44 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:44 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:44 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken Dec 20 18:21:44 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Dec 20 18:21:45 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Dec 20 18:21:47 volumio volumio[1175]: info: CoreCommandRouter::volumioPlay Dec 20 18:21:47 volumio volumio[1175]: info: CoreStateMachine::play index undefined Dec 20 18:21:47 volumio volumio[1175]: info: CoreStateMachine::setConsumeUpdateService undefined Dec 20 18:21:47 volumio volumio[1175]: info: CorePlayQueue::getTrack 6 Dec 20 18:21:47 volumio volumio[1175]: info: CoreStateMachine::startPlaybackTimer Dec 20 18:21:47 volumio volumio[1175]: info: CorePlayQueue::getTrack 6 Dec 20 18:21:47 volumio volumio[1175]: info: [1766254907020] ControllerQobuz::resume Dec 20 18:21:47 volumio volumio[1175]: info: CoreStateMachine::setConsumeUpdateService mpd Dec 20 18:21:47 volumio volumio[1175]: info: ControllerMpd::resume Dec 20 18:21:47 volumio volumio[1175]: verbose: ControllerMpd::sendMpdCommand play Dec 20 18:21:47 volumio volumio[1175]: info: sendMpdCommand play took 1 milliseconds Dec 20 18:21:47 volumio volumio[1175]: info: Executing endpoint metavolumio Dec 20 18:21:47 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Dec 20 18:21:47 volumio volumio[1175]: info: Executing endpoint metavolumio Dec 20 18:21:47 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Dec 20 18:21:47 volumio volumio[1175]: info: Executing endpoint metavolumio Dec 20 18:21:47 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Dec 20 18:21:48 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 20 18:21:48 volumio volumio[1175]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Dec 20 18:21:48 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Dec 20 18:21:48 volumio volumio[1175]: info: Received Get System Version Dec 20 18:21:48 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Dec 20 18:21:48 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:48 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:48 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:48 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:48 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:48 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:49 volumio volumio[1175]: info: CoreCommandRouter::volumioPlay Dec 20 18:21:49 volumio volumio[1175]: info: CoreStateMachine::play index undefined Dec 20 18:21:49 volumio volumio[1175]: info: CoreStateMachine::setConsumeUpdateService undefined Dec 20 18:21:49 volumio volumio[1175]: info: CorePlayQueue::getTrack 6 Dec 20 18:21:49 volumio volumio[1175]: info: CoreStateMachine::startPlaybackTimer Dec 20 18:21:49 volumio volumio[1175]: info: CorePlayQueue::getTrack 6 Dec 20 18:21:49 volumio volumio[1175]: info: [1766254909116] ControllerQobuz::resume Dec 20 18:21:49 volumio volumio[1175]: info: CoreStateMachine::setConsumeUpdateService mpd Dec 20 18:21:49 volumio volumio[1175]: info: ControllerMpd::resume Dec 20 18:21:49 volumio volumio[1175]: verbose: ControllerMpd::sendMpdCommand play Dec 20 18:21:49 volumio volumio[1175]: info: sendMpdCommand play took 1 milliseconds Dec 20 18:21:49 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:21:49 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 20 18:21:49 volumio volumio[1175]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Dec 20 18:21:49 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Dec 20 18:21:49 volumio volumio[1175]: info: Received Get System Version Dec 20 18:21:49 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Dec 20 18:21:49 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:49 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:49 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:49 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:49 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:49 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:51 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:51 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:51 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:51 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:51 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:51 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:52 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:21:52 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:52 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:52 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:52 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:52 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:52 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:53 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 20 18:21:54 volumio volumio[1175]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Dec 20 18:21:54 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Dec 20 18:21:54 volumio volumio[1175]: info: Received Get System Version Dec 20 18:21:54 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Dec 20 18:21:54 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:54 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:54 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:54 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:54 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:54 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:54 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:21:54 volumio volumio[1175]: info: Received Get System Info Dec 20 18:21:54 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:21:54 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:21:54 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:21:54 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:21:54 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:21:55 volumio volumio[1175]: info: CoreCommandRouter::volumioPlay Dec 20 18:21:55 volumio volumio[1175]: info: CoreStateMachine::play index undefined Dec 20 18:21:55 volumio volumio[1175]: info: CoreStateMachine::setConsumeUpdateService undefined Dec 20 18:21:55 volumio volumio[1175]: info: CorePlayQueue::getTrack 6 Dec 20 18:21:55 volumio volumio[1175]: info: CoreStateMachine::startPlaybackTimer Dec 20 18:21:55 volumio volumio[1175]: info: CorePlayQueue::getTrack 6 Dec 20 18:21:55 volumio volumio[1175]: info: [1766254915206] ControllerQobuz::resume Dec 20 18:21:55 volumio volumio[1175]: info: CoreStateMachine::setConsumeUpdateService mpd Dec 20 18:21:55 volumio volumio[1175]: info: ControllerMpd::resume Dec 20 18:21:55 volumio volumio[1175]: verbose: ControllerMpd::sendMpdCommand play Dec 20 18:21:55 volumio volumio[1175]: info: sendMpdCommand play took 0 milliseconds Dec 20 18:22:02 volumio sudo[29620]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 20 18:22:02 volumio sudo[29621]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 20 18:22:02 volumio sudo[29621]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:02 volumio sudo[29620]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:02 volumio sudo[29620]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:02 volumio sudo[29621]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:03 volumio volumio[1175]: verbose: New Socket.io Connection to 192.168.1.26 from 192.168.1.51 UA: Mozilla/5.0 (X11; Linux x86_64; rv:140.0) Gecko/20100101 Firefox/140.0 Engine version: 3 Transport: polling Total Clients: 6 Dec 20 18:22:03 volumio sudo[29625]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 20 18:22:03 volumio sudo[29625]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:03 volumio sudo[29625]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:03 volumio sudo[29628]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 20 18:22:03 volumio sudo[29628]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:03 volumio sudo[29628]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:03 volumio volumio[1175]: verbose: New Socket.io Connection to 192.168.1.26 from 192.168.1.51 UA: Mozilla/5.0 (X11; Linux x86_64; rv:140.0) Gecko/20100101 Firefox/140.0 Engine version: 3 Transport: polling Total Clients: 7 Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::volumioGetVisibleSources Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Dec 20 18:22:04 volumio volumio[1175]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom Dec 20 18:22:04 volumio volumio[1175]: info: Received Get System Info Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:22:04 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:22:04 volumio volumio[1175]: info: Listing playlists Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Dec 20 18:22:04 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:22:05 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:22:05 volumio volumio[1175]: info: Received Get System Info Dec 20 18:22:05 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:22:05 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:22:05 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:22:05 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:22:05 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:22:05 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Dec 20 18:22:06 volumio volumio[1175]: info: CoreCommandRouter::volumioPlay Dec 20 18:22:06 volumio volumio[1175]: info: CoreStateMachine::play index undefined Dec 20 18:22:06 volumio volumio[1175]: info: CoreStateMachine::setConsumeUpdateService undefined Dec 20 18:22:06 volumio volumio[1175]: info: CorePlayQueue::getTrack 6 Dec 20 18:22:06 volumio volumio[1175]: info: CoreStateMachine::startPlaybackTimer Dec 20 18:22:06 volumio volumio[1175]: info: CorePlayQueue::getTrack 6 Dec 20 18:22:06 volumio volumio[1175]: info: [1766254926519] ControllerQobuz::resume Dec 20 18:22:06 volumio volumio[1175]: info: CoreStateMachine::setConsumeUpdateService mpd Dec 20 18:22:06 volumio volumio[1175]: info: ControllerMpd::resume Dec 20 18:22:06 volumio volumio[1175]: verbose: ControllerMpd::sendMpdCommand play Dec 20 18:22:06 volumio volumio[1175]: info: sendMpdCommand play took 1 milliseconds Dec 20 18:22:06 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:22:06 volumio volumio[1175]: info: Received Get System Info Dec 20 18:22:06 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:22:06 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:22:06 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:22:06 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:22:06 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:22:06 volumio volumio[1175]: info: Executing endpoint metavolumio Dec 20 18:22:06 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Dec 20 18:22:06 volumio volumio[1175]: info: Executing endpoint metavolumio Dec 20 18:22:06 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Dec 20 18:22:06 volumio volumio[1175]: info: Executing endpoint metavolumio Dec 20 18:22:06 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Dec 20 18:22:13 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Dec 20 18:22:21 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 20 18:22:21 volumio volumio[1175]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Dec 20 18:22:21 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Dec 20 18:22:21 volumio volumio[1175]: info: Received Get System Version Dec 20 18:22:21 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Dec 20 18:22:21 volumio volumio[1175]: info: Received Get System Info Dec 20 18:22:21 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:22:21 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:22:21 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:22:21 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:22:21 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:22:22 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:22 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam Dec 20 18:22:22 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam Dec 20 18:22:22 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam Dec 20 18:22:22 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , getAvailableUIs Dec 20 18:22:22 volumio volumio[1175]: info: Received Get System Version Dec 20 18:22:22 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Dec 20 18:22:32 volumio volumio[1175]: info: CoreCommandRouter::volumioPlay Dec 20 18:22:32 volumio volumio[1175]: info: CoreStateMachine::play index undefined Dec 20 18:22:32 volumio volumio[1175]: info: CoreStateMachine::setConsumeUpdateService undefined Dec 20 18:22:32 volumio volumio[1175]: info: CorePlayQueue::getTrack 6 Dec 20 18:22:32 volumio volumio[1175]: info: CoreStateMachine::startPlaybackTimer Dec 20 18:22:32 volumio volumio[1175]: info: CorePlayQueue::getTrack 6 Dec 20 18:22:32 volumio volumio[1175]: info: [1766254952174] ControllerQobuz::resume Dec 20 18:22:32 volumio volumio[1175]: info: CoreStateMachine::setConsumeUpdateService mpd Dec 20 18:22:32 volumio volumio[1175]: info: ControllerMpd::resume Dec 20 18:22:32 volumio volumio[1175]: verbose: ControllerMpd::sendMpdCommand play Dec 20 18:22:32 volumio volumio[1175]: info: sendMpdCommand play took 1 milliseconds Dec 20 18:22:35 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: wizard , openWizard Dec 20 18:22:35 volumio volumio[1175]: info: CoreCommandRouter::Reload Ui Dec 20 18:22:36 volumio sudo[29755]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 20 18:22:36 volumio sudo[29755]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:36 volumio sudo[29755]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:36 volumio sudo[29757]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 20 18:22:36 volumio sudo[29757]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:36 volumio sudo[29757]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:36 volumio sudo[29761]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 20 18:22:36 volumio sudo[29761]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:36 volumio sudo[29761]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:36 volumio sudo[29764]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 20 18:22:36 volumio sudo[29764]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:36 volumio sudo[29764]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:36 volumio volumio[1175]: verbose: New Socket.io Connection to 192.168.1.26 from 192.168.1.51 UA: Mozilla/5.0 (X11; Linux x86_64; rv:140.0) Gecko/20100101 Firefox/140.0 Engine version: 3 Transport: polling Total Clients: 4 Dec 20 18:22:37 volumio volumio-remote-updater[582]: zsync done Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::volumioGetVisibleSources Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: wizard , getWizardSteps Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , showActivationCode Dec 20 18:22:37 volumio volumio-remote-updater[582]: PROGRESS: 80, STATUS: "Downloading new update", ETA: "2m" Dec 20 18:22:37 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , getAvailableLanguages Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getAvailableTimezones Dec 20 18:22:37 volumio volumio[1175]: info: Received Get System Info Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:22:37 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:37 volumio volumio[1175]: info: Retrieving Cloud Streaming UI Dec 20 18:22:37 volumio volumio[1175]: info: Getting Tidal Cloud Configuration Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:37 volumio volumio[1175]: info: Getting Qobuz Cloud Configuration Dec 20 18:22:37 volumio volumio[1175]: info: Asking plugin for UI Config Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:37 volumio volumio[1175]: info: Getting Spotify Cloud Configuration Dec 20 18:22:37 volumio volumio[1175]: info: Asking plugin for UI Config Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:37 volumio volumio[1175]: info: Saving Spotify Acccount Dec 20 18:22:37 volumio volumio[1175]: info: Got it Dec 20 18:22:37 volumio volumio[1175]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: websocket , broadcastMessage Dec 20 18:22:37 volumio volumio[1175]: updateProgress Dec 20 18:22:37 volumio volumio[1175]: { Dec 20 18:22:37 volumio volumio[1175]: downloadSpeed: '', Dec 20 18:22:37 volumio volumio[1175]: eta: '2m', Dec 20 18:22:37 volumio volumio[1175]: progress: 80, Dec 20 18:22:37 volumio volumio[1175]: status: 'Téléchargement de la mise à jour' Dec 20 18:22:37 volumio volumio[1175]: } Dec 20 18:22:37 volumio volumio[1175]: info: Got Tidal Cloud Configuration Dec 20 18:22:37 volumio volumio[1175]: info: Got it Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:37 volumio sudo[29776]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 20 18:22:37 volumio sudo[29776]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:37 volumio sudo[29776]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:37 volumio sudo[29778]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 20 18:22:37 volumio sudo[29778]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:37 volumio sudo[29778]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:37 volumio volumio[1175]: verbose: New Socket.io Connection to 192.168.1.26 from 192.168.1.23 UA: Mozilla/5.0 (Linux; Android 10; K) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/143.0.0.0 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 5 Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::volumioGetVisibleSources Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: wizard , getWizardSteps Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , showActivationCode Dec 20 18:22:37 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , getAvailableLanguages Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getAvailableTimezones Dec 20 18:22:37 volumio volumio[1175]: info: Received Get System Info Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:22:37 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:37 volumio volumio[1175]: info: Retrieving Cloud Streaming UI Dec 20 18:22:37 volumio volumio[1175]: info: Getting Tidal Cloud Configuration Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:37 volumio volumio[1175]: info: Getting Qobuz Cloud Configuration Dec 20 18:22:37 volumio volumio[1175]: info: Asking plugin for UI Config Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:37 volumio volumio[1175]: info: Getting Spotify Cloud Configuration Dec 20 18:22:37 volumio volumio[1175]: info: Asking plugin for UI Config Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:37 volumio volumio[1175]: info: Saving Spotify Acccount Dec 20 18:22:37 volumio volumio[1175]: info: Got it Dec 20 18:22:37 volumio volumio[1175]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Dec 20 18:22:37 volumio volumio[1175]: info: Got Tidal Cloud Configuration Dec 20 18:22:37 volumio volumio[1175]: info: Got it Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:37 volumio volumio[1175]: verbose: New Socket.io Connection to 192.168.1.26 from 192.168.1.51 UA: Mozilla/5.0 (X11; Linux x86_64; rv:140.0) Gecko/20100101 Firefox/140.0 Engine version: 3 Transport: polling Total Clients: 6 Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::volumioGetVisibleSources Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: wizard , getWizardSteps Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , showActivationCode Dec 20 18:22:37 volumio volumio[1175]: xcb_connection_has_error() returned true Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , getAvailableLanguages Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getAvailableTimezones Dec 20 18:22:37 volumio volumio[1175]: info: Received Get System Info Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 20 18:22:37 volumio volumio[1175]: info: Discovery: Getting this device information Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::volumioGetState Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 20 18:22:37 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:37 volumio volumio[1175]: info: Retrieving Cloud Streaming UI Dec 20 18:22:38 volumio volumio[1175]: info: Getting Tidal Cloud Configuration Dec 20 18:22:38 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:38 volumio volumio[1175]: info: Getting Qobuz Cloud Configuration Dec 20 18:22:38 volumio volumio[1175]: info: Asking plugin for UI Config Dec 20 18:22:38 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:38 volumio volumio[1175]: info: Getting Spotify Cloud Configuration Dec 20 18:22:38 volumio volumio[1175]: info: Asking plugin for UI Config Dec 20 18:22:38 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:38 volumio volumio[1175]: info: Saving Spotify Acccount Dec 20 18:22:38 volumio volumio[1175]: info: Got it Dec 20 18:22:38 volumio volumio[1175]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Dec 20 18:22:38 volumio volumio[1175]: info: Got Tidal Cloud Configuration Dec 20 18:22:38 volumio volumio[1175]: info: Got it Dec 20 18:22:38 volumio volumio[1175]: info: CoreCommandRouter::getUIConfigOnPlugin Dec 20 18:22:38 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , setLanguage Dec 20 18:22:38 volumio volumio[1175]: info: Loading i18n strings for locale en Dec 20 18:22:38 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , setTimezone Dec 20 18:22:38 volumio volumio[1175]: info: Setting timezone to Europe/London Dec 20 18:22:38 volumio sudo[29788]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/unlink /etc/localtime Dec 20 18:22:38 volumio sudo[29788]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:38 volumio sudo[29788]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:38 volumio sudo[29791]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/ln -s /usr/share/zoneinfo/Europe/London /etc/localtime Dec 20 18:22:38 volumio sudo[29791]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:38 volumio sudo[29791]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:38 volumio sudo[29794]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/localtime Dec 20 18:22:38 volumio sudo[29794]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:38 volumio sudo[29794]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:38 volumio sudo[29797]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/timedatectl set-timezone Europe/London Dec 20 18:22:38 volumio sudo[29797]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:38 volumio dbus-daemon[576]: [system] Activating via systemd: service name='org.freedesktop.timedate1' unit='dbus-org.freedesktop.timedate1.service' requested by ':1.58' (uid=0 pid=29798 comm="/usr/bin/timedatectl set-timezone Europe/London ") Dec 20 18:22:39 volumio systemd[1]: Starting Time & Date Service... Dec 20 18:22:39 volumio dbus-daemon[576]: [system] Successfully activated service 'org.freedesktop.timedate1' Dec 20 18:22:39 volumio systemd[1]: Started Time & Date Service. Dec 20 18:22:39 volumio sudo[29797]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:39 volumio volumio[1175]: info: Fetching Streaming Services browse cache Dec 20 18:22:39 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:22:39 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:22:40 volumio volumio[1175]: ------------------------------------ BT MESSAGE: BT STATUS: running Dec 20 18:22:40 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , setLanguage Dec 20 18:22:40 volumio volumio[1175]: info: Loading i18n strings for locale fr Dec 20 18:22:40 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , setTimezone Dec 20 18:22:40 volumio volumio[1175]: info: Setting timezone to Europe/Paris Dec 20 18:22:40 volumio sudo[29801]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/unlink /etc/localtime Dec 20 18:22:40 volumio sudo[29801]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:40 volumio sudo[29801]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:40 volumio sudo[29804]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/ln -s /usr/share/zoneinfo/Europe/Paris /etc/localtime Dec 20 18:22:40 volumio sudo[29804]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:40 volumio sudo[29804]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:40 volumio sudo[29807]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/localtime Dec 20 18:22:40 volumio sudo[29807]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:41 volumio sudo[29807]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:41 volumio sudo[29810]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/timedatectl set-timezone Europe/Paris Dec 20 18:22:41 volumio sudo[29810]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:41 volumio systemd-timedated[29799]: Failed to set time zone: Permission denied Dec 20 18:22:41 volumio sudo[29810]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:41 volumio volumio[1175]: Failed to set time zone: Access denied Dec 20 18:22:41 volumio volumio[1175]: info: Could not set timezone, retrying Dec 20 18:22:41 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:22:41 volumio volumio[1175]: info: Fetching Streaming Services browse cache Dec 20 18:22:41 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:22:41 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 20 18:22:41 volumio volumio[1175]: Updating browse sources language Dec 20 18:22:41 volumio volumio[1175]: Cannot find translation for source HiFiBerry ADC Dec 20 18:22:41 volumio volumio[1175]: Cannot find translation for source QOBUZ Dec 20 18:22:41 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 20 18:22:41 volumio volumio[1175]: Cannot find translation for source HiFiBerry ADC Dec 20 18:22:41 volumio volumio[1175]: Cannot find translation for source QOBUZ Dec 20 18:22:41 volumio volumio[1175]: Updating browse sources language Dec 20 18:22:41 volumio volumio[1175]: Cannot find translation for source HiFiBerry ADC Dec 20 18:22:41 volumio volumio[1175]: Cannot find translation for source QOBUZ Dec 20 18:22:41 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 20 18:22:41 volumio volumio[1175]: Cannot find translation for source HiFiBerry ADC Dec 20 18:22:41 volumio volumio[1175]: Cannot find translation for source QOBUZ Dec 20 18:22:41 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: appearance , setLanguage Dec 20 18:22:41 volumio volumio[1175]: info: Loading i18n strings for locale en Dec 20 18:22:41 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: system , setTimezone Dec 20 18:22:41 volumio volumio[1175]: info: Setting timezone to Europe/London Dec 20 18:22:41 volumio sudo[29813]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/unlink /etc/localtime Dec 20 18:22:41 volumio sudo[29813]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:41 volumio sudo[29813]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:41 volumio sudo[29816]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/ln -s /usr/share/zoneinfo/Europe/London /etc/localtime Dec 20 18:22:41 volumio sudo[29816]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:41 volumio sudo[29816]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:42 volumio sudo[29819]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/localtime Dec 20 18:22:42 volumio sudo[29819]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:42 volumio sudo[29819]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:42 volumio sudo[29822]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/timedatectl set-timezone Europe/London Dec 20 18:22:42 volumio sudo[29822]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:42 volumio systemd-timedated[29799]: Failed to set time zone: Permission denied Dec 20 18:22:42 volumio sudo[29822]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:42 volumio volumio[1175]: Failed to set time zone: Access denied Dec 20 18:22:42 volumio volumio[1175]: info: Could not set timezone, retrying Dec 20 18:22:42 volumio volumio[1175]: Updating browse sources language Dec 20 18:22:42 volumio volumio[1175]: Cannot find translation for source HiFiBerry ADC Dec 20 18:22:42 volumio volumio[1175]: Cannot find translation for source QOBUZ Dec 20 18:22:42 volumio volumio[1175]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 20 18:22:42 volumio volumio[1175]: Cannot find translation for source HiFiBerry ADC Dec 20 18:22:42 volumio volumio[1175]: Cannot find translation for source QOBUZ Dec 20 18:22:42 volumio volumio[1175]: info: Fetching Streaming Services browse cache Dec 20 18:22:42 volumio sudo[29825]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/timedatectl set-timezone Europe/Paris Dec 20 18:22:42 volumio sudo[29825]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 20 18:22:42 volumio systemd-timedated[29799]: Failed to set time zone: Permission denied Dec 20 18:22:42 volumio sudo[29825]: pam_unix(sudo:session): session closed for user root Dec 20 18:22:42 volumio volumio[1175]: Failed to set time zone: Access denied Dec 20 18:22:42 volumio volumio[1175]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Dec 20 18:22:42 volumio volumio[1175]: Error: Command failed: /usr/bin/sudo /usr/bin/timedatectl set-timezone 'Europe/Paris' Dec 20 18:22:42 volumio volumio[1175]: Failed to set time zone: Access denied Dec 20 18:22:42 volumio volumio[1175]: at checkExecSyncError (child_process.js:616:11) Dec 20 18:22:42 volumio volumio[1175]: at execSync (child_process.js:652:15) Dec 20 18:22:42 volumio volumio[1175]: at Timeout._onTimeout (/volumio/app/plugins/system_controller/system/index.js:1680:9) Dec 20 18:22:42 volumio volumio[1175]: at listOnTimeout (internal/timers.js:554:17) Dec 20 18:22:42 volumio volumio[1175]: at processTimers (internal/timers.js:497:7) { Dec 20 18:22:42 volumio volumio[1175]: status: 1, Dec 20 18:22:42 volumio volumio[1175]: signal: null, Dec 20 18:22:42 volumio volumio[1175]: output: [ null, '', 'Failed to set time zone: Access denied\n' ], Dec 20 18:22:42 volumio volumio[1175]: pid: 29824, Dec 20 18:22:42 volumio volumio[1175]: stdout: '', Dec 20 18:22:42 volumio volumio[1175]: stderr: 'Failed to set time zone: Access denied\n' Dec 20 18:22:42 volumio volumio[1175]: } Dec 20 18:22:42 volumio volumio[1175]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Dec 20 18:22:42 volumio sudo[29836]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-12-20 18:21 Dec 20 18:22:42 volumio sudo[29836]: 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="cc50ad4a2058d01de272214eb33827883bd2b7d8" VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd" VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2" VOLUMIO_BE_VERSION="502750e5d54ecf269d25125b622bfabc030fb553" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Wed 12 Nov 2025 06:58:02 PM CET" VOLUMIO_VERSION="3.874" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="4ae6504ed6f22e44c01a6e93b16badbd"