May 30 23:22:05 volumio-display volumio[1257]: info: Stopping peppymeterbasic service
May 30 23:22:05 volumio-display volumio[1257]: info: CoreStateMachine::stop
May 30 23:22:05 volumio-display volumio[1257]: info: CoreStateMachine::setConsumeUpdateService undefined
May 30 23:22:05 volumio-display volumio[1257]: info: CoreStateMachine::stPlaybackTimer
May 30 23:22:05 volumio-display volumio[1257]: info: CoreStateMachine::updateTrackBlock
May 30 23:22:05 volumio-display volumio[1257]: info: CorePlayQueue::getTrackBlock
May 30 23:22:05 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:22:05 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:22:05 volumio-display volumio[1257]: info: CoreStateMachine::serviceStop
May 30 23:22:05 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::serviceStop
May 30 23:22:05 volumio-display volumio[1257]: info: [1780176125416] ControllerWebradio::stop
May 30 23:22:05 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand stop
May 30 23:22:05 volumio-display volumio[1257]: info: Disabling plugin peppymeterbasic
May 30 23:22:05 volumio-display volumio[1257]: info: Preparing to generate the ALSA configuration file
May 30 23:22:05 volumio-display volumio[1257]: info: PeppyMeterBasic ---peppymeterbasic status stop
May 30 23:22:05 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status stop
May 30 23:22:05 volumio-display volumio[1257]: info:
May 30 23:22:05 volumio-display volumio[1257]: ---------------------------- MPD announces state update: player
May 30 23:22:05 volumio-display volumio[1257]: info: sendMpdCommand stop took 44 milliseconds
May 30 23:22:05 volumio-display volumio[1257]: info: ControllerMpd::getState
May 30 23:22:05 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand status
May 30 23:22:05 volumio-display sudo[13749]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop peppymeterbasic.service
May 30 23:22:05 volumio-display volumio[1257]: info: The plugin peppyspectrum has an ALSA contribution file peppy_in.peppy_out.6.conf
May 30 23:22:05 volumio-display volumio[1257]: info: Reading ALSA contributions from plugins.
May 30 23:22:05 volumio-display sudo[13749]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:05 volumio-display sudo[13751]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop peppyspectrum.service
May 30 23:22:05 volumio-display sudo[13751]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:05 volumio-display volumio[1257]: info:
May 30 23:22:05 volumio-display volumio[1257]: ---------------------------- MPD announces state update: player
May 30 23:22:05 volumio-display volumio[1257]: info: ControllerMpd::getState
May 30 23:22:05 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand status
May 30 23:22:05 volumio-display sudo[13753]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop peppymeterbasic.service
May 30 23:22:05 volumio-display sudo[13753]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:05 volumio-display volumio[1257]: info: sendMpdCommand status took 31 milliseconds
May 30 23:22:05 volumio-display volumio[1257]: verbose: ControllerMpd::parseState
May 30 23:22:05 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 30 23:22:05 volumio-display volumio[1257]: info: sendMpdCommand status took 12 milliseconds
May 30 23:22:05 volumio-display volumio[1257]: info: sendMpdCommand playlistinfo took 1 milliseconds
May 30 23:22:05 volumio-display volumio[1257]: verbose: ControllerMpd::parseState
May 30 23:22:05 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 30 23:22:05 volumio-display volumio[1257]: verbose: ControllerMpd::parseTrackInfo
May 30 23:22:05 volumio-display volumio[1257]: info: ControllerMpd::pushState
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::servicePushState
May 30 23:22:05 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:22:05 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:22:05 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:22:05 volumio-display volumio[1257]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd
May 30 23:22:05 volumio-display volumio[1257]: info: ------------------------------ 42ms
May 30 23:22:05 volumio-display volumio[1257]: info: sendMpdCommand playlistinfo took 10 milliseconds
May 30 23:22:05 volumio-display volumio[1257]: verbose: ControllerMpd::parseTrackInfo
May 30 23:22:05 volumio-display volumio[1257]: info: ControllerMpd::pushState
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::servicePushState
May 30 23:22:05 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:22:05 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:22:05 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:22:05 volumio-display volumio[1257]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd
May 30 23:22:05 volumio-display volumio[1257]: info: ------------------------------ 35ms
May 30 23:22:05 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status stop
May 30 23:22:05 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status stop
May 30 23:22:05 volumio-display systemd[1]: Stopping peppymeterbasic.service - peppymeterbasic Daemon...
May 30 23:22:05 volumio-display sudo[13751]: pam_unix(sudo:session): session closed for user root
May 30 23:22:05 volumio-display volumio[1257]: info: peppyspectrum Daemon Stop
May 30 23:22:05 volumio-display volumio[1257]: info: touch_display: Setting screensaver timeout to 0 seconds.
May 30 23:22:05 volumio-display volumio[1257]: info: Asound.conf file written
May 30 23:22:05 volumio-display sudo[13760]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop peppyspectrum.service
May 30 23:22:05 volumio-display sudo[13760]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:05 volumio-display sudo[13762]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop peppyspectrum.service
May 30 23:22:05 volumio-display sudo[13762]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:05 volumio-display sudo[13766]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/mv /home/volumio/.asoundrc /etc/asound.conf
May 30 23:22:05 volumio-display sudo[13766]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:05 volumio-display sudo[13760]: pam_unix(sudo:session): session closed for user root
May 30 23:22:05 volumio-display sudo[13766]: pam_unix(sudo:session): session closed for user root
May 30 23:22:05 volumio-display systemd[1]: peppymeterbasic.service: Deactivated successfully.
May 30 23:22:05 volumio-display systemd[1]: Stopped peppymeterbasic.service - peppymeterbasic Daemon.
May 30 23:22:05 volumio-display systemd[1]: peppymeterbasic.service: Consumed 2.470s CPU time.
May 30 23:22:05 volumio-display sudo[13753]: pam_unix(sudo:session): session closed for user root
May 30 23:22:05 volumio-display sudo[13749]: pam_unix(sudo:session): session closed for user root
May 30 23:22:05 volumio-display sudo[13762]: pam_unix(sudo:session): session closed for user root
May 30 23:22:05 volumio-display volumio[1257]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:0 use case configuration -2
May 30 23:22:05 volumio-display volumio[1257]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:1 use case configuration -2
May 30 23:22:05 volumio-display volumio[1257]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:2 use case configuration -2
May 30 23:22:05 volumio-display volumio[1257]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:3 use case configuration -2
May 30 23:22:05 volumio-display volumio[1257]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:4 use case configuration -2
May 30 23:22:05 volumio-display volumio[1257]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:7 use case configuration -2
May 30 23:22:05 volumio-display volumio[1257]: No state is present for card Loopback
May 30 23:22:05 volumio-display volumio[1257]: alsa-lib main.c:1541:(snd_use_case_mgr_open) error: failed to import hw:7 use case configuration -2
May 30 23:22:05 volumio-display volumio[1257]: Found hardware: "Loopback" "Loopback Mixer" "" "" ""
May 30 23:22:05 volumio-display volumio[1257]: Hardware is initialized using a generic method
May 30 23:22:05 volumio-display volumio[1257]: No state is present for card Loopback
May 30 23:22:05 volumio-display volumio[1257]: info: Output device has changed, restarting MPD
May 30 23:22:05 volumio-display volumio[1257]: info: Output device has changed, restarting Shairport Sync
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
May 30 23:22:05 volumio-display sudo[13775]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service
May 30 23:22:05 volumio-display sudo[13775]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:05 volumio-display volumio[1257]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0
May 30 23:22:05 volumio-display volumio[1257]: info: Done.
May 30 23:22:05 volumio-display sudo[13773]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf
May 30 23:22:05 volumio-display sudo[13773]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:05 volumio-display volumio[1257]: info: peppyspectrum Daemon Stop
May 30 23:22:05 volumio-display volumio[1257]: info: peppymeterbasic Daemon Stop
May 30 23:22:05 volumio-display volumio[1257]: info: peppyspectrum Daemon Stop
May 30 23:22:05 volumio-display sudo[13773]: pam_unix(sudo:session): session closed for user root
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
May 30 23:22:05 volumio-display systemd[1]: Stopping mpd.service - Music Player Daemon...
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
May 30 23:22:05 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
May 30 23:22:05 volumio-display volumio[1257]: info: MPD Permissions set
May 30 23:22:05 volumio-display systemd[1]: mpd.service: Deactivated successfully.
May 30 23:22:05 volumio-display systemd[1]: Stopped mpd.service - Music Player Daemon.
May 30 23:22:05 volumio-display systemd[1]: mpd.service: Consumed 2.728s CPU time.
May 30 23:22:05 volumio-display volumio[1257]: info: Starting Shairport Sync
May 30 23:22:05 volumio-display systemd[1]: mpd.socket: Deactivated successfully.
May 30 23:22:05 volumio-display systemd[1]: Closed mpd.socket - Music Player Daemon Socket.
May 30 23:22:05 volumio-display systemd[1]: Stopping mpd.socket - Music Player Daemon Socket...
May 30 23:22:05 volumio-display sudo[13791]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync
May 30 23:22:05 volumio-display sudo[13791]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:05 volumio-display systemd[1]: Listening on mpd.socket - Music Player Daemon Socket.
May 30 23:22:05 volumio-display systemd[1]: Starting mpd.service - Music Player Daemon...
May 30 23:22:05 volumio-display systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver...
May 30 23:22:05 volumio-display systemd[1]: shairport-sync.service: Deactivated successfully.
May 30 23:22:05 volumio-display systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver.
May 30 23:22:05 volumio-display systemd[1]: shairport-sync.service: Consumed 1.659s CPU time.
May 30 23:22:05 volumio-display systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver.
May 30 23:22:05 volumio-display sudo[13791]: pam_unix(sudo:session): session closed for user root
May 30 23:22:05 volumio-display volumio[1257]: info: Shairport-Sync Started
May 30 23:22:06 volumio-display sudo[13793]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log
May 30 23:22:06 volumio-display sudo[13793]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0)
May 30 23:22:06 volumio-display sudo[13793]: pam_unix(sudo:session): session closed for user root
May 30 23:22:06 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
May 30 23:22:06 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
May 30 23:22:07 volumio-display mpd[13810]: 2026-05-30T23:22:07 decoder: Decoder plugin "wildmidi" is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg
May 30 23:22:07 volumio-display systemd[1]: Started mpd.service - Music Player Daemon.
May 30 23:22:07 volumio-display sudo[13775]: pam_unix(sudo:session): session closed for user root
May 30 23:22:07 volumio-display volumio[1257]: error: updateQueue error: null
May 30 23:22:09 volumio-display volumio[1257]: info: CoreCommandRouter::getUIConfigOnPlugin
May 30 23:22:17 volumio-display volumio[1257]: info: CALLMETHOD: user_interface peppyspectrum savepeppy [object Object]
May 30 23:22:17 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: peppyspectrum , savepeppy
May 30 23:22:17 volumio-display volumio[1257]: aaaaaaaaaaa 1280,400_Gelo5 Spec&Met_220
May 30 23:22:17 volumio-display volumio[1257]: info: PeppySpectrum ---1280400_Gelo5 Spec&Met_220
May 30 23:22:17 volumio-display volumio[1257]: info: PeppySpectrum ---1280400NaN
May 30 23:22:17 volumio-display volumio[1257]: error: Failed callmethod call: TypeError: Cannot read properties of undefined (reading 'then')
May 30 23:22:17 volumio-display volumio[1257]: info: CoreCommandRouter::getUIConfigOnPlugin
May 30 23:22:17 volumio-display volumio[1257]: info: CoreCommandRouter::Close All Modals sent
May 30 23:22:18 volumio-display volumio[1257]: info: CALLMETHOD: user_interface peppyspectrum savepeppy [object Object]
May 30 23:22:18 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: peppyspectrum , savepeppy
May 30 23:22:18 volumio-display volumio[1257]: aaaaaaaaaaa 1280,400_Gelo5 Spec&Met_220
May 30 23:22:18 volumio-display volumio[1257]: info: PeppySpectrum ---1280400_Gelo5 Spec&Met_220
May 30 23:22:18 volumio-display volumio[1257]: info: PeppySpectrum ---1280400NaN
May 30 23:22:18 volumio-display volumio[1257]: error: Failed callmethod call: TypeError: Cannot read properties of undefined (reading 'then')
May 30 23:22:18 volumio-display volumio[1257]: info: CoreCommandRouter::getUIConfigOnPlugin
May 30 23:22:18 volumio-display volumio[1257]: info: CoreCommandRouter::Close All Modals sent
May 30 23:22:24 volumio-display volumio[1257]: info: CALLMETHOD: user_interface peppyspectrum savepeppy1 [object Object]
May 30 23:22:24 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: peppyspectrum , savepeppy1
May 30 23:22:24 volumio-display volumio[1257]: error: Failed callmethod call: TypeError: Cannot read properties of undefined (reading 'then')
May 30 23:22:24 volumio-display volumio[1257]: info: PeppySpectrum -----------------------spectrumMarantz
May 30 23:22:24 volumio-display volumio[1257]: info: PeppySpectrum -----------------------$basefolder/data/INTERNAL/PeppySpectrum/Templates
May 30 23:22:24 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screensize1280x400_Gelo5 Spec&Met_220
May 30 23:22:24 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screenwidth1280
May 30 23:22:24 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screenheight400
May 30 23:22:24 volumio-display volumio[1257]: info: PeppySpectrum -----------------------spectrumsize30
May 30 23:22:24 volumio-display volumio[1257]: error: PeppySpectrum ---Error writing config null
May 30 23:22:24 volumio-display sudo[13940]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart peppyspectrum.service
May 30 23:22:24 volumio-display sudo[13940]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:24 volumio-display volumio[1257]: info: CoreCommandRouter::getUIConfigOnPlugin
May 30 23:22:24 volumio-display volumio[1257]: info: CoreCommandRouter::Close All Modals sent
May 30 23:22:24 volumio-display systemd[1]: Started peppyspectrum.service - peppyspectrum Daemon.
May 30 23:22:24 volumio-display sudo[13940]: pam_unix(sudo:session): session closed for user root
May 30 23:22:24 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:22:28 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPlay
May 30 23:22:28 volumio-display volumio[1257]: info: CoreStateMachine::play index undefined
May 30 23:22:28 volumio-display volumio[1257]: info: CoreStateMachine::setConsumeUpdateService undefined
May 30 23:22:28 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:22:28 volumio-display volumio[1257]: info: CoreStateMachine::startPlaybackTimer
May 30 23:22:28 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:22:28 volumio-display volumio[1257]: info: [1780176148568] ControllerWebradio::clearAddPlayTrack
May 30 23:22:28 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand stop
May 30 23:22:28 volumio-display volumio[1257]: info: sendMpdCommand stop took 0 milliseconds
May 30 23:22:28 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand clear
May 30 23:22:28 volumio-display volumio[1257]: info:
May 30 23:22:28 volumio-display volumio[1257]: ---------------------------- MPD announces system playlist update
May 30 23:22:28 volumio-display volumio[1257]: info: Ignoring MPD Status Update
May 30 23:22:28 volumio-display volumio[1257]: info: sendMpdCommand clear took 0 milliseconds
May 30 23:22:28 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand load "http://s0.radiohost.pl:8018/stream"
May 30 23:22:28 volumio-display volumio[1257]: error: updateQueue error: null
May 30 23:22:28 volumio-display volumio[1257]: info: ------------------------------ 2ms
May 30 23:22:28 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand add "http://s0.radiohost.pl:8018/stream"
May 30 23:22:28 volumio-display volumio[1257]: info:
May 30 23:22:28 volumio-display volumio[1257]: ---------------------------- MPD announces system playlist update
May 30 23:22:28 volumio-display volumio[1257]: info: Ignoring MPD Status Update
May 30 23:22:28 volumio-display volumio[1257]: info: sendMpdCommand add "http://s0.radiohost.pl:8018/stream" took 1 milliseconds
May 30 23:22:28 volumio-display volumio[1257]: info: CoreStateMachine::setConsumeUpdateService mpd
May 30 23:22:28 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand play
May 30 23:22:28 volumio-display volumio[1257]: info: ------------------------------ 1ms
May 30 23:22:28 volumio-display volumio[1257]: info: sendMpdCommand play took 2 milliseconds
May 30 23:22:28 volumio-display volumio[1257]: info:
May 30 23:22:28 volumio-display volumio[1257]: ---------------------------- MPD announces state update: player
May 30 23:22:28 volumio-display volumio[1257]: info: ControllerMpd::getState
May 30 23:22:28 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand status
May 30 23:22:28 volumio-display volumio[1257]: info:
May 30 23:22:28 volumio-display volumio[1257]: ---------------------------- MPD announces state update: player
May 30 23:22:28 volumio-display volumio[1257]: info: sendMpdCommand status took 54 milliseconds
May 30 23:22:28 volumio-display volumio[1257]: info: ControllerMpd::getState
May 30 23:22:28 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand status
May 30 23:22:28 volumio-display volumio[1257]: verbose: ControllerMpd::parseState
May 30 23:22:28 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 30 23:22:28 volumio-display volumio[1257]: info: sendMpdCommand status took 1 milliseconds
May 30 23:22:28 volumio-display volumio[1257]: info: sendMpdCommand playlistinfo took 1 milliseconds
May 30 23:22:28 volumio-display volumio[1257]: verbose: ControllerMpd::parseState
May 30 23:22:28 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 30 23:22:28 volumio-display volumio[1257]: verbose: ControllerMpd::parseTrackInfo
May 30 23:22:28 volumio-display volumio[1257]: info: ControllerMpd::pushState
May 30 23:22:28 volumio-display volumio[1257]: info: CoreCommandRouter::servicePushState
May 30 23:22:28 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:22:28 volumio-display volumio[1257]: 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":"stream","artist":null,"album":null,"uri":"http://s0.radiohost.pl:8018/stream","trackType":""}
May 30 23:22:28 volumio-display volumio[1257]: verbose: CURRENT POSITION 0
May 30 23:22:28 volumio-display volumio[1257]: info: CoreStateMachine::syncState stateService play
May 30 23:22:28 volumio-display volumio[1257]: info: CoreStateMachine::syncState currentStatus stop
May 30 23:22:28 volumio-display volumio[1257]: info: ------------------------------ 59ms
May 30 23:22:28 volumio-display volumio[1257]: info: sendMpdCommand playlistinfo took 3 milliseconds
May 30 23:22:28 volumio-display volumio[1257]: verbose: ControllerMpd::parseTrackInfo
May 30 23:22:28 volumio-display volumio[1257]: info: ControllerMpd::pushState
May 30 23:22:28 volumio-display volumio[1257]: info: CoreCommandRouter::servicePushState
May 30 23:22:28 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:22:28 volumio-display volumio[1257]: 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":"stream","artist":null,"album":null,"uri":"http://s0.radiohost.pl:8018/stream","trackType":""}
May 30 23:22:28 volumio-display volumio[1257]: verbose: CURRENT POSITION 0
May 30 23:22:28 volumio-display volumio[1257]: info: CoreStateMachine::syncState stateService play
May 30 23:22:28 volumio-display volumio[1257]: info: CoreStateMachine::syncState currentStatus play
May 30 23:22:28 volumio-display volumio[1257]: info: Received an update from plugin. extracting info from payload
May 30 23:22:28 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:22:28 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:22:28 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 30 23:22:28 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:22:28 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:22:28 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:22:28 volumio-display volumio[1257]: info: ------------------------------ 18ms
May 30 23:22:28 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status play
May 30 23:22:28 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status play
May 30 23:22:28 volumio-display sudo[13952]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service
May 30 23:22:28 volumio-display sudo[13952]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:28 volumio-display sudo[13954]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service
May 30 23:22:28 volumio-display sudo[13954]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:29 volumio-display sudo[13954]: pam_unix(sudo:session): session closed for user root
May 30 23:22:29 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:22:29 volumio-display sudo[13952]: pam_unix(sudo:session): session closed for user root
May 30 23:22:29 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:22:29 volumio-display startpeppyspectrum.sh[13945]: pygame 2.1.2 (SDL 2.26.5, Python 3.11.2)
May 30 23:22:29 volumio-display startpeppyspectrum.sh[13945]: Hello from the pygame community. https://www.pygame.org/contribute.html
May 30 23:22:29 volumio-display startpeppyspectrum.sh[13945]: Traceback (most recent call last):
May 30 23:22:29 volumio-display startpeppyspectrum.sh[13945]: File "/data/plugins/user_interface/peppyspectrum/PeppySpectrum/spectrum.py", line 30, in
May 30 23:22:29 volumio-display startpeppyspectrum.sh[13945]: from spectrumutil import SpectrumUtil
May 30 23:22:29 volumio-display startpeppyspectrum.sh[13945]: File "/data/plugins/user_interface/peppyspectrum/PeppySpectrum/spectrumutil.py", line 19, in
May 30 23:22:29 volumio-display startpeppyspectrum.sh[13945]: from PIL import Image
May 30 23:22:29 volumio-display startpeppyspectrum.sh[13945]: ModuleNotFoundError: No module named 'PIL'
May 30 23:22:29 volumio-display systemd[1]: peppyspectrum.service: Main process exited, code=exited, status=1/FAILURE
May 30 23:22:29 volumio-display systemd[1]: peppyspectrum.service: Failed with result 'exit-code'.
May 30 23:22:29 volumio-display systemd[1]: peppyspectrum.service: Consumed 1.382s CPU time.
May 30 23:22:29 volumio-display volumio[1257]: info:
May 30 23:22:29 volumio-display volumio[1257]: ---------------------------- MPD announces system playlist update
May 30 23:22:29 volumio-display volumio[1257]: info: Ignoring MPD Status Update
May 30 23:22:29 volumio-display volumio[1257]: info:
May 30 23:22:29 volumio-display volumio[1257]: ---------------------------- MPD announces state update: player
May 30 23:22:29 volumio-display volumio[1257]: info: ControllerMpd::getState
May 30 23:22:29 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand status
May 30 23:22:29 volumio-display volumio[1257]: info:
May 30 23:22:29 volumio-display volumio[1257]: ---------------------------- MPD announces system playlist update
May 30 23:22:29 volumio-display volumio[1257]: info: Ignoring MPD Status Update
May 30 23:22:29 volumio-display volumio[1257]: info:
May 30 23:22:29 volumio-display volumio[1257]: ---------------------------- MPD announces state update: player
May 30 23:22:29 volumio-display volumio[1257]: info: ------------------------------ 2ms
May 30 23:22:29 volumio-display volumio[1257]: info: ControllerMpd::getState
May 30 23:22:29 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand status
May 30 23:22:29 volumio-display volumio[1257]: info: sendMpdCommand status took 1 milliseconds
May 30 23:22:29 volumio-display volumio[1257]: verbose: ControllerMpd::parseState
May 30 23:22:29 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 30 23:22:29 volumio-display volumio[1257]: info: ------------------------------ 2ms
May 30 23:22:29 volumio-display volumio[1257]: info: sendMpdCommand status took 2 milliseconds
May 30 23:22:29 volumio-display volumio[1257]: info: sendMpdCommand playlistinfo took 2 milliseconds
May 30 23:22:29 volumio-display volumio[1257]: verbose: ControllerMpd::parseState
May 30 23:22:29 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 30 23:22:29 volumio-display volumio[1257]: verbose: ControllerMpd::parseTrackInfo
May 30 23:22:29 volumio-display volumio[1257]: info: ControllerMpd::pushState
May 30 23:22:29 volumio-display volumio[1257]: info: CoreCommandRouter::servicePushState
May 30 23:22:29 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:22:29 volumio-display volumio[1257]: verbose: STATE SERVICE {"status":"play","position":0,"seek":277,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"256 Kbps","isStreaming":false,"title":"Savage - And You Are (Flashback Remix)","artist":"Radio Italo4you","album":null,"uri":"http://s0.radiohost.pl:8018/stream","trackType":""}
May 30 23:22:29 volumio-display volumio[1257]: verbose: CURRENT POSITION 0
May 30 23:22:29 volumio-display volumio[1257]: info: CoreStateMachine::syncState stateService play
May 30 23:22:29 volumio-display volumio[1257]: info: CoreStateMachine::syncState currentStatus play
May 30 23:22:29 volumio-display volumio[1257]: info: Received an update from plugin. extracting info from payload
May 30 23:22:29 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:22:29 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 30 23:22:29 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:22:29 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:22:29 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:22:29 volumio-display volumio[1257]: info: ------------------------------ 17ms
May 30 23:22:29 volumio-display volumio[1257]: info: sendMpdCommand playlistinfo took 13 milliseconds
May 30 23:22:29 volumio-display volumio[1257]: verbose: ControllerMpd::parseTrackInfo
May 30 23:22:29 volumio-display volumio[1257]: info: ControllerMpd::pushState
May 30 23:22:29 volumio-display volumio[1257]: info: CoreCommandRouter::servicePushState
May 30 23:22:29 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:22:29 volumio-display volumio[1257]: verbose: STATE SERVICE {"status":"play","position":0,"seek":586,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"256 Kbps","isStreaming":false,"title":"Savage - And You Are (Flashback Remix)","artist":"Radio Italo4you","album":null,"uri":"http://s0.radiohost.pl:8018/stream","trackType":""}
May 30 23:22:29 volumio-display volumio[1257]: verbose: CURRENT POSITION 0
May 30 23:22:29 volumio-display volumio[1257]: info: CoreStateMachine::syncState stateService play
May 30 23:22:29 volumio-display volumio[1257]: info: CoreStateMachine::syncState currentStatus play
May 30 23:22:29 volumio-display volumio[1257]: info: Received an update from plugin. extracting info from payload
May 30 23:22:29 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:22:29 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:22:29 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:22:29 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:22:29 volumio-display volumio[1257]: info: ------------------------------ 29ms
May 30 23:22:29 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status play
May 30 23:22:29 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status play
May 30 23:22:29 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status play
May 30 23:22:29 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status play
May 30 23:22:29 volumio-display sudo[13960]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service
May 30 23:22:29 volumio-display sudo[13960]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:29 volumio-display sudo[13961]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service
May 30 23:22:29 volumio-display sudo[13961]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:29 volumio-display sudo[13965]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service
May 30 23:22:29 volumio-display sudo[13965]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:29 volumio-display sudo[13963]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service
May 30 23:22:29 volumio-display sudo[13963]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:29 volumio-display systemd[1]: Started peppyspectrum.service - peppyspectrum Daemon.
May 30 23:22:29 volumio-display sudo[13963]: pam_unix(sudo:session): session closed for user root
May 30 23:22:29 volumio-display sudo[13965]: pam_unix(sudo:session): session closed for user root
May 30 23:22:29 volumio-display sudo[13961]: pam_unix(sudo:session): session closed for user root
May 30 23:22:29 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:22:29 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:22:29 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:22:29 volumio-display sudo[13960]: pam_unix(sudo:session): session closed for user root
May 30 23:22:29 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:22:33 volumio-display startpeppyspectrum.sh[13986]: pygame 2.1.2 (SDL 2.26.5, Python 3.11.2)
May 30 23:22:33 volumio-display startpeppyspectrum.sh[13986]: Hello from the pygame community. https://www.pygame.org/contribute.html
May 30 23:22:33 volumio-display startpeppyspectrum.sh[13986]: Traceback (most recent call last):
May 30 23:22:33 volumio-display startpeppyspectrum.sh[13986]: File "/data/plugins/user_interface/peppyspectrum/PeppySpectrum/spectrum.py", line 30, in
May 30 23:22:33 volumio-display startpeppyspectrum.sh[13986]: from spectrumutil import SpectrumUtil
May 30 23:22:33 volumio-display startpeppyspectrum.sh[13986]: File "/data/plugins/user_interface/peppyspectrum/PeppySpectrum/spectrumutil.py", line 19, in
May 30 23:22:33 volumio-display startpeppyspectrum.sh[13986]: from PIL import Image
May 30 23:22:33 volumio-display startpeppyspectrum.sh[13986]: ModuleNotFoundError: No module named 'PIL'
May 30 23:22:33 volumio-display systemd[1]: peppyspectrum.service: Main process exited, code=exited, status=1/FAILURE
May 30 23:22:33 volumio-display systemd[1]: peppyspectrum.service: Failed with result 'exit-code'.
May 30 23:22:33 volumio-display systemd[1]: peppyspectrum.service: Consumed 1.359s CPU time.
May 30 23:22:48 volumio-display volumio[1257]: info: CALLMETHOD: user_interface peppyspectrum savepeppy1 [object Object]
May 30 23:22:48 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: peppyspectrum , savepeppy1
May 30 23:22:48 volumio-display volumio[1257]: error: Failed callmethod call: TypeError: Cannot read properties of undefined (reading 'then')
May 30 23:22:48 volumio-display volumio[1257]: info: PeppySpectrum -----------------------spectrumMarantz
May 30 23:22:48 volumio-display volumio[1257]: info: PeppySpectrum -----------------------$basefolder/data/INTERNAL/PeppySpectrum/Templates
May 30 23:22:48 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screensize1280x400_Gelo5 Spec&Met_220
May 30 23:22:48 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screenwidth1280
May 30 23:22:48 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screenheight400
May 30 23:22:48 volumio-display volumio[1257]: info: PeppySpectrum -----------------------spectrumsize30
May 30 23:22:48 volumio-display volumio[1257]: error: PeppySpectrum ---Error writing config null
May 30 23:22:48 volumio-display sudo[14100]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart peppyspectrum.service
May 30 23:22:48 volumio-display sudo[14100]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:22:48 volumio-display volumio[1257]: info: CoreCommandRouter::getUIConfigOnPlugin
May 30 23:22:48 volumio-display volumio[1257]: info: CoreCommandRouter::Close All Modals sent
May 30 23:22:48 volumio-display systemd[1]: Started peppyspectrum.service - peppyspectrum Daemon.
May 30 23:22:48 volumio-display sudo[14100]: pam_unix(sudo:session): session closed for user root
May 30 23:22:48 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:22:52 volumio-display startpeppyspectrum.sh[14202]: pygame 2.1.2 (SDL 2.26.5, Python 3.11.2)
May 30 23:22:52 volumio-display startpeppyspectrum.sh[14202]: Hello from the pygame community. https://www.pygame.org/contribute.html
May 30 23:22:52 volumio-display startpeppyspectrum.sh[14202]: Traceback (most recent call last):
May 30 23:22:52 volumio-display startpeppyspectrum.sh[14202]: File "/data/plugins/user_interface/peppyspectrum/PeppySpectrum/spectrum.py", line 30, in
May 30 23:22:52 volumio-display startpeppyspectrum.sh[14202]: from spectrumutil import SpectrumUtil
May 30 23:22:52 volumio-display startpeppyspectrum.sh[14202]: File "/data/plugins/user_interface/peppyspectrum/PeppySpectrum/spectrumutil.py", line 19, in
May 30 23:22:52 volumio-display startpeppyspectrum.sh[14202]: from PIL import Image
May 30 23:22:52 volumio-display startpeppyspectrum.sh[14202]: ModuleNotFoundError: No module named 'PIL'
May 30 23:22:52 volumio-display systemd[1]: peppyspectrum.service: Main process exited, code=exited, status=1/FAILURE
May 30 23:22:52 volumio-display systemd[1]: peppyspectrum.service: Failed with result 'exit-code'.
May 30 23:22:52 volumio-display systemd[1]: peppyspectrum.service: Consumed 1.361s CPU time.
May 30 23:23:08 volumio-display volumio[1257]: info: CALLMETHOD: user_interface peppyspectrum delayspectrum [object Object]
May 30 23:23:08 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: peppyspectrum , delayspectrum
May 30 23:23:08 volumio-display volumio[1257]: error: Failed callmethod call: TypeError: Cannot read properties of undefined (reading 'then')
May 30 23:23:08 volumio-display volumio[1257]: info: PeppySpectrum -----------------------spectrumMarantz
May 30 23:23:08 volumio-display volumio[1257]: info: PeppySpectrum -----------------------$basefolder/data/INTERNAL/PeppySpectrum/Templates
May 30 23:23:08 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screensize1280x400_Gelo5 Spec&Met_220
May 30 23:23:08 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screenwidth1280
May 30 23:23:08 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screenheight400
May 30 23:23:08 volumio-display volumio[1257]: info: PeppySpectrum -----------------------spectrumsize30
May 30 23:23:08 volumio-display volumio[1257]: error: PeppySpectrum ---Error writing config null
May 30 23:23:08 volumio-display sudo[14330]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart peppyspectrum.service
May 30 23:23:08 volumio-display sudo[14330]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:23:08 volumio-display volumio[1257]: info: CoreCommandRouter::getUIConfigOnPlugin
May 30 23:23:08 volumio-display volumio[1257]: info: CoreCommandRouter::Close All Modals sent
May 30 23:23:08 volumio-display systemd[1]: Started peppyspectrum.service - peppyspectrum Daemon.
May 30 23:23:08 volumio-display sudo[14330]: pam_unix(sudo:session): session closed for user root
May 30 23:23:08 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:23:09 volumio-display startpeppyspectrum.sh[14336]: pygame 2.1.2 (SDL 2.26.5, Python 3.11.2)
May 30 23:23:09 volumio-display startpeppyspectrum.sh[14336]: Hello from the pygame community. https://www.pygame.org/contribute.html
May 30 23:23:09 volumio-display startpeppyspectrum.sh[14336]: Traceback (most recent call last):
May 30 23:23:09 volumio-display startpeppyspectrum.sh[14336]: File "/data/plugins/user_interface/peppyspectrum/PeppySpectrum/spectrum.py", line 30, in
May 30 23:23:09 volumio-display startpeppyspectrum.sh[14336]: from spectrumutil import SpectrumUtil
May 30 23:23:09 volumio-display startpeppyspectrum.sh[14336]: File "/data/plugins/user_interface/peppyspectrum/PeppySpectrum/spectrumutil.py", line 19, in
May 30 23:23:09 volumio-display startpeppyspectrum.sh[14336]: from PIL import Image
May 30 23:23:09 volumio-display startpeppyspectrum.sh[14336]: ModuleNotFoundError: No module named 'PIL'
May 30 23:23:09 volumio-display systemd[1]: peppyspectrum.service: Main process exited, code=exited, status=1/FAILURE
May 30 23:23:09 volumio-display systemd[1]: peppyspectrum.service: Failed with result 'exit-code'.
May 30 23:23:09 volumio-display systemd[1]: peppyspectrum.service: Consumed 1.359s CPU time.
May 30 23:23:11 volumio-display volumio[1257]: info: CALLMETHOD: user_interface peppyspectrum delayspectrum [object Object]
May 30 23:23:11 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: peppyspectrum , delayspectrum
May 30 23:23:11 volumio-display volumio[1257]: error: Failed callmethod call: TypeError: Cannot read properties of undefined (reading 'then')
May 30 23:23:11 volumio-display volumio[1257]: info: PeppySpectrum -----------------------spectrumMarantz
May 30 23:23:11 volumio-display volumio[1257]: info: PeppySpectrum -----------------------$basefolder/data/INTERNAL/PeppySpectrum/Templates
May 30 23:23:11 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screensize1280x400_Gelo5 Spec&Met_220
May 30 23:23:11 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screenwidth1280
May 30 23:23:11 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screenheight400
May 30 23:23:11 volumio-display volumio[1257]: info: PeppySpectrum -----------------------spectrumsize30
May 30 23:23:11 volumio-display volumio[1257]: error: PeppySpectrum ---Error writing config null
May 30 23:23:11 volumio-display sudo[14338]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart peppyspectrum.service
May 30 23:23:11 volumio-display sudo[14338]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:23:11 volumio-display volumio[1257]: info: CoreCommandRouter::getUIConfigOnPlugin
May 30 23:23:11 volumio-display volumio[1257]: info: CoreCommandRouter::Close All Modals sent
May 30 23:23:11 volumio-display systemd[1]: Started peppyspectrum.service - peppyspectrum Daemon.
May 30 23:23:11 volumio-display sudo[14338]: pam_unix(sudo:session): session closed for user root
May 30 23:23:11 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:23:12 volumio-display volumio[1257]: info: CoreCommandRouter::volumioStop
May 30 23:23:12 volumio-display volumio[1257]: info: CoreStateMachine::stop
May 30 23:23:12 volumio-display volumio[1257]: info: CoreStateMachine::setConsumeUpdateService undefined
May 30 23:23:12 volumio-display volumio[1257]: info: CoreStateMachine::stPlaybackTimer
May 30 23:23:12 volumio-display volumio[1257]: info: CoreStateMachine::updateTrackBlock
May 30 23:23:12 volumio-display volumio[1257]: info: CorePlayQueue::getTrackBlock
May 30 23:23:12 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:23:12 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:23:12 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 30 23:23:12 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:23:12 volumio-display volumio[1257]: info: CoreStateMachine::serviceStop
May 30 23:23:12 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:23:12 volumio-display volumio[1257]: info: CoreCommandRouter::serviceStop
May 30 23:23:12 volumio-display volumio[1257]: info: [1780176192640] ControllerWebradio::stop
May 30 23:23:12 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand stop
May 30 23:23:12 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status stop
May 30 23:23:12 volumio-display volumio[1257]: info:
May 30 23:23:12 volumio-display volumio[1257]: ---------------------------- MPD announces state update: player
May 30 23:23:12 volumio-display volumio[1257]: info: sendMpdCommand stop took 35 milliseconds
May 30 23:23:12 volumio-display volumio[1257]: info: ControllerMpd::getState
May 30 23:23:12 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand status
May 30 23:23:12 volumio-display volumio[1257]: info: sendMpdCommand status took 1 milliseconds
May 30 23:23:12 volumio-display volumio[1257]: verbose: ControllerMpd::parseState
May 30 23:23:12 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 30 23:23:12 volumio-display volumio[1257]: info: sendMpdCommand playlistinfo took 23 milliseconds
May 30 23:23:12 volumio-display volumio[1257]: verbose: ControllerMpd::parseTrackInfo
May 30 23:23:12 volumio-display volumio[1257]: info: ControllerMpd::pushState
May 30 23:23:12 volumio-display volumio[1257]: info: CoreCommandRouter::servicePushState
May 30 23:23:12 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:23:12 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:23:12 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:23:12 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:23:12 volumio-display volumio[1257]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd
May 30 23:23:12 volumio-display volumio[1257]: info: ------------------------------ 36ms
May 30 23:23:12 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status stop
May 30 23:23:12 volumio-display sudo[14358]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop peppyspectrum.service
May 30 23:23:12 volumio-display sudo[14358]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:23:12 volumio-display volumio[1257]: info: touch_display: Setting screensaver timeout to 0 seconds.
May 30 23:23:12 volumio-display sudo[14363]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop peppyspectrum.service
May 30 23:23:12 volumio-display sudo[14363]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:23:12 volumio-display systemd[1]: Stopping peppyspectrum.service - peppyspectrum Daemon...
May 30 23:23:12 volumio-display systemd[1]: peppyspectrum.service: Deactivated successfully.
May 30 23:23:12 volumio-display systemd[1]: Stopped peppyspectrum.service - peppyspectrum Daemon.
May 30 23:23:12 volumio-display systemd[1]: peppyspectrum.service: Consumed 1.086s CPU time.
May 30 23:23:12 volumio-display sudo[14358]: pam_unix(sudo:session): session closed for user root
May 30 23:23:12 volumio-display volumio[1257]: info: peppyspectrum Daemon Stop
May 30 23:23:12 volumio-display sudo[14363]: pam_unix(sudo:session): session closed for user root
May 30 23:23:12 volumio-display volumio[1257]: info: peppyspectrum Daemon Stop
May 30 23:23:14 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPlay
May 30 23:23:14 volumio-display volumio[1257]: info: CoreStateMachine::play index undefined
May 30 23:23:14 volumio-display volumio[1257]: info: CoreStateMachine::setConsumeUpdateService undefined
May 30 23:23:14 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:23:14 volumio-display volumio[1257]: info: CoreStateMachine::startPlaybackTimer
May 30 23:23:14 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:23:14 volumio-display volumio[1257]: info: [1780176194900] ControllerWebradio::clearAddPlayTrack
May 30 23:23:14 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand stop
May 30 23:23:14 volumio-display volumio[1257]: info: sendMpdCommand stop took 1 milliseconds
May 30 23:23:14 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand clear
May 30 23:23:14 volumio-display volumio[1257]: info:
May 30 23:23:14 volumio-display volumio[1257]: ---------------------------- MPD announces system playlist update
May 30 23:23:14 volumio-display volumio[1257]: info: Ignoring MPD Status Update
May 30 23:23:14 volumio-display volumio[1257]: info: sendMpdCommand clear took 1 milliseconds
May 30 23:23:14 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand load "http://s0.radiohost.pl:8018/stream"
May 30 23:23:14 volumio-display volumio[1257]: error: updateQueue error: null
May 30 23:23:14 volumio-display volumio[1257]: info: ------------------------------ 1ms
May 30 23:23:14 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand add "http://s0.radiohost.pl:8018/stream"
May 30 23:23:14 volumio-display volumio[1257]: info:
May 30 23:23:14 volumio-display volumio[1257]: ---------------------------- MPD announces system playlist update
May 30 23:23:14 volumio-display volumio[1257]: info: Ignoring MPD Status Update
May 30 23:23:14 volumio-display volumio[1257]: info: sendMpdCommand add "http://s0.radiohost.pl:8018/stream" took 1 milliseconds
May 30 23:23:14 volumio-display volumio[1257]: info: CoreStateMachine::setConsumeUpdateService mpd
May 30 23:23:14 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand play
May 30 23:23:14 volumio-display volumio[1257]: info: ------------------------------ 1ms
May 30 23:23:14 volumio-display volumio[1257]: info: sendMpdCommand play took 1 milliseconds
May 30 23:23:15 volumio-display volumio[1257]: info:
May 30 23:23:15 volumio-display volumio[1257]: ---------------------------- MPD announces state update: player
May 30 23:23:15 volumio-display volumio[1257]: info: ControllerMpd::getState
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand status
May 30 23:23:15 volumio-display volumio[1257]: info:
May 30 23:23:15 volumio-display volumio[1257]: ---------------------------- MPD announces state update: player
May 30 23:23:15 volumio-display volumio[1257]: info: sendMpdCommand status took 38 milliseconds
May 30 23:23:15 volumio-display volumio[1257]: info: ControllerMpd::getState
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand status
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::parseState
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 30 23:23:15 volumio-display volumio[1257]: info: sendMpdCommand status took 0 milliseconds
May 30 23:23:15 volumio-display volumio[1257]: info: sendMpdCommand playlistinfo took 1 milliseconds
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::parseState
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::parseTrackInfo
May 30 23:23:15 volumio-display volumio[1257]: info: ControllerMpd::pushState
May 30 23:23:15 volumio-display volumio[1257]: info: CoreCommandRouter::servicePushState
May 30 23:23:15 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:23:15 volumio-display volumio[1257]: 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":"stream","artist":null,"album":null,"uri":"http://s0.radiohost.pl:8018/stream","trackType":""}
May 30 23:23:15 volumio-display volumio[1257]: verbose: CURRENT POSITION 0
May 30 23:23:15 volumio-display volumio[1257]: info: CoreStateMachine::syncState stateService play
May 30 23:23:15 volumio-display volumio[1257]: info: CoreStateMachine::syncState currentStatus stop
May 30 23:23:15 volumio-display volumio[1257]: info: ------------------------------ 41ms
May 30 23:23:15 volumio-display volumio[1257]: info: sendMpdCommand playlistinfo took 1 milliseconds
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::parseTrackInfo
May 30 23:23:15 volumio-display volumio[1257]: info: ControllerMpd::pushState
May 30 23:23:15 volumio-display volumio[1257]: info: CoreCommandRouter::servicePushState
May 30 23:23:15 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:23:15 volumio-display volumio[1257]: 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":"stream","artist":null,"album":null,"uri":"http://s0.radiohost.pl:8018/stream","trackType":""}
May 30 23:23:15 volumio-display volumio[1257]: verbose: CURRENT POSITION 0
May 30 23:23:15 volumio-display volumio[1257]: info: CoreStateMachine::syncState stateService play
May 30 23:23:15 volumio-display volumio[1257]: info: CoreStateMachine::syncState currentStatus play
May 30 23:23:15 volumio-display volumio[1257]: info: Received an update from plugin. extracting info from payload
May 30 23:23:15 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:23:15 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:23:15 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 30 23:23:15 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:23:15 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:23:15 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:23:15 volumio-display volumio[1257]: info: ------------------------------ 11ms
May 30 23:23:15 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status play
May 30 23:23:15 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status play
May 30 23:23:15 volumio-display sudo[14367]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service
May 30 23:23:15 volumio-display sudo[14367]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:23:15 volumio-display sudo[14369]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service
May 30 23:23:15 volumio-display sudo[14369]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:23:15 volumio-display systemd[1]: Started peppyspectrum.service - peppyspectrum Daemon.
May 30 23:23:15 volumio-display sudo[14367]: pam_unix(sudo:session): session closed for user root
May 30 23:23:15 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:23:15 volumio-display sudo[14369]: pam_unix(sudo:session): session closed for user root
May 30 23:23:15 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:23:15 volumio-display volumio[1257]: info:
May 30 23:23:15 volumio-display volumio[1257]: ---------------------------- MPD announces system playlist update
May 30 23:23:15 volumio-display volumio[1257]: info: Ignoring MPD Status Update
May 30 23:23:15 volumio-display volumio[1257]: info:
May 30 23:23:15 volumio-display volumio[1257]: ---------------------------- MPD announces state update: player
May 30 23:23:15 volumio-display volumio[1257]: info: ControllerMpd::getState
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand status
May 30 23:23:15 volumio-display volumio[1257]: info:
May 30 23:23:15 volumio-display volumio[1257]: ---------------------------- MPD announces system playlist update
May 30 23:23:15 volumio-display volumio[1257]: info: Ignoring MPD Status Update
May 30 23:23:15 volumio-display volumio[1257]: info:
May 30 23:23:15 volumio-display volumio[1257]: ---------------------------- MPD announces state update: player
May 30 23:23:15 volumio-display volumio[1257]: info: ControllerMpd::getState
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand status
May 30 23:23:15 volumio-display volumio[1257]: info: ------------------------------ 6ms
May 30 23:23:15 volumio-display volumio[1257]: info: sendMpdCommand status took 1 milliseconds
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::parseState
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 30 23:23:15 volumio-display volumio[1257]: info: ------------------------------ 4ms
May 30 23:23:15 volumio-display volumio[1257]: info: sendMpdCommand status took 3 milliseconds
May 30 23:23:15 volumio-display volumio[1257]: info: sendMpdCommand playlistinfo took 4 milliseconds
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::parseState
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::parseTrackInfo
May 30 23:23:15 volumio-display volumio[1257]: info: ControllerMpd::pushState
May 30 23:23:15 volumio-display volumio[1257]: info: CoreCommandRouter::servicePushState
May 30 23:23:15 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:23:15 volumio-display volumio[1257]: verbose: STATE SERVICE {"status":"play","position":0,"seek":884,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"256 Kbps","isStreaming":false,"title":"Savage - And You Are (Flashback Remix)","artist":"Radio Italo4you","album":null,"uri":"http://s0.radiohost.pl:8018/stream","trackType":""}
May 30 23:23:15 volumio-display volumio[1257]: verbose: CURRENT POSITION 0
May 30 23:23:15 volumio-display volumio[1257]: info: CoreStateMachine::syncState stateService play
May 30 23:23:15 volumio-display volumio[1257]: info: CoreStateMachine::syncState currentStatus play
May 30 23:23:15 volumio-display volumio[1257]: info: Received an update from plugin. extracting info from payload
May 30 23:23:15 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:23:15 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 30 23:23:15 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:23:15 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:23:15 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:23:15 volumio-display volumio[1257]: info: ------------------------------ 44ms
May 30 23:23:15 volumio-display volumio[1257]: info: sendMpdCommand playlistinfo took 39 milliseconds
May 30 23:23:15 volumio-display volumio[1257]: verbose: ControllerMpd::parseTrackInfo
May 30 23:23:15 volumio-display volumio[1257]: info: ControllerMpd::pushState
May 30 23:23:15 volumio-display volumio[1257]: info: CoreCommandRouter::servicePushState
May 30 23:23:15 volumio-display volumio[1257]: info: CorePlayQueue::getTrack 0
May 30 23:23:15 volumio-display volumio[1257]: verbose: STATE SERVICE {"status":"play","position":0,"seek":884,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"256 Kbps","isStreaming":false,"title":"Savage - And You Are (Flashback Remix)","artist":"Radio Italo4you","album":null,"uri":"http://s0.radiohost.pl:8018/stream","trackType":""}
May 30 23:23:15 volumio-display volumio[1257]: verbose: CURRENT POSITION 0
May 30 23:23:15 volumio-display volumio[1257]: info: CoreStateMachine::syncState stateService play
May 30 23:23:15 volumio-display volumio[1257]: info: CoreStateMachine::syncState currentStatus play
May 30 23:23:15 volumio-display volumio[1257]: info: Received an update from plugin. extracting info from payload
May 30 23:23:15 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:23:15 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:23:15 volumio-display volumio[1257]: info: CoreStateMachine::pushState
May 30 23:23:15 volumio-display volumio[1257]: info: CoreCommandRouter::volumioPushState
May 30 23:23:15 volumio-display volumio[1257]: info: ------------------------------ 73ms
May 30 23:23:15 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status play
May 30 23:23:15 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status play
May 30 23:23:15 volumio-display sudo[14376]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service
May 30 23:23:15 volumio-display sudo[14376]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:23:15 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status play
May 30 23:23:15 volumio-display volumio[1257]: info: PeppySpectrum ---peppyspectrum status play
May 30 23:23:15 volumio-display sudo[14379]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service
May 30 23:23:15 volumio-display sudo[14379]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:23:15 volumio-display sudo[14381]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service
May 30 23:23:15 volumio-display sudo[14381]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:23:15 volumio-display sudo[14385]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service
May 30 23:23:15 volumio-display sudo[14385]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:23:15 volumio-display sudo[14376]: pam_unix(sudo:session): session closed for user root
May 30 23:23:15 volumio-display sudo[14379]: pam_unix(sudo:session): session closed for user root
May 30 23:23:15 volumio-display sudo[14381]: pam_unix(sudo:session): session closed for user root
May 30 23:23:15 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:23:15 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:23:15 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:23:15 volumio-display sudo[14385]: pam_unix(sudo:session): session closed for user root
May 30 23:23:15 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:23:16 volumio-display startpeppyspectrum.sh[14374]: pygame 2.1.2 (SDL 2.26.5, Python 3.11.2)
May 30 23:23:16 volumio-display startpeppyspectrum.sh[14374]: Hello from the pygame community. https://www.pygame.org/contribute.html
May 30 23:23:16 volumio-display startpeppyspectrum.sh[14374]: Traceback (most recent call last):
May 30 23:23:16 volumio-display startpeppyspectrum.sh[14374]: File "/data/plugins/user_interface/peppyspectrum/PeppySpectrum/spectrum.py", line 30, in
May 30 23:23:16 volumio-display startpeppyspectrum.sh[14374]: from spectrumutil import SpectrumUtil
May 30 23:23:16 volumio-display startpeppyspectrum.sh[14374]: File "/data/plugins/user_interface/peppyspectrum/PeppySpectrum/spectrumutil.py", line 19, in
May 30 23:23:16 volumio-display startpeppyspectrum.sh[14374]: from PIL import Image
May 30 23:23:16 volumio-display startpeppyspectrum.sh[14374]: ModuleNotFoundError: No module named 'PIL'
May 30 23:23:16 volumio-display systemd[1]: peppyspectrum.service: Main process exited, code=exited, status=1/FAILURE
May 30 23:23:16 volumio-display systemd[1]: peppyspectrum.service: Failed with result 'exit-code'.
May 30 23:23:16 volumio-display systemd[1]: peppyspectrum.service: Consumed 1.424s CPU time.
May 30 23:23:24 volumio-display volumio[1257]: info: CALLMETHOD: user_interface peppyspectrum savepeppy1 [object Object]
May 30 23:23:24 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: peppyspectrum , savepeppy1
May 30 23:23:24 volumio-display volumio[1257]: error: Failed callmethod call: TypeError: Cannot read properties of undefined (reading 'then')
May 30 23:23:24 volumio-display volumio[1257]: info: PeppySpectrum -----------------------spectrumCD Cover
May 30 23:23:24 volumio-display volumio[1257]: info: PeppySpectrum -----------------------$basefolder/data/INTERNAL/PeppySpectrum/Templates
May 30 23:23:24 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screensize1280x400_Gelo5 Spec&Met_220
May 30 23:23:24 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screenwidth1280
May 30 23:23:24 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screenheight400
May 30 23:23:24 volumio-display volumio[1257]: info: PeppySpectrum -----------------------spectrumsize30
May 30 23:23:24 volumio-display volumio[1257]: error: PeppySpectrum ---Error writing config null
May 30 23:23:24 volumio-display sudo[14501]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart peppyspectrum.service
May 30 23:23:24 volumio-display sudo[14501]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:23:24 volumio-display volumio[1257]: info: CoreCommandRouter::getUIConfigOnPlugin
May 30 23:23:24 volumio-display volumio[1257]: info: CoreCommandRouter::Close All Modals sent
May 30 23:23:24 volumio-display systemd[1]: Started peppyspectrum.service - peppyspectrum Daemon.
May 30 23:23:24 volumio-display sudo[14501]: pam_unix(sudo:session): session closed for user root
May 30 23:23:24 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:23:25 volumio-display startpeppyspectrum.sh[14505]: pygame 2.1.2 (SDL 2.26.5, Python 3.11.2)
May 30 23:23:25 volumio-display startpeppyspectrum.sh[14505]: Hello from the pygame community. https://www.pygame.org/contribute.html
May 30 23:23:25 volumio-display startpeppyspectrum.sh[14505]: Traceback (most recent call last):
May 30 23:23:25 volumio-display startpeppyspectrum.sh[14505]: File "/data/plugins/user_interface/peppyspectrum/PeppySpectrum/spectrum.py", line 30, in
May 30 23:23:25 volumio-display startpeppyspectrum.sh[14505]: from spectrumutil import SpectrumUtil
May 30 23:23:25 volumio-display startpeppyspectrum.sh[14505]: File "/data/plugins/user_interface/peppyspectrum/PeppySpectrum/spectrumutil.py", line 19, in
May 30 23:23:25 volumio-display startpeppyspectrum.sh[14505]: from PIL import Image
May 30 23:23:25 volumio-display startpeppyspectrum.sh[14505]: ModuleNotFoundError: No module named 'PIL'
May 30 23:23:26 volumio-display systemd[1]: peppyspectrum.service: Main process exited, code=exited, status=1/FAILURE
May 30 23:23:26 volumio-display systemd[1]: peppyspectrum.service: Failed with result 'exit-code'.
May 30 23:23:26 volumio-display systemd[1]: peppyspectrum.service: Consumed 1.363s CPU time.
May 30 23:23:26 volumio-display volumio[1257]: info: CALLMETHOD: user_interface peppyspectrum savepeppy1 [object Object]
May 30 23:23:26 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: peppyspectrum , savepeppy1
May 30 23:23:26 volumio-display volumio[1257]: error: Failed callmethod call: TypeError: Cannot read properties of undefined (reading 'then')
May 30 23:23:26 volumio-display volumio[1257]: info: PeppySpectrum -----------------------spectrumCD Cover
May 30 23:23:26 volumio-display volumio[1257]: info: PeppySpectrum -----------------------$basefolder/data/INTERNAL/PeppySpectrum/Templates
May 30 23:23:26 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screensize1280x400_Gelo5 Spec&Met_220
May 30 23:23:26 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screenwidth1280
May 30 23:23:26 volumio-display volumio[1257]: info: PeppySpectrum -----------------------screenheight400
May 30 23:23:26 volumio-display volumio[1257]: info: PeppySpectrum -----------------------spectrumsize30
May 30 23:23:26 volumio-display volumio[1257]: error: PeppySpectrum ---Error writing config null
May 30 23:23:26 volumio-display sudo[14507]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart peppyspectrum.service
May 30 23:23:26 volumio-display sudo[14507]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 30 23:23:26 volumio-display volumio[1257]: info: CoreCommandRouter::getUIConfigOnPlugin
May 30 23:23:26 volumio-display volumio[1257]: info: CoreCommandRouter::Close All Modals sent
May 30 23:23:26 volumio-display systemd[1]: Started peppyspectrum.service - peppyspectrum Daemon.
May 30 23:23:26 volumio-display sudo[14507]: pam_unix(sudo:session): session closed for user root
May 30 23:23:26 volumio-display volumio[1257]: info: peppyspectrum Daemon Started
May 30 23:23:26 volumio-display wpa_supplicant[1219]: wlan0: WPA: Group rekeying completed with 48:5d:35:f7:f2:e2 [GTK=CCMP]
May 30 23:23:27 volumio-display startpeppyspectrum.sh[14512]: pygame 2.1.2 (SDL 2.26.5, Python 3.11.2)
May 30 23:23:27 volumio-display startpeppyspectrum.sh[14512]: Hello from the pygame community. https://www.pygame.org/contribute.html
May 30 23:23:27 volumio-display startpeppyspectrum.sh[14512]: Traceback (most recent call last):
May 30 23:23:27 volumio-display startpeppyspectrum.sh[14512]: File "/data/plugins/user_interface/peppyspectrum/PeppySpectrum/spectrum.py", line 30, in
May 30 23:23:27 volumio-display startpeppyspectrum.sh[14512]: from spectrumutil import SpectrumUtil
May 30 23:23:27 volumio-display startpeppyspectrum.sh[14512]: File "/data/plugins/user_interface/peppyspectrum/PeppySpectrum/spectrumutil.py", line 19, in
May 30 23:23:27 volumio-display startpeppyspectrum.sh[14512]: from PIL import Image
May 30 23:23:27 volumio-display startpeppyspectrum.sh[14512]: ModuleNotFoundError: No module named 'PIL'
May 30 23:23:27 volumio-display systemd[1]: peppyspectrum.service: Main process exited, code=exited, status=1/FAILURE
May 30 23:23:27 volumio-display systemd[1]: peppyspectrum.service: Failed with result 'exit-code'.
May 30 23:23:27 volumio-display systemd[1]: peppyspectrum.service: Consumed 1.353s CPU time.
May 30 23:23:31 volumio-display volumio[1257]: info: CALLMETHOD: user_interface peppyspectrum dlspectrum [object Object]
May 30 23:23:31 volumio-display volumio[1257]: info: CoreCommandRouter::executeOnPlugin: peppyspectrum , dlspectrum
May 30 23:23:33 volumio-display volumio[1257]: --2026-05-30 23:23:31-- https://github.com/balbuze/Spectrum-peppyspectrum/raw/main/Zipped-folders/Choose
May 30 23:23:33 volumio-display volumio[1257]: Resolving github.com (github.com)... 140.82.121.4
May 30 23:23:33 volumio-display volumio[1257]: Connecting to github.com (github.com)|140.82.121.4|:443... connected.
May 30 23:23:33 volumio-display volumio[1257]: HTTP request sent, awaiting response... 404 Not Found
May 30 23:23:33 volumio-display volumio[1257]: 2026-05-30 23:23:32 ERROR 404: Not Found.
May 30 23:23:33 volumio-display volumio[1257]: --2026-05-30 23:23:32-- http://a/
May 30 23:23:33 volumio-display volumio[1257]: Resolving a (a)... failed: Device or resource busy.
May 30 23:23:33 volumio-display volumio[1257]: wget: unable to resolve host address ‘a’
May 30 23:23:33 volumio-display volumio[1257]: --2026-05-30 23:23:32-- http://packet.zip/
May 30 23:23:33 volumio-display volumio[1257]: Resolving packet.zip (packet.zip)... 162.255.119.167
May 30 23:23:33 volumio-display volumio[1257]: Connecting to packet.zip (packet.zip)|162.255.119.167|:80... connected.
May 30 23:23:33 volumio-display volumio[1257]: HTTP request sent, awaiting response... 302 Found
May 30 23:23:33 volumio-display volumio[1257]: Location: http://www.packet.zip/ [following]
May 30 23:23:33 volumio-display volumio[1257]: --2026-05-30 23:23:32-- http://www.packet.zip/
May 30 23:23:33 volumio-display volumio[1257]: Resolving www.packet.zip (www.packet.zip)... 91.195.240.19
May 30 23:23:33 volumio-display volumio[1257]: Connecting to www.packet.zip (www.packet.zip)|91.195.240.19|:80... connected.
May 30 23:23:33 volumio-display volumio[1257]: HTTP request sent, awaiting response... 403 Forbidden
May 30 23:23:33 volumio-display volumio[1257]: 2026-05-30 23:23:33 ERROR 403: Forbidden.
May 30 23:23:33 volumio-display volumio[1257]: error: PeppySpectrum --- An error occurs while downloading or installing Spectrums
May 30 23:23:33 volumio-display volumio[1257]: /bin/rm: cannot remove '/tmp/Choose': No such file or directory
May 30 23:23:33 volumio-display volumio[1257]: /bin/rm: cannot remove 'a': No such file or directory
May 30 23:23:33 volumio-display volumio[1257]: /bin/rm: cannot remove 'packet.zip*': No such file or directory
May 30 23:23:33 volumio-display volumio[1257]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
May 30 23:23:33 volumio-display volumio[1257]: Error: Command failed: /bin/rm /tmp/Choose a packet.zip*
May 30 23:23:33 volumio-display volumio[1257]: /bin/rm: cannot remove '/tmp/Choose': No such file or directory
May 30 23:23:33 volumio-display volumio[1257]: /bin/rm: cannot remove 'a': No such file or directory
May 30 23:23:33 volumio-display volumio[1257]: /bin/rm: cannot remove 'packet.zip*': No such file or directory
May 30 23:23:33 volumio-display volumio[1257]: at checkExecSyncError (node:child_process:887:11)
May 30 23:23:33 volumio-display volumio[1257]: at execSync (node:child_process:959:15)
May 30 23:23:33 volumio-display volumio[1257]: at /data/plugins/user_interface/peppyspectrum/index.js:770:19
May 30 23:23:33 volumio-display volumio[1257]: at new Promise ()
May 30 23:23:33 volumio-display volumio[1257]: at peppyspectrum.dlspectrum (/data/plugins/user_interface/peppyspectrum/index.js:745:12)
May 30 23:23:33 volumio-display volumio[1257]: at CoreCommandRouter.executeOnPlugin (/volumio/app/index.js:1096:32)
May 30 23:23:33 volumio-display volumio[1257]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:337:42)
May 30 23:23:33 volumio-display volumio[1257]: at Socket.emit (node:events:514:28)
May 30 23:23:33 volumio-display volumio[1257]: at /volumio/node_modules/socket.io/lib/socket.js:503:12
May 30 23:23:33 volumio-display volumio[1257]: at process.processTicksAndRejections (node:internal/process/task_queues:77:11) {
May 30 23:23:33 volumio-display volumio[1257]: status: 1,
May 30 23:23:33 volumio-display volumio[1257]: signal: null,
May 30 23:23:33 volumio-display volumio[1257]: output: [
May 30 23:23:33 volumio-display volumio[1257]: null,
May 30 23:23:33 volumio-display volumio[1257]: ,
May 30 23:23:33 volumio-display volumio[1257]:
May 30 23:23:33 volumio-display volumio[1257]: ],
May 30 23:23:33 volumio-display volumio[1257]: pid: 14531,
May 30 23:23:33 volumio-display volumio[1257]: stdout: ,
May 30 23:23:33 volumio-display volumio[1257]: stderr:
May 30 23:23:33 volumio-display volumio[1257]: }
May 30 23:23:33 volumio-display volumio[1257]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
May 30 23:23:33 volumio-display sudo[14547]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-05-30 23:22'
May 30 23:23:33 volumio-display sudo[14547]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
PRETTY_NAME="Raspbian GNU/Linux 12 (bookworm)"
NAME="Raspbian GNU/Linux"
VERSION_ID="12"
VERSION="12 (bookworm)"
VERSION_CODENAME=bookworm
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="18952480e8d8c63f22208e9007a0f47a9563eae6"
VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd"
VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2"
VOLUMIO_BE_VERSION="0e58f1861fa88e02087981b8d91f7511f0e7011b"
VOLUMIO_ARCH="arm"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Tue Mar 24 17:20:52 UTC 2026"
VOLUMIO_VERSION="4.119"
VOLUMIO_HARDWARE="pi"
VOLUMIO_DEVICENAME="Raspberry Pi"
VOLUMIO_HASH="d0c2fd9dbc5e70e58c32413c12353563"