-- Logs begin at Thu 2019-02-14 19:11:58 JST, end at Tue 2025-06-03 16:23:57 JST. -- Jun 03 16:22:01 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Jun 03 16:22:01 masason-mpd volumio[975]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Jun 03 16:22:01 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Jun 03 16:22:01 masason-mpd volumio[975]: info: Received Get System Version Jun 03 16:22:01 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Jun 03 16:22:01 masason-mpd volumio[975]: info: Received Get System Info Jun 03 16:22:01 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Jun 03 16:22:01 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Jun 03 16:22:01 masason-mpd volumio[975]: info: Discovery: Getting this device information Jun 03 16:22:01 masason-mpd volumio[975]: info: CoreCommandRouter::volumioGetState Jun 03 16:22:01 masason-mpd volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:22:01 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Jun 03 16:22:04 masason-mpd volumio[975]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 03 16:22:04 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam Jun 03 16:22:04 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam Jun 03 16:22:04 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam Jun 03 16:22:04 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: appearance , getAvailableUIs Jun 03 16:22:04 masason-mpd volumio[975]: info: Received Get System Version Jun 03 16:22:04 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Jun 03 16:22:08 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: updater_comm , clearUpdateSchedule Jun 03 16:22:08 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Jun 03 16:22:08 masason-mpd systemd[1]: systemd-timedated.service: Succeeded. Jun 03 16:22:14 masason-mpd volumio[975]: info: CALLMETHOD: system_controller system saveGeneralSettings [object Object] Jun 03 16:22:14 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: system , saveGeneralSettings Jun 03 16:22:14 masason-mpd volumio[975]: info: System name has changed, restarting Shairport Sync Jun 03 16:22:14 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 03 16:22:14 masason-mpd volumio[975]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jun 03 16:22:14 masason-mpd volumio[975]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Jun 03 16:22:14 masason-mpd volumio[975]: info: Discovery: Restarting Advertising due to device name change Jun 03 16:22:14 masason-mpd sudo[4318]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/killall upmpdcli Jun 03 16:22:14 masason-mpd sudo[4318]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:22:14 masason-mpd volumio[975]: info: Starting Shairport Sync Jun 03 16:22:14 masason-mpd sudo[4318]: pam_unix(sudo:session): session closed for user root Jun 03 16:22:14 masason-mpd sudo[4322]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/hosts Jun 03 16:22:14 masason-mpd sudo[4322]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:22:14 masason-mpd sudo[4322]: pam_unix(sudo:session): session closed for user root Jun 03 16:22:14 masason-mpd volumio[975]: error: Upnp client error: Error: This socket has been ended by the other party Jun 03 16:22:14 masason-mpd volumio[975]: info: Permissions for /etc/hosts set Jun 03 16:22:14 masason-mpd sudo[4325]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Jun 03 16:22:14 masason-mpd sudo[4325]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:22:14 masason-mpd volumio[975]: info: Hostname now is volumio Jun 03 16:22:14 masason-mpd systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Jun 03 16:22:14 masason-mpd systemd[1]: shairport-sync.service: Succeeded. Jun 03 16:22:14 masason-mpd systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Jun 03 16:22:14 masason-mpd sudo[4328]: volumio : unable to resolve host masason-mpd Jun 03 16:22:14 volumio volumio[975]: info: New hostname set Jun 03 16:22:14 volumio sudo[4328]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jun 03 16:22:14 volumio sudo[4328]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/hostname volumio Jun 03 16:22:14 volumio sudo[4328]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:22:14 volumio sudo[4328]: pam_unix(sudo:session): session closed for user root Jun 03 16:22:14 volumio sudo[4330]: volumio : unable to resolve host masason-mpd Jun 03 16:22:14 volumio sudo[4330]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jun 03 16:22:14 volumio systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Jun 03 16:22:14 volumio sudo[4330]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod -R 777 /etc/avahi/services/ Jun 03 16:22:14 volumio sudo[4330]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:22:14 volumio sudo[4330]: pam_unix(sudo:session): session closed for user root Jun 03 16:22:14 volumio sudo[4325]: pam_unix(sudo:session): session closed for user root Jun 03 16:22:14 volumio volumio[975]: info: Shairport-Sync Started Jun 03 16:22:14 volumio volumio[975]: info: Permissions for /etc/avahi/services/volumio.service Jun 03 16:22:14 volumio avahi-daemon[625]: Files changed, reloading. Jun 03 16:22:14 volumio avahi-daemon[625]: Service group file /services/volumio.service changed, reloading. Jun 03 16:22:14 volumio volumio[975]: info: Avahi name changed to volumio Jun 03 16:22:15 volumio volumio[975]: info: Discovery: A device disappeared from network Jun 03 16:22:15 volumio volumio[975]: info: Discovery: A device disappeared from network Jun 03 16:22:15 volumio avahi-daemon[625]: Service "volumio" (/services/volumio.service) successfully established. Jun 03 16:22:19 volumio volumio[975]: info: Discovery: Started advertising with name: volumio Jun 03 16:22:20 volumio volumio[975]: info: Discovery: adding c7e323b8-0a4b-4f37-9dac-66286795fde9 Jun 03 16:22:20 volumio volumio[975]: info: Discovery: Found device volumio Jun 03 16:22:20 volumio volumio[975]: info: CoreCommandRouter::volumioGetState Jun 03 16:22:20 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:22:20 volumio volumio[975]: info: Discovery: this is already registered, c7e323b8-0a4b-4f37-9dac-66286795fde9 Jun 03 16:22:20 volumio volumio[975]: info: Discovery: Found device volumio Jun 03 16:22:20 volumio volumio[975]: info: CoreCommandRouter::volumioGetState Jun 03 16:22:20 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:22:21 volumio volumio[975]: info: CoreCommandRouter::volumioGetState Jun 03 16:22:21 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:22:21 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Jun 03 16:22:22 volumio volumio[975]: info: CoreCommandRouter::Close All Modals sent Jun 03 16:22:24 volumio sudo[4354]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/samba/smb.conf Jun 03 16:22:24 volumio sudo[4354]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:22:24 volumio sudo[4354]: pam_unix(sudo:session): session closed for user root Jun 03 16:22:24 volumio volumio[975]: info: smb.conf Permissions set Jun 03 16:22:24 volumio sudo[4357]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /data/INTERNAL Jun 03 16:22:24 volumio sudo[4357]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:22:24 volumio sudo[4357]: pam_unix(sudo:session): session closed for user root Jun 03 16:22:24 volumio volumio[975]: info: Internal perms successfully set Jun 03 16:22:24 volumio sudo[4360]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart nmbd.service Jun 03 16:22:24 volumio sudo[4360]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:22:24 volumio nmbd[2770]: [2025/06/03 16:22:24.633653, 0] ../source3/nmbd/nmbd.c:58(terminate) Jun 03 16:22:24 volumio systemd[1]: Stopping Samba NMB Daemon... Jun 03 16:22:24 volumio nmbd[2770]: Got SIGTERM: going down... Jun 03 16:22:24 volumio sudo[4363]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Jun 03 16:22:24 volumio sudo[4363]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:22:24 volumio sudo[4363]: pam_unix(sudo:session): session closed for user root Jun 03 16:22:24 volumio sudo[4366]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Jun 03 16:22:24 volumio sudo[4366]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:22:24 volumio sudo[4366]: pam_unix(sudo:session): session closed for user root Jun 03 16:22:24 volumio systemd[1]: nmbd.service: Succeeded. Jun 03 16:22:24 volumio systemd[1]: Stopped Samba NMB Daemon. Jun 03 16:22:24 volumio sudo[4369]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service Jun 03 16:22:24 volumio sudo[4369]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:22:24 volumio systemd[1]: Starting Samba NMB Daemon... Jun 03 16:22:24 volumio sudo[4369]: pam_unix(sudo:session): session closed for user root Jun 03 16:22:24 volumio volumio[975]: info: Upmpdcli Daemon Started Jun 03 16:22:24 volumio nmbd[4372]: [2025/06/03 16:22:24.836601, 0] ../source3/nmbd/asyncdns.c:158(start_async_dns) Jun 03 16:22:24 volumio nmbd[4372]: started asyncdns process 4375 Jun 03 16:22:24 volumio nmbd[4372]: [2025/06/03 16:22:24.840340, 0] ../lib/util/become_daemon.c:138(daemon_ready) Jun 03 16:22:24 volumio systemd[1]: Started Samba NMB Daemon. Jun 03 16:22:24 volumio nmbd[4372]: daemon_ready: STATUS=daemon 'nmbd' finished starting up and ready to serve connections Jun 03 16:22:24 volumio sudo[4360]: pam_unix(sudo:session): session closed for user root Jun 03 16:22:24 volumio sudo[4377]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart smbd.service Jun 03 16:22:24 volumio sudo[4377]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:22:24 volumio systemd[1]: Stopping Samba SMB Daemon... Jun 03 16:22:24 volumio systemd[1]: smbd.service: Main process exited, code=killed, status=15/TERM Jun 03 16:22:24 volumio systemd[1]: smbd.service: Succeeded. Jun 03 16:22:24 volumio systemd[1]: Stopped Samba SMB Daemon. Jun 03 16:22:24 volumio systemd[1]: Starting Samba SMB Daemon... Jun 03 16:22:25 volumio smbd[4381]: [2025/06/03 16:22:25.057662, 0] ../lib/util/become_daemon.c:138(daemon_ready) Jun 03 16:22:25 volumio smbd[4381]: daemon_ready: STATUS=daemon 'smbd' finished starting up and ready to serve connections Jun 03 16:22:25 volumio systemd[1]: Started Samba SMB Daemon. Jun 03 16:22:25 volumio sudo[4377]: pam_unix(sudo:session): session closed for user root Jun 03 16:22:25 volumio volumio[975]: info: SAMBA Restarted Jun 03 16:22:25 volumio volumio[975]: info: CoreCommandRouter::volumioGetState Jun 03 16:22:25 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:22:35 volumio ntpd[776]: 162.159.200.123 local addr 172.16.10.194 -> Jun 03 16:22:49 volumio volumio[975]: info: CoreCommandRouter::volumioGetQueue Jun 03 16:22:49 volumio volumio[975]: info: CoreStateMachine::getQueue Jun 03 16:22:49 volumio volumio[975]: info: CorePlayQueue::getQueue Jun 03 16:22:51 volumio volumio[975]: info: CoreCommandRouter::volumioGetState Jun 03 16:22:51 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:22:59 volumio volumio[975]: info: CoreCommandRouter::volumioPlay Jun 03 16:22:59 volumio volumio[975]: info: CoreStateMachine::play index undefined Jun 03 16:22:59 volumio volumio[975]: info: CoreStateMachine::setConsumeUpdateService undefined Jun 03 16:22:59 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:22:59 volumio volumio[975]: info: CoreStateMachine::startPlaybackTimer Jun 03 16:22:59 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:22:59 volumio volumio[975]: info: [1748935379581] ControllerWebradio::clearAddPlayTrack Jun 03 16:22:59 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand stop Jun 03 16:22:59 volumio volumio[975]: info: sendMpdCommand stop took 1 milliseconds Jun 03 16:22:59 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand clear Jun 03 16:22:59 volumio volumio[975]: info: Jun 03 16:22:59 volumio volumio[975]: ---------------------------- MPD announces system playlist update Jun 03 16:22:59 volumio volumio[975]: info: Ignoring MPD Status Update Jun 03 16:22:59 volumio volumio[975]: info: sendMpdCommand clear took 2 milliseconds Jun 03 16:22:59 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand load "http://media-ice.musicradio.com/ClassicFMMP3" Jun 03 16:22:59 volumio volumio[975]: error: updateQueue error: null Jun 03 16:22:59 volumio volumio[975]: info: ------------------------------ 3ms Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand add "http://media-ice.musicradio.com/ClassicFMMP3" Jun 03 16:23:01 volumio volumio[975]: info: Jun 03 16:23:01 volumio volumio[975]: ---------------------------- MPD announces system playlist update Jun 03 16:23:01 volumio volumio[975]: info: Ignoring MPD Status Update Jun 03 16:23:01 volumio volumio[975]: info: sendMpdCommand add "http://media-ice.musicradio.com/ClassicFMMP3" took 1 milliseconds Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::setConsumeUpdateService mpd Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand play Jun 03 16:23:01 volumio volumio[975]: info: ------------------------------ 3ms Jun 03 16:23:01 volumio volumio[975]: info: sendMpdCommand play took 2 milliseconds Jun 03 16:23:01 volumio volumio[975]: info: Jun 03 16:23:01 volumio volumio[975]: ---------------------------- MPD announces state update: player Jun 03 16:23:01 volumio volumio[975]: info: ControllerMpd::getState Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand status Jun 03 16:23:01 volumio volumio[975]: info: Jun 03 16:23:01 volumio volumio[975]: ---------------------------- MPD announces state update: player Jun 03 16:23:01 volumio volumio[975]: info: sendMpdCommand status took 2 milliseconds Jun 03 16:23:01 volumio volumio[975]: info: ControllerMpd::getState Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand status Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::parseState Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 03 16:23:01 volumio volumio[975]: info: sendMpdCommand status took 2 milliseconds Jun 03 16:23:01 volumio volumio[975]: info: sendMpdCommand playlistinfo took 1 milliseconds Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::parseState Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::parseTrackInfo Jun 03 16:23:01 volumio volumio[975]: info: ControllerMpd::pushState Jun 03 16:23:01 volumio volumio[975]: info: CoreCommandRouter::servicePushState Jun 03 16:23:01 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:01 volumio volumio[975]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"ClassicFMMP3","artist":null,"album":null,"uri":"http://media-ice.musicradio.com/ClassicFMMP3","trackType":""} Jun 03 16:23:01 volumio volumio[975]: verbose: CURRENT POSITION 0 Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::syncState stateService play Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::syncState currentStatus stop Jun 03 16:23:01 volumio volumio[975]: info: ------------------------------ 12ms Jun 03 16:23:01 volumio volumio[975]: info: sendMpdCommand playlistinfo took 5 milliseconds Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::parseTrackInfo Jun 03 16:23:01 volumio volumio[975]: info: ControllerMpd::pushState Jun 03 16:23:01 volumio volumio[975]: info: CoreCommandRouter::servicePushState Jun 03 16:23:01 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:01 volumio volumio[975]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"ClassicFMMP3","artist":null,"album":null,"uri":"http://media-ice.musicradio.com/ClassicFMMP3","trackType":""} Jun 03 16:23:01 volumio volumio[975]: verbose: CURRENT POSITION 0 Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::syncState stateService play Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::syncState currentStatus play Jun 03 16:23:01 volumio volumio[975]: info: Received an update from plugin. extracting info from payload Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:01 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:01 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:01 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:01 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:01 volumio volumio[975]: info: ------------------------------ 25ms Jun 03 16:23:01 volumio volumio[975]: info: Jun 03 16:23:01 volumio volumio[975]: ---------------------------- MPD announces system playlist update Jun 03 16:23:01 volumio volumio[975]: info: Ignoring MPD Status Update Jun 03 16:23:01 volumio volumio[975]: info: Jun 03 16:23:01 volumio volumio[975]: ---------------------------- MPD announces state update: player Jun 03 16:23:01 volumio volumio[975]: info: ControllerMpd::getState Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand status Jun 03 16:23:01 volumio volumio[975]: info: Jun 03 16:23:01 volumio volumio[975]: ---------------------------- MPD announces system playlist update Jun 03 16:23:01 volumio volumio[975]: info: Ignoring MPD Status Update Jun 03 16:23:01 volumio volumio[975]: info: Jun 03 16:23:01 volumio volumio[975]: ---------------------------- MPD announces state update: player Jun 03 16:23:01 volumio volumio[975]: info: ------------------------------ 5ms Jun 03 16:23:01 volumio volumio[975]: info: sendMpdCommand status took 3 milliseconds Jun 03 16:23:01 volumio volumio[975]: info: ControllerMpd::getState Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand status Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::parseState Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 03 16:23:01 volumio volumio[975]: info: ------------------------------ 3ms Jun 03 16:23:01 volumio volumio[975]: info: sendMpdCommand status took 2 milliseconds Jun 03 16:23:01 volumio volumio[975]: info: sendMpdCommand playlistinfo took 2 milliseconds Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::parseState Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::parseTrackInfo Jun 03 16:23:01 volumio volumio[975]: info: ControllerMpd::pushState Jun 03 16:23:01 volumio volumio[975]: info: CoreCommandRouter::servicePushState Jun 03 16:23:01 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:01 volumio volumio[975]: verbose: STATE SERVICE {"status":"play","position":0,"seek":486,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"ClassicFMMP3","artist":"Classic FM","album":null,"uri":"http://media-ice.musicradio.com/ClassicFMMP3","trackType":""} Jun 03 16:23:01 volumio volumio[975]: verbose: CURRENT POSITION 0 Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::syncState stateService play Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::syncState currentStatus play Jun 03 16:23:01 volumio volumio[975]: info: Received an update from plugin. extracting info from payload Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:01 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:01 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:01 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:01 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:01 volumio volumio[975]: info: ------------------------------ 20ms Jun 03 16:23:01 volumio volumio[975]: info: sendMpdCommand playlistinfo took 12 milliseconds Jun 03 16:23:01 volumio volumio[975]: verbose: ControllerMpd::parseTrackInfo Jun 03 16:23:01 volumio volumio[975]: info: ControllerMpd::pushState Jun 03 16:23:01 volumio volumio[975]: info: CoreCommandRouter::servicePushState Jun 03 16:23:01 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:01 volumio volumio[975]: verbose: STATE SERVICE {"status":"play","position":0,"seek":987,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"ClassicFMMP3","artist":"Classic FM","album":null,"uri":"http://media-ice.musicradio.com/ClassicFMMP3","trackType":""} Jun 03 16:23:01 volumio volumio[975]: verbose: CURRENT POSITION 0 Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::syncState stateService play Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::syncState currentStatus play Jun 03 16:23:01 volumio volumio[975]: info: Received an update from plugin. extracting info from payload Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:01 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:01 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:01 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:01 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:01 volumio volumio[975]: info: ------------------------------ 28ms Jun 03 16:23:02 volumio volumio[975]: info: Jun 03 16:23:02 volumio volumio[975]: ---------------------------- MPD announces system playlist update Jun 03 16:23:02 volumio volumio[975]: info: Ignoring MPD Status Update Jun 03 16:23:02 volumio volumio[975]: info: Jun 03 16:23:02 volumio volumio[975]: ---------------------------- MPD announces state update: player Jun 03 16:23:02 volumio volumio[975]: info: ControllerMpd::getState Jun 03 16:23:02 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand status Jun 03 16:23:02 volumio volumio[975]: info: Jun 03 16:23:02 volumio volumio[975]: ---------------------------- MPD announces system playlist update Jun 03 16:23:02 volumio volumio[975]: info: Ignoring MPD Status Update Jun 03 16:23:02 volumio volumio[975]: info: Jun 03 16:23:02 volumio volumio[975]: ---------------------------- MPD announces state update: player Jun 03 16:23:02 volumio volumio[975]: info: ControllerMpd::getState Jun 03 16:23:02 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand status Jun 03 16:23:02 volumio volumio[975]: info: ------------------------------ 3ms Jun 03 16:23:02 volumio volumio[975]: info: sendMpdCommand status took 2 milliseconds Jun 03 16:23:02 volumio volumio[975]: verbose: ControllerMpd::parseState Jun 03 16:23:02 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 03 16:23:02 volumio volumio[975]: info: ------------------------------ 3ms Jun 03 16:23:02 volumio volumio[975]: info: sendMpdCommand status took 2 milliseconds Jun 03 16:23:02 volumio volumio[975]: info: sendMpdCommand playlistinfo took 1 milliseconds Jun 03 16:23:02 volumio volumio[975]: verbose: ControllerMpd::parseState Jun 03 16:23:02 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 03 16:23:02 volumio volumio[975]: verbose: ControllerMpd::parseTrackInfo Jun 03 16:23:02 volumio volumio[975]: info: ControllerMpd::pushState Jun 03 16:23:02 volumio volumio[975]: info: CoreCommandRouter::servicePushState Jun 03 16:23:02 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:02 volumio volumio[975]: verbose: STATE SERVICE {"status":"play","position":0,"seek":1982,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"ClassicFMMP3","artist":"Classic FM","album":null,"uri":"http://media-ice.musicradio.com/ClassicFMMP3","trackType":""} Jun 03 16:23:02 volumio volumio[975]: verbose: CURRENT POSITION 0 Jun 03 16:23:02 volumio volumio[975]: info: CoreStateMachine::syncState stateService play Jun 03 16:23:02 volumio volumio[975]: info: CoreStateMachine::syncState currentStatus play Jun 03 16:23:02 volumio volumio[975]: info: Received an update from plugin. extracting info from payload Jun 03 16:23:02 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:02 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:02 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:02 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:02 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:02 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:02 volumio volumio[975]: info: ------------------------------ 19ms Jun 03 16:23:02 volumio volumio[975]: info: sendMpdCommand playlistinfo took 16 milliseconds Jun 03 16:23:02 volumio volumio[975]: verbose: ControllerMpd::parseTrackInfo Jun 03 16:23:02 volumio volumio[975]: info: ControllerMpd::pushState Jun 03 16:23:02 volumio volumio[975]: info: CoreCommandRouter::servicePushState Jun 03 16:23:02 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:02 volumio volumio[975]: verbose: STATE SERVICE {"status":"play","position":0,"seek":1982,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"ClassicFMMP3","artist":"Classic FM","album":null,"uri":"http://media-ice.musicradio.com/ClassicFMMP3","trackType":""} Jun 03 16:23:02 volumio volumio[975]: verbose: CURRENT POSITION 0 Jun 03 16:23:02 volumio volumio[975]: info: CoreStateMachine::syncState stateService play Jun 03 16:23:02 volumio volumio[975]: info: CoreStateMachine::syncState currentStatus play Jun 03 16:23:02 volumio volumio[975]: info: Received an update from plugin. extracting info from payload Jun 03 16:23:02 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:02 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:02 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:02 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:02 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:02 volumio volumio[975]: info: ------------------------------ 30ms Jun 03 16:23:05 volumio volumio[975]: info: Jun 03 16:23:05 volumio volumio[975]: ---------------------------- MPD announces system playlist update Jun 03 16:23:05 volumio volumio[975]: info: Ignoring MPD Status Update Jun 03 16:23:05 volumio volumio[975]: info: Jun 03 16:23:05 volumio volumio[975]: ---------------------------- MPD announces state update: player Jun 03 16:23:05 volumio volumio[975]: info: ControllerMpd::getState Jun 03 16:23:05 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand status Jun 03 16:23:05 volumio volumio[975]: info: ------------------------------ 2ms Jun 03 16:23:05 volumio volumio[975]: info: sendMpdCommand status took 1 milliseconds Jun 03 16:23:05 volumio volumio[975]: verbose: ControllerMpd::parseState Jun 03 16:23:05 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 03 16:23:05 volumio volumio[975]: info: sendMpdCommand playlistinfo took 0 milliseconds Jun 03 16:23:05 volumio volumio[975]: verbose: ControllerMpd::parseTrackInfo Jun 03 16:23:05 volumio volumio[975]: info: ControllerMpd::pushState Jun 03 16:23:05 volumio volumio[975]: info: CoreCommandRouter::servicePushState Jun 03 16:23:05 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:05 volumio volumio[975]: verbose: STATE SERVICE {"status":"play","position":0,"seek":4733,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"ClassicFMMP3","artist":"Classic FM","album":null,"uri":"http://media-ice.musicradio.com/ClassicFMMP3","trackType":""} Jun 03 16:23:05 volumio volumio[975]: verbose: CURRENT POSITION 0 Jun 03 16:23:05 volumio volumio[975]: info: CoreStateMachine::syncState stateService play Jun 03 16:23:05 volumio volumio[975]: info: CoreStateMachine::syncState currentStatus play Jun 03 16:23:05 volumio volumio[975]: info: Received an update from plugin. extracting info from payload Jun 03 16:23:05 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:05 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:05 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:05 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:05 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:05 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:05 volumio volumio[975]: info: ------------------------------ 15ms Jun 03 16:23:06 volumio volumio[975]: info: Jun 03 16:23:06 volumio volumio[975]: ---------------------------- MPD announces system playlist update Jun 03 16:23:06 volumio volumio[975]: info: Ignoring MPD Status Update Jun 03 16:23:06 volumio volumio[975]: info: Jun 03 16:23:06 volumio volumio[975]: ---------------------------- MPD announces state update: player Jun 03 16:23:06 volumio volumio[975]: info: ControllerMpd::getState Jun 03 16:23:06 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand status Jun 03 16:23:06 volumio volumio[975]: info: ------------------------------ 2ms Jun 03 16:23:06 volumio volumio[975]: info: sendMpdCommand status took 2 milliseconds Jun 03 16:23:06 volumio volumio[975]: verbose: ControllerMpd::parseState Jun 03 16:23:06 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 03 16:23:06 volumio volumio[975]: info: sendMpdCommand playlistinfo took 1 milliseconds Jun 03 16:23:06 volumio volumio[975]: verbose: ControllerMpd::parseTrackInfo Jun 03 16:23:06 volumio volumio[975]: info: ControllerMpd::pushState Jun 03 16:23:06 volumio volumio[975]: info: CoreCommandRouter::servicePushState Jun 03 16:23:06 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:06 volumio volumio[975]: verbose: STATE SERVICE {"status":"play","position":0,"seek":5735,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"ClassicFMMP3","artist":"Classic FM","album":null,"uri":"http://media-ice.musicradio.com/ClassicFMMP3","trackType":""} Jun 03 16:23:06 volumio volumio[975]: verbose: CURRENT POSITION 0 Jun 03 16:23:06 volumio volumio[975]: info: CoreStateMachine::syncState stateService play Jun 03 16:23:06 volumio volumio[975]: info: CoreStateMachine::syncState currentStatus play Jun 03 16:23:06 volumio volumio[975]: info: Received an update from plugin. extracting info from payload Jun 03 16:23:06 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:06 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:06 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:06 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:06 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:06 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:06 volumio volumio[975]: info: ------------------------------ 13ms Jun 03 16:23:08 volumio volumio[975]: info: Jun 03 16:23:08 volumio volumio[975]: ---------------------------- MPD announces system playlist update Jun 03 16:23:08 volumio volumio[975]: info: Ignoring MPD Status Update Jun 03 16:23:08 volumio volumio[975]: info: Jun 03 16:23:08 volumio volumio[975]: ---------------------------- MPD announces state update: player Jun 03 16:23:08 volumio volumio[975]: info: ControllerMpd::getState Jun 03 16:23:08 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand status Jun 03 16:23:08 volumio volumio[975]: info: ------------------------------ 2ms Jun 03 16:23:08 volumio volumio[975]: info: sendMpdCommand status took 1 milliseconds Jun 03 16:23:08 volumio volumio[975]: verbose: ControllerMpd::parseState Jun 03 16:23:08 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 03 16:23:08 volumio volumio[975]: info: sendMpdCommand playlistinfo took 1 milliseconds Jun 03 16:23:08 volumio volumio[975]: verbose: ControllerMpd::parseTrackInfo Jun 03 16:23:08 volumio volumio[975]: info: ControllerMpd::pushState Jun 03 16:23:08 volumio volumio[975]: info: CoreCommandRouter::servicePushState Jun 03 16:23:08 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:08 volumio volumio[975]: verbose: STATE SERVICE {"status":"play","position":0,"seek":8109,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"ClassicFMMP3","artist":"Classic FM","album":null,"uri":"http://media-ice.musicradio.com/ClassicFMMP3","trackType":""} Jun 03 16:23:08 volumio volumio[975]: verbose: CURRENT POSITION 0 Jun 03 16:23:08 volumio volumio[975]: info: CoreStateMachine::syncState stateService play Jun 03 16:23:08 volumio volumio[975]: info: CoreStateMachine::syncState currentStatus play Jun 03 16:23:08 volumio volumio[975]: info: Received an update from plugin. extracting info from payload Jun 03 16:23:08 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:08 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:08 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:08 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:08 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:08 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:08 volumio volumio[975]: info: ------------------------------ 13ms Jun 03 16:23:11 volumio volumio[975]: info: Jun 03 16:23:11 volumio volumio[975]: ---------------------------- MPD announces system playlist update Jun 03 16:23:11 volumio volumio[975]: info: Ignoring MPD Status Update Jun 03 16:23:11 volumio volumio[975]: info: Jun 03 16:23:11 volumio volumio[975]: ---------------------------- MPD announces state update: player Jun 03 16:23:11 volumio volumio[975]: info: ControllerMpd::getState Jun 03 16:23:11 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand status Jun 03 16:23:11 volumio volumio[975]: info: ------------------------------ 2ms Jun 03 16:23:11 volumio volumio[975]: info: sendMpdCommand status took 2 milliseconds Jun 03 16:23:11 volumio volumio[975]: verbose: ControllerMpd::parseState Jun 03 16:23:11 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 03 16:23:11 volumio volumio[975]: info: sendMpdCommand playlistinfo took 1 milliseconds Jun 03 16:23:11 volumio volumio[975]: verbose: ControllerMpd::parseTrackInfo Jun 03 16:23:11 volumio volumio[975]: info: ControllerMpd::pushState Jun 03 16:23:11 volumio volumio[975]: info: CoreCommandRouter::servicePushState Jun 03 16:23:11 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:11 volumio volumio[975]: verbose: STATE SERVICE {"status":"play","position":0,"seek":10860,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"ClassicFMMP3","artist":"Classic FM","album":null,"uri":"http://media-ice.musicradio.com/ClassicFMMP3","trackType":""} Jun 03 16:23:11 volumio volumio[975]: verbose: CURRENT POSITION 0 Jun 03 16:23:11 volumio volumio[975]: info: CoreStateMachine::syncState stateService play Jun 03 16:23:11 volumio volumio[975]: info: CoreStateMachine::syncState currentStatus play Jun 03 16:23:11 volumio volumio[975]: info: Received an update from plugin. extracting info from payload Jun 03 16:23:11 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:11 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:11 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:11 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:11 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:11 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:11 volumio volumio[975]: info: ------------------------------ 15ms Jun 03 16:23:12 volumio volumio[975]: info: CoreCommandRouter::volumioGetState Jun 03 16:23:14 volumio volumio[975]: info: Jun 03 16:23:14 volumio volumio[975]: ---------------------------- MPD announces system playlist update Jun 03 16:23:14 volumio volumio[975]: info: Ignoring MPD Status Update Jun 03 16:23:14 volumio volumio[975]: info: Jun 03 16:23:14 volumio volumio[975]: ---------------------------- MPD announces state update: player Jun 03 16:23:14 volumio volumio[975]: info: ControllerMpd::getState Jun 03 16:23:14 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand status Jun 03 16:23:14 volumio volumio[975]: info: ------------------------------ 2ms Jun 03 16:23:14 volumio volumio[975]: info: sendMpdCommand status took 2 milliseconds Jun 03 16:23:14 volumio volumio[975]: verbose: ControllerMpd::parseState Jun 03 16:23:14 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 03 16:23:14 volumio volumio[975]: info: sendMpdCommand playlistinfo took 1 milliseconds Jun 03 16:23:14 volumio volumio[975]: verbose: ControllerMpd::parseTrackInfo Jun 03 16:23:14 volumio volumio[975]: info: ControllerMpd::pushState Jun 03 16:23:14 volumio volumio[975]: info: CoreCommandRouter::servicePushState Jun 03 16:23:14 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:14 volumio volumio[975]: verbose: STATE SERVICE {"status":"play","position":0,"seek":13862,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"ClassicFMMP3","artist":"Classic FM","album":null,"uri":"http://media-ice.musicradio.com/ClassicFMMP3","trackType":""} Jun 03 16:23:14 volumio volumio[975]: verbose: CURRENT POSITION 0 Jun 03 16:23:14 volumio volumio[975]: info: CoreStateMachine::syncState stateService play Jun 03 16:23:14 volumio volumio[975]: info: CoreStateMachine::syncState currentStatus play Jun 03 16:23:14 volumio volumio[975]: info: Received an update from plugin. extracting info from payload Jun 03 16:23:14 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:14 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:14 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:14 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:14 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:14 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:14 volumio volumio[975]: info: ------------------------------ 13ms Jun 03 16:23:14 volumio volumio[975]: info: VolumeController::SetAlsaVolume39 Jun 03 16:23:14 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:14 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:14 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:15 volumio volumio[975]: info: VolumeController::SetAlsaVolume100 Jun 03 16:23:15 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:15 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:15 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:16 volumio volumio[975]: info: Jun 03 16:23:16 volumio volumio[975]: ---------------------------- MPD announces system playlist update Jun 03 16:23:16 volumio volumio[975]: info: Ignoring MPD Status Update Jun 03 16:23:16 volumio volumio[975]: info: Jun 03 16:23:16 volumio volumio[975]: ---------------------------- MPD announces state update: player Jun 03 16:23:16 volumio volumio[975]: info: ControllerMpd::getState Jun 03 16:23:16 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand status Jun 03 16:23:16 volumio volumio[975]: info: ------------------------------ 2ms Jun 03 16:23:16 volumio volumio[975]: info: sendMpdCommand status took 1 milliseconds Jun 03 16:23:16 volumio volumio[975]: verbose: ControllerMpd::parseState Jun 03 16:23:16 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 03 16:23:16 volumio volumio[975]: info: sendMpdCommand playlistinfo took 0 milliseconds Jun 03 16:23:16 volumio volumio[975]: verbose: ControllerMpd::parseTrackInfo Jun 03 16:23:16 volumio volumio[975]: info: ControllerMpd::pushState Jun 03 16:23:16 volumio volumio[975]: info: CoreCommandRouter::servicePushState Jun 03 16:23:16 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:16 volumio volumio[975]: verbose: STATE SERVICE {"status":"play","position":0,"seek":16111,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"ClassicFMMP3","artist":"Classic FM","album":null,"uri":"http://media-ice.musicradio.com/ClassicFMMP3","trackType":""} Jun 03 16:23:16 volumio volumio[975]: verbose: CURRENT POSITION 0 Jun 03 16:23:16 volumio volumio[975]: info: CoreStateMachine::syncState stateService play Jun 03 16:23:16 volumio volumio[975]: info: CoreStateMachine::syncState currentStatus play Jun 03 16:23:16 volumio volumio[975]: info: Received an update from plugin. extracting info from payload Jun 03 16:23:16 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:16 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:16 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:16 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:16 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:16 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:16 volumio volumio[975]: info: ------------------------------ 17ms Jun 03 16:23:17 volumio volumio[975]: info: VolumeController::SetAlsaVolume94 Jun 03 16:23:17 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:17 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:17 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:17 volumio volumio[975]: info: VolumeController::SetAlsaVolume37 Jun 03 16:23:17 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:17 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:17 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:19 volumio volumio[975]: info: Jun 03 16:23:19 volumio volumio[975]: ---------------------------- MPD announces system playlist update Jun 03 16:23:19 volumio volumio[975]: info: Ignoring MPD Status Update Jun 03 16:23:19 volumio volumio[975]: info: Jun 03 16:23:19 volumio volumio[975]: ---------------------------- MPD announces state update: player Jun 03 16:23:19 volumio volumio[975]: info: ControllerMpd::getState Jun 03 16:23:19 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand status Jun 03 16:23:19 volumio volumio[975]: info: ------------------------------ 2ms Jun 03 16:23:19 volumio volumio[975]: info: sendMpdCommand status took 1 milliseconds Jun 03 16:23:19 volumio volumio[975]: verbose: ControllerMpd::parseState Jun 03 16:23:19 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 03 16:23:19 volumio volumio[975]: info: sendMpdCommand playlistinfo took 1 milliseconds Jun 03 16:23:19 volumio volumio[975]: verbose: ControllerMpd::parseTrackInfo Jun 03 16:23:19 volumio volumio[975]: info: ControllerMpd::pushState Jun 03 16:23:19 volumio volumio[975]: info: CoreCommandRouter::servicePushState Jun 03 16:23:19 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:19 volumio volumio[975]: verbose: STATE SERVICE {"status":"play","position":0,"seek":18359,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"ClassicFMMP3","artist":"Classic FM","album":null,"uri":"http://media-ice.musicradio.com/ClassicFMMP3","trackType":""} Jun 03 16:23:19 volumio volumio[975]: verbose: CURRENT POSITION 0 Jun 03 16:23:19 volumio volumio[975]: info: CoreStateMachine::syncState stateService play Jun 03 16:23:19 volumio volumio[975]: info: CoreStateMachine::syncState currentStatus play Jun 03 16:23:19 volumio volumio[975]: info: Received an update from plugin. extracting info from payload Jun 03 16:23:19 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:19 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:19 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:19 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:19 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:19 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:19 volumio volumio[975]: info: ------------------------------ 14ms Jun 03 16:23:19 volumio volumio[975]: info: CoreCommandRouter::volumioStop Jun 03 16:23:19 volumio volumio[975]: info: CoreStateMachine::stop Jun 03 16:23:19 volumio volumio[975]: info: CoreStateMachine::setConsumeUpdateService undefined Jun 03 16:23:19 volumio volumio[975]: info: CoreStateMachine::stPlaybackTimer Jun 03 16:23:19 volumio volumio[975]: info: CoreStateMachine::updateTrackBlock Jun 03 16:23:19 volumio volumio[975]: info: CorePlayQueue::getTrackBlock Jun 03 16:23:19 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:19 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:19 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 03 16:23:19 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:19 volumio volumio[975]: info: CoreStateMachine::serviceStop Jun 03 16:23:19 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:19 volumio volumio[975]: info: CoreCommandRouter::serviceStop Jun 03 16:23:19 volumio volumio[975]: info: [1748935399186] ControllerWebradio::stop Jun 03 16:23:19 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand stop Jun 03 16:23:19 volumio volumio[975]: info: Jun 03 16:23:19 volumio volumio[975]: ---------------------------- MPD announces state update: player Jun 03 16:23:19 volumio volumio[975]: info: sendMpdCommand stop took 5 milliseconds Jun 03 16:23:19 volumio volumio[975]: info: ControllerMpd::getState Jun 03 16:23:19 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand status Jun 03 16:23:19 volumio volumio[975]: info: sendMpdCommand status took 1 milliseconds Jun 03 16:23:19 volumio volumio[975]: verbose: ControllerMpd::parseState Jun 03 16:23:19 volumio volumio[975]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 03 16:23:19 volumio volumio[975]: info: sendMpdCommand playlistinfo took 1 milliseconds Jun 03 16:23:19 volumio volumio[975]: verbose: ControllerMpd::parseTrackInfo Jun 03 16:23:19 volumio volumio[975]: info: ControllerMpd::pushState Jun 03 16:23:19 volumio volumio[975]: info: CoreCommandRouter::servicePushState Jun 03 16:23:19 volumio volumio[975]: info: CoreStateMachine::pushState Jun 03 16:23:19 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:19 volumio volumio[975]: info: CoreCommandRouter::volumioPushState Jun 03 16:23:19 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:19 volumio volumio[975]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Jun 03 16:23:19 volumio volumio[975]: info: ------------------------------ 9ms Jun 03 16:23:31 volumio volumio[975]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 03 16:23:31 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Jun 03 16:23:31 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: network , getInfoNetwork Jun 03 16:23:31 volumio sudo[4546]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ethtool eth0 Jun 03 16:23:31 volumio sudo[4546]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:31 volumio sudo[4546]: pam_unix(sudo:session): session closed for user root Jun 03 16:23:31 volumio sudo[4551]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Jun 03 16:23:31 volumio sudo[4551]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:31 volumio sudo[4551]: pam_unix(sudo:session): session closed for user root Jun 03 16:23:31 volumio sudo[4560]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Jun 03 16:23:31 volumio sudo[4560]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:31 volumio sudo[4560]: pam_unix(sudo:session): session closed for user root Jun 03 16:23:31 volumio sudo[4565]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Jun 03 16:23:31 volumio sudo[4565]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:31 volumio sudo[4565]: pam_unix(sudo:session): session closed for user root Jun 03 16:23:31 volumio sudo[4571]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Jun 03 16:23:31 volumio sudo[4571]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:31 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworksScanCache Jun 03 16:23:31 volumio sudo[4571]: pam_unix(sudo:session): session closed for user root Jun 03 16:23:31 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworks Jun 03 16:23:31 volumio sudo[4575]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Jun 03 16:23:31 volumio sudo[4575]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:31 volumio sudo[4575]: pam_unix(sudo:session): session closed for user root Jun 03 16:23:31 volumio sudo[4578]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Jun 03 16:23:31 volumio sudo[4578]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:35 volumio sudo[4578]: pam_unix(sudo:session): session closed for user root Jun 03 16:23:36 volumio volumio[975]: info: CoreCommandRouter::volumioGetState Jun 03 16:23:36 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:38 volumio volumio[975]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 03 16:23:38 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Jun 03 16:23:38 volumio systemd[1]: Starting Cleanup of Temporary Directories... Jun 03 16:23:38 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: network , getInfoNetwork Jun 03 16:23:38 volumio sudo[4598]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ethtool eth0 Jun 03 16:23:38 volumio systemd[1]: systemd-tmpfiles-clean.service: Succeeded. Jun 03 16:23:38 volumio sudo[4598]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:38 volumio systemd[1]: Started Cleanup of Temporary Directories. Jun 03 16:23:38 volumio sudo[4598]: pam_unix(sudo:session): session closed for user root Jun 03 16:23:38 volumio sudo[4604]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Jun 03 16:23:38 volumio sudo[4604]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:38 volumio sudo[4604]: pam_unix(sudo:session): session closed for user root Jun 03 16:23:38 volumio sudo[4612]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Jun 03 16:23:38 volumio sudo[4612]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:38 volumio sudo[4612]: pam_unix(sudo:session): session closed for user root Jun 03 16:23:38 volumio sudo[4616]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Jun 03 16:23:38 volumio sudo[4616]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:38 volumio sudo[4616]: pam_unix(sudo:session): session closed for user root Jun 03 16:23:38 volumio sudo[4623]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Jun 03 16:23:38 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworksScanCache Jun 03 16:23:38 volumio sudo[4623]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:38 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworks Jun 03 16:23:38 volumio sudo[4623]: pam_unix(sudo:session): session closed for user root Jun 03 16:23:38 volumio sudo[4626]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Jun 03 16:23:38 volumio sudo[4626]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:38 volumio sudo[4626]: pam_unix(sudo:session): session closed for user root Jun 03 16:23:38 volumio sudo[4630]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Jun 03 16:23:38 volumio sudo[4630]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:41 volumio volumio[975]: info: CoreCommandRouter::volumioGetState Jun 03 16:23:41 volumio volumio[975]: info: CorePlayQueue::getTrack 0 Jun 03 16:23:41 volumio sudo[4630]: pam_unix(sudo:session): session closed for user root Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 03 16:23:42 volumio volumio[975]: info: Retrieving Cloud Streaming UI Jun 03 16:23:42 volumio volumio[975]: info: Getting Tidal Cloud Configuration Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 03 16:23:42 volumio volumio[975]: info: Getting Qobuz Cloud Configuration Jun 03 16:23:42 volumio volumio[975]: info: Asking plugin for UI Config Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 03 16:23:42 volumio volumio[975]: info: Getting Spotify Cloud Configuration Jun 03 16:23:42 volumio volumio[975]: info: Asking plugin for UI Config Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 03 16:23:42 volumio volumio[975]: info: Saving Spotify Acccount Jun 03 16:23:42 volumio volumio[975]: info: Got Tidal Cloud Configuration Jun 03 16:23:42 volumio volumio[975]: info: Got it Jun 03 16:23:42 volumio volumio[975]: info: Got it Jun 03 16:23:42 volumio volumio[975]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 03 16:23:42 volumio volumio[975]: error: Error retrieving Highresaudio conf: TypeError: Cannot read property 'onSave' of undefined Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::volumioGetBrowseSources Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::volumioGetBrowseSources Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::volumioGetBrowseSources Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jun 03 16:23:42 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares Jun 03 16:23:46 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jun 03 16:23:46 volumio volumio[975]: info: Enabling MyMusic plugin tidalconnect Jun 03 16:23:46 volumio volumio[975]: info: [MyVolumio PluginManager] Enabling and starting plugin music_service tidalconnect Jun 03 16:23:46 volumio volumio[975]: info: [MyVolumio PluginManager] Plugin music_service tidalconnect not in user plan, not enabling Jun 03 16:23:46 volumio volumio[975]: info: Error: Plugin music_service tidalconnect not in user plan, not enabling Jun 03 16:23:46 volumio volumio[975]: error: Could not Enable MyMusic Plugin: Error Jun 03 16:23:50 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jun 03 16:23:54 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jun 03 16:23:56 volumio volumio[975]: info: Disabling MyMusic plugin upnp Jun 03 16:23:56 volumio sudo[4692]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop upmpdcli.service Jun 03 16:23:56 volumio sudo[4692]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 03 16:23:56 volumio volumio[975]: error: Upnp client error: Error: This socket has been ended by the other party Jun 03 16:23:56 volumio systemd[1]: Stopping UPnP Renderer front-end to MPD... Jun 03 16:23:56 volumio volumio[975]: info: Enabling MyMusic plugin upnp Jun 03 16:23:56 volumio volumio[975]: info: Enabling plugin upnp Jun 03 16:23:56 volumio volumio[975]: info: Loading plugin "upnp"... Jun 03 16:23:56 volumio volumio[975]: info: [1748935436668] Starting Upmpd Daemon Jun 03 16:23:56 volumio volumio[975]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Jun 03 16:23:56 volumio volumio[975]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jun 03 16:23:56 volumio volumio[975]: Error: listen EADDRINUSE: address already in use :::6599 Jun 03 16:23:56 volumio volumio[975]: at Server.setupListenHandle [as _listen2] (net.js:1318:16) Jun 03 16:23:56 volumio volumio[975]: at listenInCluster (net.js:1366:12) Jun 03 16:23:56 volumio volumio[975]: at Server.listen (net.js:1452:7) Jun 03 16:23:56 volumio volumio[975]: at UpnpInterface.onVolumioStart (/volumio/app/plugins/audio_interface/upnp/index.js:78:17) Jun 03 16:23:56 volumio volumio[975]: at PluginManager.loadCorePlugin (/volumio/app/pluginmanager.js:255:38) Jun 03 16:23:56 volumio volumio[975]: at Promise._successFn (/volumio/app/pluginmanager.js:1855:19) Jun 03 16:23:56 volumio volumio[975]: at nextTickCallback (/volumio/node_modules/kew/kew.js:47:28) Jun 03 16:23:56 volumio volumio[975]: at processTicksAndRejections (internal/process/task_queues.js:75:11) { Jun 03 16:23:56 volumio volumio[975]: code: 'EADDRINUSE', Jun 03 16:23:56 volumio volumio[975]: errno: -98, Jun 03 16:23:56 volumio volumio[975]: syscall: 'listen', Jun 03 16:23:56 volumio volumio[975]: address: '::', Jun 03 16:23:56 volumio volumio[975]: port: 6599 Jun 03 16:23:56 volumio volumio[975]: } Jun 03 16:23:56 volumio volumio[975]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jun 03 16:23:57 volumio sudo[4703]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-06-03 16:22 Jun 03 16:23:57 volumio sudo[4703]: 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="570c5791513f5bac7da274aba6690c1a961705de" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="35e4a13c94df42ebab19fd6178d6be47190c244d" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 13 May 2025 05:16:30 PM CEST" VOLUMIO_VERSION="3.812" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="3934ee440d5d3f0186049a23752ad680"