-- Logs begin at Thu 2025-07-03 04:13:22 UTC, end at Thu 2025-07-03 10:50:50 UTC. -- Jul 03 10:49:00 volumio kernel: [SNDRV]:[atm7059_link_hw_params] ###atm7059_link_hw_params Jul 03 10:49:00 volumio kernel: spdif_audio_hw_params 135 Jul 03 10:49:00 volumio kernel: spdif_audio_enable 82 Jul 03 10:49:00 volumio kernel: spdif_audio_enable: MFP_CTL3=0x40100008 Jul 03 10:49:00 volumio kernel: spdif_audio_enable: new MFP_CTL3=0x40200008 Jul 03 10:49:00 volumio kernel: atm7059_dai_hw_params,SNDRV_PCM_FORMAT_S32_LE Jul 03 10:49:00 volumio kernel: spdif_channel_status_cfg: tmp03=0x10550100, tmp47=0xf2 Jul 03 10:49:00 volumio kernel: spdif_channel_status_cfg: tmp03=0x10550100, tmp47=0xf2 Jul 03 10:49:02 volumio kernel: [SNDRV]:[atm7059_link_hw_params] ###atm7059_link_hw_params Jul 03 10:49:02 volumio kernel: spdif_audio_hw_params 135 Jul 03 10:49:02 volumio kernel: spdif_audio_enable 82 Jul 03 10:49:02 volumio kernel: spdif_audio_enable: MFP_CTL3=0x40100008 Jul 03 10:49:02 volumio kernel: spdif_audio_enable: new MFP_CTL3=0x40200008 Jul 03 10:49:02 volumio kernel: atm7059_dai_hw_params,SNDRV_PCM_FORMAT_S32_LE Jul 03 10:49:02 volumio kernel: spdif_channel_status_cfg: tmp03=0x12550100, tmp47=0xd2 Jul 03 10:49:02 volumio kernel: spdif_channel_status_cfg: tmp03=0x12550100, tmp47=0xd2 Jul 03 10:49:04 volumio kernel: [SNDRV]:[atm7059_link_hw_params] ###atm7059_link_hw_params Jul 03 10:49:04 volumio kernel: spdif_audio_hw_params 135 Jul 03 10:49:04 volumio kernel: spdif_audio_enable 82 Jul 03 10:49:04 volumio kernel: spdif_audio_enable: MFP_CTL3=0x40100008 Jul 03 10:49:04 volumio kernel: spdif_audio_enable: new MFP_CTL3=0x40200008 Jul 03 10:49:04 volumio kernel: atm7059_dai_hw_params,SNDRV_PCM_FORMAT_S32_LE Jul 03 10:49:04 volumio kernel: spdif_channel_status_cfg: tmp03=0x10550100, tmp47=0xf2 Jul 03 10:49:04 volumio kernel: spdif_channel_status_cfg: tmp03=0x10550100, tmp47=0xf2 Jul 03 10:49:05 volumio kernel: [SNDRV]:[atm7059_link_hw_params] ###atm7059_link_hw_params Jul 03 10:49:05 volumio kernel: spdif_audio_hw_params 135 Jul 03 10:49:05 volumio kernel: spdif_audio_enable 82 Jul 03 10:49:05 volumio kernel: spdif_audio_enable: MFP_CTL3=0x40100008 Jul 03 10:49:05 volumio kernel: spdif_audio_enable: new MFP_CTL3=0x40200008 Jul 03 10:49:05 volumio kernel: atm7059_dai_hw_params,SNDRV_PCM_FORMAT_S32_LE Jul 03 10:49:05 volumio kernel: spdif_channel_status_cfg: tmp03=0x10550100, tmp47=0xf2 Jul 03 10:49:05 volumio kernel: spdif_channel_status_cfg: tmp03=0x10550100, tmp47=0xf2 Jul 03 10:49:07 volumio systemd-journal[217]: Suppressed 889 messages from /system.slice/volumio.service Jul 03 10:49:07 volumio volumio[18421]: info: CoreCommandRouter::volumioNext Jul 03 10:49:07 volumio volumio[18421]: info: CoreStateMachine::next Jul 03 10:49:07 volumio volumio[18421]: info: CoreStateMachine::stop Jul 03 10:49:07 volumio volumio[18421]: info: CoreStateMachine::setConsumeUpdateService undefined Jul 03 10:49:07 volumio volumio[18421]: verbose: UNSET VOLATILE Jul 03 10:49:07 volumio volumio[18421]: info: CoreStateMachine::stPlaybackTimer Jul 03 10:49:07 volumio volumio[18421]: info: CoreStateMachine::updateTrackBlock Jul 03 10:49:07 volumio volumio[18421]: info: CorePlayQueue::getTrackBlock Jul 03 10:49:07 volumio volumio[18421]: info: CoreStateMachine::pushState Jul 03 10:49:07 volumio volumio[18421]: info: CorePlayQueue::getTrack 32 Jul 03 10:49:07 volumio volumio[18421]: info: CoreCommandRouter::volumioPushState Jul 03 10:49:07 volumio volumio[18421]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jul 03 10:49:07 volumio volumio[18421]: info: CoreStateMachine::serviceStop Jul 03 10:49:07 volumio volumio[18421]: info: CorePlayQueue::getTrack 32 Jul 03 10:49:07 volumio volumio[18421]: info: CoreCommandRouter::serviceStop Jul 03 10:49:07 volumio volumio[18421]: info: ControllerMpd::stop Jul 03 10:49:07 volumio volumio[18421]: verbose: ControllerMpd::sendMpdCommand stop Jul 03 10:49:07 volumio volumio[18421]: info: sendMpdCommand stop took 47 milliseconds Jul 03 10:49:07 volumio volumio[18421]: info: CoreStateMachine::play index undefined Jul 03 10:49:07 volumio volumio[18421]: info: CoreStateMachine::setConsumeUpdateService undefined Jul 03 10:49:07 volumio volumio[18421]: info: CorePlayQueue::getTrack 14 Jul 03 10:49:07 volumio volumio[18421]: info: CoreStateMachine::startPlaybackTimer Jul 03 10:49:07 volumio volumio[18421]: info: CorePlayQueue::getTrack 14 Jul 03 10:49:07 volumio volumio[18421]: verbose: ControllerMpd::clearAddPlayTracks USB/7CD5-2D50/song/Alan Walker_Iselin Solheim-Faded.flac Jul 03 10:49:07 volumio volumio[18421]: verbose: ControllerMpd::sendMpdCommand stop Jul 03 10:49:07 volumio volumio[18421]: info: CoreStateMachine::updateTrackBlock Jul 03 10:49:07 volumio volumio[18421]: info: CorePlayQueue::getTrackBlock Jul 03 10:49:07 volumio volumio[18421]: info: Jul 03 10:49:07 volumio volumio[18421]: ---------------------------- MPD announces state update: player Jul 03 10:49:07 volumio volumio[18421]: info: ControllerMpd::getState Jul 03 10:49:07 volumio volumio[18421]: verbose: ControllerMpd::sendMpdCommand status Jul 03 10:49:07 volumio volumio[18421]: info: sendMpdCommand stop took 17 milliseconds Jul 03 10:49:07 volumio volumio[18421]: verbose: ControllerMpd::sendMpdCommand clear Jul 03 10:49:07 volumio volumio[18421]: info: Jul 03 10:49:07 volumio volumio[18421]: ---------------------------- MPD announces system playlist update Jul 03 10:49:07 volumio volumio[18421]: info: Ignoring MPD Status Update Jul 03 10:49:07 volumio volumio[18421]: info: sendMpdCommand status took 20 milliseconds Jul 03 10:49:07 volumio volumio[18421]: info: sendMpdCommand clear took 17 milliseconds Jul 03 10:49:07 volumio volumio[18421]: verbose: ControllerMpd::parseState Jul 03 10:49:07 volumio volumio[18421]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jul 03 10:49:07 volumio volumio[18421]: verbose: ControllerMpd::sendMpdCommand add "USB/7CD5-2D50/song/Alan Walker_Iselin Solheim-Faded.flac" Jul 03 10:49:07 volumio volumio[18421]: error: updateQueue error: null Jul 03 10:49:07 volumio volumio[18421]: info: Jul 03 10:49:07 volumio volumio[18421]: ---------------------------- MPD announces system playlist update Jul 03 10:49:07 volumio volumio[18421]: info: Ignoring MPD Status Update Jul 03 10:49:07 volumio volumio[18421]: info: ------------------------------ 24ms Jul 03 10:49:07 volumio volumio[18421]: info: sendMpdCommand playlistinfo took 15 milliseconds Jul 03 10:49:08 volumio volumio[18421]: info: sendMpdCommand add "USB/7CD5-2D50/song/Alan Walker_Iselin Solheim-Faded.flac" took 14 milliseconds Jul 03 10:49:08 volumio volumio[18421]: verbose: ControllerMpd::parseTrackInfo Jul 03 10:49:08 volumio volumio[18421]: verbose: ControllerMpd::sendMpdCommand play Jul 03 10:49:08 volumio volumio[18421]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined Jul 03 10:49:08 volumio volumio[18421]: info: ------------------------------ 57ms Jul 03 10:49:08 volumio volumio[18421]: info: ------------------------------ 27ms Jul 03 10:49:08 volumio volumio[18421]: info: sendMpdCommand play took 19 milliseconds Jul 03 10:49:08 volumio volumio[18421]: info: Jul 03 10:49:08 volumio volumio[18421]: ---------------------------- MPD announces state update: player Jul 03 10:49:08 volumio volumio[18421]: info: ControllerMpd::getState Jul 03 10:49:08 volumio kernel: [SNDRV]:[atm7059_link_hw_params] ###atm7059_link_hw_params Jul 03 10:49:08 volumio kernel: spdif_audio_hw_params 135 Jul 03 10:49:08 volumio kernel: spdif_audio_enable 82 Jul 03 10:49:08 volumio kernel: spdif_audio_enable: MFP_CTL3=0x40100008 Jul 03 10:49:08 volumio kernel: spdif_audio_enable: new MFP_CTL3=0x40200008 Jul 03 10:49:08 volumio kernel: atm7059_dai_hw_params,SNDRV_PCM_FORMAT_S32_LE Jul 03 10:49:08 volumio kernel: spdif_channel_status_cfg: tmp03=0x10550100, tmp47=0xf2 Jul 03 10:49:08 volumio kernel: spdif_channel_status_cfg: tmp03=0x10550100, tmp47=0xf2 Jul 03 10:49:08 volumio volumio[18421]: verbose: ControllerMpd::sendMpdCommand status Jul 03 10:49:08 volumio volumio[18421]: info: Jul 03 10:49:08 volumio volumio[18421]: ---------------------------- MPD announces state update: player Jul 03 10:49:08 volumio volumio[18421]: info: sendMpdCommand status took 25 milliseconds Jul 03 10:49:08 volumio volumio[18421]: info: ControllerMpd::getState Jul 03 10:49:08 volumio volumio[18421]: verbose: ControllerMpd::sendMpdCommand status Jul 03 10:49:08 volumio volumio[18421]: verbose: ControllerMpd::parseState Jul 03 10:49:08 volumio volumio[18421]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jul 03 10:49:08 volumio volumio[18421]: info: sendMpdCommand status took 11 milliseconds Jul 03 10:49:08 volumio volumio[18421]: info: sendMpdCommand playlistinfo took 11 milliseconds Jul 03 10:49:08 volumio volumio[18421]: verbose: ControllerMpd::parseState Jul 03 10:49:08 volumio volumio[18421]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jul 03 10:49:08 volumio volumio[18421]: verbose: ControllerMpd::parseTrackInfo Jul 03 10:49:08 volumio volumio[18421]: info: ControllerMpd::pushState Jul 03 10:49:08 volumio volumio[18421]: info: CoreCommandRouter::servicePushState Jul 03 10:49:08 volumio volumio[18421]: info: CorePlayQueue::getTrack 14 Jul 03 10:49:08 volumio volumio[18421]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":213,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":true,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Faded","artist":"Alan Walker&Iselin Solheim","album":"Faded-[憔悴不堪]","uri":"USB/7CD5-2D50/song/Alan Walker_Iselin Solheim-Faded.flac","trackType":"flac"} Jul 03 10:49:08 volumio volumio[18421]: verbose: CURRENT POSITION 14 Jul 03 10:49:08 volumio volumio[18421]: info: CoreStateMachine::syncState stateService play Jul 03 10:49:08 volumio volumio[18421]: info: CoreStateMachine::syncState currentStatus stop Jul 03 10:49:08 volumio volumio[18421]: info: CoreStateMachine::pushState Jul 03 10:49:08 volumio volumio[18421]: info: CorePlayQueue::getTrack 14 Jul 03 10:49:08 volumio volumio[18421]: info: CoreCommandRouter::volumioPushState Jul 03 10:49:08 volumio volumio[18421]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jul 03 10:49:08 volumio volumio[18421]: info: ------------------------------ 92ms Jul 03 10:49:08 volumio volumio[18421]: info: sendMpdCommand playlistinfo took 42 milliseconds Jul 03 10:49:08 volumio volumio[18421]: verbose: ControllerMpd::parseTrackInfo Jul 03 10:49:08 volumio volumio[18421]: info: ControllerMpd::pushState Jul 03 10:49:08 volumio volumio[18421]: info: CoreCommandRouter::servicePushState Jul 03 10:49:08 volumio volumio[18421]: info: CorePlayQueue::getTrack 14 Jul 03 10:49:08 volumio volumio[18421]: verbose: STATE SERVICE {"status":"play","position":0,"seek":162,"duration":213,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":true,"repeat":false,"bitrate":"648 Kbps","isStreaming":false,"title":"Faded","artist":"Alan Walker&Iselin Solheim","album":"Faded-[憔悴不堪]","uri":"USB/7CD5-2D50/song/Alan Walker_Iselin Solheim-Faded.flac","trackType":"flac"} Jul 03 10:49:08 volumio volumio[18421]: verbose: CURRENT POSITION 14 Jul 03 10:49:08 volumio volumio[18421]: info: CoreStateMachine::syncState stateService play Jul 03 10:49:08 volumio volumio[18421]: info: CoreStateMachine::syncState currentStatus play Jul 03 10:49:08 volumio volumio[18421]: info: Received an update from plugin. extracting info from payload Jul 03 10:49:08 volumio volumio[18421]: info: CoreStateMachine::pushState Jul 03 10:49:08 volumio volumio[18421]: info: CorePlayQueue::getTrack 14 Jul 03 10:49:08 volumio volumio[18421]: info: CoreCommandRouter::volumioPushState Jul 03 10:49:08 volumio volumio[18421]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jul 03 10:49:08 volumio volumio[18421]: info: CoreStateMachine::pushState Jul 03 10:49:08 volumio volumio[18421]: info: CorePlayQueue::getTrack 14 Jul 03 10:49:08 volumio volumio[18421]: info: CoreCommandRouter::volumioPushState Jul 03 10:49:08 volumio volumio[18421]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jul 03 10:49:08 volumio volumio[18421]: info: ------------------------------ 127ms Jul 03 10:50:49 volumio volumio[18421]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jul 03 10:50:49 volumio volumio[18421]: { Error: connect ETIMEDOUT 50.117.117.42:443 Jul 03 10:50:49 volumio volumio[18421]: at Object._errnoException (util.js:1022:11) Jul 03 10:50:49 volumio volumio[18421]: at _exceptionWithHostPort (util.js:1044:20) Jul 03 10:50:49 volumio volumio[18421]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1198:14) Jul 03 10:50:49 volumio volumio[18421]: code: 'ETIMEDOUT', Jul 03 10:50:49 volumio volumio[18421]: errno: 'ETIMEDOUT', Jul 03 10:50:49 volumio volumio[18421]: syscall: 'connect', Jul 03 10:50:49 volumio volumio[18421]: address: '50.117.117.42', Jul 03 10:50:49 volumio volumio[18421]: port: 443 } Jul 03 10:50:49 volumio volumio[18421]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jul 03 10:50:50 volumio sudo[19500]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-07-03 10:49 Jul 03 10:50:50 volumio sudo[19500]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Raspbian GNU/Linux 8 (jessie)" NAME="Raspbian GNU/Linux" VERSION_ID="8" VERSION="8 (jessie)" 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="dd2a4339faaeb892c7f467e7dc8d424aefb0bd03" VOLUMIO_FE_VERSION="958dedc0edff114f244fa9acc70cf53089d9e5ae" VOLUMIO_BE_VERSION="307f91893fca011201acba9973e1c41bd3a0ad5d" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Fri Oct 1 12:12:00 CEST 2021" VOLUMIO_VERSION="2.916" VOLUMIO_HARDWARE="sparky" VOLUMIO_HASH="1507c65028120e16c14994c066bc5dd4"