-- Logs begin at Fri 2025-07-18 03:20:41 UTC, end at Thu 2025-09-11 09:18:12 UTC. -- Sep 11 09:17:22 volumio volumio[1246]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Sep 11 09:17:22 volumio volumio[1246]: info: CURURI: music-library/USB/MP3 Sep 11 09:17:26 volumio volumio[1246]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Sep 11 09:17:26 volumio volumio[1246]: info: CURURI: albums:// Sep 11 09:17:26 volumio volumio[1246]: listAlbums - loading Albums from cache Sep 11 09:17:26 volumio volumio[1246]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Madonna/Like%20a%20Virgin/9fca53d4-f0d5-43dc-b4cd-8492509c0d7a.png' Sep 11 09:17:27 volumio volumio[1246]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Backstreet%20Boys/Millenium/e0357f81-12e0-4979-9940-8fddcdafe0df.png' Sep 11 09:17:27 volumio volumio[1246]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Garth%20Brooks/No%20Fences/be9e7837-7016-40a9-a4dc-78b03e4099ab.png' Sep 11 09:17:27 volumio volumio[1246]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Led%20Zeppelin/Physical%20Graffiti/5166f8ca-63b1-444c-ba9b-887f2422cf88.jpg' Sep 11 09:17:27 volumio volumio[1246]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Prince/Purple%20Rain/1b9ead46-b96b-4029-aa73-5de254ea51b2.jpg' Sep 11 09:17:27 volumio volumio[1246]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Apocalyptica/Reflections/65f64893-60a5-4964-98b1-56c0c36d8295.png' Sep 11 09:17:41 volumio volumio[1246]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Sep 11 09:17:41 volumio volumio[1246]: info: CURURI: albums://Led%20Zeppelin/Physical%20Graffiti Sep 11 09:17:42 volumio volumio[1246]: info: CoreCommandRouter::volumioAddQueueItems Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::addQueueItems Sep 11 09:17:42 volumio volumio[1246]: info: CorePlayQueue::addQueueItems Sep 11 09:17:42 volumio volumio[1246]: info: Adding Item to queue: albums://Led%20Zeppelin/Physical%20Graffiti Sep 11 09:17:42 volumio volumio[1246]: info: Exploding uri albums://Led%20Zeppelin/Physical%20Graffiti in service mpd Sep 11 09:17:42 volumio volumio[1246]: info: CorePlayQueue::saveQueue Sep 11 09:17:42 volumio volumio[1246]: info: CoreCommandRouter::volumioPushQueue Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::updateTrackBlock Sep 11 09:17:42 volumio volumio[1246]: info: CorePlayQueue::getTrackBlock Sep 11 09:17:42 volumio volumio[1246]: info: CoreCommandRouter::volumioPlay Sep 11 09:17:42 volumio volumio[1246]: UNSET VOLATILE Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::play index 93 Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::setConsumeUpdateService undefined Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::stop Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::setConsumeUpdateService undefined Sep 11 09:17:42 volumio volumio[1246]: UNSET VOLATILE Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::stPlaybackTimer Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::updateTrackBlock Sep 11 09:17:42 volumio volumio[1246]: info: CorePlayQueue::getTrackBlock Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::pushState Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::getState Sep 11 09:17:42 volumio volumio[1246]: info: CorePlayQueue::getTrack 92 Sep 11 09:17:42 volumio volumio[1246]: info: CoreCommandRouter::volumioPushState Sep 11 09:17:42 volumio volumio[1246]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::serviceStop Sep 11 09:17:42 volumio volumio[1246]: info: CorePlayQueue::getTrack 92 Sep 11 09:17:42 volumio volumio[1246]: info: CoreCommandRouter::serviceStop Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::stop Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::sendMpdCommand stop Sep 11 09:17:42 volumio volumio[1246]: info: sending command... Sep 11 09:17:42 volumio sudo[1470]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Sep 11 09:17:42 volumio sudo[1470]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 11 09:17:42 volumio sudo[1470]: pam_unix(sudo:session): session closed for user root Sep 11 09:17:42 volumio volumio[1246]: info: parsing response... Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::play index undefined Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::setConsumeUpdateService undefined Sep 11 09:17:42 volumio volumio[1246]: info: CorePlayQueue::getTrack 93 Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::startPlaybackTimer Sep 11 09:17:42 volumio volumio[1246]: info: CorePlayQueue::getTrack 93 Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::clearAddPlayTracks USB/MP3/cd pop2/Custard Pie.mp3 Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::sendMpdCommand stop Sep 11 09:17:42 volumio volumio[1246]: info: sending command... Sep 11 09:17:42 volumio volumio[1246]: info: Sep 11 09:17:42 volumio volumio[1246]: ---------------------------- MPD announces state update: player Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::getState Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::sendMpdCommand status Sep 11 09:17:42 volumio volumio[1246]: info: parsing response... Sep 11 09:17:42 volumio volumio[1246]: info: sending command... Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::sendMpdCommand clear Sep 11 09:17:42 volumio volumio[1246]: info: sending command... Sep 11 09:17:42 volumio volumio[1246]: info: Sep 11 09:17:42 volumio volumio[1246]: ---------------------------- MPD announces system playlist update Sep 11 09:17:42 volumio volumio[1246]: info: Ignoring MPD Status Update Sep 11 09:17:42 volumio volumio[1246]: info: parsing response... Sep 11 09:17:42 volumio volumio[1246]: info: parsing response... Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::parseState Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::sendMpdCommand playlistinfo Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::sendMpdCommand add "USB/MP3/cd pop2/Custard Pie.mp3" Sep 11 09:17:42 volumio volumio[1246]: info: sending command... Sep 11 09:17:42 volumio volumio[1246]: info: sending command... Sep 11 09:17:42 volumio volumio[1246]: info: Sep 11 09:17:42 volumio volumio[1246]: info: Sep 11 09:17:42 volumio volumio[1246]: ---------------------------- MPD announces system playlist update Sep 11 09:17:42 volumio volumio[1246]: info: Ignoring MPD Status Update Sep 11 09:17:42 volumio volumio[1246]: info: ------------------------------ 11ms Sep 11 09:17:42 volumio volumio[1246]: info: parsing response... Sep 11 09:17:42 volumio volumio[1246]: info: parsing response... Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::parseTrackInfo Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::sendMpdCommand play Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::pushError Sep 11 09:17:42 volumio volumio[1246]: info: message=Cannot read property 'split' of undefined, stack=TypeError: Cannot read property 'split' of undefined Sep 11 09:17:42 volumio volumio[1246]: at Promise._successFn (/volumio/app/plugins/music_service/mpd/index.js:295:72) Sep 11 09:17:42 volumio volumio[1246]: at nextTickCallback (/volumio/node_modules/kew/kew.js:47:28) Sep 11 09:17:42 volumio volumio[1246]: at _combinedTickCallback (internal/process/next_tick.js:131:7) Sep 11 09:17:42 volumio volumio[1246]: at process._tickCallback (internal/process/next_tick.js:180:9) Sep 11 09:17:42 volumio volumio[1246]: info: sending command... Sep 11 09:17:42 volumio volumio[1246]: info: ------------------------------ 27ms Sep 11 09:17:42 volumio volumio[1246]: info: ------------------------------ 11ms Sep 11 09:17:42 volumio volumio[1246]: info: parsing response... Sep 11 09:17:42 volumio volumio[1246]: info: Sep 11 09:17:42 volumio volumio[1246]: ---------------------------- MPD announces state update: player Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::getState Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::sendMpdCommand status Sep 11 09:17:42 volumio volumio[1246]: info: sending command... Sep 11 09:17:42 volumio volumio[1246]: info: Sep 11 09:17:42 volumio volumio[1246]: ---------------------------- MPD announces state update: player Sep 11 09:17:42 volumio volumio[1246]: info: parsing response... Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::getState Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::sendMpdCommand status Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::parseState Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::sendMpdCommand playlistinfo Sep 11 09:17:42 volumio volumio[1246]: info: sending command... Sep 11 09:17:42 volumio volumio[1246]: info: sending command... Sep 11 09:17:42 volumio volumio[1246]: info: parsing response... Sep 11 09:17:42 volumio volumio[1246]: info: parsing response... Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::parseState Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::sendMpdCommand playlistinfo Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::parseTrackInfo Sep 11 09:17:42 volumio volumio[1246]: info: sending command... Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::pushState Sep 11 09:17:42 volumio volumio[1246]: info: CoreCommandRouter::servicePushState Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::syncState Sep 11 09:17:42 volumio volumio[1246]: info: CorePlayQueue::getTrack 93 Sep 11 09:17:42 volumio volumio[1246]: info: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":254,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"isStreaming":false,"title":"Custard Pie","artist":"Led Zeppelin","album":"Physical Graffiti","uri":"USB/MP3/cd pop2/Custard Pie.mp3","trackType":"mp3"} Sep 11 09:17:42 volumio volumio[1246]: info: CURRENT POSITION 93 Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::syncState stateService play Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::syncState currentStatus stop Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::pushState Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::getState Sep 11 09:17:42 volumio volumio[1246]: info: CorePlayQueue::getTrack 93 Sep 11 09:17:42 volumio volumio[1246]: info: CoreCommandRouter::volumioPushState Sep 11 09:17:42 volumio volumio[1246]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 11 09:17:42 volumio volumio[1246]: info: ------------------------------ 72ms Sep 11 09:17:42 volumio volumio[1246]: info: parsing response... Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::parseTrackInfo Sep 11 09:17:42 volumio volumio[1246]: info: ControllerMpd::pushState Sep 11 09:17:42 volumio volumio[1246]: info: CoreCommandRouter::servicePushState Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::syncState Sep 11 09:17:42 volumio volumio[1246]: info: CorePlayQueue::getTrack 93 Sep 11 09:17:42 volumio sudo[1475]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Sep 11 09:17:42 volumio sudo[1475]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 11 09:17:42 volumio volumio[1246]: info: STATE SERVICE {"status":"play","position":0,"seek":487,"duration":254,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"isStreaming":false,"title":"Custard Pie","artist":"Led Zeppelin","album":"Physical Graffiti","uri":"USB/MP3/cd pop2/Custard Pie.mp3","trackType":"mp3"} Sep 11 09:17:42 volumio volumio[1246]: info: CURRENT POSITION 93 Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::syncState stateService play Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::syncState currentStatus play Sep 11 09:17:42 volumio volumio[1246]: info: Received an update from plugin. extracting info from payload Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::pushState Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::getState Sep 11 09:17:42 volumio volumio[1246]: info: CorePlayQueue::getTrack 93 Sep 11 09:17:42 volumio volumio[1246]: info: CoreCommandRouter::volumioPushState Sep 11 09:17:42 volumio volumio[1246]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 11 09:17:42 volumio sudo[1475]: pam_unix(sudo:session): session closed for user root Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::pushState Sep 11 09:17:42 volumio volumio[1246]: info: CoreStateMachine::getState Sep 11 09:17:42 volumio volumio[1246]: info: CorePlayQueue::getTrack 93 Sep 11 09:17:42 volumio volumio[1246]: info: CoreCommandRouter::volumioPushState Sep 11 09:17:42 volumio volumio[1246]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 11 09:17:42 volumio sudo[1480]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Sep 11 09:17:42 volumio sudo[1480]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 11 09:17:42 volumio volumio[1246]: info: ------------------------------ 112ms Sep 11 09:17:42 volumio sudo[1480]: pam_unix(sudo:session): session closed for user root Sep 11 09:17:42 volumio sudo[1482]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Sep 11 09:17:42 volumio sudo[1482]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 11 09:17:42 volumio sudo[1482]: pam_unix(sudo:session): session closed for user root Sep 11 09:17:48 volumio volumio[1246]: info: VolumeController::SetAlsaVolume+ Sep 11 09:17:48 volumio volumio[1246]: info: CoreStateMachine::pushState Sep 11 09:17:48 volumio volumio[1246]: info: CoreStateMachine::getState Sep 11 09:17:48 volumio volumio[1246]: info: CorePlayQueue::getTrack 93 Sep 11 09:17:48 volumio volumio[1246]: info: CoreCommandRouter::volumioPushState Sep 11 09:17:48 volumio volumio[1246]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 11 09:17:48 volumio sudo[1492]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Sep 11 09:17:48 volumio sudo[1492]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 11 09:17:48 volumio sudo[1492]: pam_unix(sudo:session): session closed for user root Sep 11 09:17:48 volumio volumio[1246]: info: VolumeController::SetAlsaVolume+ Sep 11 09:17:48 volumio volumio[1246]: info: CoreStateMachine::pushState Sep 11 09:17:48 volumio volumio[1246]: info: CoreStateMachine::getState Sep 11 09:17:48 volumio volumio[1246]: info: CorePlayQueue::getTrack 93 Sep 11 09:17:48 volumio volumio[1246]: info: CoreCommandRouter::volumioPushState Sep 11 09:17:48 volumio volumio[1246]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 11 09:17:48 volumio sudo[1499]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Sep 11 09:17:48 volumio sudo[1499]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 11 09:17:48 volumio sudo[1499]: pam_unix(sudo:session): session closed for user root Sep 11 09:18:11 volumio volumio[1246]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Sep 11 09:18:11 volumio volumio[1246]: { Error: connect ETIMEDOUT 108.160.170.26:443 Sep 11 09:18:11 volumio volumio[1246]: at Object._errnoException (util.js:1022:11) Sep 11 09:18:11 volumio volumio[1246]: at _exceptionWithHostPort (util.js:1044:20) Sep 11 09:18:11 volumio volumio[1246]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1198:14) Sep 11 09:18:11 volumio volumio[1246]: code: 'ETIMEDOUT', Sep 11 09:18:11 volumio volumio[1246]: errno: 'ETIMEDOUT', Sep 11 09:18:11 volumio volumio[1246]: syscall: 'connect', Sep 11 09:18:11 volumio volumio[1246]: address: '108.160.170.26', Sep 11 09:18:11 volumio volumio[1246]: port: 443 } Sep 11 09:18:11 volumio volumio[1246]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Sep 11 09:18:12 volumio sudo[1512]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-09-11 09:17 Sep 11 09:18:12 volumio sudo[1512]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Debian GNU/Linux 8 (jessie)" NAME="Debian GNU/Linux" VERSION_ID="8" VERSION="8 (jessie)" ID=debian HOME_URL="http://www.debian.org/" SUPPORT_URL="http://www.debian.org/support" BUG_REPORT_URL="https://bugs.debian.org/" VOLUMIO_BUILD_VERSION="14e505ebc0c0b6541b6ad04e5b86c2128df58d23" VOLUMIO_FE_VERSION="" VOLUMIO_BE_VERSION="182fd1481f62b921e0a6fbcd29a33d75c95ccac8" VOLUMIO_ARCH="armv7" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Wed Mar 4 21:53:25 CET 2020" VOLUMIO_VERSION="2.715" VOLUMIO_HARDWARE="rock64" VOLUMIO_HASH="682d7f799b82e8a07b3632960574d000"