-- Logs begin at Thu 2019-02-14 18:12:00 CST, end at Sun 2025-03-09 11:44:56 CST. -- Mar 09 11:43:38 volumio volumio[935]: info: CoreCommandRouter::volumioGetState Mar 09 11:43:38 volumio volumio[935]: info: CorePlayQueue::getTrack 7 Mar 09 11:43:38 volumio volumio[935]: info: CoreCommandRouter::volumioGetState Mar 09 11:43:38 volumio volumio[935]: info: CorePlayQueue::getTrack 7 Mar 09 11:43:38 volumio volumio[935]: info: CoreCommandRouter::volumioGetState Mar 09 11:43:38 volumio volumio[935]: info: CorePlayQueue::getTrack 7 Mar 09 11:43:39 volumio sudo[7152]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Mar 09 11:43:39 volumio sudo[7152]: pam_unix(sudo:session): session opened for user root by (uid=0) Mar 09 11:43:39 volumio sudo[7152]: pam_unix(sudo:session): session closed for user root Mar 09 11:43:39 volumio sudo[7154]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Mar 09 11:43:39 volumio sudo[7154]: pam_unix(sudo:session): session opened for user root by (uid=0) Mar 09 11:43:39 volumio sudo[7154]: pam_unix(sudo:session): session closed for user root Mar 09 11:43:39 volumio sudo[7158]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Mar 09 11:43:39 volumio sudo[7158]: pam_unix(sudo:session): session opened for user root by (uid=0) Mar 09 11:43:39 volumio sudo[7158]: pam_unix(sudo:session): session closed for user root Mar 09 11:43:39 volumio sudo[7161]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Mar 09 11:43:39 volumio sudo[7161]: pam_unix(sudo:session): session opened for user root by (uid=0) Mar 09 11:43:39 volumio sudo[7161]: pam_unix(sudo:session): session closed for user root Mar 09 11:43:39 volumio volumio[935]: verbose: New Socket.io Connection to 192.168.0.105 from 192.168.0.100 UA: Mozilla/5.0 (Linux; Android 15; 2201123C Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/130.0.6723.86 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 7 Mar 09 11:43:39 volumio volumio[935]: verbose: New Socket.io Connection to 192.168.0.105 from 192.168.0.100 UA: Mozilla/5.0 (Linux; Android 15; 2201123C Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/130.0.6723.86 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 8 Mar 09 11:43:40 volumio sudo[7164]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Mar 09 11:43:40 volumio sudo[7164]: pam_unix(sudo:session): session opened for user root by (uid=0) Mar 09 11:43:40 volumio sudo[7164]: pam_unix(sudo:session): session closed for user root Mar 09 11:43:40 volumio sudo[7166]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Mar 09 11:43:40 volumio sudo[7166]: pam_unix(sudo:session): session opened for user root by (uid=0) Mar 09 11:43:40 volumio sudo[7166]: pam_unix(sudo:session): session closed for user root Mar 09 11:43:40 volumio sudo[7170]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Mar 09 11:43:40 volumio sudo[7170]: pam_unix(sudo:session): session opened for user root by (uid=0) Mar 09 11:43:40 volumio sudo[7170]: pam_unix(sudo:session): session closed for user root Mar 09 11:43:40 volumio sudo[7172]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Mar 09 11:43:40 volumio sudo[7172]: pam_unix(sudo:session): session opened for user root by (uid=0) Mar 09 11:43:40 volumio sudo[7172]: pam_unix(sudo:session): session closed for user root Mar 09 11:43:40 volumio volumio[935]: verbose: New Socket.io Connection to 192.168.0.105 from 192.168.0.100 UA: Mozilla/5.0 (Linux; Android 15; 2201123C Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/130.0.6723.86 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 9 Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Mar 09 11:43:40 volumio volumio[935]: verbose: New Socket.io Connection to 192.168.0.105 from 192.168.0.100 UA: Mozilla/5.0 (Linux; Android 15; 2201123C Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/130.0.6723.86 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 10 Mar 09 11:43:40 volumio volumio[935]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%C3%8D%C3%B5%C2%B7%C3%86/a42fe80e-b1c0-4ff8-aac5-2659211ec9ea.jpg' Mar 09 11:43:40 volumio volumio[935]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%C3%95%C3%85%C2%B9%C3%BA%C3%88%C3%99/c6dcfd50-5fc4-459e-bad9-ac1bfb108ace.jpg' Mar 09 11:43:40 volumio volumio[935]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E4%BB%BB%E8%B4%A4%E9%BD%90/aa64dbc1-9a40-4540-9d7e-12dd68ab7919.jpg' Mar 09 11:43:40 volumio volumio[935]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%C3%95%C3%85%C3%91%C2%A7%C3%93%C3%91/b8149719-1919-4f3a-a66b-2d3cb2415ae6.jpg' Mar 09 11:43:40 volumio volumio[935]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E5%84%BF%E7%AB%A5%E6%AD%8C%E6%9B%B2/6418e6bb-02e8-4f28-9f18-2f02aedfdf11.jpg' Mar 09 11:43:40 volumio volumio[935]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E5%85%89%E8%89%AF/b0449ed4-1326-402b-991f-29e4197fcc89.jpg' Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::volumioGetVisibleSources Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::volumioGetState Mar 09 11:43:40 volumio volumio[935]: info: CorePlayQueue::getTrack 7 Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::volumioGetQueue Mar 09 11:43:40 volumio volumio[935]: info: CoreStateMachine::getQueue Mar 09 11:43:40 volumio volumio[935]: info: CorePlayQueue::getQueue Mar 09 11:43:40 volumio volumio[935]: info: Listing playlists Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Mar 09 11:43:40 volumio volumio[935]: info: Received Get System Info Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 09 11:43:40 volumio volumio[935]: info: Discovery: Getting this device information Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::volumioGetState Mar 09 11:43:40 volumio volumio[935]: info: CorePlayQueue::getTrack 7 Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::volumioGetState Mar 09 11:43:40 volumio volumio[935]: info: CorePlayQueue::getTrack 7 Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Mar 09 11:43:40 volumio volumio[935]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E5%88%98%E5%BE%B7%E5%8D%8E/72366449-71a3-48d1-b79b-7f955e764fd0.jpg' Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::volumioGetVisibleSources Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::volumioGetState Mar 09 11:43:40 volumio volumio[935]: info: CorePlayQueue::getTrack 7 Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::volumioGetQueue Mar 09 11:43:40 volumio volumio[935]: info: CoreStateMachine::getQueue Mar 09 11:43:40 volumio volumio[935]: info: CorePlayQueue::getQueue Mar 09 11:43:40 volumio volumio[935]: info: Listing playlists Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Mar 09 11:43:40 volumio volumio[935]: info: Received Get System Info Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 09 11:43:40 volumio volumio[935]: info: Discovery: Getting this device information Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::volumioGetState Mar 09 11:43:40 volumio volumio[935]: info: CorePlayQueue::getTrack 7 Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::volumioGetState Mar 09 11:43:40 volumio volumio[935]: info: CorePlayQueue::getTrack 7 Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Mar 09 11:43:40 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Mar 09 11:43:41 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Mar 09 11:43:41 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Mar 09 11:43:41 volumio volumio[935]: info: Received Get System Info Mar 09 11:43:41 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 09 11:43:41 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 09 11:43:41 volumio volumio[935]: info: Discovery: Getting this device information Mar 09 11:43:41 volumio volumio[935]: info: CoreCommandRouter::volumioGetState Mar 09 11:43:41 volumio volumio[935]: info: CorePlayQueue::getTrack 7 Mar 09 11:43:41 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Mar 09 11:43:42 volumio volumio[935]: info: Received Get System Info Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 09 11:43:42 volumio volumio[935]: info: Discovery: Getting this device information Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioGetState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 7 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioNext Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::next Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::stop Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::stPlaybackTimer Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::updateTrackBlock Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrackBlock Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 7 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::serviceStop Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 7 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::serviceStop Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::stop Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand stop Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand stop took 13 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::play index undefined Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::startPlaybackTimer Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::clearAddPlayTracks USB/7254-4C56/一人有一个梦想-陈慧娴-4315486(1).mp3 Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand stop Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::updateTrackBlock Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrackBlock Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand status took 4 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand stop took 2 milliseconds Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand clear Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:42 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand playlistinfo took 26 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand clear took 26 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand status took 25 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand status took 24 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand status took 23 milliseconds Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand add "USB/7254-4C56/一人有一个梦想-陈慧娴-4315486(1).mp3" Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: 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":"045.十万人大合唱 - 交织千个心.wav","artist":null,"album":null,"uri":"USB/7254-4C56/045.十万人大合唱 - 交织千个心.wav","trackType":"wav"} Mar 09 11:43:42 volumio volumio[935]: verbose: CURRENT POSITION 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState stateService stop Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus stop Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: No code Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: 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} Mar 09 11:43:42 volumio volumio[935]: verbose: CURRENT POSITION 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState stateService stop Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus stop Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: No code Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: 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} Mar 09 11:43:42 volumio volumio[935]: verbose: CURRENT POSITION 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState stateService stop Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus stop Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: No code Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: 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} Mar 09 11:43:42 volumio volumio[935]: verbose: CURRENT POSITION 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState stateService stop Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus stop Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: No code Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 153ms Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 145ms Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 145ms Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 145ms Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:42 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:42 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:42 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:42 volumio volumio[935]: error: updateQueue error: null Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:42 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 128ms Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand add "USB/7254-4C56/一人有一个梦想-陈慧娴-4315486(1).mp3" took 125 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 4ms Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 4ms Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 3ms Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand play Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:42 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:42 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:42 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:42 volumio volumio[935]: info: touch_display: Setting screensaver timeout to 120 seconds. Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 39ms Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand play took 38 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 38ms Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 37ms Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 36ms Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand status took 12 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand status took 12 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand status took 12 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand status took 11 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand status took 3 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand playlistinfo took 3 milliseconds Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":232,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"一人有一个梦想","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/一人有一个梦想-陈慧娴-4315486(1).mp3","trackType":"mp3"} Mar 09 11:43:42 volumio volumio[935]: verbose: CURRENT POSITION 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus stop Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 41ms Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:42 volumio volumio[935]: info: Mar 09 11:43:42 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand playlistinfo took 28 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand playlistinfo took 29 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand playlistinfo took 28 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand status took 4 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand status took 3 milliseconds Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":232,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"一人有一个梦想","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/一人有一个梦想-陈慧娴-4315486(1).mp3","trackType":"mp3"} Mar 09 11:43:42 volumio volumio[935]: verbose: CURRENT POSITION 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus play Mar 09 11:43:42 volumio volumio[935]: info: Received an update from plugin. extracting info from payload Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":731,"duration":232,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"一人有一个梦想","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/一人有一个梦想-陈慧娴-4315486(1).mp3","trackType":"mp3"} Mar 09 11:43:42 volumio volumio[935]: verbose: CURRENT POSITION 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus play Mar 09 11:43:42 volumio volumio[935]: info: Received an update from plugin. extracting info from payload Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":731,"duration":232,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"一人有一个梦想","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/一人有一个梦想-陈慧娴-4315486(1).mp3","trackType":"mp3"} Mar 09 11:43:42 volumio volumio[935]: verbose: CURRENT POSITION 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus play Mar 09 11:43:42 volumio volumio[935]: info: Received an update from plugin. extracting info from payload Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":731,"duration":232,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"一人有一个梦想","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/一人有一个梦想-陈慧娴-4315486(1).mp3","trackType":"mp3"} Mar 09 11:43:42 volumio volumio[935]: verbose: CURRENT POSITION 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus play Mar 09 11:43:42 volumio volumio[935]: info: Received an update from plugin. extracting info from payload Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 136ms Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 137ms Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 136ms Mar 09 11:43:42 volumio volumio[935]: info: ------------------------------ 129ms Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand status took 97 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand playlistinfo took 94 milliseconds Mar 09 11:43:42 volumio volumio[935]: info: sendMpdCommand playlistinfo took 94 milliseconds Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:42 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":731,"duration":232,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"一人有一个梦想","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/一人有一个梦想-陈慧娴-4315486(1).mp3","trackType":"mp3"} Mar 09 11:43:42 volumio volumio[935]: verbose: CURRENT POSITION 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus play Mar 09 11:43:42 volumio volumio[935]: info: Received an update from plugin. extracting info from payload Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:42 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:42 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:42 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:43 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":731,"duration":232,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"一人有一个梦想","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/一人有一个梦想-陈慧娴-4315486(1).mp3","trackType":"mp3"} Mar 09 11:43:43 volumio volumio[935]: verbose: CURRENT POSITION 8 Mar 09 11:43:43 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:43 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus play Mar 09 11:43:43 volumio volumio[935]: info: Received an update from plugin. extracting info from payload Mar 09 11:43:43 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:43 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:43 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:43 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:43 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:43 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:43 volumio volumio[935]: info: ------------------------------ 137ms Mar 09 11:43:43 volumio volumio[935]: info: ------------------------------ 136ms Mar 09 11:43:43 volumio volumio[935]: info: sendMpdCommand playlistinfo took 58 milliseconds Mar 09 11:43:43 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:43 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:43 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:43 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:43 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":731,"duration":232,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"一人有一个梦想","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/一人有一个梦想-陈慧娴-4315486(1).mp3","trackType":"mp3"} Mar 09 11:43:43 volumio volumio[935]: verbose: CURRENT POSITION 8 Mar 09 11:43:43 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:43 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus play Mar 09 11:43:43 volumio volumio[935]: info: Received an update from plugin. extracting info from payload Mar 09 11:43:43 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:43 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:43 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:43 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:43 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:43 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:43 volumio volumio[935]: info: ------------------------------ 174ms Mar 09 11:43:43 volumio volumio[935]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E9%99%88%E6%85%A7%E5%A8%B4/17e83728-8959-4395-aea4-ef4e381c3d6e.jpg' Mar 09 11:43:45 volumio volumio[935]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E9%99%88%E6%85%A7%E5%A8%B4/17e83728-8959-4395-aea4-ef4e381c3d6e.jpg' Mar 09 11:43:47 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::volumioNext Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::next Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::stop Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::stPlaybackTimer Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::updateTrackBlock Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrackBlock Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::serviceStop Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 8 Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::serviceStop Mar 09 11:43:49 volumio volumio[935]: info: ControllerMpd::stop Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand stop Mar 09 11:43:49 volumio volumio[935]: info: Mar 09 11:43:49 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:49 volumio volumio[935]: info: sendMpdCommand stop took 14 milliseconds Mar 09 11:43:49 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::play index undefined Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::startPlaybackTimer Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::clearAddPlayTracks USB/7254-4C56/人活着就是等待-陈慧娴-20272761(1).mp3 Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand stop Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::updateTrackBlock Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrackBlock Mar 09 11:43:49 volumio volumio[935]: info: sendMpdCommand status took 4 milliseconds Mar 09 11:43:49 volumio volumio[935]: info: sendMpdCommand stop took 2 milliseconds Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand clear Mar 09 11:43:49 volumio volumio[935]: info: Mar 09 11:43:49 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:49 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:49 volumio volumio[935]: info: Mar 09 11:43:49 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:49 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:49 volumio volumio[935]: info: Mar 09 11:43:49 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:49 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:49 volumio volumio[935]: info: Mar 09 11:43:49 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:49 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:49 volumio volumio[935]: info: sendMpdCommand playlistinfo took 34 milliseconds Mar 09 11:43:49 volumio volumio[935]: info: sendMpdCommand clear took 34 milliseconds Mar 09 11:43:49 volumio volumio[935]: info: sendMpdCommand status took 33 milliseconds Mar 09 11:43:49 volumio volumio[935]: info: sendMpdCommand status took 31 milliseconds Mar 09 11:43:49 volumio volumio[935]: info: sendMpdCommand status took 30 milliseconds Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand add "USB/7254-4C56/人活着就是等待-陈慧娴-20272761(1).mp3" Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:49 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: 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":null,"uri":"USB/7254-4C56/一人有一个梦想-陈慧娴-4315486(1).mp3","trackType":"mp3"} Mar 09 11:43:49 volumio volumio[935]: verbose: CURRENT POSITION 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::syncState stateService stop Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus stop Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:49 volumio volumio[935]: info: No code Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:49 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: 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} Mar 09 11:43:49 volumio volumio[935]: verbose: CURRENT POSITION 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::syncState stateService stop Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus stop Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:49 volumio volumio[935]: info: No code Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:49 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: 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} Mar 09 11:43:49 volumio volumio[935]: verbose: CURRENT POSITION 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::syncState stateService stop Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus stop Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:49 volumio volumio[935]: info: No code Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:49 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: 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} Mar 09 11:43:49 volumio volumio[935]: verbose: CURRENT POSITION 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::syncState stateService stop Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus stop Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:49 volumio volumio[935]: info: No code Mar 09 11:43:49 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:49 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:49 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:49 volumio volumio[935]: info: ------------------------------ 187ms Mar 09 11:43:49 volumio volumio[935]: info: ------------------------------ 181ms Mar 09 11:43:49 volumio volumio[935]: info: ------------------------------ 181ms Mar 09 11:43:49 volumio volumio[935]: info: ------------------------------ 181ms Mar 09 11:43:49 volumio volumio[935]: info: Mar 09 11:43:49 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:49 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:49 volumio volumio[935]: info: Mar 09 11:43:49 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:49 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:49 volumio volumio[935]: info: Mar 09 11:43:49 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:49 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:49 volumio volumio[935]: error: updateQueue error: null Mar 09 11:43:49 volumio volumio[935]: info: Mar 09 11:43:49 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:49 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:49 volumio volumio[935]: info: ------------------------------ 165ms Mar 09 11:43:49 volumio volumio[935]: info: sendMpdCommand add "USB/7254-4C56/人活着就是等待-陈慧娴-20272761(1).mp3" took 163 milliseconds Mar 09 11:43:49 volumio volumio[935]: info: ------------------------------ 12ms Mar 09 11:43:49 volumio volumio[935]: info: ------------------------------ 8ms Mar 09 11:43:49 volumio volumio[935]: info: ------------------------------ 7ms Mar 09 11:43:49 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand play Mar 09 11:43:49 volumio volumio[935]: info: Mar 09 11:43:49 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:49 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:49 volumio volumio[935]: info: Mar 09 11:43:49 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:49 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:50 volumio volumio[935]: info: Mar 09 11:43:50 volumio volumio[935]: ---------------------------- MPD announces system playlist update Mar 09 11:43:50 volumio volumio[935]: info: Ignoring MPD Status Update Mar 09 11:43:50 volumio volumio[935]: info: touch_display: Setting screensaver timeout to 120 seconds. Mar 09 11:43:50 volumio volumio[935]: info: Mar 09 11:43:50 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:50 volumio volumio[935]: info: Mar 09 11:43:50 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:50 volumio volumio[935]: info: ------------------------------ 69ms Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand play took 65 milliseconds Mar 09 11:43:50 volumio volumio[935]: info: ------------------------------ 63ms Mar 09 11:43:50 volumio volumio[935]: info: ------------------------------ 58ms Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:50 volumio volumio[935]: info: ------------------------------ 57ms Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:50 volumio volumio[935]: info: Mar 09 11:43:50 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:50 volumio volumio[935]: info: Mar 09 11:43:50 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:50 volumio volumio[935]: info: Mar 09 11:43:50 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand status took 5 milliseconds Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand status took 5 milliseconds Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand status took 5 milliseconds Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand status took 3 milliseconds Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand status took 3 milliseconds Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:50 volumio volumio[935]: info: Mar 09 11:43:50 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:50 volumio volumio[935]: info: Mar 09 11:43:50 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:50 volumio volumio[935]: info: Mar 09 11:43:50 volumio volumio[935]: ---------------------------- MPD announces state update: player Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::getState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand status Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand playlistinfo took 4 milliseconds Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand playlistinfo took 5 milliseconds Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand playlistinfo took 5 milliseconds Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand playlistinfo took 5 milliseconds Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand playlistinfo took 4 milliseconds Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand status took 3 milliseconds Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand status took 3 milliseconds Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand status took 2 milliseconds Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseState Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":731,"duration":257,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"人活着就是等待","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/人活着就是等待-陈慧娴-20272761(1).mp3","trackType":"mp3"} Mar 09 11:43:50 volumio volumio[935]: verbose: CURRENT POSITION 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus stop Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":731,"duration":257,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"人活着就是等待","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/人活着就是等待-陈慧娴-20272761(1).mp3","trackType":"mp3"} Mar 09 11:43:50 volumio volumio[935]: verbose: CURRENT POSITION 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus play Mar 09 11:43:50 volumio volumio[935]: info: Received an update from plugin. extracting info from payload Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":731,"duration":257,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"人活着就是等待","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/人活着就是等待-陈慧娴-20272761(1).mp3","trackType":"mp3"} Mar 09 11:43:50 volumio volumio[935]: verbose: CURRENT POSITION 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus play Mar 09 11:43:50 volumio volumio[935]: info: Received an update from plugin. extracting info from payload Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":731,"duration":257,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"人活着就是等待","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/人活着就是等待-陈慧娴-20272761(1).mp3","trackType":"mp3"} Mar 09 11:43:50 volumio volumio[935]: verbose: CURRENT POSITION 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus play Mar 09 11:43:50 volumio volumio[935]: info: Received an update from plugin. extracting info from payload Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":731,"duration":257,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"人活着就是等待","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/人活着就是等待-陈慧娴-20272761(1).mp3","trackType":"mp3"} Mar 09 11:43:50 volumio volumio[935]: verbose: CURRENT POSITION 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus play Mar 09 11:43:50 volumio volumio[935]: info: Received an update from plugin. extracting info from payload Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:50 volumio volumio[935]: info: ------------------------------ 54ms Mar 09 11:43:50 volumio volumio[935]: info: ------------------------------ 128ms Mar 09 11:43:50 volumio volumio[935]: info: ------------------------------ 122ms Mar 09 11:43:50 volumio volumio[935]: info: ------------------------------ 122ms Mar 09 11:43:50 volumio volumio[935]: info: ------------------------------ 121ms Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand playlistinfo took 111 milliseconds Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand playlistinfo took 111 milliseconds Mar 09 11:43:50 volumio volumio[935]: info: sendMpdCommand playlistinfo took 112 milliseconds Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:50 volumio volumio[935]: verbose: ControllerMpd::parseTrackInfo Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":731,"duration":257,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"人活着就是等待","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/人活着就是等待-陈慧娴-20272761(1).mp3","trackType":"mp3"} Mar 09 11:43:50 volumio volumio[935]: verbose: CURRENT POSITION 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus play Mar 09 11:43:50 volumio volumio[935]: info: Received an update from plugin. extracting info from payload Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":731,"duration":257,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"人活着就是等待","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/人活着就是等待-陈慧娴-20272761(1).mp3","trackType":"mp3"} Mar 09 11:43:50 volumio volumio[935]: verbose: CURRENT POSITION 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus play Mar 09 11:43:50 volumio volumio[935]: info: Received an update from plugin. extracting info from payload Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:50 volumio volumio[935]: info: ControllerMpd::pushState Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::servicePushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: verbose: STATE SERVICE {"status":"play","position":0,"seek":731,"duration":257,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"人活着就是等待","artist":"陈慧娴","album":null,"uri":"USB/7254-4C56/人活着就是等待-陈慧娴-20272761(1).mp3","trackType":"mp3"} Mar 09 11:43:50 volumio volumio[935]: verbose: CURRENT POSITION 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState stateService play Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::syncState currentStatus play Mar 09 11:43:50 volumio volumio[935]: info: Received an update from plugin. extracting info from payload Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:50 volumio volumio[935]: info: CoreStateMachine::pushState Mar 09 11:43:50 volumio volumio[935]: info: CorePlayQueue::getTrack 9 Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::volumioPushState Mar 09 11:43:50 volumio volumio[935]: info: ------------------------------ 180ms Mar 09 11:43:50 volumio volumio[935]: info: ------------------------------ 179ms Mar 09 11:43:50 volumio volumio[935]: info: ------------------------------ 179ms Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Mar 09 11:43:50 volumio volumio[935]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Mar 09 11:43:52 volumio volumio[935]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E5%90%B4%E5%80%A9%E8%8E%B2/52f5a63d-1c2f-4a47-9325-0a0f5b195739.jpg' Mar 09 11:43:52 volumio volumio[935]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E5%8F%B6%E5%80%A9%E6%96%87/9b26af38-6c3b-4fd9-834a-3629310ac457.jpg' Mar 09 11:43:52 volumio volumio[935]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E5%90%B4%E5%A5%87%E9%9A%86/ac00be02-9d3a-426d-8174-c5daba02e32b.jpg' Mar 09 11:44:55 volumio volumio[935]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Mar 09 11:44:55 volumio volumio[935]: Error: connect ETIMEDOUT 88.191.249.183:80 Mar 09 11:44:55 volumio volumio[935]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1146:16) { Mar 09 11:44:55 volumio volumio[935]: errno: -110, Mar 09 11:44:55 volumio volumio[935]: code: 'ETIMEDOUT', Mar 09 11:44:55 volumio volumio[935]: syscall: 'connect', Mar 09 11:44:55 volumio volumio[935]: address: '88.191.249.183', Mar 09 11:44:55 volumio volumio[935]: port: 80 Mar 09 11:44:55 volumio volumio[935]: } Mar 09 11:44:55 volumio volumio[935]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Mar 09 11:44:56 volumio sudo[7403]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-03-09 11:43 Mar 09 11:44:56 volumio sudo[7403]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Raspbian GNU/Linux 10 (buster)" NAME="Raspbian GNU/Linux" VERSION_ID="10" VERSION="10 (buster)" VERSION_CODENAME=buster 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="bba9e3185e150dd0995f9a49355b34fc6218d5a2" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="8aa57e3ae5b742ea1069404608336a9884ccfb4e" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 17 Sep 2024 05:01:09 PM CEST" VOLUMIO_VERSION="3.757" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="e0a6dc7e914e3fb93cbf2123f2f73eac"