-- Logs begin at Mon 2025-01-13 23:02:49 CST, end at Mon 2025-01-13 23:32:01 CST. -- Jan 13 23:31:10 volumio dnsmasq-dhcp[798]: DHCPRELEASE(wlan0) 192.168.211.195 fa:73:c2:13:6e:f9 Jan 13 23:31:33 volumio volumio[796]: info: Airplay started streaming, receiving metadatas Jan 13 23:31:33 volumio volumio[796]: info: Airplay started streaming, receiving metadatas Jan 13 23:31:34 volumio shairport-sync[1125]: {"time":1736782184412,"response":"stopAirplayPlayback Success"} % Total % Received % Xferd Average Speed Time Time Time Current Jan 13 23:31:34 volumio shairport-sync[1125]: Dload Upload Total Spent Left Speed Jan 13 23:31:34 volumio volumio[796]: info: Jan 13 23:31:34 volumio volumio[796]: ---------------------------- Client requests Start Airplay PlaybackRoutine Jan 13 23:31:34 volumio volumio[796]: info: CoreCommandRouter::executeOnPlugin: airplay_emulation , startAirplayPlayback Jan 13 23:31:34 volumio volumio[796]: info: Airplay playback start Jan 13 23:31:34 volumio shairport-sync[1125]: [158B blob data] Jan 13 23:31:34 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:34 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:34 volumio volumio[796]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 13 23:31:34 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:34 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:34 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:34 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:34 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:34 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:34 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:34 volumio shairport-sync[1125]: {"time":1736782294116,"response":"startAirplayPlayback Success"} % Total % Received % Xferd Average Speed Time Time Time Current Jan 13 23:31:34 volumio shairport-sync[1125]: Dload Upload Total Spent Left Speed Jan 13 23:31:34 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:34 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:34 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:34 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:35 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:35 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:35 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:35 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:35 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:35 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:35 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:35 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:35 volumio volumio[796]: info: Jan 13 23:31:35 volumio volumio[796]: ---------------------------- Client requests Stop Airplay Playback Jan 13 23:31:35 volumio volumio[796]: info: CoreCommandRouter::executeOnPlugin: airplay_emulation , stopAirplayPlayback Jan 13 23:31:35 volumio volumio[796]: info: Airplay playback stop Jan 13 23:31:35 volumio volumio[796]: info: Airplay Playback Stopped, clearing state Jan 13 23:31:35 volumio volumio[796]: info: CoreStateMachine::resetVolumioState Jan 13 23:31:35 volumio volumio[796]: info: CoreStateMachine::getcurrentVolume Jan 13 23:31:35 volumio volumio[796]: info: CoreCommandRouter::volumioRetrievevolume Jan 13 23:31:35 volumio shairport-sync[1125]: [237B blob data] Jan 13 23:31:35 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:35 volumio volumio[796]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 13 23:31:35 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:36 volumio volumio[796]: info: Airplay started streaming, receiving metadatas Jan 13 23:31:36 volumio shairport-sync[1125]: {"time":1736782295410,"response":"stopAirplayPlayback Success"} % Total % Received % Xferd Average Speed Time Time Time Current Jan 13 23:31:36 volumio shairport-sync[1125]: Dload Upload Total Spent Left Speed Jan 13 23:31:36 volumio volumio[796]: info: Jan 13 23:31:36 volumio volumio[796]: ---------------------------- Client requests Start Airplay PlaybackRoutine Jan 13 23:31:36 volumio volumio[796]: info: CoreCommandRouter::executeOnPlugin: airplay_emulation , startAirplayPlayback Jan 13 23:31:36 volumio volumio[796]: info: Airplay playback start Jan 13 23:31:36 volumio shairport-sync[1125]: [158B blob data] Jan 13 23:31:37 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:37 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:37 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:37 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:37 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:37 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:37 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:37 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:37 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:37 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:37 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:37 volumio volumio[796]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 13 23:31:37 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:37 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:37 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:37 volumio volumio[796]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 13 23:31:37 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:38 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:38 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:38 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:38 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:38 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:38 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:38 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:38 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:38 volumio volumio[796]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 13 23:31:38 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:38 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:38 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:38 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:38 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:38 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:38 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:38 volumio volumio[796]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E9%80%83%E8%B7%91%E8%AE%A1%E5%88%92/%E5%9B%9E%E5%88%B0%E6%B5%B7%E6%B4%8B/6035c4ae-7a26-4306-8c25-b7474fca84ec.jpg' Jan 13 23:31:46 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:46 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:46 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:46 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:46 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:46 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:46 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:46 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:46 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:47 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:47 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:47 volumio volumio[796]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 13 23:31:47 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:47 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:47 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:47 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:47 volumio volumio[796]: info: CoreCommandRouter::servicePushState Jan 13 23:31:47 volumio volumio[796]: info: CoreStateMachine::pushState Jan 13 23:31:47 volumio volumio[796]: info: CoreCommandRouter::volumioPushState Jan 13 23:31:54 volumio volumio[796]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jan 13 23:31:54 volumio volumio[796]: Error: connect ETIMEDOUT 198.27.124.186:443 Jan 13 23:31:54 volumio volumio[796]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1146:16) { Jan 13 23:31:54 volumio volumio[796]: errno: -110, Jan 13 23:31:54 volumio volumio[796]: code: 'ETIMEDOUT', Jan 13 23:31:54 volumio volumio[796]: syscall: 'connect', Jan 13 23:31:54 volumio volumio[796]: address: '198.27.124.186', Jan 13 23:31:54 volumio volumio[796]: port: 443 Jan 13 23:31:54 volumio volumio[796]: } Jan 13 23:31:54 volumio volumio[796]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jan 13 23:32:01 volumio sudo[5077]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-01-13 23:31 Jan 13 23:32:01 volumio sudo[5077]: 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="f6610a1100d2380eef33bd3004af43153c786f96" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="1c0e5daee99fe3a72cc38b0d1fe6cd78d7f001fe" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Mon 16 Dec 2024 09:30:04 AM CET" VOLUMIO_VERSION="3.785" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="fe0ac4b79aed19ccde4b5bd83d468193"