Aug 27 19:36:05 ferrum-broen kernel: usb 4-1: new high-speed USB device number 9 using xhci-hcd Aug 27 19:36:05 ferrum-broen kernel: usb 4-1: New USB device found, idVendor=13fd, idProduct=0840, bcdDevice= 1.14 Aug 27 19:36:05 ferrum-broen kernel: usb 4-1: New USB device strings: Mfr=1, Product=2, SerialNumber=3 Aug 27 19:36:05 ferrum-broen kernel: usb 4-1: Product: External Aug 27 19:36:05 ferrum-broen kernel: usb 4-1: Manufacturer: Generic Aug 27 19:36:05 ferrum-broen kernel: usb 4-1: SerialNumber: 4D335A423250473332333820 Aug 27 19:36:05 ferrum-broen kernel: usb-storage 4-1:1.0: USB Mass Storage device detected Aug 27 19:36:05 ferrum-broen kernel: scsi host0: usb-storage 4-1:1.0 Aug 27 19:36:05 ferrum-broen fsctd[1901]: [2026-08-27T17:36:05Z WARN fsct_driver::usb_device_watch] Failed to initialize device 13fd:0840: BOS descriptor not available, unsupported usb version 2.00 Aug 27 19:36:06 ferrum-broen kernel: scsi 0:0:0:0: CD-ROM hp DVDRAM GT30L mP06 PQ: 0 ANSI: 0 Aug 27 19:36:06 ferrum-broen kernel: sr 0:0:0:0: Power-on or device reset occurred Aug 27 19:36:06 ferrum-broen kernel: sr 0:0:0:0: [sr0] scsi3-mmc drive: 24x/24x writer dvd-ram cd/rw xa/form2 cdda tray Aug 27 19:36:06 ferrum-broen kernel: sr 0:0:0:0: Attached scsi CD-ROM sr0 Aug 27 19:36:06 ferrum-broen kernel: sr 0:0:0:0: Attached scsi generic sg0 type 5 Aug 27 19:36:06 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:06 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:06 ferrum-broen volumio[1418]: info: Clearing queue from CD entries Aug 27 19:36:06 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushQueue Aug 27 19:36:06 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioRemoveToBrowseSourcesAudio CD Aug 27 19:36:06 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Aug 27 19:36:06 ferrum-broen volumio[1418]: Cannot find translation for source Jellyfin Aug 27 19:36:23 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:23 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 3 Aug 27 19:36:23 ferrum-broen volumio[1418]: info: Prefetching next song Aug 27 19:36:23 ferrum-broen volumio[1418]: info: [jellyfin-play] Stream URL for Potrafisz: http://192.168.1.2:8096/Audio/f34a02769fab3574ab5eddf8437232e5/stream.wav?static=true&mediaSourceId=f34a02769fab3574ab5eddf8437232e5&tag=5b8c897aec2eac8b90f50414c8f68988 Aug 27 19:36:23 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand addid "http://192.168.1.2:8096/Audio/f34a02769fab3574ab5eddf8437232e5/stream.wav?static=true&mediaSourceId=f34a02769fab3574ab5eddf8437232e5&tag=5b8c897aec2eac8b90f50414c8f68988&t.wav" Aug 27 19:36:23 ferrum-broen volumio[1418]: info: sendMpdCommand addid "http://192.168.1.2:8096/Audio/f34a02769fab3574ab5eddf8437232e5/stream.wav?static=true&mediaSourceId=f34a02769fab3574ab5eddf8437232e5&tag=5b8c897aec2eac8b90f50414c8f68988&t.wav" took 1 milliseconds Aug 27 19:36:23 ferrum-broen volumio[1418]: verbose: MPD COMMAND [object Object] Aug 27 19:36:23 ferrum-broen volumio[1418]: verbose: MPD COMMAND [object Object] Aug 27 19:36:23 ferrum-broen volumio[1418]: verbose: MPD COMMAND [object Object] Aug 27 19:36:23 ferrum-broen volumio[1418]: info: Aug 27 19:36:23 ferrum-broen volumio[1418]: ---------------------------- MPD announces system playlist update Aug 27 19:36:23 ferrum-broen volumio[1418]: info: Ignoring MPD Status Update Aug 27 19:36:23 ferrum-broen volumio[1418]: info: Aug 27 19:36:23 ferrum-broen volumio[1418]: ---------------------------- MPD announces system playlist update Aug 27 19:36:23 ferrum-broen volumio[1418]: info: Ignoring MPD Status Update Aug 27 19:36:23 ferrum-broen volumio[1418]: info: Aug 27 19:36:23 ferrum-broen volumio[1418]: ---------------------------- MPD announces system playlist update Aug 27 19:36:23 ferrum-broen volumio[1418]: info: Ignoring MPD Status Update Aug 27 19:36:23 ferrum-broen volumio[1418]: info: Aug 27 19:36:23 ferrum-broen volumio[1418]: ---------------------------- MPD announces system playlist update Aug 27 19:36:23 ferrum-broen volumio[1418]: info: Ignoring MPD Status Update Aug 27 19:36:23 ferrum-broen volumio[1418]: info: ------------------------------ 1ms Aug 27 19:36:23 ferrum-broen volumio[1418]: info: ------------------------------ 1ms Aug 27 19:36:23 ferrum-broen volumio[1418]: info: [jellyfin-play] Prefetched and added song to MPD queue: Potrafisz Aug 27 19:36:23 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand consume 1 Aug 27 19:36:23 ferrum-broen volumio[1418]: info: Aug 27 19:36:23 ferrum-broen volumio[1418]: ---------------------------- MPD announces system playlist update Aug 27 19:36:23 ferrum-broen volumio[1418]: info: Ignoring MPD Status Update Aug 27 19:36:23 ferrum-broen volumio[1418]: info: Aug 27 19:36:23 ferrum-broen volumio[1418]: ---------------------------- MPD announces system playlist update Aug 27 19:36:23 ferrum-broen volumio[1418]: info: Ignoring MPD Status Update Aug 27 19:36:23 ferrum-broen volumio[1418]: info: ------------------------------ 2ms Aug 27 19:36:23 ferrum-broen volumio[1418]: info: ------------------------------ 2ms Aug 27 19:36:23 ferrum-broen volumio[1418]: info: sendMpdCommand consume 1 took 1 milliseconds Aug 27 19:36:23 ferrum-broen volumio[1418]: info: ------------------------------ 1ms Aug 27 19:36:23 ferrum-broen volumio[1418]: info: ------------------------------ 1ms Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Aug 27 19:36:24 ferrum-broen volumio[1418]: ---------------------------- MPD announces system playlist update Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Ignoring MPD Status Update Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Aug 27 19:36:24 ferrum-broen volumio[1418]: ---------------------------- MPD announces state update: player Aug 27 19:36:24 ferrum-broen volumio[1418]: info: ControllerMpd::getState Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand status Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Aug 27 19:36:24 ferrum-broen volumio[1418]: ---------------------------- MPD announces system playlist update Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Ignoring MPD Status Update Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Aug 27 19:36:24 ferrum-broen volumio[1418]: ---------------------------- MPD announces state update: player Aug 27 19:36:24 ferrum-broen volumio[1418]: info: ControllerMpd::getState Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand status Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Aug 27 19:36:24 ferrum-broen volumio[1418]: ---------------------------- MPD announces system playlist update Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Ignoring MPD Status Update Aug 27 19:36:24 ferrum-broen volumio[1418]: info: ControllerMpd::getState Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand status Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Aug 27 19:36:24 ferrum-broen volumio[1418]: ---------------------------- MPD announces state update: player Aug 27 19:36:24 ferrum-broen volumio[1418]: info: ControllerMpd::getState Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand status Aug 27 19:36:24 ferrum-broen volumio[1418]: info: ------------------------------ 2ms Aug 27 19:36:24 ferrum-broen volumio[1418]: info: sendMpdCommand status took 1 milliseconds Aug 27 19:36:24 ferrum-broen volumio[1418]: info: ------------------------------ 1ms Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::parseState Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand playlistinfo Aug 27 19:36:24 ferrum-broen volumio[1418]: info: sendMpdCommand status took 2 milliseconds Aug 27 19:36:24 ferrum-broen volumio[1418]: info: sendMpdCommand status took 5 milliseconds Aug 27 19:36:24 ferrum-broen volumio[1418]: info: ------------------------------ 6ms Aug 27 19:36:24 ferrum-broen volumio[1418]: info: sendMpdCommand status took 5 milliseconds Aug 27 19:36:24 ferrum-broen volumio[1418]: info: sendMpdCommand playlistinfo took 4 milliseconds Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::parseState Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand playlistinfo Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::parseState Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand playlistinfo Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::parseState Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand playlistinfo Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::parseTrackInfo Aug 27 19:36:24 ferrum-broen volumio[1418]: info: ControllerMpd::pushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::servicePushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":197,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"Potrafisz","artist":"Roksana Wegiel","album":"Roksana Wegiel","uri":"http://192.168.1.2:8096/Audio/f34a02769fab3574ab5eddf8437232e5/stream.wav?static=true&mediaSourceId=f34a02769fab3574ab5eddf8437232e5&tag=5b8c897aec2eac8b90f50414c8f68988&t.wav","trackType":"wav"} Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: CURRENT POSITION 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreStateMachine::syncState stateService play Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreStateMachine::syncState currentStatus play Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Received an update from plugin. extracting info from payload Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreStateMachine::pushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output update for this device Aug 27 19:36:24 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreStateMachine::pushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output update for this device Aug 27 19:36:24 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: ------------------------------ 20ms Aug 27 19:36:24 ferrum-broen volumio[1418]: info: sendMpdCommand playlistinfo took 15 milliseconds Aug 27 19:36:24 ferrum-broen volumio[1418]: info: sendMpdCommand playlistinfo took 15 milliseconds Aug 27 19:36:24 ferrum-broen volumio[1418]: info: sendMpdCommand playlistinfo took 14 milliseconds Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::parseTrackInfo Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::parseTrackInfo Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: ControllerMpd::parseTrackInfo Aug 27 19:36:24 ferrum-broen volumio[1418]: info: ControllerMpd::pushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::servicePushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":197,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"Potrafisz","artist":"Roksana Wegiel","album":"Roksana Wegiel","uri":"http://192.168.1.2:8096/Audio/f34a02769fab3574ab5eddf8437232e5/stream.wav?static=true&mediaSourceId=f34a02769fab3574ab5eddf8437232e5&tag=5b8c897aec2eac8b90f50414c8f68988&t.wav","trackType":"wav"} Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: CURRENT POSITION 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreStateMachine::syncState stateService play Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreStateMachine::syncState currentStatus play Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Received an update from plugin. extracting info from payload Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreStateMachine::pushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output update for this device Aug 27 19:36:24 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreStateMachine::pushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output update for this device Aug 27 19:36:24 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: ControllerMpd::pushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::servicePushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":197,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"Potrafisz","artist":"Roksana Wegiel","album":"Roksana Wegiel","uri":"http://192.168.1.2:8096/Audio/f34a02769fab3574ab5eddf8437232e5/stream.wav?static=true&mediaSourceId=f34a02769fab3574ab5eddf8437232e5&tag=5b8c897aec2eac8b90f50414c8f68988&t.wav","trackType":"wav"} Aug 27 19:36:24 ferrum-broen volumio[1418]: verbose: CURRENT POSITION 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreStateMachine::syncState stateService play Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreStateMachine::syncState currentStatus play Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Received an update from plugin. extracting info from payload Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreStateMachine::pushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output update for this device Aug 27 19:36:24 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreStateMachine::pushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output update for this device Aug 27 19:36:24 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output Aug 27 19:36:24 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 2 Aug 27 19:36:24 ferrum-broen volumio[1418]: info: ------------------------------ 38ms Aug 27 19:36:24 ferrum-broen volumio[1418]: info: ------------------------------ 37ms Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Pushing Favourites {"favourite":false} Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Signalling Playback active due to playback status change Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Signalling Playback active due to playback status change Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Signalling Playback active due to playback status change Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Signalling Playback active due to playback status change Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Signalling Playback active due to playback status change Aug 27 19:36:24 ferrum-broen volumio[1418]: info: Signalling Playback active due to playback status change Aug 27 19:36:24 ferrum-broen volumio[1418]: info: [jellyfin-play]: Reported 'stop' for song: Szampan (at 202087 ms) Aug 27 19:36:24 ferrum-broen volumio[1418]: info: [jellyfin-play]: Reported 'start' for song: Potrafisz (at 0 ms) Aug 27 19:36:26 ferrum-broen volumio[1418]: info: Preload queue cleared Aug 27 19:36:27 ferrum-broen volumio[1418]: info: CoreStateMachine::startPlaybackTimer Aug 27 19:36:27 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 3 Aug 27 19:36:28 ferrum-broen volumio[1418]: info: CoreStateMachine::pushState Aug 27 19:36:28 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 3 Aug 27 19:36:28 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Aug 27 19:36:28 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushState Aug 27 19:36:28 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:28 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 3 Aug 27 19:36:28 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output update for this device Aug 27 19:36:28 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output Aug 27 19:36:28 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 3 Aug 27 19:36:28 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 3 Aug 27 19:36:28 ferrum-broen volumio[1418]: info: Signalling Playback active due to playback status change Aug 27 19:36:28 ferrum-broen systemd[1]: Starting setdatetime-helper.service - Time Synchronization Helper Service... Aug 27 19:36:29 ferrum-broen systemd[1]: setdatetime-helper.service: Deactivated successfully. Aug 27 19:36:29 ferrum-broen systemd[1]: Finished setdatetime-helper.service - Time Synchronization Helper Service. Aug 27 19:36:30 ferrum-broen volumio[1418]: info: Executing endpoint metavolumio Aug 27 19:36:30 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Aug 27 19:36:30 ferrum-broen volumio[1418]: info: Executing endpoint metavolumio Aug 27 19:36:30 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Aug 27 19:36:30 ferrum-broen volumio[1418]: info: Executing endpoint metavolumio Aug 27 19:36:30 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Aug 27 19:36:31 ferrum-broen sudo[11760]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /dev/sr0 Aug 27 19:36:31 ferrum-broen sudo[11760]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Aug 27 19:36:31 ferrum-broen sudo[11760]: pam_unix(sudo:session): session closed for user root Aug 27 19:36:31 ferrum-broen sudo[11764]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /dev/sr1 Aug 27 19:36:31 ferrum-broen sudo[11764]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Aug 27 19:36:31 ferrum-broen sudo[11764]: pam_unix(sudo:session): session closed for user root Aug 27 19:36:31 ferrum-broen volumio[1418]: /bin/chmod: cannot access '/dev/sr1': No such file or directory Aug 27 19:36:31 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Aug 27 19:36:31 ferrum-broen volumio[1418]: info: [1787852191211] CoreMusicLibrary::Adding element Audio CD Aug 27 19:36:31 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Aug 27 19:36:31 ferrum-broen volumio[1418]: Cannot find translation for source Jellyfin Aug 27 19:36:31 ferrum-broen volumio[1418]: Cannot find translation for source Audio CD Aug 27 19:36:32 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: cd_controller , handleBrowseUri Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CDDB Entry Already exists Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Aug 27 19:36:33 ferrum-broen volumio[1418]: info: [1787852193573] CoreMusicLibrary::Adding element Audio CD Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Aug 27 19:36:33 ferrum-broen volumio[1418]: Cannot find translation for source Jellyfin Aug 27 19:36:33 ferrum-broen volumio[1418]: Cannot find translation for source Audio CD Aug 27 19:36:33 ferrum-broen volumio[1418]: info: Preload queue cleared Aug 27 19:36:33 ferrum-broen volumio[1418]: info: Executing endpoint getSimilarAlbums Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getSimilarAlbums Aug 27 19:36:33 ferrum-broen volumio[1418]: info: Executing endpoint getSimilarAlbums Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getSimilarAlbums Aug 27 19:36:33 ferrum-broen volumio[1418]: info: Executing endpoint getSimilarAlbums Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getSimilarAlbums Aug 27 19:36:33 ferrum-broen volumio[1418]: info: Executing endpoint getSimilarAlbums Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getSimilarAlbums Aug 27 19:36:33 ferrum-broen volumio[1418]: info: Executing endpoint getSimilarAlbums Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getSimilarAlbums Aug 27 19:36:33 ferrum-broen volumio[1418]: info: Executing endpoint getSimilarAlbums Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getSimilarAlbums Aug 27 19:36:33 ferrum-broen volumio[1418]: info: Executing endpoint getSimilarAlbums Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getSimilarAlbums Aug 27 19:36:33 ferrum-broen volumio[1418]: info: Executing endpoint metavolumio Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Aug 27 19:36:33 ferrum-broen volumio[1418]: info: Executing endpoint metavolumio Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Aug 27 19:36:33 ferrum-broen volumio[1418]: info: Executing endpoint metavolumio Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Aug 27 19:36:33 ferrum-broen volumio[1418]: info: Executing endpoint metavolumio Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Aug 27 19:36:33 ferrum-broen volumio[1418]: info: Executing endpoint metavolumio Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Aug 27 19:36:33 ferrum-broen volumio[1418]: info: Executing endpoint metavolumio Aug 27 19:36:33 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Preload queue cleared Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioReplaceandPlayItems Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::ClearQueue Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::stop Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::setConsumeUpdateService undefined Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::stPlaybackTimer Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::updateTrackBlock Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrackBlock Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::pushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 3 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 3 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output update for this device Aug 27 19:36:35 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::serviceStop Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 3 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::serviceStop Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::setConsumeUpdateService mpd Aug 27 19:36:35 ferrum-broen volumio[1418]: info: ControllerMpd::stop Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand stop Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::clearPlayQueue Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::saveQueue Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushQueue Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::addQueueItems Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::addQueueItems Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Preload queue cleared Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Adding Item to queue: cdaudio/track0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Exploding uri cdaudio/track0 in service cd_controller Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushQueue Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::saveQueue Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::updateTrackBlock Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrackBlock Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPlay Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::play index 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::setConsumeUpdateService undefined Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::addQueueItems Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::addQueueItems Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Preload queue cleared Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Adding Item to queue: cdaudio/track1 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Exploding uri cdaudio/track1 in service cd_controller Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Adding Item to queue: cdaudio/track2 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Exploding uri cdaudio/track2 in service cd_controller Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Adding Item to queue: cdaudio/track3 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Exploding uri cdaudio/track3 in service cd_controller Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Adding Item to queue: cdaudio/track4 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Exploding uri cdaudio/track4 in service cd_controller Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Adding Item to queue: cdaudio/track5 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Exploding uri cdaudio/track5 in service cd_controller Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Adding Item to queue: cdaudio/track6 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Exploding uri cdaudio/track6 in service cd_controller Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Adding Item to queue: cdaudio/track7 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Exploding uri cdaudio/track7 in service cd_controller Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Adding Item to queue: cdaudio/track8 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Exploding uri cdaudio/track8 in service cd_controller Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Adding Item to queue: cdaudio/track9 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Exploding uri cdaudio/track9 in service cd_controller Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Adding Item to queue: cdaudio/track10 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Exploding uri cdaudio/track10 in service cd_controller Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Adding Item to queue: cdaudio/track11 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Exploding uri cdaudio/track11 in service cd_controller Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Adding Item to queue: cdaudio/track12 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Exploding uri cdaudio/track12 in service cd_controller Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Adding Item to queue: cdaudio/track13 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Exploding uri cdaudio/track13 in service cd_controller Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::stop Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::setConsumeUpdateService undefined Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::play index undefined Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::setConsumeUpdateService undefined Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::startPlaybackTimer Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetVisibleSources Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStatsObject Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::clearAddPlayTracks cdda:///1 Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand stop Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushQueue Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::saveQueue Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::updateTrackBlock Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrackBlock Aug 27 19:36:35 ferrum-broen volumio[1418]: info: ControllerMpd::getState Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand status Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Aug 27 19:36:35 ferrum-broen volumio[1418]: ---------------------------- MPD announces state update: player Aug 27 19:36:35 ferrum-broen volumio[1418]: info: sendMpdCommand stop took 35 milliseconds Aug 27 19:36:35 ferrum-broen volumio[1418]: info: ControllerMpd::getState Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand status Aug 27 19:36:35 ferrum-broen volumio[1418]: info: sendMpdCommand stop took 10 milliseconds Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand clear Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Aug 27 19:36:35 ferrum-broen volumio[1418]: ---------------------------- MPD announces state update: player Aug 27 19:36:35 ferrum-broen volumio[1418]: info: ControllerMpd::getState Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand status Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Aug 27 19:36:35 ferrum-broen volumio[1418]: ---------------------------- MPD announces state update: player Aug 27 19:36:35 ferrum-broen volumio[1418]: info: ControllerMpd::getState Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand status Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Aug 27 19:36:35 ferrum-broen volumio[1418]: ---------------------------- MPD announces system playlist update Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Ignoring MPD Status Update Aug 27 19:36:35 ferrum-broen volumio[1418]: info: sendMpdCommand status took 2 milliseconds Aug 27 19:36:35 ferrum-broen volumio[1418]: info: sendMpdCommand status took 2 milliseconds Aug 27 19:36:35 ferrum-broen volumio[1418]: info: sendMpdCommand clear took 2 milliseconds Aug 27 19:36:35 ferrum-broen volumio[1418]: info: sendMpdCommand status took 1 milliseconds Aug 27 19:36:35 ferrum-broen volumio[1418]: info: sendMpdCommand status took 3 milliseconds Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::parseState Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand playlistinfo Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::parseState Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand playlistinfo Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand add "cdda:///1" Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::parseState Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::parseState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: ControllerMpd::pushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::servicePushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::pushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output update for this device Aug 27 19:36:35 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: CURRENT POSITION 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::syncState stateService stop Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::syncState currentStatus stop Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::pushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output update for this device Aug 27 19:36:35 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output Aug 27 19:36:35 ferrum-broen volumio[1418]: info: No code Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::pushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output update for this device Aug 27 19:36:35 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output Aug 27 19:36:35 ferrum-broen volumio[1418]: info: ControllerMpd::pushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::servicePushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::pushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output update for this device Aug 27 19:36:35 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: CURRENT POSITION 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::syncState stateService stop Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::syncState currentStatus stop Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::pushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output update for this device Aug 27 19:36:35 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output Aug 27 19:36:35 ferrum-broen volumio[1418]: info: No code Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreStateMachine::pushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioPushState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CoreCommandRouter::volumioGetState Aug 27 19:36:35 ferrum-broen volumio[1418]: info: CorePlayQueue::getTrack 0 Aug 27 19:36:35 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output update for this device Aug 27 19:36:35 ferrum-broen volumio[1418]: info: MRS: Pushing multiroomSync output Aug 27 19:36:35 ferrum-broen volumio[1418]: info: ------------------------------ 17ms Aug 27 19:36:35 ferrum-broen volumio[1418]: info: ------------------------------ 17ms Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Aug 27 19:36:35 ferrum-broen volumio[1418]: ---------------------------- MPD announces system playlist update Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Ignoring MPD Status Update Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Aug 27 19:36:35 ferrum-broen volumio[1418]: ---------------------------- MPD announces system playlist update Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Ignoring MPD Status Update Aug 27 19:36:35 ferrum-broen volumio[1418]: error: updateQueue error: null Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Aug 27 19:36:35 ferrum-broen volumio[1418]: ---------------------------- MPD announces system playlist update Aug 27 19:36:35 ferrum-broen volumio[1418]: info: Ignoring MPD Status Update Aug 27 19:36:35 ferrum-broen volumio[1418]: info: ------------------------------ 31ms Aug 27 19:36:35 ferrum-broen volumio[1418]: info: sendMpdCommand playlistinfo took 29 milliseconds Aug 27 19:36:35 ferrum-broen volumio[1418]: info: sendMpdCommand playlistinfo took 29 milliseconds Aug 27 19:36:35 ferrum-broen volumio[1418]: info: sendMpdCommand add "cdda:///1" took 29 milliseconds Aug 27 19:36:35 ferrum-broen volumio[1418]: info: ------------------------------ 14ms Aug 27 19:36:35 ferrum-broen volumio[1418]: info: ------------------------------ 14ms Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::parseTrackInfo Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::parseTrackInfo Aug 27 19:36:35 ferrum-broen volumio[1418]: verbose: ControllerMpd::sendMpdCommand play Aug 27 19:36:35 ferrum-broen volumio[1418]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Aug 27 19:36:35 ferrum-broen volumio[1418]: info: ------------------------------ 35ms Aug 27 19:36:35 ferrum-broen volumio[1418]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Aug 27 19:36:35 ferrum-broen volumio[1418]: TypeError: Cannot read properties of undefined (reading 'split') Aug 27 19:36:35 ferrum-broen volumio[1418]: at Promise._successFn (/volumio/app/plugins/music_service/mpd/index.js:280:60) Aug 27 19:36:35 ferrum-broen volumio[1418]: at nextTickCallback (/volumio/node_modules/kew/kew.js:47:28) Aug 27 19:36:35 ferrum-broen volumio[1418]: at process.processTicksAndRejections (node:internal/process/task_queues:77:11) Aug 27 19:36:35 ferrum-broen volumio[1418]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Aug 27 19:36:35 ferrum-broen sudo[12595]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-08-27 19:35' Aug 27 19:36:35 ferrum-broen sudo[12595]: 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="ad2b65e62ee66106fc9799a5d56d019303babfad" VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd" VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2" VOLUMIO_BE_VERSION="9938d7179e3b7c4e41f3e2d60c255985cff08fee" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="ferrumbroen" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Fri Aug 21 12:25:20 UTC 2026" VOLUMIO_VERSION="4.201" VOLUMIO_HARDWARE="cm5" VOLUMIO_DEVICENAME="CM5" VOLUMIO_HASH="6c16dfe7c39a70ad0e2ac927efa80139"