-- Logs begin at Thu 2019-02-14 18:11:58 HKT, end at Fri 2025-04-18 11:41:43 HKT. -- Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , rescanDb Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand rescan Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:01 volumio volumio[12912]: info: Apr 18 11:40:01 volumio volumio[12912]: ---------------------------- MPD announces state update: update Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand rescan took 2 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: ControllerMpd::getState Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:01 volumio volumio[12912]: info: Apr 18 11:40:01 volumio volumio[12912]: ---------------------------- MPD announces state update: update Apr 18 11:40:01 volumio volumio[12912]: info: ControllerMpd::getState Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:01 volumio volumio[12912]: info: Apr 18 11:40:01 volumio volumio[12912]: ---------------------------- MPD announces state update: update Apr 18 11:40:01 volumio volumio[12912]: info: ControllerMpd::getState Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand status took 4 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand status took 3 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand status took 3 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand status took 2 milliseconds Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:01 volumio volumio[12912]: info: Command Router : Notfying DB Updatetrue Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:01 volumio volumio[12912]: info: Command Router : Notfying DB Updatetrue Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::Close All Modals sent Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:01 volumio volumio[12912]: info: Apr 18 11:40:01 volumio volumio[12912]: ---------------------------- MPD announces state update: update Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand status took 71 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand status took 70 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: ControllerMpd::getState Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand playlistinfo took 28 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand playlistinfo took 5 milliseconds Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:01 volumio volumio[12912]: info: Command Router : Notfying DB Updatetrue Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::Close All Modals sent Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseTrackInfo Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseTrackInfo Apr 18 11:40:01 volumio volumio[12912]: info: ControllerMpd::pushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:01 volumio volumio[12912]: info: CorePlayQueue::getTrack 0 Apr 18 11:40:01 volumio volumio[12912]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Apr 18 11:40:01 volumio volumio[12912]: info: ControllerMpd::pushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:01 volumio volumio[12912]: info: CorePlayQueue::getTrack 0 Apr 18 11:40:01 volumio volumio[12912]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Apr 18 11:40:01 volumio volumio[12912]: info: ------------------------------ 108ms Apr 18 11:40:01 volumio volumio[12912]: info: ------------------------------ 107ms Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:01 volumio volumio[12912]: info: Apr 18 11:40:01 volumio volumio[12912]: ---------------------------- MPD announces state update: update Apr 18 11:40:01 volumio volumio[12912]: info: ControllerMpd::getState Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:01 volumio volumio[12912]: info: Apr 18 11:40:01 volumio volumio[12912]: ---------------------------- MPD announces state update: update Apr 18 11:40:01 volumio volumio[12912]: info: ControllerMpd::getState Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand status took 41 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand status took 40 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand playlistinfo took 16 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand status took 6 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand status took 6 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand status took 5 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand status took 5 milliseconds Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:01 volumio volumio[12912]: info: Command Router : Notfying DB Updatefalse Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::Close All Modals sent Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseTrackInfo Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:01 volumio volumio[12912]: info: Command Router : Notfying DB Updatefalse Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::Close All Modals sent Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:01 volumio volumio[12912]: info: Command Router : Notfying DB Updatefalse Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::Close All Modals sent Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 18 11:40:01 volumio volumio[12912]: info: ControllerMpd::pushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:01 volumio volumio[12912]: info: CorePlayQueue::getTrack 0 Apr 18 11:40:01 volumio volumio[12912]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Apr 18 11:40:01 volumio volumio[12912]: info: ------------------------------ 188ms Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand playlistinfo took 52 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand playlistinfo took 30 milliseconds Apr 18 11:40:01 volumio volumio[12912]: info: sendMpdCommand playlistinfo took 8 milliseconds Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseTrackInfo Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseTrackInfo Apr 18 11:40:01 volumio volumio[12912]: verbose: ControllerMpd::parseTrackInfo Apr 18 11:40:01 volumio volumio[12912]: info: ControllerMpd::pushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:01 volumio volumio[12912]: info: CorePlayQueue::getTrack 0 Apr 18 11:40:01 volumio volumio[12912]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Apr 18 11:40:01 volumio volumio[12912]: info: ControllerMpd::pushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:01 volumio volumio[12912]: info: CorePlayQueue::getTrack 0 Apr 18 11:40:01 volumio volumio[12912]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Apr 18 11:40:01 volumio volumio[12912]: info: ControllerMpd::pushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:01 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:01 volumio volumio[12912]: info: CorePlayQueue::getTrack 0 Apr 18 11:40:01 volumio volumio[12912]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Apr 18 11:40:01 volumio volumio[12912]: info: ------------------------------ 125ms Apr 18 11:40:01 volumio volumio[12912]: info: ------------------------------ 90ms Apr 18 11:40:01 volumio volumio[12912]: info: ------------------------------ 89ms Apr 18 11:40:01 volumio volumio[12912]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E5%B0%8F%E7%94%B0%E5%92%8C%E6%AD%A3/%E8%87%AA%E5%B7%B1%E3%83%99%E3%82%B9%E3%83%88-2%20(2024Ver.)/a758bb23-cdc8-4afe-93d5-eb3d729dee7d.jpg' Apr 18 11:40:05 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , updateDb Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand update Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:06 volumio volumio[12912]: info: Apr 18 11:40:06 volumio volumio[12912]: ---------------------------- MPD announces state update: update Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand update took 2 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: ControllerMpd::getState Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:06 volumio volumio[12912]: info: Apr 18 11:40:06 volumio volumio[12912]: ---------------------------- MPD announces state update: update Apr 18 11:40:06 volumio volumio[12912]: info: ControllerMpd::getState Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:06 volumio volumio[12912]: info: Apr 18 11:40:06 volumio volumio[12912]: ---------------------------- MPD announces state update: update Apr 18 11:40:06 volumio volumio[12912]: info: ControllerMpd::getState Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:06 volumio volumio[12912]: info: Apr 18 11:40:06 volumio volumio[12912]: ---------------------------- MPD announces state update: update Apr 18 11:40:06 volumio volumio[12912]: info: ControllerMpd::getState Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand status took 3 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand status took 4 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand status took 3 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand status took 3 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand status took 2 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand status took 2 milliseconds Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:06 volumio volumio[12912]: info: Command Router : Notfying DB Updatefalse Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::Close All Modals sent Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:06 volumio volumio[12912]: info: Command Router : Notfying DB Updatefalse Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::Close All Modals sent Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:06 volumio volumio[12912]: info: Command Router : Notfying DB Updatefalse Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::Close All Modals sent Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:06 volumio volumio[12912]: info: Apr 18 11:40:06 volumio volumio[12912]: ---------------------------- MPD announces state update: update Apr 18 11:40:06 volumio volumio[12912]: info: ControllerMpd::getState Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:06 volumio volumio[12912]: info: Apr 18 11:40:06 volumio volumio[12912]: ---------------------------- MPD announces state update: update Apr 18 11:40:06 volumio volumio[12912]: info: ControllerMpd::getState Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand status Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand status took 76 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand status took 76 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand playlistinfo took 52 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand playlistinfo took 29 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand playlistinfo took 7 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand status took 3 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand status took 3 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand status took 2 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand status took 2 milliseconds Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:06 volumio volumio[12912]: info: Command Router : Notfying DB Updatefalse Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::Close All Modals sent Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseTrackInfo Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseTrackInfo Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseTrackInfo Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:06 volumio volumio[12912]: info: Command Router : Notfying DB Updatefalse Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::Close All Modals sent Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:06 volumio volumio[12912]: info: Command Router : Notfying DB Updatefalse Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::Close All Modals sent Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseState Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::sendMpdCommand playlistinfo Apr 18 11:40:06 volumio volumio[12912]: info: ControllerMpd::pushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:06 volumio volumio[12912]: info: CorePlayQueue::getTrack 0 Apr 18 11:40:06 volumio volumio[12912]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Apr 18 11:40:06 volumio volumio[12912]: info: ControllerMpd::pushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:06 volumio volumio[12912]: info: CorePlayQueue::getTrack 0 Apr 18 11:40:06 volumio volumio[12912]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Apr 18 11:40:06 volumio volumio[12912]: info: ControllerMpd::pushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:06 volumio volumio[12912]: info: CorePlayQueue::getTrack 0 Apr 18 11:40:06 volumio volumio[12912]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Apr 18 11:40:06 volumio volumio[12912]: info: ------------------------------ 162ms Apr 18 11:40:06 volumio volumio[12912]: info: ------------------------------ 162ms Apr 18 11:40:06 volumio volumio[12912]: info: ------------------------------ 161ms Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand playlistinfo took 63 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand playlistinfo took 39 milliseconds Apr 18 11:40:06 volumio volumio[12912]: info: sendMpdCommand playlistinfo took 17 milliseconds Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseTrackInfo Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseTrackInfo Apr 18 11:40:06 volumio volumio[12912]: verbose: ControllerMpd::parseTrackInfo Apr 18 11:40:06 volumio volumio[12912]: info: ControllerMpd::pushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:06 volumio volumio[12912]: info: CorePlayQueue::getTrack 0 Apr 18 11:40:06 volumio volumio[12912]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Apr 18 11:40:06 volumio volumio[12912]: info: ControllerMpd::pushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:06 volumio volumio[12912]: info: CorePlayQueue::getTrack 0 Apr 18 11:40:06 volumio volumio[12912]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Apr 18 11:40:06 volumio volumio[12912]: info: ControllerMpd::pushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:06 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:06 volumio volumio[12912]: info: CorePlayQueue::getTrack 0 Apr 18 11:40:06 volumio volumio[12912]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Apr 18 11:40:06 volumio volumio[12912]: info: ------------------------------ 171ms Apr 18 11:40:06 volumio volumio[12912]: info: ------------------------------ 97ms Apr 18 11:40:06 volumio volumio[12912]: info: ------------------------------ 96ms Apr 18 11:40:09 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 18 11:40:13 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 18 11:40:17 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 18 11:40:21 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 18 11:40:24 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 18 11:40:24 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 18 11:40:24 volumio volumio[12912]: info: Discovery: Getting this device information Apr 18 11:40:24 volumio volumio[12912]: info: CoreCommandRouter::volumioGetState Apr 18 11:40:24 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 18 11:40:25 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 18 11:40:29 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 18 11:40:31 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: networkfs , discoverShares Apr 18 11:40:31 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , browseForService Apr 18 11:40:33 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 18 11:40:37 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 18 11:40:41 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:48 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:52 volumio volumio[12912]: info: CoreCommandRouter::volumioGetQueue Apr 18 11:40:52 volumio volumio[12912]: info: CoreStateMachine::getQueue Apr 18 11:40:52 volumio volumio[12912]: info: CorePlayQueue::getQueue Apr 18 11:40:54 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 18 11:40:54 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 18 11:40:54 volumio volumio[12912]: info: Discovery: Getting this device information Apr 18 11:40:54 volumio volumio[12912]: info: CoreCommandRouter::volumioGetState Apr 18 11:40:54 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 18 11:40:55 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:55 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:55 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 18 11:40:55 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:55 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:55 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:55 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:55 volumio volumio[12912]: info: CoreCommandRouter::servicePushState Apr 18 11:40:55 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:40:55 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:40:58 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Apr 18 11:40:58 volumio volumio[12912]: info: CURURI: music-library Apr 18 11:40:58 volumio volumio[12912]: info: Preload queue cleared Apr 18 11:41:07 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Apr 18 11:41:07 volumio volumio[12912]: info: CURURI: music-library/INTERNAL Apr 18 11:41:07 volumio volumio[12912]: error: Failed LSINFO: null Apr 18 11:41:07 volumio volumio[12912]: info: Preload queue cleared Apr 18 11:41:12 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Apr 18 11:41:12 volumio volumio[12912]: info: CURURI: music-library/USB Apr 18 11:41:12 volumio volumio[12912]: error: Failed LSINFO: null Apr 18 11:41:12 volumio volumio[12912]: info: Preload queue cleared Apr 18 11:41:27 volumio volumio[12912]: info: Updating volume from AirPlay: -7.43; 75% Apr 18 11:41:27 volumio volumio[12912]: info: VolumeController::SetAlsaVolume75 Apr 18 11:41:27 volumio volumio[12912]: info: CoreStateMachine::pushState Apr 18 11:41:27 volumio volumio[12912]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 18 11:41:27 volumio volumio[12912]: info: CoreCommandRouter::volumioPushState Apr 18 11:41:43 volumio volumio[12912]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Apr 18 11:41:43 volumio volumio[12912]: Error: connect ETIMEDOUT 174.36.228.136:443 Apr 18 11:41:43 volumio volumio[12912]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1146:16) { Apr 18 11:41:43 volumio volumio[12912]: errno: -110, Apr 18 11:41:43 volumio volumio[12912]: code: 'ETIMEDOUT', Apr 18 11:41:43 volumio volumio[12912]: syscall: 'connect', Apr 18 11:41:43 volumio volumio[12912]: address: '174.36.228.136', Apr 18 11:41:43 volumio volumio[12912]: port: 443 Apr 18 11:41:43 volumio volumio[12912]: } Apr 18 11:41:43 volumio volumio[12912]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Apr 18 11:41:43 volumio sudo[23552]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-04-18 11:40 Apr 18 11:41:43 volumio sudo[23552]: 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="147953990fca4aa103a8f90538ef56fb0454638c" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="e32c2c71ae78852844c70357816bdd871c155ab8" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Mon 31 Mar 2025 06:54:47 PM CEST" VOLUMIO_VERSION="3.799" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="436f3f84f6d0b4ffc344f0bc132a32e8"