-- Logs begin at Tue 2026-01-13 11:04:59 UTC, end at Tue 2026-01-13 14:23:01 UTC. -- Jan 13 14:22:28 volumio volumio[5790]: info: Jan 13 14:22:28 volumio volumio[5790]: ---------------------------- MPD announces state update: player Jan 13 14:22:28 volumio volumio[5790]: info: ControllerMpd::getState Jan 13 14:22:28 volumio volumio[5790]: verbose: ControllerMpd::sendMpdCommand status Jan 13 14:22:28 volumio volumio[5790]: info: sendMpdCommand status took 4 milliseconds Jan 13 14:22:28 volumio volumio[5790]: verbose: ControllerMpd::parseState Jan 13 14:22:28 volumio volumio[5790]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 13 14:22:28 volumio volumio[5790]: info: sendMpdCommand playlistinfo took 2 milliseconds Jan 13 14:22:28 volumio volumio[5790]: verbose: ControllerMpd::parseTrackInfo Jan 13 14:22:28 volumio volumio[5790]: info: ControllerMpd::pushState Jan 13 14:22:28 volumio volumio[5790]: info: CoreCommandRouter::servicePushState Jan 13 14:22:28 volumio volumio[5790]: info: CoreStateMachine::pushState Jan 13 14:22:28 volumio volumio[5790]: info: CoreCommandRouter::volumioPushState Jan 13 14:22:28 volumio volumio[5790]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 13 14:22:28 volumio volumio[5790]: info: CorePlayQueue::getTrack 0 Jan 13 14:22:28 volumio volumio[5790]: verbose: STATE SERVICE {"status":"stop","position":0,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"爱错","artist":"王力宏","album":"火力全开","uri":"http://fsandroid.tx.kugou.com/202601132220/d4dcfb356f63abb18549b5614e7e9b64/v3/37a31e2833c6a67d5bccea48ca430838/yp/full/ap1005_us1564332105_df349nwv1x5czs2prhm31as6sf_pi2_mx27581553_quhigh_ct450100_s2441402602.flac","trackType":"flac"} Jan 13 14:22:28 volumio volumio[5790]: verbose: CURRENT POSITION 0 Jan 13 14:22:28 volumio volumio[5790]: info: CoreStateMachine::syncState stateService stop Jan 13 14:22:28 volumio volumio[5790]: info: CoreStateMachine::syncState currentStatus play Jan 13 14:22:28 volumio volumio[5790]: info: CoreStateMachine::play index undefined Jan 13 14:22:28 volumio volumio[5790]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 13 14:22:28 volumio volumio[5790]: info: CoreStateMachine::pushState Jan 13 14:22:28 volumio volumio[5790]: info: CorePlayQueue::getTrack 0 Jan 13 14:22:28 volumio volumio[5790]: info: CoreCommandRouter::volumioPushState Jan 13 14:22:28 volumio volumio[5790]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 13 14:22:28 volumio volumio[5790]: info: CorePlayQueue::getTrack 0 Jan 13 14:22:28 volumio volumio[5790]: info: ------------------------------ 58ms Jan 13 14:22:28 volumio volumio[5790]: info: CoreCommandRouter::volumioGetQueue Jan 13 14:22:28 volumio volumio[5790]: info: CoreStateMachine::getQueue Jan 13 14:22:28 volumio volumio[5790]: info: CorePlayQueue::getQueue Jan 13 14:22:29 volumio volumio[5790]: info: Clearing queue after UPNP request Jan 13 14:22:29 volumio volumio[5790]: info: CoreStateMachine::ClearQueue Jan 13 14:22:29 volumio volumio[5790]: info: CoreStateMachine::stop Jan 13 14:22:29 volumio volumio[5790]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 13 14:22:29 volumio volumio[5790]: verbose: UNSET VOLATILE Jan 13 14:22:29 volumio volumio[5790]: info: CorePlayQueue::clearPlayQueue Jan 13 14:22:29 volumio volumio[5790]: info: CorePlayQueue::saveQueue Jan 13 14:22:29 volumio volumio[5790]: info: CoreCommandRouter::volumioPushState Jan 13 14:22:29 volumio volumio[5790]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 13 14:22:29 volumio volumio[5790]: info: CoreCommandRouter::volumioPushQueue Jan 13 14:22:29 volumio volumio[5790]: info: Jan 13 14:22:29 volumio volumio[5790]: ---------------------------- MPD announces system playlist update Jan 13 14:22:29 volumio volumio[5790]: info: Ignoring MPD Status Update Jan 13 14:22:29 volumio volumio[5790]: error: updateQueue error: null Jan 13 14:22:29 volumio volumio[5790]: info: ------------------------------ 5ms Jan 13 14:22:29 volumio volumio[5790]: info: Starting UPNP Playback Jan 13 14:22:29 volumio volumio[5790]: info: Preparing playback through UPNP Jan 13 14:22:29 volumio volumio[5790]: info: CoreCommandRouter::volumioGetState Jan 13 14:22:29 volumio volumio[5790]: info: CorePlayQueue::getTrack 0 Jan 13 14:22:29 volumio volumio[5790]: info: CoreStateMachine::setConsumeUpdateService mpd Jan 13 14:22:29 volumio volumio[5790]: info: Jan 13 14:22:29 volumio volumio[5790]: ---------------------------- MPD announces system playlist update Jan 13 14:22:29 volumio volumio[5790]: info: Ignoring MPD Status Update Jan 13 14:22:29 volumio volumio[5790]: info: ------------------------------ 3ms Jan 13 14:22:29 volumio volumio[5790]: info: Jan 13 14:22:29 volumio volumio[5790]: ---------------------------- MPD announces system playlist update Jan 13 14:22:29 volumio volumio[5790]: info: Ignoring MPD Status Update Jan 13 14:22:29 volumio volumio[5790]: info: ------------------------------ 3ms Jan 13 14:22:29 volumio volumio[5790]: info: Jan 13 14:22:29 volumio volumio[5790]: ---------------------------- MPD announces system playlist update Jan 13 14:22:29 volumio volumio[5790]: info: Ignoring MPD Status Update Jan 13 14:22:29 volumio volumio[5790]: info: ------------------------------ 3ms Jan 13 14:22:29 volumio volumio[5790]: info: Jan 13 14:22:29 volumio volumio[5790]: ---------------------------- MPD announces system playlist update Jan 13 14:22:29 volumio volumio[5790]: info: Ignoring MPD Status Update Jan 13 14:22:29 volumio volumio[5790]: info: ------------------------------ 4ms Jan 13 14:22:29 volumio volumio[5790]: info: Jan 13 14:22:29 volumio volumio[5790]: ---------------------------- MPD announces system playlist update Jan 13 14:22:29 volumio volumio[5790]: info: Ignoring MPD Status Update Jan 13 14:22:29 volumio volumio[5790]: info: ------------------------------ 4ms Jan 13 14:22:29 volumio volumio[5790]: info: Jan 13 14:22:29 volumio volumio[5790]: ---------------------------- MPD announces system playlist update Jan 13 14:22:29 volumio volumio[5790]: info: Ignoring MPD Status Update Jan 13 14:22:29 volumio volumio[5790]: info: ------------------------------ 3ms Jan 13 14:22:37 volumio volumio[5790]: info: Jan 13 14:22:37 volumio volumio[5790]: ---------------------------- MPD announces state update: player Jan 13 14:22:37 volumio volumio[5790]: info: ControllerMpd::getState Jan 13 14:22:37 volumio volumio[5790]: verbose: ControllerMpd::sendMpdCommand status Jan 13 14:22:37 volumio volumio[5790]: info: sendMpdCommand status took 9 milliseconds Jan 13 14:22:37 volumio volumio[5790]: verbose: ControllerMpd::parseState Jan 13 14:22:37 volumio volumio[5790]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 13 14:22:37 volumio volumio[5790]: info: Jan 13 14:22:37 volumio volumio[5790]: ---------------------------- MPD announces state update: player Jan 13 14:22:37 volumio volumio[5790]: info: ControllerMpd::getState Jan 13 14:22:37 volumio volumio[5790]: verbose: ControllerMpd::sendMpdCommand status Jan 13 14:22:37 volumio volumio[5790]: info: sendMpdCommand playlistinfo took 6 milliseconds Jan 13 14:22:37 volumio volumio[5790]: info: sendMpdCommand status took 3 milliseconds Jan 13 14:22:37 volumio volumio[5790]: verbose: ControllerMpd::parseTrackInfo Jan 13 14:22:37 volumio volumio[5790]: verbose: ControllerMpd::parseState Jan 13 14:22:37 volumio volumio[5790]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 13 14:22:37 volumio volumio[5790]: info: ControllerMpd::pushState Jan 13 14:22:37 volumio volumio[5790]: info: CoreCommandRouter::servicePushState Jan 13 14:22:37 volumio volumio[5790]: verbose: In UPNP mode Jan 13 14:22:37 volumio volumio[5790]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":161,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Robert Cohen、Johann Sebastian Bach - Cello Suite No. 1 in G Major, BWV 1007: I. Prelude","artist":"Robert Cohen、Johann Sebastian Bach","album":null,"uri":"http://fsandroid.tx.kugou.com/202601132222/3647d3dd1275bdc65dd59fbc5d925ca8/v3/47f4aefd9a3eeaf7ea0fe2561540486c/yp/full/ap1005_us1564332105_df349nwv1x5czs2prhm31as6sf_pi2_mx114229731_quflac_ct450100_s1427287426.flac","trackType":"flac"} Jan 13 14:22:37 volumio volumio[5790]: verbose: CURRENT POSITION 0 Jan 13 14:22:37 volumio volumio[5790]: info: CoreStateMachine::syncState stateService play Jan 13 14:22:37 volumio volumio[5790]: info: CoreStateMachine::syncState currentStatus stop Jan 13 14:22:37 volumio volumio[5790]: info: CoreStateMachine::pushState Jan 13 14:22:37 volumio volumio[5790]: info: CoreCommandRouter::volumioPushState Jan 13 14:22:37 volumio volumio[5790]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 13 14:22:37 volumio volumio[5790]: info: ------------------------------ 37ms Jan 13 14:22:37 volumio volumio[5790]: info: sendMpdCommand playlistinfo took 25 milliseconds Jan 13 14:22:37 volumio volumio[5790]: verbose: ControllerMpd::parseTrackInfo Jan 13 14:22:37 volumio volumio[5790]: info: ControllerMpd::pushState Jan 13 14:22:37 volumio volumio[5790]: info: CoreCommandRouter::servicePushState Jan 13 14:22:37 volumio volumio[5790]: verbose: In UPNP mode Jan 13 14:22:37 volumio volumio[5790]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":161,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Robert Cohen、Johann Sebastian Bach - Cello Suite No. 1 in G Major, BWV 1007: I. Prelude","artist":"Robert Cohen、Johann Sebastian Bach","album":null,"uri":"http://fsandroid.tx.kugou.com/202601132222/3647d3dd1275bdc65dd59fbc5d925ca8/v3/47f4aefd9a3eeaf7ea0fe2561540486c/yp/full/ap1005_us1564332105_df349nwv1x5czs2prhm31as6sf_pi2_mx114229731_quflac_ct450100_s1427287426.flac","trackType":"flac"} Jan 13 14:22:37 volumio volumio[5790]: verbose: CURRENT POSITION 0 Jan 13 14:22:37 volumio volumio[5790]: info: CoreStateMachine::syncState stateService play Jan 13 14:22:37 volumio volumio[5790]: info: CoreStateMachine::syncState currentStatus play Jan 13 14:22:37 volumio volumio[5790]: info: Received an update from plugin. extracting info from payload Jan 13 14:22:37 volumio volumio[5790]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Jan 13 14:22:37 volumio volumio[5790]: info: CoreStateMachine::pushState Jan 13 14:22:37 volumio volumio[5790]: info: CoreCommandRouter::volumioPushState Jan 13 14:22:37 volumio volumio[5790]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 13 14:22:37 volumio volumio[5790]: info: CoreStateMachine::pushState Jan 13 14:22:37 volumio volumio[5790]: info: CoreCommandRouter::volumioPushState Jan 13 14:22:37 volumio volumio[5790]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 13 14:22:37 volumio volumio[5790]: info: ------------------------------ 94ms Jan 13 14:22:37 volumio volumio[5790]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E7%8E%8B%E5%8A%9B%E5%AE%8F/%E7%81%AB%E5%8A%9B%E5%85%A8%E5%BC%80/32fb66ce-4c9f-4254-b62d-9caaa1a347ef.jpg' Jan 13 14:23:00 volumio volumio[5790]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jan 13 14:23:00 volumio volumio[5790]: { Error: connect ETIMEDOUT 31.13.82.169:443 Jan 13 14:23:00 volumio volumio[5790]: at Object._errnoException (util.js:1022:11) Jan 13 14:23:00 volumio volumio[5790]: at _exceptionWithHostPort (util.js:1044:20) Jan 13 14:23:00 volumio volumio[5790]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1198:14) Jan 13 14:23:00 volumio volumio[5790]: code: 'ETIMEDOUT', Jan 13 14:23:00 volumio volumio[5790]: errno: 'ETIMEDOUT', Jan 13 14:23:00 volumio volumio[5790]: syscall: 'connect', Jan 13 14:23:00 volumio volumio[5790]: address: '31.13.82.169', Jan 13 14:23:00 volumio volumio[5790]: port: 443 } Jan 13 14:23:00 volumio volumio[5790]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jan 13 14:23:01 volumio sudo[10607]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2026-01-13 14:22 Jan 13 14:23:01 volumio sudo[10607]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Debian GNU/Linux 8 (jessie)" NAME="Debian GNU/Linux" VERSION_ID="8" VERSION="8 (jessie)" ID=debian HOME_URL="http://www.debian.org/" SUPPORT_URL="http://www.debian.org/support" BUG_REPORT_URL="https://bugs.debian.org/" VOLUMIO_BUILD_VERSION="dd2a4339faaeb892c7f467e7dc8d424aefb0bd03" VOLUMIO_FE_VERSION="958dedc0edff114f244fa9acc70cf53089d9e5ae" VOLUMIO_BE_VERSION="307f91893fca011201acba9973e1c41bd3a0ad5d" VOLUMIO_ARCH="x86" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Fri Oct 1 11:49:13 CEST 2021" VOLUMIO_VERSION="2.916" VOLUMIO_HARDWARE="x86" VOLUMIO_HASH="62511ec23417b6085328d5bda7373a0c"