-- Logs begin at Sun 2025-01-12 10:33:12 CST, end at Sun 2025-01-12 11:09:52 CST. -- Jan 12 11:08:05 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Jan 12 11:08:08 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Jan 12 11:08:08 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 11:08:08 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Jan 12 11:08:09 volumio volumio[8426]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 6 Jan 12 11:08:12 volumio volumio[8426]: Cannot compose Albumart path Jan 12 11:08:13 volumio volumio[8426]: Cannot compose Albumart path Jan 12 11:08:13 volumio volumio[8426]: Cannot compose Albumart path Jan 12 11:08:14 volumio volumio[8426]: info: sendMpdCommand stop took 28568 milliseconds Jan 12 11:08:14 volumio volumio[8426]: info: sendMpdCommand stop took 25652 milliseconds Jan 12 11:08:14 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand clear Jan 12 11:08:14 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand clear Jan 12 11:08:14 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 11:08:14 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 11:08:14 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getConfigParam Jan 12 11:08:14 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam Jan 12 11:08:14 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStatsObject Jan 12 11:08:14 volumio volumio[8426]: info: CoreCommandRouter::volumioGetBrowseSources Jan 12 11:08:14 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Jan 12 11:08:15 volumio volumio[8426]: error: MyVolumio Plugin failed to authenticate in a timely fashion Jan 12 11:08:15 volumio volumio[8426]: info: Completed starting MyVolumio Plugin Jan 12 11:08:15 volumio volumio[8426]: [Metrics] CommandRouter: 51s 351.54ms Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumiosetStartupVolume Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::Close All Modals sent Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::Close All Modals sent Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:15 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:15 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand clear took 58 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand clear took 58 milliseconds Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand add "USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]周慧敏 - 痴心换情深.flac" Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand add "USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]周慧敏 - 痴心换情深.flac" Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPlay Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::play index 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::stop Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::play index undefined Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::startPlaybackTimer Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::clearAddPlayTracks USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand stop Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:15 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:15 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:15 volumio volumio[8426]: info: Preload queue cleared Jan 12 11:08:15 volumio volumio[8426]: error: updateQueue error: null Jan 12 11:08:15 volumio volumio[8426]: error: updateQueue error: null Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:15 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:15 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 24ms Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 23ms Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand add "USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]周慧敏 - 痴心换情深.flac" took 23 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand add "USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]周慧敏 - 痴心换情深.flac" took 23 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand stop took 15 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 14ms Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 14ms Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand play Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand play Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand clear Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:15 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:15 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioGetState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:15 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:15 volumio volumio[8426]: error: updateQueue error: null Jan 12 11:08:15 volumio volumio[8426]: error: updateQueue error: null Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 32ms Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 31ms Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand play took 30 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand play took 30 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand clear took 29 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 16ms Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 15ms Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand add "USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac" Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:15 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:15 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:15 volumio volumio[8426]: error: updateQueue error: null Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:15 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 40ms Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand status took 38 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand add "USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac" took 39 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 10ms Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand status took 9 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 9ms Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand status took 8 milliseconds Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand play Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: 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} Jan 12 11:08:15 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState stateService stop Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus stop Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: No code Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: 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} Jan 12 11:08:15 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState stateService stop Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus stop Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: No code Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: 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} Jan 12 11:08:15 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState stateService stop Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus stop Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: No code Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 71ms Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 41ms Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 40ms Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:15 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:15 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 37ms Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand play took 35 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 3ms Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 3ms Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand clearerror Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand status took 6 milliseconds Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand clearerror Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand status took 6 milliseconds Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand clearerror Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand status took 6 milliseconds Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:15 volumio volumio[8426]: info: Jan 12 11:08:15 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand clearerror Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand status took 211 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand clearerror took 209 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand clearerror took 209 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand clearerror took 209 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand playlistinfo took 207 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand playlistinfo took 206 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand playlistinfo took 206 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand status took 205 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand status took 204 milliseconds Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseTrackInfo Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseTrackInfo Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseTrackInfo Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":0,"duration":242,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"天下浪子不独你一人","artist":"[51ape.com]林倩莲","album":"宝丽金最受欢迎女巨星金曲精选","uri":"USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac","trackType":"flac"} Jan 12 11:08:15 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState stateService pause Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus stop Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":0,"duration":242,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"天下浪子不独你一人","artist":"[51ape.com]林倩莲","album":"宝丽金最受欢迎女巨星金曲精选","uri":"USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac","trackType":"flac"} Jan 12 11:08:15 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState stateService pause Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus stop Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":0,"duration":242,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"天下浪子不独你一人","artist":"[51ape.com]林倩莲","album":"宝丽金最受欢迎女巨星金曲精选","uri":"USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac","trackType":"flac"} Jan 12 11:08:15 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState stateService pause Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus stop Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 232ms Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 231ms Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 230ms Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand clearerror took 25 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand playlistinfo took 23 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand playlistinfo took 20 milliseconds Jan 12 11:08:15 volumio volumio[8426]: info: sendMpdCommand playlistinfo took 21 milliseconds Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseTrackInfo Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseTrackInfo Jan 12 11:08:15 volumio volumio[8426]: verbose: ControllerMpd::parseTrackInfo Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":0,"duration":242,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"天下浪子不独你一人","artist":"[51ape.com]林倩莲","album":"宝丽金最受欢迎女巨星金曲精选","uri":"USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac","trackType":"flac"} Jan 12 11:08:15 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState stateService pause Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus stop Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":0,"duration":242,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"天下浪子不独你一人","artist":"[51ape.com]林倩莲","album":"宝丽金最受欢迎女巨星金曲精选","uri":"USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac","trackType":"flac"} Jan 12 11:08:15 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState stateService pause Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus stop Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":0,"duration":242,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"天下浪子不独你一人","artist":"[51ape.com]林倩莲","album":"宝丽金最受欢迎女巨星金曲精选","uri":"USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac","trackType":"flac"} Jan 12 11:08:15 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState stateService pause Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus stop Jan 12 11:08:15 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:15 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:15 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 248ms Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 241ms Jan 12 11:08:15 volumio volumio[8426]: info: ------------------------------ 240ms Jan 12 11:08:16 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkAudioDeviceAvailable Jan 12 11:08:16 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Jan 12 11:08:16 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: system , versionChangeDetect Jan 12 11:08:22 volumio volumio[8426]: info: BOOT COMPLETED Jan 12 11:08:28 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Jan 12 11:08:28 volumio volumio[8426]: info: CURURI: music-library/USB Jan 12 11:08:29 volumio volumio[8426]: info: Preload queue cleared Jan 12 11:08:29 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Jan 12 11:08:29 volumio volumio[8426]: info: CURURI: music-library/USB/32165DD7165D9CA3 Jan 12 11:08:29 volumio volumio[8426]: info: Preload queue cleared Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPlay Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::play index 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::stop Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::play index undefined Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::startPlaybackTimer Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::clearAddPlayTracks USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand stop Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand stop took 2 milliseconds Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand clear Jan 12 11:08:35 volumio volumio[8426]: info: Jan 12 11:08:35 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:35 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:35 volumio volumio[8426]: info: Jan 12 11:08:35 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:35 volumio volumio[8426]: info: Jan 12 11:08:35 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:35 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:35 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand clear took 2 milliseconds Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand status took 1 milliseconds Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand add "USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac" Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:35 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: 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} Jan 12 11:08:35 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::syncState stateService stop Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus stop Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: No code Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: ------------------------------ 18ms Jan 12 11:08:35 volumio volumio[8426]: info: Jan 12 11:08:35 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:35 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:35 volumio volumio[8426]: info: Jan 12 11:08:35 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:35 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:35 volumio volumio[8426]: error: updateQueue error: null Jan 12 11:08:35 volumio volumio[8426]: info: Jan 12 11:08:35 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:35 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand status took 18 milliseconds Jan 12 11:08:35 volumio volumio[8426]: info: ------------------------------ 20ms Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand add "USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac" took 18 milliseconds Jan 12 11:08:35 volumio volumio[8426]: info: ------------------------------ 3ms Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand status took 2 milliseconds Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand play Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:35 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: 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} Jan 12 11:08:35 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::syncState stateService stop Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus stop Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: No code Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: 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} Jan 12 11:08:35 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::syncState stateService stop Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus stop Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: No code Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: ------------------------------ 45ms Jan 12 11:08:35 volumio volumio[8426]: info: ------------------------------ 28ms Jan 12 11:08:35 volumio volumio[8426]: info: Jan 12 11:08:35 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:35 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:35 volumio volumio[8426]: info: Jan 12 11:08:35 volumio volumio[8426]: ---------------------------- MPD announces system playlist update Jan 12 11:08:35 volumio volumio[8426]: info: Ignoring MPD Status Update Jan 12 11:08:35 volumio volumio[8426]: info: Jan 12 11:08:35 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:35 volumio volumio[8426]: info: Jan 12 11:08:35 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:35 volumio volumio[8426]: info: ------------------------------ 34ms Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand play took 33 milliseconds Jan 12 11:08:35 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:35 volumio volumio[8426]: info: ------------------------------ 7ms Jan 12 11:08:35 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:35 volumio volumio[8426]: info: ------------------------------ 7ms Jan 12 11:08:35 volumio volumio[8426]: info: Jan 12 11:08:35 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:35 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:35 volumio volumio[8426]: info: Jan 12 11:08:35 volumio volumio[8426]: ---------------------------- MPD announces state update: player Jan 12 11:08:35 volumio volumio[8426]: info: ControllerMpd::getState Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand status Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand status took 2 milliseconds Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand status took 3 milliseconds Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand status took 2 milliseconds Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand status took 1 milliseconds Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::parseState Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand playlistinfo took 2 milliseconds Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand playlistinfo took 1 milliseconds Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand playlistinfo took 1 milliseconds Jan 12 11:08:35 volumio volumio[8426]: info: sendMpdCommand playlistinfo took 1 milliseconds Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::parseTrackInfo Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::parseTrackInfo Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::parseTrackInfo Jan 12 11:08:35 volumio volumio[8426]: verbose: ControllerMpd::parseTrackInfo Jan 12 11:08:35 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: verbose: STATE SERVICE {"status":"play","position":0,"seek":842,"duration":242,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"594 Kbps","isStreaming":false,"title":"天下浪子不独你一人","artist":"[51ape.com]林倩莲","album":"宝丽金最受欢迎女巨星金曲精选","uri":"USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac","trackType":"flac"} Jan 12 11:08:35 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::syncState stateService play Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus stop Jan 12 11:08:35 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: verbose: STATE SERVICE {"status":"play","position":0,"seek":842,"duration":242,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"594 Kbps","isStreaming":false,"title":"天下浪子不独你一人","artist":"[51ape.com]林倩莲","album":"宝丽金最受欢迎女巨星金曲精选","uri":"USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac","trackType":"flac"} Jan 12 11:08:35 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::syncState stateService play Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus play Jan 12 11:08:35 volumio volumio[8426]: info: Received an update from plugin. extracting info from payload Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: verbose: STATE SERVICE {"status":"play","position":0,"seek":842,"duration":242,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"594 Kbps","isStreaming":false,"title":"天下浪子不独你一人","artist":"[51ape.com]林倩莲","album":"宝丽金最受欢迎女巨星金曲精选","uri":"USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac","trackType":"flac"} Jan 12 11:08:35 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::syncState stateService play Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus play Jan 12 11:08:35 volumio volumio[8426]: info: Received an update from plugin. extracting info from payload Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: ControllerMpd::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::servicePushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: verbose: STATE SERVICE {"status":"play","position":0,"seek":842,"duration":242,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"594 Kbps","isStreaming":false,"title":"天下浪子不独你一人","artist":"[51ape.com]林倩莲","album":"宝丽金最受欢迎女巨星金曲精选","uri":"USB/32165DD7165D9CA3/宝丽金/宝丽金最受欢迎女巨星金曲精选/[51ape.com]林倩莲 - 天下浪子不独你一人.flac","trackType":"flac"} Jan 12 11:08:35 volumio volumio[8426]: verbose: CURRENT POSITION 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::syncState stateService play Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::syncState currentStatus play Jan 12 11:08:35 volumio volumio[8426]: info: Received an update from plugin. extracting info from payload Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: CoreStateMachine::pushState Jan 12 11:08:35 volumio volumio[8426]: info: CorePlayQueue::getTrack 3 Jan 12 11:08:35 volumio volumio[8426]: info: CoreCommandRouter::volumioPushState Jan 12 11:08:35 volumio volumio[8426]: info: ------------------------------ 17ms Jan 12 11:08:35 volumio volumio[8426]: info: ------------------------------ 32ms Jan 12 11:08:35 volumio volumio[8426]: info: ------------------------------ 30ms Jan 12 11:08:35 volumio volumio[8426]: info: ------------------------------ 31ms Jan 12 11:09:22 volumio volumio-remote-updater[631]: No test mode Jan 12 11:09:22 volumio volumio-remote-updater[631]: No alpha test mode Jan 12 11:09:22 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled Jan 12 11:09:22 volumio volumio[8426]: info: Update Ready: {"changeLogLink":"","description":"You're already on the latest version","title":"No Updates Available","updateavailable":false} Jan 12 11:09:22 volumio volumio[8426]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache Jan 12 11:09:52 volumio volumio[8426]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jan 12 11:09:52 volumio volumio[8426]: Error: connect ETIMEDOUT 103.252.114.101:443 Jan 12 11:09:52 volumio volumio[8426]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1159:16) { Jan 12 11:09:52 volumio volumio[8426]: errno: -110, Jan 12 11:09:52 volumio volumio[8426]: code: 'ETIMEDOUT', Jan 12 11:09:52 volumio volumio[8426]: syscall: 'connect', Jan 12 11:09:52 volumio volumio[8426]: address: '103.252.114.101', Jan 12 11:09:52 volumio volumio[8426]: port: 443 Jan 12 11:09:52 volumio volumio[8426]: } Jan 12 11:09:52 volumio volumio[8426]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jan 12 11:09:52 volumio sudo[9039]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-01-12 11:08 Jan 12 11:09:52 volumio sudo[9039]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Debian GNU/Linux 10 (buster)" NAME="Debian GNU/Linux" VERSION_ID="10" VERSION="10 (buster)" VERSION_CODENAME=buster ID=debian HOME_URL="https://www.debian.org/" SUPPORT_URL="https://www.debian.org/support" BUG_REPORT_URL="https://bugs.debian.org/" VOLUMIO_BUILD_VERSION="70bcab5180cf11352f5a5197ade215ea8ee93db0" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="678d37490b3eb2102ce7c6d7a6dc3cf042ff2347" VOLUMIO_ARCH="x64" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Fri 08 Nov 2024 07:25:16 PM CET" VOLUMIO_VERSION="3.779" VOLUMIO_HARDWARE="x86_amd64" VOLUMIO_DEVICENAME="x86_64" VOLUMIO_HASH="66c567362bdbb3dc1644a18f7879afe7"