Apr 03 13:58:03 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: tidal , handleBrowseUri Apr 03 13:58:03 volumio volumio[1189]: info: browseTIDALUri took 234 milliseconds Apr 03 13:58:03 volumio volumio[1189]: info: Preload queue cleared Apr 03 13:58:03 volumio volumio[1189]: info: Preload queue cleared Apr 03 13:58:05 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: tidal , handleBrowseUri Apr 03 13:58:05 volumio volumio[1189]: info: browseTIDALUri took 274 milliseconds Apr 03 13:58:05 volumio volumio[1189]: info: Preload queue cleared Apr 03 13:58:05 volumio volumio[1189]: info: Preload queue cleared Apr 03 13:58:06 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: tidal , handleBrowseUri Apr 03 13:58:07 volumio volumio[1189]: info: browseTIDALUri took 458 milliseconds Apr 03 13:58:07 volumio volumio[1189]: info: Preload queue cleared Apr 03 13:58:07 volumio volumio[1189]: info: Preloading song: tidal://song/77646085 Apr 03 13:58:07 volumio volumio[1189]: info: Preloading song: tidal://song/77651773 Apr 03 13:58:07 volumio volumio[1189]: info: Preloading song: tidal://song/539204 Apr 03 13:58:07 volumio volumio[1189]: info: Preloading song: tidal://song/77646602 Apr 03 13:58:07 volumio volumio[1189]: info: Preloading song: tidal://song/82489104 Apr 03 13:58:07 volumio volumio[1189]: info: Preloading song: tidal://song/103398060 Apr 03 13:58:07 volumio volumio[1189]: info: Preloading song: tidal://song/46447 Apr 03 13:58:07 volumio volumio[1189]: info: Preloading song: tidal://song/1787489 Apr 03 13:58:07 volumio volumio[1189]: info: Preloading song: tidal://song/225081310 Apr 03 13:58:07 volumio volumio[1189]: info: Preloading song: tidal://song/77555238 Apr 03 13:58:07 volumio volumio[1189]: info: Exploding uri tidal://song/77646085 in service tidal Apr 03 13:58:07 volumio volumio[1189]: info: Exploding uri tidal://song/77651773 in service tidal Apr 03 13:58:07 volumio volumio[1189]: info: Exploding uri tidal://song/539204 in service tidal Apr 03 13:58:07 volumio volumio[1189]: info: Exploding uri tidal://song/77646602 in service tidal Apr 03 13:58:07 volumio volumio[1189]: info: explodeTIDALUri took 178 milliseconds Apr 03 13:58:07 volumio volumio[1189]: info: Exploding uri tidal://song/82489104 in service tidal Apr 03 13:58:07 volumio volumio[1189]: info: Exploding uri tidal://song/103398060 in service tidal Apr 03 13:58:07 volumio volumio[1189]: info: Exploding uri tidal://song/46447 in service tidal Apr 03 13:58:07 volumio volumio[1189]: info: Exploding uri tidal://song/1787489 in service tidal Apr 03 13:58:07 volumio volumio[1189]: info: explodeTIDALUri took 326 milliseconds Apr 03 13:58:07 volumio volumio[1189]: info: explodeTIDALUri took 171 milliseconds Apr 03 13:58:07 volumio volumio[1189]: info: Exploding uri tidal://song/225081310 in service tidal Apr 03 13:58:07 volumio volumio[1189]: info: explodeTIDALUri took 327 milliseconds Apr 03 13:58:07 volumio volumio[1189]: info: Exploding uri tidal://song/77555238 in service tidal Apr 03 13:58:07 volumio volumio[1189]: info: explodeTIDALUri took 353 milliseconds Apr 03 13:58:07 volumio volumio[1189]: info: explodeTIDALUri took 167 milliseconds Apr 03 13:58:07 volumio volumio[1189]: info: explodeTIDALUri took 397 milliseconds Apr 03 13:58:07 volumio volumio[1189]: info: explodeTIDALUri took 197 milliseconds Apr 03 13:58:07 volumio volumio[1189]: info: explodeTIDALUri took 380 milliseconds Apr 03 13:58:07 volumio volumio[1189]: info: explodeTIDALUri took 345 milliseconds Apr 03 13:58:10 volumio volumio[1189]: info: Preload queue cleared Apr 03 13:58:10 volumio volumio[1189]: info: CoreCommandRouter::volumioReplaceandPlayItems Apr 03 13:58:10 volumio volumio[1189]: info: CoreStateMachine::ClearQueue Apr 03 13:58:10 volumio volumio[1189]: info: CoreStateMachine::stop Apr 03 13:58:10 volumio volumio[1189]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 03 13:58:10 volumio volumio[1189]: info: CorePlayQueue::clearPlayQueue Apr 03 13:58:10 volumio volumio[1189]: info: CorePlayQueue::saveQueue Apr 03 13:58:10 volumio volumio[1189]: info: CoreCommandRouter::volumioPushQueue Apr 03 13:58:10 volumio volumio[1189]: info: CoreStateMachine::addQueueItems Apr 03 13:58:10 volumio volumio[1189]: info: CorePlayQueue::addQueueItems Apr 03 13:58:10 volumio volumio[1189]: info: Preload queue cleared Apr 03 13:58:10 volumio volumio[1189]: info: Adding Item to queue: tidal://playlist/4f835e4a-87c2-4bec-a138-0e8ec8aa17d0 Apr 03 13:58:10 volumio volumio[1189]: info: Exploding uri tidal://playlist/4f835e4a-87c2-4bec-a138-0e8ec8aa17d0 in service tidal Apr 03 13:58:10 volumio volumio[1189]: info: explodeTIDALUri took 535 milliseconds Apr 03 13:58:10 volumio volumio[1189]: info: CoreCommandRouter::volumioPushQueue Apr 03 13:58:10 volumio volumio[1189]: info: CorePlayQueue::saveQueue Apr 03 13:58:10 volumio volumio[1189]: info: CoreStateMachine::updateTrackBlock Apr 03 13:58:10 volumio volumio[1189]: info: CorePlayQueue::getTrackBlock Apr 03 13:58:10 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:10 volumio volumio[1189]: info: CorePlayQueue::getTrack 2 Apr 03 13:58:10 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: play , [object Object] Apr 03 13:58:10 volumio volumio[1189]: info: CoreCommandRouter::volumioPlay Apr 03 13:58:10 volumio volumio[1189]: info: CoreStateMachine::play index 0 Apr 03 13:58:10 volumio volumio[1189]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 03 13:58:10 volumio volumio[1189]: info: CoreStateMachine::stop Apr 03 13:58:10 volumio volumio[1189]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 03 13:58:10 volumio volumio[1189]: info: CoreStateMachine::play index undefined Apr 03 13:58:10 volumio volumio[1189]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 03 13:58:10 volumio volumio[1189]: info: CorePlayQueue::getTrack 0 Apr 03 13:58:10 volumio volumio[1189]: info: CoreStateMachine::startPlaybackTimer Apr 03 13:58:10 volumio volumio[1189]: info: CorePlayQueue::getTrack 0 Apr 03 13:58:10 volumio volumio[1189]: info: [1775217490904] ControllerTidal::clearAddPlayTrack Apr 03 13:58:10 volumio volumio[1189]: info: Getting stream with soundQuality HI_RES Apr 03 13:58:11 volumio volumio[1189]: info: getStreamUrl took 186 milliseconds Apr 03 13:58:11 volumio volumio[1189]: verbose: ControllerMpd::sendMpdCommand stop Apr 03 13:58:11 volumio volumio[1189]: info: sendMpdCommand stop took 1 milliseconds Apr 03 13:58:11 volumio volumio[1189]: verbose: ControllerMpd::sendMpdCommand clear Apr 03 13:58:11 volumio volumio[1189]: info: Apr 03 13:58:11 volumio volumio[1189]: ---------------------------- MPD announces system playlist update Apr 03 13:58:11 volumio volumio[1189]: info: Ignoring MPD Status Update Apr 03 13:58:11 volumio volumio[1189]: info: sendMpdCommand clear took 2 milliseconds Apr 03 13:58:11 volumio volumio[1189]: verbose: ControllerMpd::sendMpdCommand add "http://lgf.audio.tidal.com/mediatracks/CAEaKAgDEiQwM2I5MGQ0YjY3NmI4OWY1ZDgzYmY1ODM0ZDMyOTM5Yi5tcDQ/0.flac?token=1775221091~NTM5NTFlN2FhY2M5YzE1MDE0NWEyMWM5MDgyYTI4ZjExMzM3NTNjYQ==" Apr 03 13:58:11 volumio upmpdcli[1482]: :3:../src/mpdcli.cxx:148::MPDCli::startEventLoop: already started Apr 03 13:58:11 volumio volumio[1189]: error: updateQueue error: null Apr 03 13:58:11 volumio volumio[1189]: info: Apr 03 13:58:11 volumio volumio[1189]: ---------------------------- MPD announces system playlist update Apr 03 13:58:11 volumio volumio[1189]: info: Ignoring MPD Status Update Apr 03 13:58:11 volumio volumio[1189]: info: ------------------------------ 8ms Apr 03 13:58:11 volumio volumio[1189]: info: sendMpdCommand add "http://lgf.audio.tidal.com/mediatracks/CAEaKAgDEiQwM2I5MGQ0YjY3NmI4OWY1ZDgzYmY1ODM0ZDMyOTM5Yi5tcDQ/0.flac?token=1775221091~NTM5NTFlN2FhY2M5YzE1MDE0NWEyMWM5MDgyYTI4ZjExMzM3NTNjYQ==" took 7 milliseconds Apr 03 13:58:11 volumio volumio[1189]: info: CoreStateMachine::setConsumeUpdateService mpd Apr 03 13:58:11 volumio volumio[1189]: verbose: ControllerMpd::sendMpdCommand play Apr 03 13:58:11 volumio volumio[1189]: info: ------------------------------ 4ms Apr 03 13:58:11 volumio volumio[1189]: info: sendMpdCommand play took 2 milliseconds Apr 03 13:58:11 volumio volumio[1189]: info: Apr 03 13:58:11 volumio volumio[1189]: ---------------------------- MPD announces state update: player Apr 03 13:58:11 volumio volumio[1189]: info: ControllerMpd::getState Apr 03 13:58:11 volumio volumio[1189]: verbose: ControllerMpd::sendMpdCommand status Apr 03 13:58:11 volumio volumio[1189]: info: Apr 03 13:58:11 volumio volumio[1189]: ---------------------------- MPD announces state update: player Apr 03 13:58:11 volumio volumio[1189]: info: sendMpdCommand status took 24 milliseconds Apr 03 13:58:11 volumio volumio[1189]: info: ControllerMpd::getState Apr 03 13:58:11 volumio volumio[1189]: verbose: ControllerMpd::sendMpdCommand status Apr 03 13:58:11 volumio volumio[1189]: verbose: ControllerMpd::parseState Apr 03 13:58:11 volumio volumio[1189]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 03 13:58:11 volumio volumio[1189]: info: sendMpdCommand status took 2 milliseconds Apr 03 13:58:11 volumio volumio[1189]: info: sendMpdCommand playlistinfo took 2 milliseconds Apr 03 13:58:11 volumio volumio[1189]: verbose: ControllerMpd::parseState Apr 03 13:58:11 volumio volumio[1189]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 03 13:58:11 volumio volumio[1189]: verbose: ControllerMpd::parseTrackInfo Apr 03 13:58:11 volumio volumio[1189]: info: ControllerMpd::pushState Apr 03 13:58:11 volumio volumio[1189]: info: CoreCommandRouter::servicePushState Apr 03 13:58:11 volumio volumio[1189]: info: CorePlayQueue::getTrack 0 Apr 03 13:58:11 volumio volumio[1189]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":139,"samplerate":"192 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"0.flac?token=1775221091~NTM5NTFlN2FhY2M5YzE1MDE0NWEyMWM5MDgyYTI4ZjExMzM3NTNjYQ==","artist":null,"album":null,"uri":"http://lgf.audio.tidal.com/mediatracks/CAEaKAgDEiQwM2I5MGQ0YjY3NmI4OWY1ZDgzYmY1ODM0ZDMyOTM5Yi5tcDQ/0.flac?token=1775221091~NTM5NTFlN2FhY2M5YzE1MDE0NWEyMWM5MDgyYTI4ZjExMzM3NTNjYQ==","trackType":"tidal"} Apr 03 13:58:11 volumio volumio[1189]: verbose: CURRENT POSITION 0 Apr 03 13:58:11 volumio volumio[1189]: info: CoreStateMachine::syncState stateService play Apr 03 13:58:11 volumio volumio[1189]: info: CoreStateMachine::syncState currentStatus stop Apr 03 13:58:11 volumio volumio[1189]: info: ------------------------------ 32ms Apr 03 13:58:11 volumio volumio[1189]: info: sendMpdCommand playlistinfo took 4 milliseconds Apr 03 13:58:11 volumio volumio[1189]: verbose: ControllerMpd::parseTrackInfo Apr 03 13:58:11 volumio volumio[1189]: info: ControllerMpd::pushState Apr 03 13:58:11 volumio volumio[1189]: info: CoreCommandRouter::servicePushState Apr 03 13:58:11 volumio volumio[1189]: info: CorePlayQueue::getTrack 0 Apr 03 13:58:11 volumio volumio[1189]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":139,"samplerate":"192 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"0.flac?token=1775221091~NTM5NTFlN2FhY2M5YzE1MDE0NWEyMWM5MDgyYTI4ZjExMzM3NTNjYQ==","artist":null,"album":null,"uri":"http://lgf.audio.tidal.com/mediatracks/CAEaKAgDEiQwM2I5MGQ0YjY3NmI4OWY1ZDgzYmY1ODM0ZDMyOTM5Yi5tcDQ/0.flac?token=1775221091~NTM5NTFlN2FhY2M5YzE1MDE0NWEyMWM5MDgyYTI4ZjExMzM3NTNjYQ==","trackType":"tidal"} Apr 03 13:58:11 volumio volumio[1189]: verbose: CURRENT POSITION 0 Apr 03 13:58:11 volumio volumio[1189]: info: CoreStateMachine::syncState stateService play Apr 03 13:58:11 volumio volumio[1189]: info: CoreStateMachine::syncState currentStatus play Apr 03 13:58:11 volumio volumio[1189]: info: Received an update from plugin. extracting info from payload Apr 03 13:58:11 volumio volumio[1189]: info: CoreStateMachine::pushState Apr 03 13:58:11 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 03 13:58:11 volumio volumio[1189]: info: CoreCommandRouter::volumioPushState Apr 03 13:58:11 volumio volumio[1189]: info: MRS: Pushing multiroomSync output update for this device Apr 03 13:58:11 volumio volumio[1189]: info: MRS: Pushing multiroomSync output Apr 03 13:58:11 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:11 volumio volumio[1189]: info: CoreStateMachine::pushState Apr 03 13:58:11 volumio volumio[1189]: info: CoreCommandRouter::volumioPushState Apr 03 13:58:11 volumio volumio[1189]: info: MRS: Pushing multiroomSync output update for this device Apr 03 13:58:11 volumio volumio[1189]: info: MRS: Pushing multiroomSync output Apr 03 13:58:11 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:11 volumio volumio5-onboarding[1407]: time=2026-04-03T13:58:11.283+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.38:52334,00:00:00:00:00:00%03 @ 0x3360990" state=STATUS_PLAYING positionMs=0 volume=100 Apr 03 13:58:11 volumio volumio5-onboarding[1407]: time=2026-04-03T13:58:11.284+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.38:52334,00:00:00:00:00:00%03 @ 0x3360990" id=tidal://song/77646085 title="What A Wonderful World" Apr 03 13:58:11 volumio volumio5-onboarding[1407]: time=2026-04-03T13:58:11.289+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.38:52334,00:00:00:00:00:00%03 @ 0x3360990" state=STATUS_PLAYING positionMs=0 volume=100 Apr 03 13:58:11 volumio volumio5-onboarding[1407]: time=2026-04-03T13:58:11.289+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.38:52334,00:00:00:00:00:00%03 @ 0x3360990" id=tidal://song/77646085 title="What A Wonderful World" Apr 03 13:58:11 volumio volumio[1189]: info: ------------------------------ 72ms Apr 03 13:58:29 volumio volumio5-onboarding[1407]: time=2026-04-03T13:58:29.430+02:00 level=INFO msg="navigate to next page" component=server type=REQUEST_TYPE_CONTINUE_NAVIGATION peer="192.168.0.38:52334,00:00:00:00:00:00%03 @ 0x3360990" latency=815.701356ms timeout=10s from=APP_PAGE_ROOT to=APP_PAGE_LEGACY_DEVICE Apr 03 13:58:30 volumio sudo[2607]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Apr 03 13:58:30 volumio sudo[2607]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:30 volumio sudo[2607]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:30 volumio sudo[2609]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Apr 03 13:58:30 volumio sudo[2609]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:30 volumio sudo[2609]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:30 volumio volumio[1189]: verbose: New Socket.io Connection to 192.168.0.233 from 192.168.0.38 UA: Mozilla/5.0 (Linux; Android 16; SM-S901B Build/BP2A.250605.031.A3; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/146.0.7680.119 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 8 Apr 03 13:58:30 volumio sudo[2613]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Apr 03 13:58:30 volumio sudo[2613]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:30 volumio sudo[2613]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:30 volumio sudo[2615]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Apr 03 13:58:30 volumio sudo[2615]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:30 volumio sudo[2615]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:30 volumio volumio[1189]: verbose: New Socket.io Connection to 192.168.0.233 from 192.168.0.38 UA: Mozilla/5.0 (Linux; Android 16; SM-S901B Build/BP2A.250605.031.A3; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/146.0.7680.119 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 9 Apr 03 13:58:30 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Apr 03 13:58:30 volumio volumio[1189]: info: CoreCommandRouter::volumioGetVisibleSources Apr 03 13:58:30 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Apr 03 13:58:30 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:30 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Apr 03 13:58:30 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Apr 03 13:58:30 volumio volumio[1189]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom Apr 03 13:58:30 volumio volumio[1189]: info: Received Get System Info Apr 03 13:58:30 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 03 13:58:30 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 03 13:58:30 volumio volumio[1189]: info: Discovery: Getting this device information Apr 03 13:58:30 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:30 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 03 13:58:30 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:30 volumio volumio[1189]: info: Listing playlists Apr 03 13:58:30 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Apr 03 13:58:30 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Apr 03 13:58:30 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Apr 03 13:58:32 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Apr 03 13:58:32 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Apr 03 13:58:32 volumio volumio[1189]: info: Received Get System Info Apr 03 13:58:32 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 03 13:58:32 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 03 13:58:32 volumio volumio[1189]: info: Discovery: Getting this device information Apr 03 13:58:32 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:32 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 03 13:58:33 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Apr 03 13:58:33 volumio volumio[1189]: info: Received Get System Info Apr 03 13:58:33 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 03 13:58:33 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 03 13:58:33 volumio volumio[1189]: info: Discovery: Getting this device information Apr 03 13:58:33 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:33 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 03 13:58:40 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Apr 03 13:58:45 volumio volumio[1189]: info: CoreCommandRouter::getUIConfigOnPlugin Apr 03 13:58:45 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sOptions Apr 03 13:58:45 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 03 13:58:45 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Apr 03 13:58:45 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:45 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:45 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:45 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:45 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:45 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:45 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:45 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getPlaybackMode Apr 03 13:58:45 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Apr 03 13:58:48 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Apr 03 13:58:48 volumio volumio[1189]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Apr 03 13:58:48 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Apr 03 13:58:48 volumio volumio[1189]: info: Received Get System Version Apr 03 13:58:48 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Apr 03 13:58:48 volumio volumio[1189]: info: Received Get System Info Apr 03 13:58:48 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 03 13:58:48 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 03 13:58:48 volumio volumio[1189]: info: Discovery: Getting this device information Apr 03 13:58:48 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:48 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 03 13:58:54 volumio volumio[1189]: info: CALLMETHOD: audio_interface alsa_controller saveAlsaOptions [object Object] Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , saveAlsaOptions Apr 03 13:58:54 volumio volumio[1189]: info: Preparing to save Alsa Options, stopping services first Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::volumioPause Apr 03 13:58:54 volumio volumio[1189]: info: CoreStateMachine::pause Apr 03 13:58:54 volumio volumio[1189]: info: CoreStateMachine::stPlaybackTimer Apr 03 13:58:54 volumio volumio[1189]: info: CoreStateMachine::servicePause Apr 03 13:58:54 volumio volumio[1189]: info: CorePlayQueue::getTrack 0 Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::servicePause Apr 03 13:58:54 volumio volumio[1189]: info: [1775217534420] ControllerTidal::pause Apr 03 13:58:54 volumio volumio[1189]: info: CoreStateMachine::setConsumeUpdateService mpd Apr 03 13:58:54 volumio volumio[1189]: info: ControllerMpd::pause Apr 03 13:58:54 volumio volumio[1189]: verbose: ControllerMpd::sendMpdCommand pause Apr 03 13:58:54 volumio volumio[1189]: info: Saving Audio Output to: {"output_device":{"value":"2","label":"vc4-hdmi"},"i2s":false,"i2sid":{"value":"adafruit-max98357","label":"Adafruit MAX98357"}} Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Apr 03 13:58:54 volumio volumio[1189]: info: Device 2 does not have any Mixer Control Available Apr 03 13:58:54 volumio volumio[1189]: info: QobuzConnect: setDeactiveState invoked Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:54 volumio vtcs[1962]: [2026-04-03 13:58:54.508] [tisoc] [warning] [SessionManagerImpl.cpp:240] Illegal State: IDLE Apr 03 13:58:54 volumio vtcs[1962]: [2026-04-03 13:58:54.510] [tisoc] [error] [SpkconServer.cpp:383] recv error. client fd=8 errorno=104 error=Connection reset by peer Apr 03 13:58:54 volumio vtcs[1962]: [2026-04-03 13:58:54.510] [tisoc] [error] [SpkconServer.cpp:378] recv error. socket disconnected Apr 03 13:58:54 volumio sudo[2676]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:54 volumio sudo[2676]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::volumioUpdateVolumeSettings Apr 03 13:58:54 volumio volumio[1189]: info: Updating Volume Controller Parameters: Device: 2 Name: vc4-hdmi Mixer: Max Vol: 100 Vol Curve; logarithmic Vol Steps: 4 Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume Apr 03 13:58:54 volumio volumio[1189]: info: Disabling external Volume Control Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::getUIConfigOnPlugin Apr 03 13:58:54 volumio volumio[1189]: info: CoreStateMachine::pushState Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::volumioPushState Apr 03 13:58:54 volumio volumio[1189]: info: MRS: Pushing multiroomSync output update for this device Apr 03 13:58:54 volumio volumio[1189]: info: MRS: Pushing multiroomSync output Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:54 volumio systemd[1]: Stopping vtcs.service - Volumio Tidal Connect Service... Apr 03 13:58:54 volumio volumio5-onboarding[1407]: time=2026-04-03T13:58:54.594+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.38:52334,00:00:00:00:00:00%03 @ 0x3360990" state=STATUS_PLAYING positionMs=43077 volume=100 Apr 03 13:58:54 volumio volumio5-onboarding[1407]: time=2026-04-03T13:58:54.595+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.38:52334,00:00:00:00:00:00%03 @ 0x3360990" id=tidal://song/77646085 title="What A Wonderful World" Apr 03 13:58:54 volumio systemd[1]: vtcs.service: Killing process 1985 (vtcs) with signal SIGKILL. Apr 03 13:58:54 volumio systemd[1]: vtcs.service: Deactivated successfully. Apr 03 13:58:54 volumio systemd[1]: Stopped vtcs.service - Volumio Tidal Connect Service. Apr 03 13:58:54 volumio volumio[1189]: info: Preparing to generate the ALSA configuration file Apr 03 13:58:54 volumio sudo[2676]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:54 volumio sudo[2683]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:54 volumio sudo[2683]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:54 volumio volumio[1189]: info: Apr 03 13:58:54 volumio volumio[1189]: ---------------------------- MPD announces state update: player Apr 03 13:58:54 volumio volumio[1189]: info: sendMpdCommand pause took 265 milliseconds Apr 03 13:58:54 volumio volumio[1189]: info: ControllerMpd::getState Apr 03 13:58:54 volumio volumio[1189]: verbose: ControllerMpd::sendMpdCommand status Apr 03 13:58:54 volumio sudo[2690]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service Apr 03 13:58:54 volumio sudo[2690]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:54 volumio volumio[1189]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf Apr 03 13:58:54 volumio volumio[1189]: info: Reading ALSA contributions from plugins. Apr 03 13:58:54 volumio volumio[1189]: info: sendMpdCommand status took 35 milliseconds Apr 03 13:58:54 volumio volumio[1189]: verbose: ControllerMpd::parseState Apr 03 13:58:54 volumio volumio[1189]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 03 13:58:54 volumio volumio[1189]: info: sendMpdCommand playlistinfo took 2 milliseconds Apr 03 13:58:54 volumio volumio[1189]: verbose: ControllerMpd::parseTrackInfo Apr 03 13:58:54 volumio volumio[1189]: info: ControllerMpd::pushState Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::servicePushState Apr 03 13:58:54 volumio volumio[1189]: info: CorePlayQueue::getTrack 0 Apr 03 13:58:54 volumio volumio[1189]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":44371,"duration":139,"samplerate":"192 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"5193 Kbps","isStreaming":false,"title":"0.flac?token=1775221091~NTM5NTFlN2FhY2M5YzE1MDE0NWEyMWM5MDgyYTI4ZjExMzM3NTNjYQ==","artist":null,"album":null,"uri":"http://lgf.audio.tidal.com/mediatracks/CAEaKAgDEiQwM2I5MGQ0YjY3NmI4OWY1ZDgzYmY1ODM0ZDMyOTM5Yi5tcDQ/0.flac?token=1775221091~NTM5NTFlN2FhY2M5YzE1MDE0NWEyMWM5MDgyYTI4ZjExMzM3NTNjYQ==","trackType":"tidal"} Apr 03 13:58:54 volumio volumio[1189]: verbose: CURRENT POSITION 0 Apr 03 13:58:54 volumio volumio[1189]: info: CoreStateMachine::syncState stateService pause Apr 03 13:58:54 volumio volumio[1189]: info: CoreStateMachine::syncState currentStatus pause Apr 03 13:58:54 volumio volumio[1189]: info: CoreStateMachine::pushState Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::volumioPushState Apr 03 13:58:54 volumio volumio[1189]: info: MRS: Pushing multiroomSync output update for this device Apr 03 13:58:54 volumio volumio[1189]: info: MRS: Pushing multiroomSync output Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:54 volumio volumio[1189]: info: CoreStateMachine::stPlaybackTimer Apr 03 13:58:54 volumio volumio5-onboarding[1407]: time=2026-04-03T13:58:54.748+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.38:52334,00:00:00:00:00:00%03 @ 0x3360990" state=STATUS_PAUSED positionMs=46308 volume=100 Apr 03 13:58:54 volumio volumio5-onboarding[1407]: time=2026-04-03T13:58:54.749+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.38:52334,00:00:00:00:00:00%03 @ 0x3360990" id=tidal://song/77646085 title="What A Wonderful World" Apr 03 13:58:54 volumio sudo[2690]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:54 volumio volumio[1189]: info: ------------------------------ 84ms Apr 03 13:58:54 volumio sudo[2683]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:54 volumio sudo[2692]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service Apr 03 13:58:54 volumio sudo[2692]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sOptions Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Apr 03 13:58:54 volumio systemd[1]: Stopping qobuz-connect.service - Volumio Qobuz Connect Service... Apr 03 13:58:54 volumio qobuz-connect[1896]: 20260403 13:58:54.850 [1896.1896] INFO SampleApp: Stopping Local configuration server Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getPlaybackMode Apr 03 13:58:54 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Apr 03 13:58:54 volumio volumio[1189]: info: Asound.conf file written Apr 03 13:58:54 volumio sudo[2703]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/mv /home/volumio/.asoundrc /etc/asound.conf Apr 03 13:58:54 volumio sudo[2703]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:54 volumio sudo[2703]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:55 volumio volumio[1189]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:0 use case configuration -2 Apr 03 13:58:55 volumio volumio[1189]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:1 use case configuration -2 Apr 03 13:58:55 volumio volumio[1189]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:2 use case configuration -2 Apr 03 13:58:55 volumio volumio[1189]: info: Output device has changed, restarting MPD Apr 03 13:58:55 volumio volumio[1189]: info: Output device has changed, restarting Shairport Sync Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 03 13:58:55 volumio sudo[2711]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Apr 03 13:58:55 volumio sudo[2711]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:55 volumio sudo[2713]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Apr 03 13:58:55 volumio sudo[2711]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:55 volumio sudo[2713]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:55 volumio volumio[1189]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Apr 03 13:58:55 volumio volumio[1189]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: QobuzConnect: setDeactiveState invoked Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:55 volumio volumio[1189]: info: Output device has changed, restarting MPD Apr 03 13:58:55 volumio systemd[1]: Stopping mpd.service - Music Player Daemon... Apr 03 13:58:55 volumio sudo[2725]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:55 volumio sudo[2725]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:55 volumio volumio[1189]: info: Output device has changed, restarting Shairport Sync Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 03 13:58:55 volumio sudo[2727]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Apr 03 13:58:55 volumio sudo[2727]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:55 volumio sudo[2730]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Apr 03 13:58:55 volumio sudo[2730]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:55 volumio sudo[2727]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:55 volumio volumio[1189]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Apr 03 13:58:55 volumio volumio[1189]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio sudo[2725]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:55 volumio volumio[1189]: info: QobuzConnect: setDeactiveState invoked Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:55 volumio sudo[2741]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:55 volumio sudo[2741]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:55 volumio sudo[2743]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:55 volumio sudo[2743]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:55 volumio sudo[2746]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:55 volumio sudo[2746]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:55 volumio systemd[1]: mpd.service: Deactivated successfully. Apr 03 13:58:55 volumio systemd[1]: Stopped mpd.service - Music Player Daemon. Apr 03 13:58:55 volumio systemd[1]: mpd.service: Consumed 40.060s CPU time. Apr 03 13:58:55 volumio sudo[2755]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service Apr 03 13:58:55 volumio sudo[2755]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:55 volumio systemd[1]: mpd.socket: Deactivated successfully. Apr 03 13:58:55 volumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. Apr 03 13:58:55 volumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... Apr 03 13:58:55 volumio volumio[1189]: info: MPD Permissions set Apr 03 13:58:55 volumio volumio[1189]: info: MPD Permissions set Apr 03 13:58:55 volumio sudo[2761]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service Apr 03 13:58:55 volumio sudo[2761]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. Apr 03 13:58:55 volumio upmpdcli[1482]: :2:../src/mpdcli.cxx:243::MPDCli::eventloop: mpd_run_idle_mask returned 0 Apr 03 13:58:55 volumio systemd[1]: Starting mpd.service - Music Player Daemon... Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:55 volumio volumio[1189]: info: CALLMETHOD: audio_interface alsa_controller saveAlsaOptions [object Object] Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , saveAlsaOptions Apr 03 13:58:55 volumio volumio[1189]: info: Preparing to save Alsa Options, stopping services first Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::volumioPause Apr 03 13:58:55 volumio volumio[1189]: info: CoreStateMachine::pause Apr 03 13:58:55 volumio volumio[1189]: info: Saving Audio Output to: {"output_device":{"value":"2","label":"vc4-hdmi"},"i2s":false,"i2sid":{"value":"adafruit-max98357","label":"Adafruit MAX98357"}} Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Apr 03 13:58:55 volumio sudo[2741]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:55 volumio volumio[1189]: info: Device 2 does not have any Mixer Control Available Apr 03 13:58:55 volumio volumio[1189]: info: QobuzConnect: setDeactiveState invoked Apr 03 13:58:55 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:55 volumio sudo[2743]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:55 volumio kernel: hwmon hwmon1: Undervoltage detected! Apr 03 13:58:55 volumio sudo[2755]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:56 volumio sudo[2746]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::volumioUpdateVolumeSettings Apr 03 13:58:56 volumio volumio[1189]: info: Updating Volume Controller Parameters: Device: 2 Name: vc4-hdmi Mixer: Max Vol: 100 Vol Curve; logarithmic Vol Steps: 4 Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume Apr 03 13:58:56 volumio volumio[1189]: info: Disabling external Volume Control Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::getUIConfigOnPlugin Apr 03 13:58:56 volumio sudo[2787]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:56 volumio volumio[1189]: info: CoreStateMachine::pushState Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::volumioPushState Apr 03 13:58:56 volumio sudo[2787]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:56 volumio sudo[2761]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:56 volumio volumio[1189]: info: MRS: Pushing multiroomSync output update for this device Apr 03 13:58:56 volumio volumio[1189]: info: MRS: Pushing multiroomSync output Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:56 volumio volumio5-onboarding[1407]: time=2026-04-03T13:58:56.091+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.38:52334,00:00:00:00:00:00%03 @ 0x3360990" state=STATUS_PAUSED positionMs=46308 volume=100 Apr 03 13:58:56 volumio volumio5-onboarding[1407]: time=2026-04-03T13:58:56.093+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.38:52334,00:00:00:00:00:00%03 @ 0x3360990" id=tidal://song/77646085 title="What A Wonderful World" Apr 03 13:58:56 volumio sudo[2792]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service Apr 03 13:58:56 volumio sudo[2792]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:56 volumio qobuz-connect[1896]: 20260403 13:58:56.173 [1896.1896] INFO SampleApp: shat down connection on UNIX socket Apr 03 13:58:56 volumio sudo[2796]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service Apr 03 13:58:56 volumio sudo[2796]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:56 volumio volumio[1189]: info: Preparing to generate the ALSA configuration file Apr 03 13:58:56 volumio systemd[1]: qobuz-connect.service: Deactivated successfully. Apr 03 13:58:56 volumio systemd[1]: Stopped qobuz-connect.service - Volumio Qobuz Connect Service. Apr 03 13:58:56 volumio systemd[1]: Started qobuz-connect.service - Volumio Qobuz Connect Service. Apr 03 13:58:56 volumio sudo[2801]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:56 volumio sudo[2692]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:56 volumio sudo[2801]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:56 volumio sudo[2766]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Apr 03 13:58:56 volumio sudo[2766]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Apr 03 13:58:56 volumio volumio[1189]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf Apr 03 13:58:56 volumio volumio[1189]: info: Reading ALSA contributions from plugins. Apr 03 13:58:56 volumio sudo[2766]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:56 volumio sudo[2809]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service Apr 03 13:58:56 volumio sudo[2809]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:56 volumio volumio[1189]: info: QobuzConnect: Qobuz Connect client [object Object] disconnected Apr 03 13:58:56 volumio volumio[1189]: info: QobuzConnect: setDeactiveState invoked Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:56 volumio volumio[1189]: info: Starting Shairport Sync Apr 03 13:58:56 volumio volumio[1189]: info: Starting Shairport Sync Apr 03 13:58:56 volumio sudo[2787]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:56 volumio sudo[2813]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Apr 03 13:58:56 volumio sudo[2813]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:56 volumio sudo[2815]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Apr 03 13:58:56 volumio sudo[2815]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:56 volumio volumio[1189]: info: Executing endpoint qc_getconfig Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: qobuzconnect , onGetConfig Apr 03 13:58:56 volumio qobuz-connect[2799]: 20260403 13:58:56.694 [2799.2799] INFO SampleApp: Started connection to /tmp/qbz-connect.socket UNIX socket Apr 03 13:58:56 volumio qobuz-connect[2799]: 20260403 13:58:56.722 [2799.2799] INFO VolumeManager: [0x10e7058]: Setting new playback volume: 75 Apr 03 13:58:56 volumio qobuz-connect[2799]: 20260403 13:58:56.722 [2799.2799] INFO VolumeManager: [0x10e7058]: Setting new mute state: 0 Apr 03 13:58:56 volumio qobuz-connect[2799]: 20260403 13:58:56.722 [2799.2799] INFO AudioStreamManager: [0x10e6db0]: Setting new audio download buffer size: 1048576 Apr 03 13:58:56 volumio qobuz-connect[2799]: 20260403 13:58:56.722 [2799.2799] INFO QobuzConnect: [0x10e7920]: Client initialized! Apr 03 13:58:56 volumio qobuz-connect[2799]: 20260403 13:58:56.722 [2799.2799] INFO SampleApp: Starting Avahi advertising, name: Volumio, service name: _qobuz-connect._tcp Apr 03 13:58:56 volumio sudo[2809]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:56 volumio qobuz-connect[2799]: 20260403 13:58:56.783 [2799.2799] INFO LocalConfigManager: [0x10e6ad8]: Starting Local Configuration server Apr 03 13:58:56 volumio qobuz-connect[2799]: 20260403 13:58:56.783 [2799.2799] INFO SampleApp: Starting Local configuration server Apr 03 13:58:56 volumio qobuz-connect[2799]: 20260403 13:58:56.784 [2799.2799] INFO SampleApp: Connected to UNIX socket client 0x10d1818 Apr 03 13:58:56 volumio systemd[1]: Stopping qobuz-connect.service - Volumio Qobuz Connect Service... Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sOptions Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 03 13:58:56 volumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... Apr 03 13:58:56 volumio qobuz-connect[2799]: 20260403 13:58:56.820 [2799.2799] INFO SampleApp: Stopping Local configuration server Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Apr 03 13:58:56 volumio sudo[2825]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service Apr 03 13:58:56 volumio systemd[1]: shairport-sync.service: Deactivated successfully. Apr 03 13:58:56 volumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Apr 03 13:58:56 volumio systemd[1]: shairport-sync.service: Consumed 2.212s CPU time. Apr 03 13:58:56 volumio sudo[2825]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:56 volumio sudo[2801]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: mpd , getPlaybackMode Apr 03 13:58:56 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Apr 03 13:58:56 volumio volumio[1189]: info: QobuzConnect: Qobuz Connect socket /tmp/qbz-connect.socket connected to client [object Object] Apr 03 13:58:56 volumio volumio[1189]: info: QobuzConnect: QOBUZ Connect daemon connected Apr 03 13:58:57 volumio volumio[1189]: info: Asound.conf file written Apr 03 13:58:57 volumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Apr 03 13:58:57 volumio sudo[2815]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:57 volumio sudo[2813]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:57 volumio sudo[2844]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/mv /home/volumio/.asoundrc /etc/asound.conf Apr 03 13:58:57 volumio sudo[2844]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:57 volumio sudo[2844]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:57 volumio volumio[1189]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:0 use case configuration -2 Apr 03 13:58:57 volumio volumio[1189]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:1 use case configuration -2 Apr 03 13:58:57 volumio volumio[1189]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:2 use case configuration -2 Apr 03 13:58:57 volumio volumio[1189]: info: Output device has changed, restarting MPD Apr 03 13:58:57 volumio volumio[1189]: info: Output device has changed, restarting Shairport Sync Apr 03 13:58:57 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:57 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 03 13:58:57 volumio sudo[2869]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Apr 03 13:58:57 volumio sudo[2869]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:57 volumio sudo[2869]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:57 volumio volumio[1189]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Apr 03 13:58:57 volumio volumio[1189]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Apr 03 13:58:57 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:57 volumio sudo[2874]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Apr 03 13:58:57 volumio sudo[2874]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:57 volumio volumio[1189]: info: QobuzConnect: setDeactiveState invoked Apr 03 13:58:57 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:57 volumio volumio[1189]: info: Preparing to generate the ALSA configuration file Apr 03 13:58:57 volumio sudo[2884]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:57 volumio sudo[2884]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:57 volumio systemd[1]: mpd.service: Deactivated successfully. Apr 03 13:58:57 volumio systemd[1]: Stopped mpd.service - Music Player Daemon. Apr 03 13:58:57 volumio systemd[1]: mpd.service: Consumed 1.054s CPU time. Apr 03 13:58:57 volumio systemd[1]: mpd.socket: Deactivated successfully. Apr 03 13:58:57 volumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. Apr 03 13:58:57 volumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... Apr 03 13:58:57 volumio upmpdcli[1482]: :2:../src/mpdcli.cxx:113::MPDCli::openconn: mpd_connection_new failed: Cannot assign requested address Apr 03 13:58:57 volumio upmpdcli[1482]: :2:../src/mpdcli.cxx:396::MPDCli::updStatus: connection failed Apr 03 13:58:57 volumio upmpdcli[1482]: :2:../src/mpdcli.cxx:243::MPDCli::eventloop: mpd_run_idle_mask returned 0 Apr 03 13:58:57 volumio volumio[1189]: info: Output device has changed, restarting MPD Apr 03 13:58:57 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. Apr 03 13:58:57 volumio volumio[1189]: info: Output device has changed, restarting Shairport Sync Apr 03 13:58:57 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:57 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 03 13:58:57 volumio systemd[1]: Starting mpd.service - Music Player Daemon... Apr 03 13:58:57 volumio sudo[2889]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Apr 03 13:58:57 volumio sudo[2889]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:57 volumio volumio[1189]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Apr 03 13:58:57 volumio volumio[1189]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Apr 03 13:58:57 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:57 volumio sudo[2891]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Apr 03 13:58:57 volumio sudo[2891]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:57 volumio sudo[2889]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:57 volumio volumio[1189]: info: QobuzConnect: setDeactiveState invoked Apr 03 13:58:57 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:57 volumio sudo[2902]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:57 volumio sudo[2902]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:57 volumio sudo[2884]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:57 volumio sudo[2904]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:57 volumio sudo[2904]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:58 volumio volumio[1189]: info: MRS: STARTING volumioStreaming Apr 03 13:58:58 volumio sudo[2913]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service Apr 03 13:58:58 volumio sudo[2906]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:58 volumio sudo[2906]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:58 volumio sudo[2913]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:58 volumio systemd[1]: mpd.service: Deactivated successfully. Apr 03 13:58:58 volumio systemd[1]: Stopped mpd.service - Music Player Daemon. Apr 03 13:58:58 volumio sudo[2921]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service Apr 03 13:58:58 volumio sudo[2921]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:58 volumio sudo[2925]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/rm -f /tmp/hls/stream.m3u8 /tmp/hls/stream38.ts /tmp/hls/stream39.ts /tmp/hls/stream40.ts /tmp/hls/stream41.ts Apr 03 13:58:58 volumio volumio[1189]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf Apr 03 13:58:58 volumio volumio[1189]: info: Reading ALSA contributions from plugins. Apr 03 13:58:58 volumio sudo[2925]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:58 volumio sudo[2925]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:58 volumio volumio[1189]: info: MPD Permissions set Apr 03 13:58:58 volumio volumio[1189]: info: MPD Permissions set Apr 03 13:58:58 volumio volumio[1189]: info: TidalConnect service stoped! Apr 03 13:58:58 volumio sudo[2927]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumioStreaming Apr 03 13:58:58 volumio sudo[2927]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:58 volumio volumio[1189]: info: TidalConnect service stoped! Apr 03 13:58:58 volumio volumio[1189]: info: Shairport-Sync Started Apr 03 13:58:58 volumio volumio[1189]: info: Shairport-Sync Started Apr 03 13:58:58 volumio volumio[1189]: info: TidalConnect service stoped! Apr 03 13:58:58 volumio systemd[1]: mpd.socket: Deactivated successfully. Apr 03 13:58:58 volumio sudo[2921]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:58 volumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. Apr 03 13:58:58 volumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio sudo[2935]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service Apr 03 13:58:58 volumio sudo[2935]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. Apr 03 13:58:58 volumio systemd[1]: Starting mpd.service - Music Player Daemon... Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: Updating tc_getconfig REST Endpoint for plugin: music_service/tidalconnect Apr 03 13:58:58 volumio volumio[1189]: info: Updating tc_connect REST Endpoint for plugin: music_service/tidalconnect Apr 03 13:58:58 volumio volumio[1189]: info: Starting Shairport Sync Apr 03 13:58:58 volumio volumio[1189]: info: Starting Shairport Sync Apr 03 13:58:58 volumio sudo[2954]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Apr 03 13:58:58 volumio volumio[1189]: info: Asound.conf file unchanged, so no further update is needed Apr 03 13:58:58 volumio volumio[1189]: info: Output device has changed, restarting MPD Apr 03 13:58:58 volumio sudo[2954]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:58 volumio sudo[2956]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Apr 03 13:58:58 volumio sudo[2956]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:58 volumio sudo[2913]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:58 volumio sudo[2958]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service Apr 03 13:58:58 volumio sudo[2958]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:58 volumio volumio[1189]: info: Output device has changed, restarting Shairport Sync Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 03 13:58:58 volumio sudo[2961]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Apr 03 13:58:58 volumio sudo[2961]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:58 volumio sudo[2961]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:58 volumio sudo[2904]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:58 volumio sudo[2964]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service Apr 03 13:58:58 volumio sudo[2964]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:58 volumio sudo[2906]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:58 volumio volumio[1189]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Apr 03 13:58:58 volumio volumio[1189]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:58 volumio sudo[2966]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Apr 03 13:58:58 volumio sudo[2966]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:58 volumio qobuz-connect[2799]: 20260403 13:58:58.791 [2799.2799] INFO SampleApp: shat down connection on UNIX socket Apr 03 13:58:58 volumio volumio[1189]: info: QobuzConnect: setDeactiveState invoked Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:58 volumio sudo[2902]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:58 volumio volumio[1189]: info: Preparing to generate the ALSA configuration file Apr 03 13:58:58 volumio systemd[1]: qobuz-connect.service: Deactivated successfully. Apr 03 13:58:58 volumio systemd[1]: Stopped qobuz-connect.service - Volumio Qobuz Connect Service. Apr 03 13:58:58 volumio sudo[2980]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:58 volumio sudo[2980]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::volumioRetrieveVolumeLevels Apr 03 13:58:58 volumio volumio[1189]: info: CoreStateMachine::getcurrentVolume Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::volumioRetrievevolume Apr 03 13:58:58 volumio volumio[1189]: info: CoreStateMachine::pushState Apr 03 13:58:58 volumio volumio[1189]: info: CoreCommandRouter::volumioPushState Apr 03 13:58:58 volumio sudo[2983]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:59 volumio volumio[1189]: info: MRS: Pushing multiroomSync output update for this device Apr 03 13:58:59 volumio sudo[2983]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:59 volumio volumio[1189]: info: MRS: Pushing multiroomSync output Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:59 volumio volumio5-onboarding[1407]: time=2026-04-03T13:58:59.014+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.38:52334,00:00:00:00:00:00%03 @ 0x3360990" state=STATUS_PAUSED positionMs=46308 volume=100 Apr 03 13:58:59 volumio volumio5-onboarding[1407]: time=2026-04-03T13:58:59.015+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.38:52334,00:00:00:00:00:00%03 @ 0x3360990" id=tidal://song/77646085 title="What A Wonderful World" Apr 03 13:58:59 volumio volumio[1189]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf Apr 03 13:58:59 volumio volumio[1189]: info: Reading ALSA contributions from plugins. Apr 03 13:58:59 volumio sudo[2989]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service Apr 03 13:58:59 volumio sudo[2989]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:59 volumio volumio[1189]: info: MPD Permissions set Apr 03 13:58:59 volumio volumio[1189]: info: TidalConnect service stoped! Apr 03 13:58:59 volumio volumio[1189]: info: TidalConnect service stoped! Apr 03 13:58:59 volumio volumio[1189]: info: TidalConnect service stoped! Apr 03 13:58:59 volumio volumio[1189]: info: QobuzConnect: Qobuz Connect client [object Object] disconnected Apr 03 13:58:59 volumio volumio[1189]: info: QobuzConnect: setDeactiveState invoked Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:59 volumio sudo[2949]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Apr 03 13:58:59 volumio sudo[2949]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:59 volumio volumio[1189]: info: Updating tc_getconfig REST Endpoint for plugin: music_service/tidalconnect Apr 03 13:58:59 volumio volumio[1189]: info: Updating tc_connect REST Endpoint for plugin: music_service/tidalconnect Apr 03 13:58:59 volumio volumio[1189]: info: Updating tc_getconfig REST Endpoint for plugin: music_service/tidalconnect Apr 03 13:58:59 volumio volumio[1189]: info: Updating tc_connect REST Endpoint for plugin: music_service/tidalconnect Apr 03 13:58:59 volumio sudo[2949]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:59 volumio volumio[1189]: info: Starting Shairport Sync Apr 03 13:58:59 volumio sudo[3017]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Apr 03 13:58:59 volumio sudo[3017]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:59 volumio volumio[1189]: info: Asound.conf file unchanged, so no further update is needed Apr 03 13:58:59 volumio volumio[1189]: info: Output device has changed, restarting MPD Apr 03 13:58:59 volumio volumio[1189]: info: Output device has changed, restarting Shairport Sync Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 03 13:58:59 volumio sudo[3023]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service Apr 03 13:58:59 volumio sudo[3023]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:59 volumio sudo[3020]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service Apr 03 13:58:59 volumio sudo[3020]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:59 volumio sudo[2958]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:59 volumio sudo[3028]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Apr 03 13:58:59 volumio sudo[3028]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:59 volumio sudo[3025]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Apr 03 13:58:59 volumio sudo[3025]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:59 volumio sudo[3025]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:59 volumio volumio[1189]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Apr 03 13:58:59 volumio volumio[1189]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 03 13:58:59 volumio volumio[1189]: info: QobuzConnect: setDeactiveState invoked Apr 03 13:58:59 volumio volumio[1189]: info: CoreCommandRouter::volumioGetState Apr 03 13:58:59 volumio sudo[3039]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:59 volumio sudo[3039]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:59 volumio sudo[2989]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:59 volumio sudo[2980]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:59 volumio sudo[2983]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:59 volumio volumio[1189]: info: MPD Permissions set Apr 03 13:58:59 volumio volumio[1189]: info: TidalConnect service stoped! Apr 03 13:58:59 volumio volumio[1189]: error: Error starting TidalConnect Command failed: /usr/bin/sudo /bin/systemctl start vtcs.service && sleep 3 Apr 03 13:58:59 volumio volumio[1189]: Job for vtcs.service canceled. Apr 03 13:58:59 volumio volumio[1189]: {"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":""} Apr 03 13:58:59 volumio volumio[1189]: error: Error starting TidalConnect Command failed: /usr/bin/sudo /bin/systemctl stop vtcs.service && sleep 3 Apr 03 13:58:59 volumio volumio[1189]: Job for vtcs.service canceled. Apr 03 13:58:59 volumio volumio[1189]: {"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":""} Apr 03 13:58:59 volumio volumio[1189]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Apr 03 13:58:59 volumio sudo[3049]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service Apr 03 13:58:59 volumio sudo[3042]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Apr 03 13:58:59 volumio sudo[3049]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:59 volumio sudo[3042]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:59 volumio sudo[3048]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service Apr 03 13:58:59 volumio sudo[3048]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:58:59 volumio volumio[1189]: Error: Command failed: /usr/bin/sudo /bin/systemctl stop vtcs.service && sleep 3 Apr 03 13:58:59 volumio volumio[1189]: Job for vtcs.service canceled. Apr 03 13:58:59 volumio volumio[1189]: at ChildProcess.exithandler (node:child_process:421:12) Apr 03 13:58:59 volumio volumio[1189]: at ChildProcess.emit (node:events:514:28) Apr 03 13:58:59 volumio volumio[1189]: at maybeClose (node:internal/child_process:1105:16) Apr 03 13:58:59 volumio volumio[1189]: at Socket. (node:internal/child_process:457:11) Apr 03 13:58:59 volumio volumio[1189]: at Socket.emit (node:events:514:28) Apr 03 13:58:59 volumio volumio[1189]: at Pipe. (node:net:337:12) { Apr 03 13:58:59 volumio volumio[1189]: code: 1, Apr 03 13:58:59 volumio volumio[1189]: killed: false, Apr 03 13:58:59 volumio volumio[1189]: signal: null, Apr 03 13:58:59 volumio volumio[1189]: cmd: '/usr/bin/sudo /bin/systemctl stop vtcs.service && sleep 3', Apr 03 13:58:59 volumio volumio[1189]: stdout: '', Apr 03 13:58:59 volumio volumio[1189]: stderr: 'Job for vtcs.service canceled.\n' Apr 03 13:58:59 volumio volumio[1189]: } Apr 03 13:58:59 volumio volumio[1189]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Apr 03 13:58:59 volumio sudo[3023]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:59 volumio sudo[3049]: pam_unix(sudo:session): session closed for user root Apr 03 13:58:59 volumio sudo[3020]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:00 volumio sudo[3064]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service Apr 03 13:59:00 volumio sudo[3064]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:59:00 volumio systemd[1]: Started qobuz-connect.service - Volumio Qobuz Connect Service. Apr 03 13:59:00 volumio sudo[2825]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:00 volumio sudo[2796]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:00 volumio sudo[2792]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:00 volumio sudo[3048]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:00 volumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... Apr 03 13:59:00 volumio sudo[2964]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:00 volumio sudo[2935]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:00 volumio systemd[1]: Stopping volumioStreaming.service - VolumioStreamingService... Apr 03 13:59:00 volumio systemd[1]: volumioStreaming.service: Killing process 2426 (ffmpeg) with signal SIGKILL. Apr 03 13:59:00 volumio systemd[1]: volumioStreaming.service: Killing process 2571 (ffmpeg) with signal SIGKILL. Apr 03 13:59:00 volumio systemd[1]: shairport-sync.service: Deactivated successfully. Apr 03 13:59:00 volumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Apr 03 13:59:00 volumio systemd[1]: mpd.service: Deactivated successfully. Apr 03 13:59:00 volumio systemd[1]: Stopped mpd.service - Music Player Daemon. Apr 03 13:59:00 volumio systemd[1]: volumioStreaming.service: Deactivated successfully. Apr 03 13:59:00 volumio systemd[1]: Stopped volumioStreaming.service - VolumioStreamingService. Apr 03 13:59:00 volumio systemd[1]: volumioStreaming.service: Consumed 9.278s CPU time. Apr 03 13:59:00 volumio sudo[3039]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:00 volumio sudo[3042]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:00 volumio systemd[1]: mpd.socket: Deactivated successfully. Apr 03 13:59:00 volumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. Apr 03 13:59:00 volumio upmpdcli[1482]: :2:../src/mpdcli.cxx:113::MPDCli::openconn: mpd_connection_new failed: Cannot assign requested address Apr 03 13:59:00 volumio upmpdcli[1482]: :2:../src/mpdcli.cxx:389::MPDCli::updStatus: no connection Apr 03 13:59:00 volumio upmpdcli[1482]: :2:../src/mpdcli.cxx:243::MPDCli::eventloop: mpd_run_idle_mask returned 0 Apr 03 13:59:00 volumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... Apr 03 13:59:01 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. Apr 03 13:59:01 volumio systemd[1]: Starting mpd.service - Music Player Daemon... Apr 03 13:59:01 volumio systemd[1]: Stopping qobuz-connect.service - Volumio Qobuz Connect Service... Apr 03 13:59:01 volumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Apr 03 13:59:01 volumio sudo[2956]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:01 volumio sudo[2954]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:01 volumio sudo[3017]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:01 volumio systemd[1]: Started volumioStreaming.service - VolumioStreamingService. Apr 03 13:59:01 volumio sudo[2927]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:01 volumio systemd[1]: qobuz-connect.service: Deactivated successfully. Apr 03 13:59:01 volumio systemd[1]: Stopped qobuz-connect.service - Volumio Qobuz Connect Service. Apr 03 13:59:01 volumio sudo[3074]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/rm -f /tmp/hls/* Apr 03 13:59:01 volumio sudo[3074]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:59:01 volumio sudo[3074]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:01 volumio systemd[1]: Started qobuz-connect.service - Volumio Qobuz Connect Service. Apr 03 13:59:01 volumio sudo[3064]: pam_unix(sudo:session): session closed for user root Apr 03 13:59:01 volumio sudo[3094]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-04-03 13:58' Apr 03 13:59:01 volumio sudo[3094]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Apr 03 13:59:01 volumio sudo[3071]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Apr 03 13:59:01 volumio sudo[3071]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Apr 03 13:59:01 volumio sudo[3071]: pam_unix(sudo:session): session closed for user root 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"