-- Logs begin at Sat 2024-07-13 12:39:14 UTC, end at Sat 2024-07-13 13:19:18 UTC. --
Jul 13 13:18:21 volumio dhcpcd[1014]: eth0: adding route to 192.168.3.0/24
Jul 13 13:18:21 volumio dhcpcd[1014]: eth0: adding default route via 192.168.3.101
Jul 13 13:18:21 volumio dhcpcd[1014]: eth0: ipv4_addroute: File exists
Jul 13 13:18:21 volumio dhcpcd[1014]: eth0: removing route to 192.168.3.0/24
Jul 13 13:18:51 volumio dhcpcd[1014]: eth0: adding route to 192.168.3.0/24
Jul 13 13:18:51 volumio dhcpcd[1014]: eth0: adding default route via 192.168.3.101
Jul 13 13:18:51 volumio dhcpcd[1014]: eth0: ipv4_addroute: File exists
Jul 13 13:18:51 volumio dhcpcd[1014]: eth0: removing route to 192.168.3.0/24
Jul 13 13:18:56 volumio volumio[4285]: info:
Jul 13 13:18:56 volumio volumio[4285]: ---------------------------- MPD announces state update: player
Jul 13 13:18:56 volumio volumio[4285]: info: ControllerMpd::getState
Jul 13 13:18:56 volumio volumio[4285]: verbose: ControllerMpd::sendMpdCommand status
Jul 13 13:18:56 volumio volumio[4285]: verbose: ControllerMpd::parseState
Jul 13 13:18:56 volumio volumio[4285]: info: ControllerMpd::pushState
Jul 13 13:18:56 volumio volumio[4285]: info: CoreCommandRouter::servicePushState
Jul 13 13:18:56 volumio volumio[4285]: info: CoreStateMachine::pushState
Jul 13 13:18:56 volumio volumio[4285]: info: CoreCommandRouter::volumioPushState
Jul 13 13:18:56 volumio volumio[4285]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Jul 13 13:18:56 volumio volumio[4285]: info: CorePlayQueue::getTrack 0
Jul 13 13:18:56 volumio volumio[4285]: 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}
Jul 13 13:18:56 volumio volumio[4285]: verbose: CURRENT POSITION 0
Jul 13 13:18:56 volumio volumio[4285]: info: CoreStateMachine::syncState stateService stop
Jul 13 13:18:56 volumio volumio[4285]: info: CoreStateMachine::syncState currentStatus play
Jul 13 13:18:56 volumio volumio[4285]: info: CoreCommandRouter::volumioPushState
Jul 13 13:18:56 volumio volumio[4285]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Jul 13 13:18:56 volumio volumio[4285]: info: CoreStateMachine::stPlaybackTimer
Jul 13 13:18:56 volumio volumio[4285]: info: ------------------------------ 16ms
Jul 13 13:18:56 volumio volumio[4285]: info: CoreCommandRouter::volumioGetQueue
Jul 13 13:18:56 volumio volumio[4285]: info: CoreStateMachine::getQueue
Jul 13 13:18:56 volumio volumio[4285]: info: CorePlayQueue::getQueue
Jul 13 13:18:56 volumio volumio[4285]: info: Clearing queue after UPNP request
Jul 13 13:18:56 volumio volumio[4285]: info: CoreStateMachine::ClearQueue
Jul 13 13:18:56 volumio volumio[4285]: info: CoreStateMachine::stop
Jul 13 13:18:56 volumio volumio[4285]: info: CoreStateMachine::setConsumeUpdateService undefined
Jul 13 13:18:56 volumio volumio[4285]: UNSET VOLATILE
Jul 13 13:18:56 volumio volumio[4285]: info: CorePlayQueue::clearPlayQueue
Jul 13 13:18:56 volumio volumio[4285]: info: CorePlayQueue::saveQueue
Jul 13 13:18:56 volumio volumio[4285]: info: CoreCommandRouter::volumioPushState
Jul 13 13:18:56 volumio volumio[4285]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Jul 13 13:18:56 volumio volumio[4285]: info: CoreCommandRouter::volumioPushQueue
Jul 13 13:18:56 volumio volumio[4285]: info:
Jul 13 13:18:56 volumio volumio[4285]: ---------------------------- MPD announces system playlist update
Jul 13 13:18:56 volumio volumio[4285]: info: Ignoring MPD Status Update
Jul 13 13:18:56 volumio volumio[4285]: error: updateQueue error: null
Jul 13 13:18:56 volumio volumio[4285]: info: ------------------------------ 3ms
Jul 13 13:18:56 volumio volumio[4285]: info: Starting UPNP Playback
Jul 13 13:18:56 volumio volumio[4285]: info: Preparing playback through UPNP
Jul 13 13:18:56 volumio volumio[4285]: info: CoreCommandRouter::volumioGetState
Jul 13 13:18:56 volumio volumio[4285]: info: CorePlayQueue::getTrack 0
Jul 13 13:18:56 volumio volumio[4285]: info: CoreStateMachine::setConsumeUpdateService mpd
Jul 13 13:18:57 volumio volumio[4285]: info:
Jul 13 13:18:57 volumio volumio[4285]: ---------------------------- MPD announces system playlist update
Jul 13 13:18:57 volumio volumio[4285]: info: Ignoring MPD Status Update
Jul 13 13:18:57 volumio volumio[4285]: info: ------------------------------ 3ms
Jul 13 13:18:57 volumio volumio[4285]: info:
Jul 13 13:18:57 volumio volumio[4285]: ---------------------------- MPD announces system playlist update
Jul 13 13:18:57 volumio volumio[4285]: info: Ignoring MPD Status Update
Jul 13 13:18:57 volumio volumio[4285]: info: ------------------------------ 1ms
Jul 13 13:18:57 volumio volumio[4285]: info:
Jul 13 13:18:57 volumio volumio[4285]: ---------------------------- MPD announces system playlist update
Jul 13 13:18:57 volumio volumio[4285]: info: Ignoring MPD Status Update
Jul 13 13:18:57 volumio volumio[4285]: info: ------------------------------ 1ms
Jul 13 13:18:57 volumio volumio[4285]: info:
Jul 13 13:18:57 volumio volumio[4285]: ---------------------------- MPD announces system playlist update
Jul 13 13:18:57 volumio volumio[4285]: info: Ignoring MPD Status Update
Jul 13 13:18:57 volumio volumio[4285]: info: ------------------------------ 1ms
Jul 13 13:18:57 volumio volumio[4285]: info:
Jul 13 13:18:57 volumio volumio[4285]: ---------------------------- MPD announces system playlist update
Jul 13 13:18:57 volumio volumio[4285]: info: Ignoring MPD Status Update
Jul 13 13:18:57 volumio volumio[4285]: info: ------------------------------ 1ms
Jul 13 13:18:57 volumio volumio[4285]: info:
Jul 13 13:18:57 volumio volumio[4285]: ---------------------------- MPD announces system playlist update
Jul 13 13:18:57 volumio volumio[4285]: info: Ignoring MPD Status Update
Jul 13 13:18:57 volumio volumio[4285]: info: ------------------------------ 1ms
Jul 13 13:19:05 volumio volumio[4285]: info:
Jul 13 13:19:05 volumio volumio[4285]: ---------------------------- MPD announces state update: player
Jul 13 13:19:05 volumio volumio[4285]: info: ControllerMpd::getState
Jul 13 13:19:05 volumio volumio[4285]: verbose: ControllerMpd::sendMpdCommand status
Jul 13 13:19:05 volumio volumio[4285]: info:
Jul 13 13:19:05 volumio volumio[4285]: ---------------------------- MPD announces state update: player
Jul 13 13:19:05 volumio volumio[4285]: info: ControllerMpd::getState
Jul 13 13:19:05 volumio volumio[4285]: verbose: ControllerMpd::sendMpdCommand status
Jul 13 13:19:05 volumio volumio[4285]: verbose: ControllerMpd::parseState
Jul 13 13:19:05 volumio volumio[4285]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Jul 13 13:19:05 volumio volumio[4285]: info:
Jul 13 13:19:05 volumio volumio[4285]: ---------------------------- MPD announces system playlist update
Jul 13 13:19:05 volumio volumio[4285]: info: Ignoring MPD Status Update
Jul 13 13:19:05 volumio volumio[4285]: verbose: ControllerMpd::parseState
Jul 13 13:19:05 volumio volumio[4285]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Jul 13 13:19:05 volumio volumio[4285]: verbose: ControllerMpd::parseTrackInfo
Jul 13 13:19:05 volumio volumio[4285]: info: ControllerMpd::pushState
Jul 13 13:19:05 volumio volumio[4285]: info: CoreCommandRouter::servicePushState
Jul 13 13:19:05 volumio volumio[4285]: In UPNP mode
Jul 13 13:19:05 volumio volumio[4285]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":253,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"莉莉安","artist":"宋冬野","album":"安和桥北","uri":"http://aqqmusic.tc.qq.com/F000002VoeFn1hzj2v.flac?guid=0000000004cb49d2000001871e73f5cf&vkey=83F0C885E8DC0B9C4350BC2E125A7755A604DB9C907DD990CAE1742FCB23F800B449D8B515299D08E03F55D1A2F2860F1695B5BA18925FA2&uin=1259438298&redirect=1&fromtag=111114","trackType":""}
Jul 13 13:19:05 volumio volumio[4285]: verbose: CURRENT POSITION 0
Jul 13 13:19:05 volumio volumio[4285]: info: CoreStateMachine::syncState stateService play
Jul 13 13:19:05 volumio volumio[4285]: info: CoreStateMachine::syncState currentStatus stop
Jul 13 13:19:05 volumio volumio[4285]: info: CoreStateMachine::pushState
Jul 13 13:19:05 volumio volumio[4285]: info: CoreCommandRouter::volumioPushState
Jul 13 13:19:05 volumio volumio[4285]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Jul 13 13:19:05 volumio volumio[4285]: info: ------------------------------ 19ms
Jul 13 13:19:05 volumio volumio[4285]: info: ------------------------------ 15ms
Jul 13 13:19:05 volumio volumio[4285]: verbose: ControllerMpd::parseTrackInfo
Jul 13 13:19:05 volumio volumio[4285]: info: ControllerMpd::pushState
Jul 13 13:19:05 volumio volumio[4285]: info: CoreCommandRouter::servicePushState
Jul 13 13:19:05 volumio volumio[4285]: In UPNP mode
Jul 13 13:19:05 volumio volumio[4285]: verbose: STATE SERVICE {"status":"play","position":0,"seek":464,"duration":253,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"589 Kbps","isStreaming":false,"title":"莉莉安","artist":"宋冬野","album":"安和桥北","uri":"http://aqqmusic.tc.qq.com/F000002VoeFn1hzj2v.flac?guid=0000000004cb49d2000001871e73f5cf&vkey=83F0C885E8DC0B9C4350BC2E125A7755A604DB9C907DD990CAE1742FCB23F800B449D8B515299D08E03F55D1A2F2860F1695B5BA18925FA2&uin=1259438298&redirect=1&fromtag=111114","trackType":""}
Jul 13 13:19:05 volumio volumio[4285]: verbose: CURRENT POSITION 0
Jul 13 13:19:05 volumio volumio[4285]: info: CoreStateMachine::syncState stateService play
Jul 13 13:19:05 volumio volumio[4285]: info: CoreStateMachine::syncState currentStatus play
Jul 13 13:19:05 volumio volumio[4285]: info: Received an update from plugin. extracting info from payload
Jul 13 13:19:05 volumio volumio[4285]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt
Jul 13 13:19:05 volumio volumio[4285]: info: CoreStateMachine::pushState
Jul 13 13:19:05 volumio volumio[4285]: info: CoreCommandRouter::volumioPushState
Jul 13 13:19:05 volumio volumio[4285]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Jul 13 13:19:05 volumio volumio[4285]: info: CoreStateMachine::pushState
Jul 13 13:19:05 volumio volumio[4285]: info: CoreCommandRouter::volumioPushState
Jul 13 13:19:05 volumio volumio[4285]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Jul 13 13:19:05 volumio volumio[4285]: info: ------------------------------ 41ms
Jul 13 13:19:05 volumio volumio[4285]: info: CoreCommandRouter::volumioGetQueue
Jul 13 13:19:05 volumio volumio[4285]: info: CoreStateMachine::getQueue
Jul 13 13:19:05 volumio volumio[4285]: info: CorePlayQueue::getQueue
Jul 13 13:19:05 volumio volumio[4285]: info: CoreCommandRouter::volumioGetQueue
Jul 13 13:19:05 volumio volumio[4285]: info: CoreStateMachine::getQueue
Jul 13 13:19:05 volumio volumio[4285]: info: CorePlayQueue::getQueue
Jul 13 13:19:05 volumio volumio[4285]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E5%AE%8B%E5%86%AC%E9%87%8E/%E5%AE%89%E5%92%8C%E6%A1%A5%E5%8C%97/f2c9a580-866a-4bb6-977e-099da3235cf4.jpg'
Jul 13 13:19:18 volumio volumio[4285]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Jul 13 13:19:18 volumio volumio[4285]: { Error: connect ETIMEDOUT 74.86.3.208:443
Jul 13 13:19:18 volumio volumio[4285]: at Object._errnoException (util.js:1022:11)
Jul 13 13:19:18 volumio volumio[4285]: at _exceptionWithHostPort (util.js:1044:20)
Jul 13 13:19:18 volumio volumio[4285]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1198:14)
Jul 13 13:19:18 volumio volumio[4285]: code: 'ETIMEDOUT',
Jul 13 13:19:18 volumio volumio[4285]: errno: 'ETIMEDOUT',
Jul 13 13:19:18 volumio volumio[4285]: syscall: 'connect',
Jul 13 13:19:18 volumio volumio[4285]: address: '74.86.3.208',
Jul 13 13:19:18 volumio volumio[4285]: port: 443 }
Jul 13 13:19:18 volumio volumio[4285]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Jul 13 13:19:18 volumio sudo[9626]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-07-13 13:18
Jul 13 13:19:18 volumio sudo[9626]: 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="168ba7444df98cd868db72f24faec0b6346489cc"
VOLUMIO_FE_VERSION="847a48ecf32d35cc502a0053d585d1a69236e391"
VOLUMIO_BE_VERSION="03f7bbd984817e093cac62b7ff876f3c2cfabc1d"
VOLUMIO_ARCH="x86"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Tue Dec 22 15:00:46 CET 2020"
VOLUMIO_VERSION="2.861"
VOLUMIO_HARDWARE="x86"
VOLUMIO_HASH="b3401e25b8d19b16b1038c2843d2deaf"