-- Logs begin at Thu 2019-02-14 18:12:00 HKT, end at Mon 2025-09-08 21:56:31 HKT. --
Sep 08 21:55:16 ryanmedia volumio[1315]: 11
Sep 08 21:55:16 ryanmedia volumio[1315]: % Total % Received % Xferd Average Speed Time Time Time Current
Sep 08 21:55:16 ryanmedia volumio[1315]: Dload Upload Total Spent Left Speed
Sep 08 21:55:16 ryanmedia volumio[972]: info:
Sep 08 21:55:16 ryanmedia volumio[972]: ---------------------------- Client requests Volume 11
Sep 08 21:55:16 ryanmedia volumio[972]: info: VolumeController::SetAlsaVolume11
Sep 08 21:55:16 ryanmedia volumio[972]: info: CoreStateMachine::pushState
Sep 08 21:55:16 ryanmedia volumio[972]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Sep 08 21:55:16 ryanmedia volumio[972]: info: CoreCommandRouter::volumioPushState
Sep 08 21:55:16 ryanmedia volumio[1315]: [158B blob data]
Sep 08 21:55:16 ryanmedia volumio[1315]: {"time":1757339716169,"response":"volume Success"}11
Sep 08 21:55:16 ryanmedia volumio[972]: info: CoreCommandRouter::volumioGetQueue
Sep 08 21:55:16 ryanmedia volumio[972]: info: CoreStateMachine::getQueue
Sep 08 21:55:16 ryanmedia volumio[972]: info: CorePlayQueue::getQueue
Sep 08 21:55:18 ryanmedia volumio[1315]: 16
Sep 08 21:55:19 ryanmedia volumio[1315]: % Total % Received % Xferd Average Speed Time Time Time Current
Sep 08 21:55:19 ryanmedia volumio[1315]: Dload Upload Total Spent Left Speed
Sep 08 21:55:19 ryanmedia volumio[972]: info:
Sep 08 21:55:19 ryanmedia volumio[972]: ---------------------------- Client requests Volume 16
Sep 08 21:55:19 ryanmedia volumio[972]: info: VolumeController::SetAlsaVolume16
Sep 08 21:55:19 ryanmedia volumio[972]: info: CoreStateMachine::pushState
Sep 08 21:55:19 ryanmedia volumio[972]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Sep 08 21:55:19 ryanmedia volumio[972]: info: CoreCommandRouter::volumioPushState
Sep 08 21:55:19 ryanmedia volumio[1315]: [158B blob data]
Sep 08 21:55:19 ryanmedia volumio[972]: info: CoreCommandRouter::volumioGetQueue
Sep 08 21:55:19 ryanmedia volumio[972]: info: CoreStateMachine::getQueue
Sep 08 21:55:19 ryanmedia volumio[972]: info: CorePlayQueue::getQueue
Sep 08 21:55:19 ryanmedia volumio[1315]: {"time":1757339719077,"response":"volume Success"}16
Sep 08 21:55:20 ryanmedia volumio[972]: error: MyVolumio got a network error: A network error (such as timeout, interrupted connection or unreachable host) has occurred.
Sep 08 21:55:20 ryanmedia volumio[972]: info: Retrying Login Due to Network Error
Sep 08 21:55:21 ryanmedia volumio[1315]: 11
Sep 08 21:55:21 ryanmedia volumio[1315]: % Total % Received % Xferd Average Speed Time Time Time Current
Sep 08 21:55:21 ryanmedia volumio[1315]: Dload Upload Total Spent Left Speed
Sep 08 21:55:21 ryanmedia volumio[972]: info:
Sep 08 21:55:21 ryanmedia volumio[972]: ---------------------------- Client requests Volume 11
Sep 08 21:55:21 ryanmedia volumio[972]: info: VolumeController::SetAlsaVolume11
Sep 08 21:55:21 ryanmedia volumio[972]: info: CoreStateMachine::pushState
Sep 08 21:55:21 ryanmedia volumio[972]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Sep 08 21:55:21 ryanmedia volumio[972]: info: CoreCommandRouter::volumioPushState
Sep 08 21:55:21 ryanmedia volumio[1315]: [158B blob data]
Sep 08 21:55:21 ryanmedia volumio[1315]: {"time":1757339721657,"response":"volume Success"}11
Sep 08 21:55:21 ryanmedia volumio[972]: info: CoreCommandRouter::volumioGetQueue
Sep 08 21:55:21 ryanmedia volumio[972]: info: CoreStateMachine::getQueue
Sep 08 21:55:21 ryanmedia volumio[972]: info: CorePlayQueue::getQueue
Sep 08 21:55:22 ryanmedia volumio[972]: error: MyVolumio got a network error: A network error (such as timeout, interrupted connection or unreachable host) has occurred.
Sep 08 21:55:22 ryanmedia volumio[972]: info: Retrying Login Due to Network Error
Sep 08 21:55:30 ryanmedia volumio[972]: info: MyVolumio login type: Token
Sep 08 21:55:32 ryanmedia volumio[972]: info: MyVolumio login type: Token
Sep 08 21:56:00 ryanmedia volumio[972]: error: MyVolumio got a network error: A network error (such as timeout, interrupted connection or unreachable host) has occurred.
Sep 08 21:56:00 ryanmedia volumio[972]: info: Retrying Login Due to Network Error
Sep 08 21:56:02 ryanmedia volumio[972]: error: MyVolumio got a network error: A network error (such as timeout, interrupted connection or unreachable host) has occurred.
Sep 08 21:56:02 ryanmedia volumio[972]: info: Retrying Login Due to Network Error
Sep 08 21:56:10 ryanmedia volumio[972]: info: MyVolumio login type: Token
Sep 08 21:56:12 ryanmedia volumio[972]: info: MyVolumio login type: Token
Sep 08 21:56:28 ryanmedia volumio[972]: info: Clearing queue after UPNP request
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::ClearQueue
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::stop
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::setConsumeUpdateService undefined
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::stPlaybackTimer
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::updateTrackBlock
Sep 08 21:56:28 ryanmedia volumio[972]: info: CorePlayQueue::getTrackBlock
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::pushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CorePlayQueue::getTrack 0
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreCommandRouter::volumioPushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::serviceStop
Sep 08 21:56:28 ryanmedia volumio[972]: info: CorePlayQueue::getTrack 0
Sep 08 21:56:28 ryanmedia volumio[972]: info: ControllerMpd::stop
Sep 08 21:56:28 ryanmedia volumio[972]: verbose: ControllerMpd::sendMpdCommand stop
Sep 08 21:56:28 ryanmedia volumio[972]: info: CorePlayQueue::clearPlayQueue
Sep 08 21:56:28 ryanmedia volumio[972]: info: CorePlayQueue::saveQueue
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreCommandRouter::volumioPushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreCommandRouter::volumioPushQueue
Sep 08 21:56:28 ryanmedia volumio[972]: error: Upnp client error: Error: This socket has been ended by the other party
Sep 08 21:56:28 ryanmedia volumio[972]: info:
Sep 08 21:56:28 ryanmedia volumio[972]: ---------------------------- MPD announces state update: player
Sep 08 21:56:28 ryanmedia volumio[972]: info: sendMpdCommand stop took 50 milliseconds
Sep 08 21:56:28 ryanmedia volumio[972]: info: ControllerMpd::getState
Sep 08 21:56:28 ryanmedia volumio[972]: verbose: ControllerMpd::sendMpdCommand status
Sep 08 21:56:28 ryanmedia volumio[972]: info:
Sep 08 21:56:28 ryanmedia volumio[972]: ---------------------------- MPD announces state update: player
Sep 08 21:56:28 ryanmedia volumio[972]: info: ControllerMpd::getState
Sep 08 21:56:28 ryanmedia volumio[972]: verbose: ControllerMpd::sendMpdCommand status
Sep 08 21:56:28 ryanmedia volumio[972]: info: sendMpdCommand status took 7 milliseconds
Sep 08 21:56:28 ryanmedia volumio[972]: info: sendMpdCommand status took 5 milliseconds
Sep 08 21:56:28 ryanmedia volumio[972]: verbose: ControllerMpd::parseState
Sep 08 21:56:28 ryanmedia volumio[972]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Sep 08 21:56:28 ryanmedia volumio[972]: verbose: ControllerMpd::parseState
Sep 08 21:56:28 ryanmedia volumio[972]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Sep 08 21:56:28 ryanmedia volumio[972]: info: sendMpdCommand playlistinfo took 3 milliseconds
Sep 08 21:56:28 ryanmedia volumio[972]: info: sendMpdCommand playlistinfo took 3 milliseconds
Sep 08 21:56:28 ryanmedia volumio[972]: verbose: ControllerMpd::parseTrackInfo
Sep 08 21:56:28 ryanmedia volumio[972]: verbose: ControllerMpd::parseTrackInfo
Sep 08 21:56:28 ryanmedia volumio[972]: info: ControllerMpd::pushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreCommandRouter::servicePushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::pushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CorePlayQueue::getTrack 0
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreCommandRouter::volumioPushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CorePlayQueue::getTrack 0
Sep 08 21:56:28 ryanmedia volumio[972]: 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":"心中的日月","uri":"http://m701.music.126.net/20250908221904/486eba291d005a2b66ea84918b35f814/jdymusic/obj/wo3DlMOGwrbDjj7DisKw/28557135003/4def/bae2/8e25/24513efa0e67d5f1380c76af67c073e5.mp3?vuutv=OkIabc5Dt6MgPBQ3OCmaNHqoMiZAen0/Jds3RU3gb/QebQ7X2cF+1oS9okvgctR95jw/zCZY3JR16hDuUS+qpdGsMqw2JecL2PYeeXxWXFA=","trackType":""}
Sep 08 21:56:28 ryanmedia volumio[972]: verbose: CURRENT POSITION 0
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::syncState stateService stop
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::syncState currentStatus stop
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::pushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CorePlayQueue::getTrack 0
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreCommandRouter::volumioPushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: No code
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::pushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CorePlayQueue::getTrack 0
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreCommandRouter::volumioPushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: ControllerMpd::pushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreCommandRouter::servicePushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::pushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CorePlayQueue::getTrack 0
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreCommandRouter::volumioPushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CorePlayQueue::getTrack 0
Sep 08 21:56:28 ryanmedia volumio[972]: 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":"心中的日月","uri":"http://m701.music.126.net/20250908221904/486eba291d005a2b66ea84918b35f814/jdymusic/obj/wo3DlMOGwrbDjj7DisKw/28557135003/4def/bae2/8e25/24513efa0e67d5f1380c76af67c073e5.mp3?vuutv=OkIabc5Dt6MgPBQ3OCmaNHqoMiZAen0/Jds3RU3gb/QebQ7X2cF+1oS9okvgctR95jw/zCZY3JR16hDuUS+qpdGsMqw2JecL2PYeeXxWXFA=","trackType":""}
Sep 08 21:56:28 ryanmedia volumio[972]: verbose: CURRENT POSITION 0
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::syncState stateService stop
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::syncState currentStatus stop
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::pushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CorePlayQueue::getTrack 0
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreCommandRouter::volumioPushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: No code
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreStateMachine::pushState
Sep 08 21:56:28 ryanmedia volumio[972]: info: CorePlayQueue::getTrack 0
Sep 08 21:56:28 ryanmedia volumio[972]: info: CoreCommandRouter::volumioPushState
Sep 08 21:56:29 ryanmedia volumio[972]: info: ------------------------------ 120ms
Sep 08 21:56:29 ryanmedia volumio[972]: info: ------------------------------ 117ms
Sep 08 21:56:30 ryanmedia volumio[972]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Sep 08 21:56:30 ryanmedia volumio[972]: Error: connect ETIMEDOUT 174.37.175.229:443
Sep 08 21:56:30 ryanmedia volumio[972]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1146:16) {
Sep 08 21:56:30 ryanmedia volumio[972]: errno: -110,
Sep 08 21:56:30 ryanmedia volumio[972]: code: 'ETIMEDOUT',
Sep 08 21:56:30 ryanmedia volumio[972]: syscall: 'connect',
Sep 08 21:56:30 ryanmedia volumio[972]: address: '174.37.175.229',
Sep 08 21:56:30 ryanmedia volumio[972]: port: 443
Sep 08 21:56:30 ryanmedia volumio[972]: }
Sep 08 21:56:30 ryanmedia volumio[972]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Sep 08 21:56:31 ryanmedia sudo[2421]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-09-08 21:55
Sep 08 21:56:31 ryanmedia sudo[2421]: 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="29866754e5f1d7e4d0f581c10d9f22852f6f21db"
VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6"
VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a"
VOLUMIO_BE_VERSION="fc4c820ddd3b5fc1a7a6b54ef112273ebd122010"
VOLUMIO_ARCH="arm"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Sat 26 Jul 2025 10:25:36 AM CEST"
VOLUMIO_VERSION="3.832"
VOLUMIO_HARDWARE="pi"
VOLUMIO_DEVICENAME="Raspberry Pi"
VOLUMIO_HASH="cf6e14681b2ecbbdc9a62186b0f3114c"