May 30 18:51:11 volumio go-librespot[1639]: time="2026-05-30T18:51:11+02:00" level=trace msg="sent dealer ping" May 30 18:51:12 volumio go-librespot[1639]: time="2026-05-30T18:51:12+02:00" level=trace msg="received dealer pong" May 30 18:51:38 volumio volumio[1266]: error: error May 30 18:51:38 volumio volumio[1266]: error: error May 30 18:51:41 volumio go-librespot[1639]: time="2026-05-30T18:51:41+02:00" level=trace msg="received accesspoint ping" May 30 18:51:41 volumio go-librespot[1639]: time="2026-05-30T18:51:41+02:00" level=trace msg="received accesspoint pong ack" May 30 18:51:41 volumio go-librespot[1639]: time="2026-05-30T18:51:41+02:00" level=trace msg="sent dealer ping" May 30 18:51:42 volumio go-librespot[1639]: time="2026-05-30T18:51:42+02:00" level=trace msg="received dealer pong" May 30 18:52:11 volumio go-librespot[1639]: time="2026-05-30T18:52:11+02:00" level=trace msg="sent dealer ping" May 30 18:52:12 volumio go-librespot[1639]: time="2026-05-30T18:52:12+02:00" level=trace msg="received dealer pong" May 30 18:52:15 volumio kernel: usb 1-1.2: new high-speed USB device number 10 using xhci_hcd May 30 18:52:15 volumio kernel: usb 1-1.2: New USB device found, idVendor=152a, idProduct=85dd, bcdDevice= 3.54 May 30 18:52:15 volumio kernel: usb 1-1.2: New USB device strings: Mfr=1, Product=3, SerialNumber=2 May 30 18:52:15 volumio kernel: usb 1-1.2: Product: SMSL USB AUDIO May 30 18:52:15 volumio kernel: usb 1-1.2: Manufacturer: SMSL May 30 18:52:16 volumio kernel: usb 1-1.2: 1:1: cannot set freq 768000 (v2/v3): err -71 May 30 18:52:16 volumio kernel: usb 1-1.2: parse_audio_format_rates_v2v3(): unable to retrieve number of sample rates (clock 41) May 30 18:52:16 volumio kernel: usb 1-1.2: parse_audio_format_rates_v2v3(): unable to retrieve number of sample rates (clock 41) May 30 18:52:16 volumio kernel: usbhid 1-1.2:1.3: can't add hid device: -71 May 30 18:52:16 volumio kernel: usbhid 1-1.2:1.3: probe with driver usbhid failed with error -71 May 30 18:52:16 volumio (udev-worker)[17040]: controlC5: Process '/usr/sbin/alsactl -E HOME=/run/alsa -E XDG_RUNTIME_DIR=/run/alsa/runtime restore 5' failed with exit code 99. May 30 18:52:16 volumio volumio[1266]: info: May 30 18:52:16 volumio volumio[1266]: ---------------------------- USB Audio Device Attached May 30 18:52:16 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , usbAudioAttach May 30 18:52:16 volumio volumio[1266]: info: CoreCommandRouter::Close All Modals sent May 30 18:52:16 volumio volumio[1266]: info: Preparing to save Alsa Options, stopping services first May 30 18:52:16 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:16 volumio volumio[1266]: info: CoreCommandRouter::volumioPause May 30 18:52:16 volumio volumio[1266]: info: CoreStateMachine::pause May 30 18:52:16 volumio volumio[1266]: info: Saving Audio Output to: {"disallowPush":true,"output_device":{"value":"5","label":"SMSL USB AUDIO","alsacard":"AUDIO"},"i2s":false} May 30 18:52:16 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:16 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:16 volumio volumio[1266]: info: Device 5 does not have any Mixer Control Available May 30 18:52:16 volumio volumio[1266]: info: QobuzConnect: setDeactiveState invoked May 30 18:52:16 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:16 volumio volumio[1266]: info: QobuzConnect: setDeactiveState(): relinquishing Volumio State May 30 18:52:16 volumio volumio[1266]: verbose: UNSET VOLATILE: Service: qobuzconnect May 30 18:52:16 volumio volumio[1266]: info: QobuzConnect: onUnsetVolatile() called, relinquishing Volumio State to another service May 30 18:52:16 volumio volumio[1266]: info: QobuzConnect: Received stop May 30 18:52:16 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:16 volumio vtcs[2043]: [2026-05-30 18:52:16.860] [tisoc] [warning] [SessionManagerImpl.cpp:240] Illegal State: IDLE May 30 18:52:16 volumio vtcs[2043]: [2026-05-30 18:52:16.860] [tisoc] [error] [SpkconServer.cpp:378] recv error. socket disconnected May 30 18:52:16 volumio qobuz-connect[1964]: 20260530 18:52:16.862 [1964.1964] INFO MediaEngine: [0xc06d10]: Stopping playback, keeping tracks May 30 18:52:16 volumio sudo[17064]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:16 volumio sudo[17064]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:16 volumio volumio[1266]: info: CoreCommandRouter::volumioUpdateVolumeSettings May 30 18:52:16 volumio volumio[1266]: info: Updating Volume Controller Parameters: Device: 5 Name: SMSL USB AUDIO Mixer: Max Vol: 100 Vol Curve; logarithmic Vol Steps: 1 May 30 18:52:16 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume May 30 18:52:16 volumio volumio[1266]: info: Disabling external Volume Control May 30 18:52:16 volumio volumio[1266]: info: CoreCommandRouter::getUIConfigOnPlugin May 30 18:52:16 volumio kernel: usb 1-1.2: USB disconnect, device number 10 May 30 18:52:16 volumio volumio[1266]: info: CoreStateMachine::pushState May 30 18:52:16 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:16 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 30 18:52:16 volumio volumio[1266]: info: CoreCommandRouter::volumioPushState May 30 18:52:16 volumio volumio[1266]: info: MRS: Pushing multiroomSync output update for this device May 30 18:52:16 volumio volumio[1266]: info: MRS: Pushing multiroomSync output May 30 18:52:16 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:16 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:16 volumio volumio[1266]: info: Preparing to generate the ALSA configuration file May 30 18:52:16 volumio systemd[1]: Stopping vtcs.service - Volumio Tidal Connect Service... May 30 18:52:16 volumio systemd[1]: vtcs.service: Deactivated successfully. May 30 18:52:16 volumio systemd[1]: Stopped vtcs.service - Volumio Tidal Connect Service. May 30 18:52:16 volumio systemd[1]: vtcs.service: Consumed 2.630s CPU time. May 30 18:52:16 volumio sudo[17064]: pam_unix(sudo:session): session closed for user root May 30 18:52:16 volumio sudo[17072]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:16 volumio sudo[17072]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:16 volumio volumio[1266]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf May 30 18:52:16 volumio sudo[17079]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service May 30 18:52:16 volumio sudo[17079]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio volumio[1266]: info: Reading ALSA contributions from plugins. May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sOptions May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:17 volumio sudo[17072]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio sudo[17079]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio volumio[1266]: Invalid card number '5'. May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getPlaybackMode May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus May 30 18:52:17 volumio sudo[17087]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service May 30 18:52:17 volumio sudo[17087]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio volumio[1266]: info: Asound.conf file unchanged, so no further update is needed May 30 18:52:17 volumio volumio[1266]: info: Output device has changed, restarting MPD May 30 18:52:17 volumio systemd[1]: Stopping qobuz-connect.service - Volumio Qobuz Connect Service... May 30 18:52:17 volumio qobuz-connect[1964]: 20260530 18:52:17.104 [1964.1964] INFO SampleApp: Stopping Local configuration server May 30 18:52:17 volumio volumio[1266]: info: Output device has changed, restarting Shairport Sync May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:17 volumio sudo[17092]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf May 30 18:52:17 volumio sudo[17092]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio sudo[17092]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio sudo[17094]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service May 30 18:52:17 volumio sudo[17094]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio volumio[1266]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 May 30 18:52:17 volumio volumio[1266]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio kernel: usb 1-1.2: new high-speed USB device number 11 using xhci_hcd May 30 18:52:17 volumio volumio[1266]: info: QobuzConnect: setDeactiveState invoked May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:17 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:17 volumio systemd[1]: Stopping mpd.service - Music Player Daemon... May 30 18:52:17 volumio sudo[17108]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:17 volumio sudo[17107]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:17 volumio sudo[17108]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio sudo[17107]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio volumio[1266]: error: Failed to parse min max audio card capabilities, sending default vales: TypeError: Cannot read properties of undefined (reading 'split') May 30 18:52:17 volumio volumio[1266]: info: MPD Permissions set May 30 18:52:17 volumio systemd[1]: mpd.service: Deactivated successfully. May 30 18:52:17 volumio systemd[1]: Stopped mpd.service - Music Player Daemon. May 30 18:52:17 volumio systemd[1]: mpd.service: Consumed 1.450s CPU time. May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio systemd[1]: mpd.socket: Deactivated successfully. May 30 18:52:17 volumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. May 30 18:52:17 volumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... May 30 18:52:17 volumio sudo[17116]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service May 30 18:52:17 volumio sudo[17116]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio kernel: usb 1-1.2: New USB device found, idVendor=152a, idProduct=85dd, bcdDevice= 3.54 May 30 18:52:17 volumio kernel: usb 1-1.2: New USB device strings: Mfr=1, Product=3, SerialNumber=2 May 30 18:52:17 volumio kernel: usb 1-1.2: Product: SMSL USB AUDIO May 30 18:52:17 volumio kernel: usb 1-1.2: Manufacturer: SMSL May 30 18:52:17 volumio volumio[1266]: info: Starting Shairport Sync May 30 18:52:17 volumio volumio[1266]: info: Preparing to generate the ALSA configuration file May 30 18:52:17 volumio volumio[1266]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf May 30 18:52:17 volumio volumio[1266]: info: Reading ALSA contributions from plugins. May 30 18:52:17 volumio sudo[17125]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync May 30 18:52:17 volumio sudo[17125]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio volumio[1266]: info: Asound.conf file written May 30 18:52:17 volumio kernel: hid-generic 0003:152A:85DD.0006: hiddev96,hidraw0: USB HID v1.10 Device [SMSL SMSL USB AUDIO] on usb-0000:01:00.0-1.2/input3 May 30 18:52:17 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. May 30 18:52:17 volumio systemd[1]: Starting mpd.service - Music Player Daemon... May 30 18:52:17 volumio sudo[17116]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio sudo[17130]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/mv /home/volumio/.asoundrc /etc/asound.conf May 30 18:52:17 volumio sudo[17130]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio sudo[17108]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio sudo[17130]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... May 30 18:52:17 volumio systemd[1]: shairport-sync.service: Deactivated successfully. May 30 18:52:17 volumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 30 18:52:17 volumio sudo[17134]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service May 30 18:52:17 volumio systemd[1]: shairport-sync.service: Consumed 25.398s CPU time. May 30 18:52:17 volumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 30 18:52:17 volumio sudo[17125]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio sudo[17134]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio sudo[17107]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio sudo[17131]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log May 30 18:52:17 volumio sudo[17131]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) May 30 18:52:17 volumio volumio[1266]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:0 use case configuration -2 May 30 18:52:17 volumio volumio[1266]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:1 use case configuration -2 May 30 18:52:17 volumio volumio[1266]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:2 use case configuration -2 May 30 18:52:17 volumio volumio[1266]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:3 use case configuration -2 May 30 18:52:17 volumio volumio[1266]: info: Output device has changed, restarting MPD May 30 18:52:17 volumio sudo[17131]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio volumio[1266]: info: Output device has changed, restarting Shairport Sync May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:17 volumio sudo[17159]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf May 30 18:52:17 volumio sudo[17159]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio sudo[17159]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio sudo[17161]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service May 30 18:52:17 volumio sudo[17161]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio volumio[1266]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 May 30 18:52:17 volumio volumio[1266]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: QobuzConnect: setDeactiveState invoked May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:17 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:17 volumio systemd[1]: mpd.service: Deactivated successfully. May 30 18:52:17 volumio systemd[1]: Stopped mpd.service - Music Player Daemon. May 30 18:52:17 volumio sudo[17174]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:17 volumio systemd[1]: mpd.socket: Deactivated successfully. May 30 18:52:17 volumio sudo[17171]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:17 volumio sudo[17171]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. May 30 18:52:17 volumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... May 30 18:52:17 volumio sudo[17174]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: raat , restartRaat May 30 18:52:17 volumio systemd[1]: Starting mpd.service - Music Player Daemon... May 30 18:52:17 volumio volumio[1266]: error: Failed to parse min max audio card capabilities, sending default vales: TypeError: Cannot read properties of undefined (reading 'split') May 30 18:52:17 volumio volumio[1266]: info: MPD Permissions set May 30 18:52:17 volumio volumio[1266]: info: Shairport-Sync Started May 30 18:52:17 volumio sudo[17181]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service May 30 18:52:17 volumio volumio[1266]: info: May 30 18:52:17 volumio volumio[1266]: ---------------------------- USB Audio Device Detached May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , usbAudioDetach May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:17 volumio sudo[17181]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio sudo[17174]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: raat , onStop May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio sudo[17181]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:17 volumio sudo[17171]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio sudo[17194]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service May 30 18:52:17 volumio sudo[17183]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log May 30 18:52:17 volumio sudo[17194]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio volumio[1266]: info: Starting Shairport Sync May 30 18:52:17 volumio sudo[17183]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) May 30 18:52:17 volumio sudo[17183]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio sudo[17202]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync May 30 18:52:17 volumio sudo[17202]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:17 volumio volumio[1266]: info: May 30 18:52:17 volumio volumio[1266]: ---------------------------- USB Audio Device Attached May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , usbAudioAttach May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::Close All Modals sent May 30 18:52:17 volumio volumio[1266]: info: Preparing to save Alsa Options, stopping services first May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:17 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::volumioPause May 30 18:52:17 volumio volumio[1266]: info: CoreStateMachine::pause May 30 18:52:17 volumio volumio[1266]: info: Saving Audio Output to: {"disallowPush":true,"output_device":{"value":"5","label":"SMSL USB AUDIO","alsacard":"AUDIO"},"i2s":false} May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:17 volumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... May 30 18:52:17 volumio systemd[1]: shairport-sync.service: Deactivated successfully. May 30 18:52:17 volumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 30 18:52:17 volumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 30 18:52:17 volumio sudo[17202]: pam_unix(sudo:session): session closed for user root May 30 18:52:17 volumio kernel: usb 1-1.2: USB disconnect, device number 11 May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:17 volumio volumio[1266]: Invalid card number '5'. May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::volumioUpdateVolumeSettings May 30 18:52:17 volumio volumio[1266]: info: Updating Volume Controller Parameters: Device: 5 Name: SMSL USB AUDIO Mixer: Max Vol: 100 Vol Curve; logarithmic Vol Steps: 1 May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume May 30 18:52:17 volumio volumio[1266]: info: Disabling external Volume Control May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::getUIConfigOnPlugin May 30 18:52:17 volumio volumio[1266]: info: CoreStateMachine::pushState May 30 18:52:17 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::volumioPushState May 30 18:52:17 volumio volumio[1266]: info: MRS: Pushing multiroomSync output update for this device May 30 18:52:17 volumio volumio[1266]: info: MRS: Pushing multiroomSync output May 30 18:52:17 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:17 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:18 volumio volumio[1266]: info: Preparing to generate the ALSA configuration file May 30 18:52:18 volumio volumio[1266]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf May 30 18:52:18 volumio volumio[1266]: info: Reading ALSA contributions from plugins. May 30 18:52:18 volumio volumio[1266]: info: Shairport-Sync Started May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sOptions May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:18 volumio volumio[1266]: Invalid card number '5'. May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getPlaybackMode May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus May 30 18:52:18 volumio volumio[1266]: info: Asound.conf file unchanged, so no further update is needed May 30 18:52:18 volumio volumio[1266]: info: Output device has changed, restarting MPD May 30 18:52:18 volumio volumio[1266]: info: Output device has changed, restarting Shairport Sync May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 May 30 18:52:18 volumio volumio[1266]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:18 volumio sudo[17248]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service May 30 18:52:18 volumio sudo[17248]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:18 volumio volumio[1266]: info: QobuzConnect: setDeactiveState invoked May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:18 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:18 volumio sudo[17255]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:18 volumio sudo[17255]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:18 volumio sudo[17257]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:18 volumio sudo[17257]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:18 volumio sudo[17244]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf May 30 18:52:18 volumio systemd[1]: mpd.service: Deactivated successfully. May 30 18:52:18 volumio systemd[1]: Stopped mpd.service - Music Player Daemon. May 30 18:52:18 volumio sudo[17244]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:18 volumio systemd[1]: mpd.socket: Deactivated successfully. May 30 18:52:18 volumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. May 30 18:52:18 volumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... May 30 18:52:18 volumio sudo[17244]: pam_unix(sudo:session): session closed for user root May 30 18:52:18 volumio volumio[1266]: error: Failed to parse min max audio card capabilities, sending default vales: TypeError: Cannot read properties of undefined (reading 'split') May 30 18:52:18 volumio volumio[1266]: info: MPD Permissions set May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:18 volumio kernel: usb 1-1.2: new high-speed USB device number 12 using xhci_hcd May 30 18:52:18 volumio sudo[17267]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service May 30 18:52:18 volumio sudo[17267]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:18 volumio volumio[1266]: info: Starting Shairport Sync May 30 18:52:18 volumio qobuz-connect[1964]: 20260530 18:52:18.331 [1964.1964] INFO SampleApp: shat down connection on UNIX socket May 30 18:52:18 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. May 30 18:52:18 volumio volumio[1266]: info: QobuzConnect: Qobuz Connect client [object Object] disconnected May 30 18:52:18 volumio sudo[17275]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync May 30 18:52:18 volumio systemd[1]: Starting mpd.service - Music Player Daemon... May 30 18:52:18 volumio systemd[1]: qobuz-connect.service: Deactivated successfully. May 30 18:52:18 volumio systemd[1]: Stopped qobuz-connect.service - Volumio Qobuz Connect Service. May 30 18:52:18 volumio sudo[17275]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:18 volumio systemd[1]: qobuz-connect.service: Consumed 31min 17.526s CPU time. May 30 18:52:18 volumio volumio[1266]: info: QobuzConnect: setDeactiveState invoked May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:18 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:18 volumio kernel: usb 1-1.2: New USB device found, idVendor=152a, idProduct=85dd, bcdDevice= 3.54 May 30 18:52:18 volumio kernel: usb 1-1.2: New USB device strings: Mfr=1, Product=3, SerialNumber=2 May 30 18:52:18 volumio kernel: usb 1-1.2: Product: SMSL USB AUDIO May 30 18:52:18 volumio kernel: usb 1-1.2: Manufacturer: SMSL May 30 18:52:18 volumio kernel: hid-generic 0003:152A:85DD.0007: hiddev96,hidraw0: USB HID v1.10 Device [SMSL SMSL USB AUDIO] on usb-0000:01:00.0-1.2/input3 May 30 18:52:18 volumio sudo[17267]: pam_unix(sudo:session): session closed for user root May 30 18:52:18 volumio sudo[17279]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service May 30 18:52:18 volumio sudo[17279]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:18 volumio volumio[1266]: info: May 30 18:52:18 volumio volumio[1266]: ---------------------------- USB Audio Device Detached May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , usbAudioDetach May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:18 volumio sudo[17276]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log May 30 18:52:18 volumio sudo[17276]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) May 30 18:52:18 volumio sudo[17276]: pam_unix(sudo:session): session closed for user root May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: raat , onStop May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: raat , restartRaat May 30 18:52:18 volumio systemd[1]: Started qobuz-connect.service - Volumio Qobuz Connect Service. May 30 18:52:18 volumio sudo[17194]: pam_unix(sudo:session): session closed for user root May 30 18:52:18 volumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... May 30 18:52:18 volumio sudo[17134]: pam_unix(sudo:session): session closed for user root May 30 18:52:18 volumio sudo[17087]: pam_unix(sudo:session): session closed for user root May 30 18:52:18 volumio systemd[1]: shairport-sync.service: Deactivated successfully. May 30 18:52:18 volumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 30 18:52:18 volumio volumio[1266]: info: Executing endpoint qc_getconfig May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: qobuzconnect , onGetConfig May 30 18:52:18 volumio sudo[17255]: pam_unix(sudo:session): session closed for user root May 30 18:52:18 volumio qobuz-connect[17280]: 20260530 18:52:18.640 [17280.17280] INFO SampleApp: Started connection to /tmp/qbz-connect.socket UNIX socket May 30 18:52:18 volumio qobuz-connect[17280]: 20260530 18:52:18.646 [17280.17280] INFO VolumeManager: [0x12ad068]: Setting new playback volume: 75 May 30 18:52:18 volumio qobuz-connect[17280]: 20260530 18:52:18.646 [17280.17280] INFO VolumeManager: [0x12ad068]: Setting new mute state: 0 May 30 18:52:18 volumio qobuz-connect[17280]: 20260530 18:52:18.646 [17280.17280] INFO AudioStreamManager: [0x12acdc0]: Setting new audio download buffer size: 1048576 May 30 18:52:18 volumio qobuz-connect[17280]: 20260530 18:52:18.646 [17280.17280] INFO QobuzConnect: [0x12ad930]: Client initialized! May 30 18:52:18 volumio qobuz-connect[17280]: 20260530 18:52:18.646 [17280.17280] INFO SampleApp: Starting Avahi advertising, name: Volumio, service name: _qobuz-connect._tcp May 30 18:52:18 volumio qobuz-connect[17280]: 20260530 18:52:18.658 [17280.17280] INFO LocalConfigManager: [0x12acae8]: Starting Local Configuration server May 30 18:52:18 volumio qobuz-connect[17280]: 20260530 18:52:18.658 [17280.17280] INFO SampleApp: Starting Local configuration server May 30 18:52:18 volumio qobuz-connect[17280]: 20260530 18:52:18.658 [17280.17280] INFO SampleApp: Connected to UNIX socket client 0x1297818 May 30 18:52:18 volumio volumio[1266]: info: QobuzConnect: Qobuz Connect socket /tmp/qbz-connect.socket connected to client [object Object] May 30 18:52:18 volumio volumio[1266]: info: QobuzConnect: QOBUZ Connect daemon connected May 30 18:52:18 volumio volumio[1266]: info: May 30 18:52:18 volumio volumio[1266]: ---------------------------- USB Audio Device Attached May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , usbAudioAttach May 30 18:52:18 volumio sudo[17257]: pam_unix(sudo:session): session closed for user root May 30 18:52:18 volumio systemd[1]: Stopping qobuz-connect.service - Volumio Qobuz Connect Service... May 30 18:52:18 volumio qobuz-connect[17280]: 20260530 18:52:18.699 [17280.17280] INFO SampleApp: Stopping Local configuration server May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::Close All Modals sent May 30 18:52:18 volumio volumio[1266]: info: Preparing to save Alsa Options, stopping services first May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:18 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::volumioPause May 30 18:52:18 volumio volumio[1266]: info: CoreStateMachine::pause May 30 18:52:18 volumio volumio[1266]: info: Saving Audio Output to: {"disallowPush":true,"output_device":{"value":"5","label":"SMSL USB AUDIO","alsacard":"AUDIO"},"i2s":false} May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:18 volumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 30 18:52:18 volumio sudo[17275]: pam_unix(sudo:session): session closed for user root May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:18 volumio volumio[1266]: info: Device 5 does not have any Mixer Control Available May 30 18:52:18 volumio volumio[1266]: info: QobuzConnect: setDeactiveState invoked May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:18 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:18 volumio sudo[17323]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::volumioUpdateVolumeSettings May 30 18:52:18 volumio volumio[1266]: info: Updating Volume Controller Parameters: Device: 5 Name: SMSL USB AUDIO Mixer: Max Vol: 100 Vol Curve; logarithmic Vol Steps: 1 May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume May 30 18:52:18 volumio volumio[1266]: info: Disabling external Volume Control May 30 18:52:18 volumio sudo[17323]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::getUIConfigOnPlugin May 30 18:52:18 volumio volumio[1266]: info: CoreStateMachine::pushState May 30 18:52:18 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::volumioPushState May 30 18:52:18 volumio volumio[1266]: info: MRS: Pushing multiroomSync output update for this device May 30 18:52:18 volumio volumio[1266]: info: MRS: Pushing multiroomSync output May 30 18:52:18 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:18 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:18 volumio volumio[1266]: info: Preparing to generate the ALSA configuration file May 30 18:52:18 volumio sudo[17323]: pam_unix(sudo:session): session closed for user root May 30 18:52:18 volumio kernel: usb 1-1.2: USB disconnect, device number 12 May 30 18:52:19 volumio sudo[17339]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:19 volumio sudo[17339]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:19 volumio sudo[17346]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service May 30 18:52:19 volumio sudo[17346]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:19 volumio volumio[1266]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf May 30 18:52:19 volumio volumio[1266]: info: Reading ALSA contributions from plugins. May 30 18:52:19 volumio volumio[1266]: info: Shairport-Sync Started May 30 18:52:19 volumio volumio[1266]: info: May 30 18:52:19 volumio volumio[1266]: ---------------------------- USB Audio Device Detached May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , usbAudioDetach May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:19 volumio sudo[17346]: pam_unix(sudo:session): session closed for user root May 30 18:52:19 volumio sudo[17339]: pam_unix(sudo:session): session closed for user root May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: raat , onStop May 30 18:52:19 volumio sudo[17349]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service May 30 18:52:19 volumio sudo[17349]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sOptions May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:19 volumio volumio[1266]: Invalid card number '5'. May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getPlaybackMode May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus May 30 18:52:19 volumio volumio[1266]: info: Asound.conf file unchanged, so no further update is needed May 30 18:52:19 volumio volumio[1266]: info: Output device has changed, restarting MPD May 30 18:52:19 volumio volumio[1266]: info: Output device has changed, restarting Shairport Sync May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:19 volumio sudo[17361]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf May 30 18:52:19 volumio sudo[17361]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:19 volumio sudo[17361]: pam_unix(sudo:session): session closed for user root May 30 18:52:19 volumio sudo[17363]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service May 30 18:52:19 volumio sudo[17363]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:19 volumio volumio[1266]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 May 30 18:52:19 volumio volumio[1266]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: QobuzConnect: setDeactiveState invoked May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:19 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:19 volumio systemd[1]: mpd.service: Deactivated successfully. May 30 18:52:19 volumio systemd[1]: Stopped mpd.service - Music Player Daemon. May 30 18:52:19 volumio systemd[1]: mpd.socket: Deactivated successfully. May 30 18:52:19 volumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. May 30 18:52:19 volumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... May 30 18:52:19 volumio kernel: usb 1-1.2: new high-speed USB device number 13 using xhci_hcd May 30 18:52:19 volumio sudo[17375]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:19 volumio sudo[17375]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:19 volumio sudo[17373]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:19 volumio sudo[17373]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: raat , restartRaat May 30 18:52:19 volumio volumio[1266]: error: Failed to parse min max audio card capabilities, sending default vales: TypeError: Cannot read properties of undefined (reading 'split') May 30 18:52:19 volumio volumio[1266]: info: MPD Permissions set May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:19 volumio sudo[17384]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service May 30 18:52:19 volumio sudo[17384]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:19 volumio volumio[1266]: info: Starting Shairport Sync May 30 18:52:19 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. May 30 18:52:19 volumio systemd[1]: Starting mpd.service - Music Player Daemon... May 30 18:52:19 volumio sudo[17393]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync May 30 18:52:19 volumio sudo[17393]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:19 volumio kernel: usb 1-1.2: New USB device found, idVendor=152a, idProduct=85dd, bcdDevice= 3.54 May 30 18:52:19 volumio kernel: usb 1-1.2: New USB device strings: Mfr=1, Product=3, SerialNumber=2 May 30 18:52:19 volumio kernel: usb 1-1.2: Product: SMSL USB AUDIO May 30 18:52:19 volumio kernel: usb 1-1.2: Manufacturer: SMSL May 30 18:52:19 volumio kernel: hid-generic 0003:152A:85DD.0008: hiddev96,hidraw0: USB HID v1.10 Device [SMSL SMSL USB AUDIO] on usb-0000:01:00.0-1.2/input3 May 30 18:52:19 volumio sudo[17384]: pam_unix(sudo:session): session closed for user root May 30 18:52:19 volumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... May 30 18:52:19 volumio systemd[1]: shairport-sync.service: Deactivated successfully. May 30 18:52:19 volumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 30 18:52:19 volumio sudo[17397]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service May 30 18:52:19 volumio sudo[17397]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:19 volumio sudo[17394]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log May 30 18:52:19 volumio sudo[17394]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) May 30 18:52:19 volumio sudo[17394]: pam_unix(sudo:session): session closed for user root May 30 18:52:19 volumio volumio[1266]: info: May 30 18:52:19 volumio volumio[1266]: ---------------------------- USB Audio Device Attached May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , usbAudioAttach May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::Close All Modals sent May 30 18:52:19 volumio volumio[1266]: info: Preparing to save Alsa Options, stopping services first May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:19 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::volumioPause May 30 18:52:19 volumio volumio[1266]: info: CoreStateMachine::pause May 30 18:52:19 volumio volumio[1266]: info: Saving Audio Output to: {"disallowPush":true,"output_device":{"value":"5","label":"SMSL USB AUDIO","alsacard":"AUDIO"},"i2s":false} May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:19 volumio sudo[17375]: pam_unix(sudo:session): session closed for user root May 30 18:52:19 volumio volumio[1266]: info: Device 5 does not have any Mixer Control Available May 30 18:52:19 volumio volumio[1266]: info: QobuzConnect: setDeactiveState invoked May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:19 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:19 volumio sudo[17418]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:19 volumio sudo[17373]: pam_unix(sudo:session): session closed for user root May 30 18:52:19 volumio sudo[17418]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::volumioUpdateVolumeSettings May 30 18:52:19 volumio volumio[1266]: info: Updating Volume Controller Parameters: Device: 5 Name: SMSL USB AUDIO Mixer: Max Vol: 100 Vol Curve; logarithmic Vol Steps: 1 May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume May 30 18:52:19 volumio volumio[1266]: info: Disabling external Volume Control May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::getUIConfigOnPlugin May 30 18:52:19 volumio volumio[1266]: info: CoreStateMachine::pushState May 30 18:52:19 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::volumioPushState May 30 18:52:19 volumio volumio[1266]: info: MRS: Pushing multiroomSync output update for this device May 30 18:52:19 volumio volumio[1266]: info: MRS: Pushing multiroomSync output May 30 18:52:19 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:19 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:19 volumio volumio[1266]: info: Preparing to generate the ALSA configuration file May 30 18:52:19 volumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 30 18:52:19 volumio sudo[17393]: pam_unix(sudo:session): session closed for user root May 30 18:52:19 volumio sudo[17428]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:19 volumio sudo[17428]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:19 volumio sudo[17418]: pam_unix(sudo:session): session closed for user root May 30 18:52:19 volumio volumio[1266]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf May 30 18:52:19 volumio volumio[1266]: info: Reading ALSA contributions from plugins. May 30 18:52:19 volumio volumio[1266]: info: Shairport-Sync Started May 30 18:52:19 volumio sudo[17447]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service May 30 18:52:19 volumio sudo[17447]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio sudo[17428]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sOptions May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:20 volumio sudo[17447]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio sudo[17455]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service May 30 18:52:20 volumio sudo[17455]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getPlaybackMode May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus May 30 18:52:20 volumio volumio[1266]: info: TidalConnect service stoped! May 30 18:52:20 volumio volumio[1266]: info: TidalConnect service stoped! May 30 18:52:20 volumio volumio[1266]: info: Asound.conf file unchanged, so no further update is needed May 30 18:52:20 volumio volumio[1266]: info: Output device has changed, restarting MPD May 30 18:52:20 volumio volumio[1266]: info: Output device has changed, restarting Shairport Sync May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:20 volumio sudo[17465]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf May 30 18:52:20 volumio sudo[17465]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio volumio[1266]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 May 30 18:52:20 volumio volumio[1266]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio sudo[17467]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service May 30 18:52:20 volumio sudo[17467]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio volumio[1266]: info: QobuzConnect: setDeactiveState invoked May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:20 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:20 volumio sudo[17465]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio systemd[1]: mpd.service: Deactivated successfully. May 30 18:52:20 volumio systemd[1]: Stopped mpd.service - Music Player Daemon. May 30 18:52:20 volumio systemd[1]: mpd.socket: Deactivated successfully. May 30 18:52:20 volumio sudo[17479]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:20 volumio sudo[17479]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio sudo[17477]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:20 volumio sudo[17477]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. May 30 18:52:20 volumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... May 30 18:52:20 volumio volumio[1266]: info: MPD Permissions set May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: raat , restartRaat May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: Updating tc_getconfig REST Endpoint for plugin: music_service/tidalconnect May 30 18:52:20 volumio volumio[1266]: info: Updating tc_connect REST Endpoint for plugin: music_service/tidalconnect May 30 18:52:20 volumio volumio[1266]: info: Starting Shairport Sync May 30 18:52:20 volumio sudo[17497]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service May 30 18:52:20 volumio sudo[17497]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. May 30 18:52:20 volumio systemd[1]: Starting mpd.service - Music Player Daemon... May 30 18:52:20 volumio sudo[17503]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service May 30 18:52:20 volumio sudo[17503]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio sudo[17501]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync May 30 18:52:20 volumio volumio[1266]: info: Preparing to generate the ALSA configuration file May 30 18:52:20 volumio sudo[17501]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio volumio[1266]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf May 30 18:52:20 volumio volumio[1266]: info: Reading ALSA contributions from plugins. May 30 18:52:20 volumio volumio[1266]: info: Asound.conf file written May 30 18:52:20 volumio sudo[17509]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/mv /home/volumio/.asoundrc /etc/asound.conf May 30 18:52:20 volumio sudo[17509]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio sudo[17509]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio volumio[1266]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:0 use case configuration -2 May 30 18:52:20 volumio volumio[1266]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:1 use case configuration -2 May 30 18:52:20 volumio volumio[1266]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:2 use case configuration -2 May 30 18:52:20 volumio volumio[1266]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:3 use case configuration -2 May 30 18:52:20 volumio volumio[1266]: info: Output device has changed, restarting MPD May 30 18:52:20 volumio sudo[17479]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio sudo[17503]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio sudo[17497]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... May 30 18:52:20 volumio sudo[17518]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service May 30 18:52:20 volumio sudo[17518]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio volumio[1266]: info: Output device has changed, restarting Shairport Sync May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:20 volumio systemd[1]: shairport-sync.service: Deactivated successfully. May 30 18:52:20 volumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 30 18:52:20 volumio sudo[17504]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log May 30 18:52:20 volumio sudo[17504]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) May 30 18:52:20 volumio sudo[17519]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf May 30 18:52:20 volumio sudo[17519]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio volumio[1266]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 May 30 18:52:20 volumio volumio[1266]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio sudo[17504]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio sudo[17520]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service May 30 18:52:20 volumio sudo[17520]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio sudo[17519]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio volumio[1266]: info: QobuzConnect: setDeactiveState invoked May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:20 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:20 volumio sudo[17533]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:20 volumio sudo[17533]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio sudo[17535]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:20 volumio sudo[17535]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio volumio[1266]: info: MPD Permissions set May 30 18:52:20 volumio volumio[1266]: error: Error starting TidalConnect Command failed: /usr/bin/sudo /bin/systemctl start vtcs.service && sleep 3 May 30 18:52:20 volumio volumio[1266]: Job for vtcs.service canceled. May 30 18:52:20 volumio volumio[1266]: {"cmd":"/usr/bin/sudo /bin/systemctl start vtcs.service && sleep 3","code":1,"killed":false,"signal":null,"stack":"Error: Command failed: /usr/bin/sudo /bin/systemctl start vtcs.service && sleep 3\nJob for vtcs.service canceled.\n\n at ChildProcess.exithandler (node:child_process:421:12)\n at ChildProcess.emit (node:events:514:28)\n at maybeClose (node:internal/child_process:1105:16)\n at Socket. (node:internal/child_process:457:11)\n at Socket.emit (node:events:514:28)\n at Pipe. (node:net:337:12)","stderr":"Job for vtcs.service canceled.\n","stdout":""} May 30 18:52:20 volumio volumio[1266]: error: Error starting TidalConnect Command failed: /usr/bin/sudo /bin/systemctl stop vtcs.service && sleep 3 May 30 18:52:20 volumio volumio[1266]: Job for vtcs.service canceled. May 30 18:52:20 volumio volumio[1266]: {"cmd":"/usr/bin/sudo /bin/systemctl stop vtcs.service && sleep 3","code":1,"killed":false,"signal":null,"stack":"Error: Command failed: /usr/bin/sudo /bin/systemctl stop vtcs.service && sleep 3\nJob for vtcs.service canceled.\n\n at ChildProcess.exithandler (node:child_process:421:12)\n at ChildProcess.emit (node:events:514:28)\n at maybeClose (node:internal/child_process:1105:16)\n at Socket. (node:internal/child_process:457:11)\n at Socket.emit (node:events:514:28)\n at Pipe. (node:net:337:12)","stderr":"Job for vtcs.service canceled.\n","stdout":""} May 30 18:52:20 volumio volumio[1266]: info: TidalConnect service stoped! May 30 18:52:20 volumio volumio[1266]: info: TidalConnect service stoped! May 30 18:52:20 volumio sudo[17543]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service May 30 18:52:20 volumio sudo[17477]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio sudo[17543]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio volumio[1266]: info: TidalConnect service stoped! May 30 18:52:20 volumio volumio[1266]: info: Updating tc_getconfig REST Endpoint for plugin: music_service/tidalconnect May 30 18:52:20 volumio volumio[1266]: info: Updating tc_connect REST Endpoint for plugin: music_service/tidalconnect May 30 18:52:20 volumio qobuz-connect[17280]: 20260530 18:52:20.668 [17280.17280] INFO SampleApp: shat down connection on UNIX socket May 30 18:52:20 volumio volumio[1266]: info: QobuzConnect: Qobuz Connect client [object Object] disconnected May 30 18:52:20 volumio volumio[1266]: info: QobuzConnect: setDeactiveState invoked May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:20 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:20 volumio systemd[1]: qobuz-connect.service: Deactivated successfully. May 30 18:52:20 volumio systemd[1]: Stopped qobuz-connect.service - Volumio Qobuz Connect Service. May 30 18:52:20 volumio volumio[1266]: info: Updating tc_getconfig REST Endpoint for plugin: music_service/tidalconnect May 30 18:52:20 volumio volumio[1266]: info: Updating tc_connect REST Endpoint for plugin: music_service/tidalconnect May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:20 volumio kernel: usb 1-1.2: USB disconnect, device number 13 May 30 18:52:20 volumio sudo[17543]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio volumio[1266]: info: TidalConnect service stoped! May 30 18:52:20 volumio sudo[17568]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service May 30 18:52:20 volumio volumio[1266]: info: Starting Shairport Sync May 30 18:52:20 volumio sudo[17568]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio sudo[17571]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service May 30 18:52:20 volumio sudo[17571]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio sudo[17572]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service May 30 18:52:20 volumio sudo[17572]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio sudo[17578]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync May 30 18:52:20 volumio sudo[17578]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:20 volumio volumio[1266]: info: May 30 18:52:20 volumio volumio[1266]: ---------------------------- USB Audio Device Detached May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , usbAudioDetach May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:20 volumio systemd[1]: Started qobuz-connect.service - Volumio Qobuz Connect Service. May 30 18:52:20 volumio sudo[17279]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio sudo[17397]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio sudo[17518]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: raat , onStop May 30 18:52:20 volumio sudo[17455]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 30 18:52:20 volumio sudo[17501]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio volumio[1266]: info: Shairport-Sync Started May 30 18:52:20 volumio sudo[17349]: pam_unix(sudo:session): session closed for user root May 30 18:52:20 volumio volumio[1266]: info: Executing endpoint qc_getconfig May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: qobuzconnect , onGetConfig May 30 18:52:20 volumio systemd[1]: mpd.service: Deactivated successfully. May 30 18:52:20 volumio systemd[1]: Stopped mpd.service - Music Player Daemon. May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::volumioRetrieveVolumeLevels May 30 18:52:20 volumio volumio[1266]: info: CoreStateMachine::getcurrentVolume May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::volumioRetrievevolume May 30 18:52:20 volumio volumio[1266]: info: CoreStateMachine::pushState May 30 18:52:20 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::volumioPushState May 30 18:52:20 volumio qobuz-connect[17574]: 20260530 18:52:20.910 [17574.17574] INFO SampleApp: Started connection to /tmp/qbz-connect.socket UNIX socket May 30 18:52:20 volumio qobuz-connect[17574]: 20260530 18:52:20.914 [17574.17574] INFO VolumeManager: [0x933068]: Setting new playback volume: 75 May 30 18:52:20 volumio qobuz-connect[17574]: 20260530 18:52:20.914 [17574.17574] INFO VolumeManager: [0x933068]: Setting new mute state: 0 May 30 18:52:20 volumio qobuz-connect[17574]: 20260530 18:52:20.914 [17574.17574] INFO AudioStreamManager: [0x932dc0]: Setting new audio download buffer size: 1048576 May 30 18:52:20 volumio qobuz-connect[17574]: 20260530 18:52:20.914 [17574.17574] INFO QobuzConnect: [0x933930]: Client initialized! May 30 18:52:20 volumio qobuz-connect[17574]: 20260530 18:52:20.914 [17574.17574] INFO SampleApp: Starting Avahi advertising, name: Volumio, service name: _qobuz-connect._tcp May 30 18:52:20 volumio volumio[1266]: info: MRS: Pushing multiroomSync output update for this device May 30 18:52:20 volumio volumio[1266]: info: MRS: Pushing multiroomSync output May 30 18:52:20 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:20 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:20 volumio volumio[1266]: info: QobuzConnect: Qobuz Connect socket /tmp/qbz-connect.socket connected to client [object Object] May 30 18:52:20 volumio volumio[1266]: info: QobuzConnect: QOBUZ Connect daemon connected May 30 18:52:20 volumio qobuz-connect[17574]: 20260530 18:52:20.937 [17574.17574] INFO LocalConfigManager: [0x932ae8]: Starting Local Configuration server May 30 18:52:20 volumio qobuz-connect[17574]: 20260530 18:52:20.937 [17574.17574] INFO SampleApp: Starting Local configuration server May 30 18:52:20 volumio qobuz-connect[17574]: 20260530 18:52:20.938 [17574.17574] INFO SampleApp: Connected to UNIX socket client 0x91d818 May 30 18:52:20 volumio kernel: usb 1-1.2: new high-speed USB device number 14 using xhci_hcd May 30 18:52:20 volumio sudo[17533]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio sudo[17535]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio qobuz-connect[17574]: 20260530 18:52:21.060 [17574.17574] INFO SampleApp: Playback volume changed: 75 May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:21 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:21 volumio systemd[1]: mpd.socket: Deactivated successfully. May 30 18:52:21 volumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. May 30 18:52:21 volumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... May 30 18:52:21 volumio kernel: usb 1-1.2: New USB device found, idVendor=152a, idProduct=85dd, bcdDevice= 3.54 May 30 18:52:21 volumio kernel: usb 1-1.2: New USB device strings: Mfr=1, Product=3, SerialNumber=2 May 30 18:52:21 volumio kernel: usb 1-1.2: Product: SMSL USB AUDIO May 30 18:52:21 volumio kernel: usb 1-1.2: Manufacturer: SMSL May 30 18:52:21 volumio kernel: hid-generic 0003:152A:85DD.0009: hiddev96,hidraw0: USB HID v1.10 Device [SMSL SMSL USB AUDIO] on usb-0000:01:00.0-1.2/input3 May 30 18:52:21 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. May 30 18:52:21 volumio systemd[1]: Starting mpd.service - Music Player Daemon... May 30 18:52:21 volumio qobuz-connect[17574]: 20260530 18:52:21.138 [17574.17574] INFO SampleApp: Stopping Local configuration server May 30 18:52:21 volumio systemd[1]: Stopping qobuz-connect.service - Volumio Qobuz Connect Service... May 30 18:52:21 volumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... May 30 18:52:21 volumio systemd[1]: Started vtcs.service - Volumio Tidal Connect Service. May 30 18:52:21 volumio sudo[17568]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio sudo[17572]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio systemd[1]: shairport-sync.service: Deactivated successfully. May 30 18:52:21 volumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 30 18:52:21 volumio volumio[1266]: info: May 30 18:52:21 volumio volumio[1266]: ---------------------------- USB Audio Device Attached May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , usbAudioAttach May 30 18:52:21 volumio systemd[1]: shairport-sync.service: Start request repeated too quickly. May 30 18:52:21 volumio systemd[1]: shairport-sync.service: Failed with result 'start-limit-hit'. May 30 18:52:21 volumio systemd[1]: Failed to start shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 30 18:52:21 volumio sudo[17578]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::Close All Modals sent May 30 18:52:21 volumio volumio[1266]: info: Preparing to save Alsa Options, stopping services first May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:21 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::volumioPause May 30 18:52:21 volumio volumio[1266]: info: CoreStateMachine::pause May 30 18:52:21 volumio volumio[1266]: info: Saving Audio Output to: {"disallowPush":true,"output_device":{"value":"5","label":"SMSL USB AUDIO","alsacard":"AUDIO"},"i2s":false} May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:21 volumio sudo[17609]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log May 30 18:52:21 volumio sudo[17609]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:21 volumio sudo[17609]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio volumio[1266]: info: Device 5 does not have any Mixer Control Available May 30 18:52:21 volumio volumio[1266]: info: QobuzConnect: setDeactiveState invoked May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:21 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:21 volumio sudo[17632]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:21 volumio sudo[17632]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::volumioUpdateVolumeSettings May 30 18:52:21 volumio volumio[1266]: info: Updating Volume Controller Parameters: Device: 5 Name: SMSL USB AUDIO Mixer: Max Vol: 100 Vol Curve; logarithmic Vol Steps: 1 May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume May 30 18:52:21 volumio volumio[1266]: info: Disabling external Volume Control May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::getUIConfigOnPlugin May 30 18:52:21 volumio volumio[1266]: info: CoreStateMachine::pushState May 30 18:52:21 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::volumioPushState May 30 18:52:21 volumio volumio[1266]: info: MRS: Pushing multiroomSync output update for this device May 30 18:52:21 volumio volumio[1266]: info: MRS: Pushing multiroomSync output May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:21 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:21 volumio volumio[1266]: info: Preparing to generate the ALSA configuration file May 30 18:52:21 volumio systemd[1]: Stopping vtcs.service - Volumio Tidal Connect Service... May 30 18:52:21 volumio systemd[1]: vtcs.service: Deactivated successfully. May 30 18:52:21 volumio systemd[1]: Stopped vtcs.service - Volumio Tidal Connect Service. May 30 18:52:21 volumio sudo[17640]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:21 volumio sudo[17640]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:21 volumio sudo[17632]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio volumio[1266]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf May 30 18:52:21 volumio volumio[1266]: info: Reading ALSA contributions from plugins. May 30 18:52:21 volumio volumio[1266]: info: Shairport-sync error: Error: Command failed: /usr/bin/sudo /bin/systemctl restart shairport-sync May 30 18:52:21 volumio volumio[1266]: Job for shairport-sync.service failed because start of the service was attempted too often. May 30 18:52:21 volumio volumio[1266]: See "systemctl status shairport-sync.service" and "journalctl -xeu shairport-sync.service" for details. May 30 18:52:21 volumio volumio[1266]: To force a start use "systemctl reset-failed shairport-sync.service" May 30 18:52:21 volumio volumio[1266]: followed by "systemctl start shairport-sync.service" again. May 30 18:52:21 volumio volumio[1266]: info: Executing endpoint tc_getconfig May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: tidalconnect , onGetConfig May 30 18:52:21 volumio sudo[17645]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service May 30 18:52:21 volumio sudo[17645]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:21 volumio sudo[17645]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sOptions May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 30 18:52:21 volumio sudo[17651]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service May 30 18:52:21 volumio sudo[17640]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio sudo[17651]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: mpd , getPlaybackMode May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus May 30 18:52:21 volumio volumio[1266]: info: Asound.conf file unchanged, so no further update is needed May 30 18:52:21 volumio volumio[1266]: info: Output device has changed, restarting MPD May 30 18:52:21 volumio volumio[1266]: info: Output device has changed, restarting Shairport Sync May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:21 volumio sudo[17658]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf May 30 18:52:21 volumio sudo[17658]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:21 volumio sudo[17658]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio sudo[17660]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service May 30 18:52:21 volumio sudo[17660]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:21 volumio volumio[1266]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 May 30 18:52:21 volumio volumio[1266]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: QobuzConnect: setDeactiveState invoked May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::volumioGetState May 30 18:52:21 volumio volumio[1266]: info: CorePlayQueue::getTrack 0 May 30 18:52:21 volumio systemd[1]: mpd.service: Deactivated successfully. May 30 18:52:21 volumio systemd[1]: Stopped mpd.service - Music Player Daemon. May 30 18:52:21 volumio systemd[1]: mpd.socket: Deactivated successfully. May 30 18:52:21 volumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. May 30 18:52:21 volumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... May 30 18:52:21 volumio sudo[17670]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:21 volumio sudo[17670]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:21 volumio sudo[17675]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service May 30 18:52:21 volumio sudo[17675]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:21 volumio volumio[1266]: info: MPD Permissions set May 30 18:52:21 volumio volumio[1266]: info: TidalConnect service stoped! May 30 18:52:21 volumio volumio[1266]: info: TidalConnect service stoped! May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:21 volumio sudo[17681]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service May 30 18:52:21 volumio sudo[17681]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:21 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 18:52:21 volumio systemd[1]: Starting mpd.service - Music Player Daemon... May 30 18:52:21 volumio volumio[1266]: info: Updating tc_getconfig REST Endpoint for plugin: music_service/tidalconnect May 30 18:52:21 volumio volumio[1266]: info: Updating tc_connect REST Endpoint for plugin: music_service/tidalconnect May 30 18:52:21 volumio volumio[1266]: info: Starting Shairport Sync May 30 18:52:21 volumio sudo[17698]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync May 30 18:52:21 volumio sudo[17698]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:21 volumio sudo[17701]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service May 30 18:52:21 volumio sudo[17701]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:21 volumio sudo[17681]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio volumio[1266]: info: CoreCommandRouter::executeOnPlugin: raat , restartRaat May 30 18:52:21 volumio sudo[17703]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service May 30 18:52:21 volumio sudo[17703]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 30 18:52:21 volumio sudo[17670]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio volumio[1266]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 30 18:52:21 volumio systemd[1]: shairport-sync.service: Start request repeated too quickly. May 30 18:52:21 volumio systemd[1]: shairport-sync.service: Failed with result 'start-limit-hit'. May 30 18:52:21 volumio systemd[1]: Failed to start shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 30 18:52:21 volumio sudo[17675]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio volumio[1266]: Error: Command failed: /usr/bin/sudo /bin/systemctl stop vtcs.service && sleep 3 May 30 18:52:21 volumio volumio[1266]: Job for vtcs.service canceled. May 30 18:52:21 volumio volumio[1266]: at ChildProcess.exithandler (node:child_process:421:12) May 30 18:52:21 volumio volumio[1266]: at ChildProcess.emit (node:events:514:28) May 30 18:52:21 volumio volumio[1266]: at maybeClose (node:internal/child_process:1105:16) May 30 18:52:21 volumio volumio[1266]: at ChildProcess._handle.onexit (node:internal/child_process:305:5) { May 30 18:52:21 volumio volumio[1266]: code: 1, May 30 18:52:21 volumio volumio[1266]: killed: false, May 30 18:52:21 volumio volumio[1266]: signal: null, May 30 18:52:21 volumio volumio[1266]: cmd: '/usr/bin/sudo /bin/systemctl stop vtcs.service && sleep 3', May 30 18:52:21 volumio volumio[1266]: stdout: '', May 30 18:52:21 volumio volumio[1266]: stderr: 'Job for vtcs.service canceled.\n' May 30 18:52:21 volumio volumio[1266]: } May 30 18:52:21 volumio volumio[1266]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 30 18:52:21 volumio sudo[17692]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log May 30 18:52:21 volumio sudo[17692]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) May 30 18:52:21 volumio sudo[17692]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio systemd[1]: Started vtcs.service - Volumio Tidal Connect Service. May 30 18:52:21 volumio sudo[17701]: pam_unix(sudo:session): session closed for user root May 30 18:52:21 volumio sudo[17698]: pam_unix(sudo:session): session closed for user root May 30 18:52:22 volumio sudo[17724]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-05-30 18:51' May 30 18:52:22 volumio sudo[17724]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) PRETTY_NAME="Raspbian GNU/Linux 12 (bookworm)" NAME="Raspbian GNU/Linux" VERSION_ID="12" VERSION="12 (bookworm)" VERSION_CODENAME=bookworm ID=raspbian ID_LIKE=debian HOME_URL="http://www.raspbian.org/" SUPPORT_URL="http://www.raspbian.org/RaspbianForums" BUG_REPORT_URL="http://www.raspbian.org/RaspbianBugs" VOLUMIO_BUILD_VERSION="18952480e8d8c63f22208e9007a0f47a9563eae6" VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd" VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2" VOLUMIO_BE_VERSION="0e58f1861fa88e02087981b8d91f7511f0e7011b" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue Mar 24 17:20:52 UTC 2026" VOLUMIO_VERSION="4.119" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="d0c2fd9dbc5e70e58c32413c12353563"