-- Logs begin at Tue 2024-11-26 23:30:30 HKT, end at Wed 2024-11-27 20:56:11 HKT. -- Nov 27 20:55:04 volumiopi wpa_supplicant[827]: wlan0: Failed to initiate sched scan Nov 27 20:55:09 volumiopi wpa_supplicant[827]: wlan0: Failed to initiate sched scan Nov 27 20:55:13 volumiopi volumio[26360]: info: Nov 27 20:55:13 volumiopi volumio[26360]: ---------------------------- MPD announces system playlist update Nov 27 20:55:13 volumiopi volumio[26360]: info: Ignoring MPD Status Update Nov 27 20:55:13 volumiopi volumio[26360]: info: Nov 27 20:55:13 volumiopi volumio[26360]: ---------------------------- MPD announces system playlist update Nov 27 20:55:13 volumiopi volumio[26360]: info: Ignoring MPD Status Update Nov 27 20:55:13 volumiopi volumio[26360]: info: Nov 27 20:55:13 volumiopi volumio[26360]: ---------------------------- MPD announces system playlist update Nov 27 20:55:13 volumiopi volumio[26360]: info: Ignoring MPD Status Update Nov 27 20:55:13 volumiopi volumio[26360]: info: Nov 27 20:55:13 volumiopi volumio[26360]: ---------------------------- MPD announces state update: player Nov 27 20:55:13 volumiopi volumio[26360]: info: ControllerMpd::getState Nov 27 20:55:13 volumiopi volumio[26360]: verbose: ControllerMpd::sendMpdCommand status Nov 27 20:55:13 volumiopi volumio[26360]: info: ------------------------------ 8ms Nov 27 20:55:13 volumiopi volumio[26360]: info: ------------------------------ 6ms Nov 27 20:55:13 volumiopi volumio[26360]: info: ------------------------------ 4ms Nov 27 20:55:13 volumiopi volumio[26360]: info: Nov 27 20:55:13 volumiopi volumio[26360]: ---------------------------- MPD announces state update: player Nov 27 20:55:13 volumiopi volumio[26360]: info: ControllerMpd::getState Nov 27 20:55:13 volumiopi volumio[26360]: verbose: ControllerMpd::sendMpdCommand status Nov 27 20:55:13 volumiopi volumio[26360]: info: Nov 27 20:55:13 volumiopi volumio[26360]: ---------------------------- MPD announces state update: player Nov 27 20:55:13 volumiopi volumio[26360]: info: ControllerMpd::getState Nov 27 20:55:13 volumiopi volumio[26360]: verbose: ControllerMpd::sendMpdCommand status Nov 27 20:55:13 volumiopi volumio[26360]: info: sendMpdCommand status took 7 milliseconds Nov 27 20:55:13 volumiopi volumio[26360]: info: sendMpdCommand status took 4 milliseconds Nov 27 20:55:13 volumiopi volumio[26360]: info: sendMpdCommand status took 10 milliseconds Nov 27 20:55:13 volumiopi volumio[26360]: verbose: ControllerMpd::parseState Nov 27 20:55:13 volumiopi volumio[26360]: verbose: ControllerMpd::sendMpdCommand playlistinfo Nov 27 20:55:13 volumiopi volumio[26360]: verbose: ControllerMpd::parseState Nov 27 20:55:13 volumiopi volumio[26360]: verbose: ControllerMpd::sendMpdCommand playlistinfo Nov 27 20:55:13 volumiopi volumio[26360]: verbose: ControllerMpd::parseState Nov 27 20:55:13 volumiopi volumio[26360]: verbose: ControllerMpd::sendMpdCommand playlistinfo Nov 27 20:55:13 volumiopi volumio[26360]: info: sendMpdCommand playlistinfo took 4 milliseconds Nov 27 20:55:13 volumiopi volumio[26360]: info: sendMpdCommand playlistinfo took 3 milliseconds Nov 27 20:55:13 volumiopi volumio[26360]: info: sendMpdCommand playlistinfo took 4 milliseconds Nov 27 20:55:13 volumiopi volumio[26360]: verbose: ControllerMpd::parseTrackInfo Nov 27 20:55:13 volumiopi volumio[26360]: verbose: ControllerMpd::parseTrackInfo Nov 27 20:55:13 volumiopi volumio[26360]: verbose: ControllerMpd::parseTrackInfo Nov 27 20:55:13 volumiopi volumio[26360]: info: ControllerMpd::pushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreCommandRouter::servicePushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CorePlayQueue::getTrack 0 Nov 27 20:55:13 volumiopi volumio[26360]: verbose: STATE SERVICE {"status":"play","position":0,"seek":77787,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"Sir Charles Thompson - Good-bye","artist":"ITU Radio Jazz/Blues","album":null,"uri":"http://160.75.86.29:8088/itucazmp3","trackType":""} Nov 27 20:55:13 volumiopi volumio[26360]: verbose: CURRENT POSITION 0 Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreStateMachine::syncState stateService play Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreStateMachine::syncState currentStatus play Nov 27 20:55:13 volumiopi volumio[26360]: info: Received an update from plugin. extracting info from payload Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreStateMachine::pushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreCommandRouter::volumioPushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreStateMachine::pushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreCommandRouter::volumioPushState Nov 27 20:55:13 volumiopi volumio[26360]: info: ControllerMpd::pushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreCommandRouter::servicePushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CorePlayQueue::getTrack 0 Nov 27 20:55:13 volumiopi volumio[26360]: verbose: STATE SERVICE {"status":"play","position":0,"seek":77787,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"Sir Charles Thompson - Good-bye","artist":"ITU Radio Jazz/Blues","album":null,"uri":"http://160.75.86.29:8088/itucazmp3","trackType":""} Nov 27 20:55:13 volumiopi volumio[26360]: verbose: CURRENT POSITION 0 Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreStateMachine::syncState stateService play Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreStateMachine::syncState currentStatus play Nov 27 20:55:13 volumiopi volumio[26360]: info: Received an update from plugin. extracting info from payload Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreStateMachine::pushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreCommandRouter::volumioPushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreStateMachine::pushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreCommandRouter::volumioPushState Nov 27 20:55:13 volumiopi volumio[26360]: info: ControllerMpd::pushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreCommandRouter::servicePushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CorePlayQueue::getTrack 0 Nov 27 20:55:13 volumiopi volumio[26360]: verbose: STATE SERVICE {"status":"play","position":0,"seek":77787,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"Sir Charles Thompson - Good-bye","artist":"ITU Radio Jazz/Blues","album":null,"uri":"http://160.75.86.29:8088/itucazmp3","trackType":""} Nov 27 20:55:13 volumiopi volumio[26360]: verbose: CURRENT POSITION 0 Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreStateMachine::syncState stateService play Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreStateMachine::syncState currentStatus play Nov 27 20:55:13 volumiopi volumio[26360]: info: Received an update from plugin. extracting info from payload Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreStateMachine::pushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreCommandRouter::volumioPushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreStateMachine::pushState Nov 27 20:55:13 volumiopi volumio[26360]: info: CoreCommandRouter::volumioPushState Nov 27 20:55:13 volumiopi volumio[26360]: info: ------------------------------ 61ms Nov 27 20:55:13 volumiopi volumio[26360]: info: ------------------------------ 58ms Nov 27 20:55:13 volumiopi volumio[26360]: info: ------------------------------ 58ms Nov 27 20:55:15 volumiopi wpa_supplicant[827]: wlan0: Failed to initiate sched scan Nov 27 20:55:21 volumiopi wpa_supplicant[827]: wlan0: Failed to initiate sched scan Nov 27 20:55:26 volumiopi wpa_supplicant[827]: wlan0: Failed to initiate sched scan Nov 27 20:55:32 volumiopi wpa_supplicant[827]: wlan0: Failed to initiate sched scan Nov 27 20:55:37 volumiopi wpa_supplicant[827]: wlan0: Failed to initiate sched scan Nov 27 20:55:37 volumiopi volumio[26360]: error: error Nov 27 20:55:43 volumiopi wpa_supplicant[827]: wlan0: Failed to initiate sched scan Nov 27 20:55:48 volumiopi wpa_supplicant[827]: wlan0: Failed to initiate sched scan Nov 27 20:55:54 volumiopi wpa_supplicant[827]: wlan0: Failed to initiate sched scan Nov 27 20:55:59 volumiopi wpa_supplicant[827]: wlan0: Failed to initiate sched scan Nov 27 20:56:05 volumiopi wpa_supplicant[827]: wlan0: Failed to initiate sched scan Nov 27 20:56:10 volumiopi volumio[26360]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Nov 27 20:56:10 volumiopi volumio[26360]: Error: connect ETIMEDOUT 162.125.2.5:80 Nov 27 20:56:10 volumiopi volumio[26360]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1146:16) { Nov 27 20:56:10 volumiopi volumio[26360]: errno: -110, Nov 27 20:56:10 volumiopi volumio[26360]: code: 'ETIMEDOUT', Nov 27 20:56:10 volumiopi volumio[26360]: syscall: 'connect', Nov 27 20:56:10 volumiopi volumio[26360]: address: '162.125.2.5', Nov 27 20:56:10 volumiopi volumio[26360]: port: 80 Nov 27 20:56:10 volumiopi volumio[26360]: } Nov 27 20:56:10 volumiopi volumio[26360]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Nov 27 20:56:10 volumiopi wpa_supplicant[827]: wlan0: Failed to initiate sched scan Nov 27 20:56:11 volumiopi sudo[8247]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-11-27 20:55 Nov 27 20:56:11 volumiopi sudo[8247]: 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="e7445fab547cd22e23d9bef72406cfb610bc1d7d" VOLUMIO_FE_VERSION="5d5e99f8f803b3ec5fc5e8ca13bb4023600f3eee" VOLUMIO_FE3_VERSION="a6ae210575eae1ff43f06ab71e1cd17576840623" VOLUMIO_BE_VERSION="a9e1e1dd6072ffb15c0fcb8938d9ea0d8900c0da" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Wed 24 Apr 2024 02:10:14 PM CEST" VOLUMIO_VERSION="3.661" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="5bdefd4af4423fd17aacb83a8538bf1f"