-- Logs begin at Wed 2024-05-08 06:32:14 UTC, end at Wed 2024-05-08 06:50:47 UTC. --
May 08 06:49:03 volumio volumio[4301]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E6%98%A5%E9%9B%B7/e6ff70c0-01c5-4478-bce7-44c7ac257a1a.jpg'
May 08 06:49:17 volumio volumio[4301]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E6%9E%97%E5%BF%86%E8%8E%B2/95b4bc99-4e58-4269-b0bc-db939207cb49.jpg'
May 08 06:49:40 volumio volumio[4301]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 08 06:49:40 volumio volumio[4301]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 08 06:49:40 volumio volumio[4301]: info: Discovery: Getting this device information
May 08 06:49:40 volumio volumio[4301]: info: CoreCommandRouter::volumioGetState
May 08 06:49:40 volumio volumio[4301]: info: CorePlayQueue::getTrack 0
May 08 06:49:40 volumio volumio[4301]: info: CoreCommandRouter::executeOnPlugin: network , getCachedPAddresses
May 08 06:49:40 volumio volumio[4301]: info: CoreCommandRouter::executeOnPlugin: system , getConf
May 08 06:49:40 volumio volumio[4301]: info: CoreCommandRouter::executeOnPlugin: system , getConf
May 08 06:49:45 volumio volumio[4301]: info: CoreCommandRouter::volumioGetState
May 08 06:49:45 volumio volumio[4301]: info: CorePlayQueue::getTrack 0
May 08 06:49:45 volumio volumio[4301]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard
May 08 06:49:45 volumio volumio[4301]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard
May 08 06:50:23 volumio volumio[4301]: info: CoreCommandRouter::volumioNext
May 08 06:50:23 volumio volumio[4301]: info: CoreStateMachine::next
May 08 06:50:23 volumio volumio[4301]: info: CoreStateMachine::stop
May 08 06:50:23 volumio volumio[4301]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 06:50:23 volumio volumio[4301]: UNSET VOLATILE
May 08 06:50:23 volumio volumio[4301]: info: CoreStateMachine::play index undefined
May 08 06:50:23 volumio volumio[4301]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 06:50:23 volumio volumio[4301]: info: CorePlayQueue::getTrack 12
May 08 06:50:23 volumio volumio[4301]: info: CoreStateMachine::startPlaybackTimer
May 08 06:50:23 volumio volumio[4301]: info: CorePlayQueue::getTrack 12
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::clearAddPlayTracks INTERNAL/电影民歌/Track (3).wav
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::sendMpdCommand stop
May 08 06:50:23 volumio volumio[4301]: info: CoreStateMachine::updateTrackBlock
May 08 06:50:23 volumio volumio[4301]: info: CorePlayQueue::getTrackBlock
May 08 06:50:23 volumio volumio[4301]: info:
May 08 06:50:23 volumio volumio[4301]: ---------------------------- MPD announces state update: player
May 08 06:50:23 volumio volumio[4301]: info: sendMpdCommand stop took 10 milliseconds
May 08 06:50:23 volumio volumio[4301]: info: ControllerMpd::getState
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::sendMpdCommand status
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::sendMpdCommand clear
May 08 06:50:23 volumio volumio[4301]: info:
May 08 06:50:23 volumio volumio[4301]: ---------------------------- MPD announces system playlist update
May 08 06:50:23 volumio volumio[4301]: info: Ignoring MPD Status Update
May 08 06:50:23 volumio volumio[4301]: info: sendMpdCommand status took 1 milliseconds
May 08 06:50:23 volumio volumio[4301]: info: sendMpdCommand clear took 1 milliseconds
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::parseState
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::sendMpdCommand add "INTERNAL/电影民歌/Track (3).wav"
May 08 06:50:23 volumio volumio[4301]: error: updateQueue error: null
May 08 06:50:23 volumio volumio[4301]: info:
May 08 06:50:23 volumio volumio[4301]: ---------------------------- MPD announces system playlist update
May 08 06:50:23 volumio volumio[4301]: info: Ignoring MPD Status Update
May 08 06:50:23 volumio volumio[4301]: info: ------------------------------ 3ms
May 08 06:50:23 volumio volumio[4301]: info: sendMpdCommand playlistinfo took 1 milliseconds
May 08 06:50:23 volumio volumio[4301]: info: sendMpdCommand add "INTERNAL/电影民歌/Track (3).wav" took 1 milliseconds
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::parseTrackInfo
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::sendMpdCommand play
May 08 06:50:23 volumio volumio[4301]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined
May 08 06:50:23 volumio volumio[4301]: info: ------------------------------ 6ms
May 08 06:50:23 volumio volumio[4301]: info: ------------------------------ 2ms
May 08 06:50:23 volumio volumio[4301]: info: sendMpdCommand play took 1 milliseconds
May 08 06:50:23 volumio volumio[4301]: info:
May 08 06:50:23 volumio volumio[4301]: ---------------------------- MPD announces state update: player
May 08 06:50:23 volumio volumio[4301]: info: ControllerMpd::getState
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::sendMpdCommand status
May 08 06:50:23 volumio volumio[4301]: info:
May 08 06:50:23 volumio volumio[4301]: ---------------------------- MPD announces state update: player
May 08 06:50:23 volumio volumio[4301]: info: ControllerMpd::getState
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::sendMpdCommand status
May 08 06:50:23 volumio volumio[4301]: info: sendMpdCommand status took 1 milliseconds
May 08 06:50:23 volumio volumio[4301]: info: sendMpdCommand status took 1 milliseconds
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::parseState
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::parseState
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 08 06:50:23 volumio volumio[4301]: info: sendMpdCommand playlistinfo took 1 milliseconds
May 08 06:50:23 volumio volumio[4301]: info: sendMpdCommand playlistinfo took 0 milliseconds
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::parseTrackInfo
May 08 06:50:23 volumio volumio[4301]: verbose: ControllerMpd::parseTrackInfo
May 08 06:50:23 volumio volumio[4301]: info: ControllerMpd::pushState
May 08 06:50:23 volumio volumio[4301]: info: CoreCommandRouter::servicePushState
May 08 06:50:23 volumio volumio[4301]: info: CorePlayQueue::getTrack 12
May 08 06:50:23 volumio volumio[4301]: verbose: STATE SERVICE {"status":"play","position":0,"seek":348,"duration":239,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Track (3).wav","artist":null,"album":null,"uri":"INTERNAL/电影民歌/Track (3).wav","trackType":"wav"}
May 08 06:50:23 volumio volumio[4301]: verbose: CURRENT POSITION 12
May 08 06:50:23 volumio volumio[4301]: info: CoreStateMachine::syncState stateService play
May 08 06:50:23 volumio volumio[4301]: info: CoreStateMachine::syncState currentStatus stop
May 08 06:50:23 volumio volumio[4301]: info: CoreStateMachine::pushState
May 08 06:50:23 volumio volumio[4301]: info: CorePlayQueue::getTrack 12
May 08 06:50:23 volumio volumio[4301]: info: CoreCommandRouter::volumioPushState
May 08 06:50:23 volumio volumio[4301]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 08 06:50:23 volumio volumio[4301]: info: ControllerMpd::pushState
May 08 06:50:23 volumio volumio[4301]: info: CoreCommandRouter::servicePushState
May 08 06:50:23 volumio volumio[4301]: info: CorePlayQueue::getTrack 12
May 08 06:50:23 volumio volumio[4301]: verbose: STATE SERVICE {"status":"play","position":0,"seek":348,"duration":239,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Track (3).wav","artist":null,"album":null,"uri":"INTERNAL/电影民歌/Track (3).wav","trackType":"wav"}
May 08 06:50:23 volumio volumio[4301]: verbose: CURRENT POSITION 12
May 08 06:50:23 volumio volumio[4301]: info: CoreStateMachine::syncState stateService play
May 08 06:50:23 volumio volumio[4301]: info: CoreStateMachine::syncState currentStatus play
May 08 06:50:23 volumio volumio[4301]: info: Received an update from plugin. extracting info from payload
May 08 06:50:23 volumio volumio[4301]: info: CoreStateMachine::pushState
May 08 06:50:23 volumio volumio[4301]: info: CorePlayQueue::getTrack 12
May 08 06:50:23 volumio volumio[4301]: info: CoreCommandRouter::volumioPushState
May 08 06:50:23 volumio volumio[4301]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 08 06:50:23 volumio volumio[4301]: info: CoreStateMachine::pushState
May 08 06:50:23 volumio volumio[4301]: info: CorePlayQueue::getTrack 12
May 08 06:50:23 volumio volumio[4301]: info: CoreCommandRouter::volumioPushState
May 08 06:50:23 volumio volumio[4301]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 08 06:50:23 volumio volumio[4301]: info: ------------------------------ 15ms
May 08 06:50:23 volumio volumio[4301]: info: ------------------------------ 14ms
May 08 06:50:33 volumio volumio[4301]: info: CoreCommandRouter::volumioPause
May 08 06:50:33 volumio volumio[4301]: info: CoreStateMachine::pause
May 08 06:50:33 volumio volumio[4301]: info: CoreStateMachine::stPlaybackTimer
May 08 06:50:33 volumio volumio[4301]: info: CoreStateMachine::servicePause
May 08 06:50:33 volumio volumio[4301]: info: CorePlayQueue::getTrack 12
May 08 06:50:33 volumio volumio[4301]: info: CoreCommandRouter::servicePause
May 08 06:50:33 volumio volumio[4301]: info: ControllerMpd::pause
May 08 06:50:33 volumio volumio[4301]: verbose: ControllerMpd::sendMpdCommand pause
May 08 06:50:33 volumio volumio[4301]: info:
May 08 06:50:33 volumio volumio[4301]: ---------------------------- MPD announces state update: player
May 08 06:50:33 volumio volumio[4301]: info: sendMpdCommand pause took 19 milliseconds
May 08 06:50:33 volumio volumio[4301]: info: ControllerMpd::getState
May 08 06:50:33 volumio volumio[4301]: verbose: ControllerMpd::sendMpdCommand status
May 08 06:50:33 volumio volumio[4301]: info: sendMpdCommand status took 0 milliseconds
May 08 06:50:33 volumio volumio[4301]: verbose: ControllerMpd::parseState
May 08 06:50:33 volumio volumio[4301]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 08 06:50:33 volumio volumio[4301]: info: sendMpdCommand playlistinfo took 0 milliseconds
May 08 06:50:33 volumio volumio[4301]: verbose: ControllerMpd::parseTrackInfo
May 08 06:50:33 volumio volumio[4301]: info: ControllerMpd::pushState
May 08 06:50:33 volumio volumio[4301]: info: CoreCommandRouter::servicePushState
May 08 06:50:33 volumio volumio[4301]: info: CorePlayQueue::getTrack 12
May 08 06:50:33 volumio volumio[4301]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":9822,"duration":239,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Track (3).wav","artist":null,"album":null,"uri":"INTERNAL/电影民歌/Track (3).wav","trackType":"wav"}
May 08 06:50:33 volumio volumio[4301]: verbose: CURRENT POSITION 12
May 08 06:50:33 volumio volumio[4301]: info: CoreStateMachine::syncState stateService pause
May 08 06:50:33 volumio volumio[4301]: info: CoreStateMachine::syncState currentStatus pause
May 08 06:50:33 volumio volumio[4301]: info: CoreStateMachine::pushState
May 08 06:50:33 volumio volumio[4301]: info: CorePlayQueue::getTrack 12
May 08 06:50:33 volumio volumio[4301]: info: CoreCommandRouter::volumioPushState
May 08 06:50:33 volumio volumio[4301]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 08 06:50:33 volumio volumio[4301]: info: CoreStateMachine::stPlaybackTimer
May 08 06:50:33 volumio volumio[4301]: info: ------------------------------ 4ms
May 08 06:50:46 volumio volumio[4301]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
May 08 06:50:46 volumio volumio[4301]: { Error: connect ETIMEDOUT 108.160.167.147:80
May 08 06:50:46 volumio volumio[4301]: at Object._errnoException (util.js:1022:11)
May 08 06:50:46 volumio volumio[4301]: at _exceptionWithHostPort (util.js:1044:20)
May 08 06:50:46 volumio volumio[4301]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1198:14)
May 08 06:50:46 volumio volumio[4301]: code: 'ETIMEDOUT',
May 08 06:50:46 volumio volumio[4301]: errno: 'ETIMEDOUT',
May 08 06:50:46 volumio volumio[4301]: syscall: 'connect',
May 08 06:50:46 volumio volumio[4301]: address: '108.160.167.147',
May 08 06:50:46 volumio volumio[4301]: port: 80 }
May 08 06:50:46 volumio volumio[4301]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
May 08 06:50:47 volumio sudo[4923]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-05-08 06:49
May 08 06:50:47 volumio sudo[4923]: 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="cd11dc738d0d82822d0aa776d0729686b82e3758"
VOLUMIO_FE_VERSION="537e3f50b5a8aa9bdf42f94adc80b348609b5c47"
VOLUMIO_BE_VERSION="d7e6c614214d5dc616fddcbcfefc47e1990da7b1"
VOLUMIO_ARCH="x86"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Wed Sep 8 12:33:16 CEST 2021"
VOLUMIO_VERSION="2.909"
VOLUMIO_HARDWARE="x86"
VOLUMIO_HASH="6e5c976a6d85b8b7d7e4e3388d208cd8"