-- Logs begin at Thu 2019-02-14 12:11:59 EET, end at Mon 2024-04-22 22:31:05 EEST. --
Apr 22 22:30:00 volumio wireless.js[550]: Cleaning previous...
Apr 22 22:30:00 volumio sudo[715]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ip addr flush dev wlan0
Apr 22 22:30:00 volumio sudo[715]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:00 volumio sudo[715]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:00 volumio sudo[717]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 down
Apr 22 22:30:00 volumio sudo[717]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:00 volumio ntpd[688]: error resolving pool 1.debian.pool.ntp.org: System error (-11)
Apr 22 22:30:00 volumio sudo[717]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:00 volumio wireless.js[550]: Stopped aP
Apr 22 22:30:00 volumio sudo[724]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 up
Apr 22 22:30:00 volumio sudo[724]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:01 volumio sudo[724]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:01 volumio kernel: brcmfmac: brcmf_cfg80211_set_power_mgmt: power save disabled
Apr 22 22:30:01 volumio sudo[726]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw reg get
Apr 22 22:30:01 volumio sudo[726]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:01 volumio sudo[726]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:01 volumio sudo[733]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 up
Apr 22 22:30:01 volumio sudo[733]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:01 volumio sudo[733]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:01 volumio sudo[735]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw wlan0 scan
Apr 22 22:30:01 volumio sudo[735]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:01 volumio ntpd[688]: error resolving pool 2.debian.pool.ntp.org: System error (-11)
Apr 22 22:30:01 volumio sudo[735]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:01 volumio wireless.js[550]: SETTING APPROPRIATE REG DOMAIN: DE
Apr 22 22:30:01 volumio sudo[740]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 up
Apr 22 22:30:01 volumio sudo[740]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:01 volumio sudo[740]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:01 volumio sudo[742]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw reg set DE
Apr 22 22:30:01 volumio sudo[742]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:01 volumio sudo[742]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:01 volumio wireless.js[550]: SUCCESSFULLY SET NEW REGDOMAIN: DE
Apr 22 22:30:01 volumio wireless.js[550]: Start wireless flow
Apr 22 22:30:01 volumio wireless.js[550]: Stopped hotspot (if there)..
Apr 22 22:30:01 volumio sudo[747]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ip addr flush dev wlan0
Apr 22 22:30:01 volumio sudo[747]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:01 volumio sudo[747]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:01 volumio sudo[749]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 down
Apr 22 22:30:01 volumio sudo[749]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:02 volumio sudo[749]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:02 volumio wireless.js[550]: DHCP IP
Apr 22 22:30:02 volumio wireless.js[550]: Start ap
Apr 22 22:30:02 volumio wpa_supplicant[751]: Successfully initialized wpa_supplicant
Apr 22 22:30:02 volumio sudo[752]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/dhcpcd
Apr 22 22:30:02 volumio sudo[752]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:02 volumio kernel: brcmfmac: brcmf_cfg80211_set_power_mgmt: power save disabled
Apr 22 22:30:02 volumio dhcpcd[753]: dev: loaded udev
Apr 22 22:30:02 volumio dhcpcd-run-hooks[770]: wlan0: starting wpa_supplicant
Apr 22 22:30:02 volumio ntpd[688]: error resolving pool 3.debian.pool.ntp.org: System error (-11)
Apr 22 22:30:02 volumio dhcpcd-run-hooks[775]: wlan0: failed to start wpa_supplicant
Apr 22 22:30:02 volumio dhcpcd-run-hooks[776]: wlan0: Successfully initialized wpa_supplicant
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Match already configured
nl80211: kernel reports: Ma
Apr 22 22:30:02 volumio dhcpcd[753]: wlan0: connected to Access Point `'
Apr 22 22:30:02 volumio dhcpcd[753]: no interfaces have a carrier
Apr 22 22:30:02 volumio dhcpcd[753]: forked to background, child pid 785
Apr 22 22:30:02 volumio dhcpcd[785]: eth0: waiting for carrier
Apr 22 22:30:02 volumio dhcpcd[785]: wlan0: waiting for carrier
Apr 22 22:30:02 volumio sudo[752]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:03 volumio wpa_supplicant[774]: wlan0: Trying to associate with SSID 'COSMOTE-9EE430-2'
Apr 22 22:30:03 volumio volumio-remote-updater[549]: [2024-04-22 22:30:03] [info] asio async_connect error: system:111 (Connection refused)
Apr 22 22:30:03 volumio volumio-remote-updater[549]: [2024-04-22 22:30:03] [info] Error getting remote endpoint: system:107 (Transport endpoint is not connected)
Apr 22 22:30:03 volumio volumio-remote-updater[549]: [2024-04-22 22:30:03] [error] handle_connect error: Underlying Transport Error
Apr 22 22:30:03 volumio bthelper[629]: Changing power off succeeded
Apr 22 22:30:03 volumio bthelper[629]: [CHG] Controller B8:27:EB:47:3A:1E Class: 0x0000041c
Apr 22 22:30:03 volumio bthelper[629]: Changing power on succeeded
Apr 22 22:30:03 volumio bthelper[629]: [CHG] Controller B8:27:EB:47:3A:1E Powered: yes
Apr 22 22:30:03 volumio wireless.js[550]: trying...
Apr 22 22:30:03 volumio sudo[794]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:03 volumio sudo[794]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:03 volumio sudo[794]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:04 volumio wireless.js[550]: trying...
Apr 22 22:30:04 volumio sudo[797]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:04 volumio sudo[797]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:04 volumio sudo[797]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:05 volumio wireless.js[550]: trying...
Apr 22 22:30:05 volumio sudo[800]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:05 volumio sudo[800]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:05 volumio sudo[800]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:06 volumio wireless.js[550]: trying...
Apr 22 22:30:06 volumio sudo[803]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:06 volumio sudo[803]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:06 volumio sudo[803]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:07 volumio wireless.js[550]: trying...
Apr 22 22:30:07 volumio sudo[806]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:07 volumio sudo[806]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:07 volumio sudo[806]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:08 volumio wireless.js[550]: trying...
Apr 22 22:30:08 volumio sudo[809]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:08 volumio sudo[809]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:08 volumio sudo[809]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:09 volumio wireless.js[550]: trying...
Apr 22 22:30:09 volumio sudo[812]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:09 volumio sudo[812]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:09 volumio sudo[812]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:10 volumio wireless.js[550]: trying...
Apr 22 22:30:10 volumio sudo[815]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:10 volumio sudo[815]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:10 volumio sudo[815]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:10 volumio volumio-remote-updater[549]: [2024-04-22 22:30:10] [info] asio async_connect error: system:111 (Connection refused)
Apr 22 22:30:10 volumio volumio-remote-updater[549]: [2024-04-22 22:30:10] [info] Error getting remote endpoint: system:107 (Transport endpoint is not connected)
Apr 22 22:30:10 volumio volumio-remote-updater[549]: [2024-04-22 22:30:10] [error] handle_connect error: Underlying Transport Error
Apr 22 22:30:11 volumio wireless.js[550]: trying...
Apr 22 22:30:11 volumio sudo[818]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:11 volumio sudo[818]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:11 volumio sudo[818]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:12 volumio wireless.js[550]: trying...
Apr 22 22:30:12 volumio sudo[821]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:12 volumio sudo[821]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:12 volumio sudo[821]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:13 volumio wpa_supplicant[774]: wlan0: Authentication with 10:3c:59:9d:58:d5 timed out.
Apr 22 22:30:13 volumio wpa_supplicant[774]: wlan0: CTRL-EVENT-DISCONNECTED bssid=10:3c:59:9d:58:d5 reason=3 locally_generated=1
Apr 22 22:30:13 volumio wpa_supplicant[774]: wlan0: CTRL-EVENT-REGDOM-CHANGE init=CORE type=WORLD
Apr 22 22:30:13 volumio wpa_supplicant[774]: wlan0: CTRL-EVENT-REGDOM-CHANGE init=USER type=COUNTRY alpha2=DE
Apr 22 22:30:13 volumio wireless.js[550]: trying...
Apr 22 22:30:13 volumio sudo[824]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:13 volumio sudo[824]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:13 volumio sudo[824]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:13 volumio wpa_supplicant[774]: wlan0: Trying to associate with SSID 'COSMOTE-9EE430-2'
Apr 22 22:30:14 volumio wireless.js[550]: trying...
Apr 22 22:30:14 volumio sudo[827]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:14 volumio sudo[827]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:14 volumio sudo[827]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:15 volumio wireless.js[550]: trying...
Apr 22 22:30:15 volumio sudo[830]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:15 volumio sudo[830]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:15 volumio sudo[830]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:16 volumio wireless.js[550]: trying...
Apr 22 22:30:16 volumio sudo[833]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:16 volumio sudo[833]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:16 volumio sudo[833]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:17 volumio wireless.js[550]: trying...
Apr 22 22:30:17 volumio sudo[836]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:17 volumio sudo[836]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:17 volumio sudo[836]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:18 volumio wireless.js[550]: trying...
Apr 22 22:30:18 volumio sudo[839]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:18 volumio sudo[839]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:18 volumio sudo[839]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:19 volumio wireless.js[550]: trying...
Apr 22 22:30:19 volumio sudo[842]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:19 volumio sudo[842]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:19 volumio sudo[842]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:20 volumio wireless.js[550]: trying...
Apr 22 22:30:20 volumio sudo[845]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:20 volumio sudo[845]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:20 volumio sudo[845]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:20 volumio volumio-remote-updater[549]: [2024-04-22 22:30:20] [info] asio async_connect error: system:111 (Connection refused)
Apr 22 22:30:20 volumio volumio-remote-updater[549]: [2024-04-22 22:30:20] [info] Error getting remote endpoint: system:107 (Transport endpoint is not connected)
Apr 22 22:30:20 volumio volumio-remote-updater[549]: [2024-04-22 22:30:20] [error] handle_connect error: Underlying Transport Error
Apr 22 22:30:21 volumio wireless.js[550]: trying...
Apr 22 22:30:21 volumio sudo[848]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:21 volumio sudo[848]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:21 volumio sudo[848]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:22 volumio wireless.js[550]: trying...
Apr 22 22:30:22 volumio sudo[851]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Apr 22 22:30:22 volumio sudo[851]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:22 volumio sudo[851]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:23 volumio wireless.js[550]: Overtime, starting plan B
Apr 22 22:30:23 volumio systemd[1]: Started Wireless Services.
Apr 22 22:30:23 volumio kernel: brcmfmac: brcmf_cfg80211_set_power_mgmt: power save disabled
Apr 22 22:30:23 volumio systemd[1]: Started Volumio Backend Module.
Apr 22 22:30:23 volumio systemd[1]: Started Volumio Cpu Tweaker.
Apr 22 22:30:23 volumio volumio-cpu-tweak[857]: Setting RT Priority for mpd
Apr 22 22:30:23 volumio volumio-cpu-tweak[857]: pid 35's current scheduling policy: SCHED_OTHER
Apr 22 22:30:23 volumio volumio-cpu-tweak[857]: pid 35's current scheduling priority: 0
Apr 22 22:30:23 volumio volumio-cpu-tweak[857]: Setting MPD Affinity
Apr 22 22:30:23 volumio volumio-cpu-tweak[857]: pid 3's current affinity mask: f
Apr 22 22:30:23 volumio volumio-cpu-tweak[857]: /bin/volumio_cpu_tweak: line 27: warning: command substitution: ignored null byte in input
Apr 22 22:30:23 volumio volumio-cpu-tweak[857]: VOLUMIO CPU TWEAK: Setting CPU Governor: performance
Apr 22 22:30:23 volumio systemd[1]: volumio_cpu_tweak.service: Succeeded.
Apr 22 22:30:23 volumio wpa_supplicant[774]: wlan0: Authentication with 10:3c:59:9d:58:d5 timed out.
Apr 22 22:30:23 volumio wpa_supplicant[774]: wlan0: CTRL-EVENT-DISCONNECTED bssid=10:3c:59:9d:58:d5 reason=3 locally_generated=1
Apr 22 22:30:23 volumio wpa_supplicant[774]: wlan0: CTRL-EVENT-SSID-TEMP-DISABLED id=0 ssid="COSMOTE-9EE430-2" auth_failures=1 duration=10 reason=CONN_FAILED
Apr 22 22:30:23 volumio wpa_supplicant[774]: wlan0: CTRL-EVENT-REGDOM-CHANGE init=CORE type=WORLD
Apr 22 22:30:23 volumio wpa_supplicant[774]: wlan0: CTRL-EVENT-REGDOM-CHANGE init=USER type=COUNTRY alpha2=DE
Apr 22 22:30:25 volumio systemd[1]: systemd-fsckd.service: Succeeded.
Apr 22 22:30:26 volumio sh[426]: timed out
Apr 22 22:30:26 volumio dhcpcd[472]: timed out
Apr 22 22:30:26 volumio sh[426]: dhcpcd exited
Apr 22 22:30:26 volumio dhcpcd[472]: dhcpcd exited
Apr 22 22:30:26 volumio sh[426]: ifup: failed to bring up eth0
Apr 22 22:30:26 volumio systemd[1]: ifup@eth0.service: Main process exited, code=exited, status=1/FAILURE
Apr 22 22:30:26 volumio systemd[1]: ifup@eth0.service: Failed with result 'exit-code'.
Apr 22 22:30:26 volumio volumio[856]: info: -------------------------------------------
Apr 22 22:30:26 volumio volumio[856]: info: ----- Volumio3 ----
Apr 22 22:30:26 volumio volumio[856]: info: -------------------------------------------
Apr 22 22:30:26 volumio volumio[856]: info: ----- System startup ----
Apr 22 22:30:26 volumio volumio[856]: info: -------------------------------------------
Apr 22 22:30:27 volumio volumio[856]: info: MYVOLUMIO Environment detected
Apr 22 22:30:28 volumio volumio[856]: info: Plugin folders cleanup
Apr 22 22:30:28 volumio volumio[856]: info: Scanning into folder /volumio/app/plugins/
Apr 22 22:30:28 volumio volumio[856]: info: Scanning category audio_interface
Apr 22 22:30:28 volumio volumio[856]: info: Scanning category miscellanea
Apr 22 22:30:28 volumio volumio[856]: info: Scanning category music_service
Apr 22 22:30:28 volumio volumio[856]: info: Scanning category plugins.json
Apr 22 22:30:28 volumio volumio[856]: info: Scanning category system_controller
Apr 22 22:30:28 volumio volumio[856]: info: Scanning category user_interface
Apr 22 22:30:28 volumio volumio[856]: info: Scanning into folder /data/plugins/
Apr 22 22:30:28 volumio volumio[856]: info: Scanning category audio_interface
Apr 22 22:30:28 volumio volumio[856]: info: Scanning category music_service
Apr 22 22:30:28 volumio volumio[856]: info: Scanning category user_interface
Apr 22 22:30:28 volumio volumio[856]: info: Plugin folders cleanup completed
Apr 22 22:30:28 volumio volumio[856]: info: -------------------------------------------
Apr 22 22:30:28 volumio volumio[856]: info: ----- Core plugins startup ----
Apr 22 22:30:28 volumio volumio[856]: info: -------------------------------------------
Apr 22 22:30:28 volumio volumio[856]: info: Loading plugins from folder /volumio/app/plugins/
Apr 22 22:30:28 volumio volumio[856]: info: Adding plugin upnp to MyMusic Plugins
Apr 22 22:30:28 volumio volumio[856]: info: Adding plugin airplay_emulation to MyMusic Plugins
Apr 22 22:30:28 volumio volumio[856]: info: Adding plugin upnp_browser to MyMusic Plugins
Apr 22 22:30:28 volumio volumio[856]: info: Loading plugins from folder /data/plugins/
Apr 22 22:30:28 volumio volumio[856]: info: Loading plugin "system"...
Apr 22 22:30:28 volumio volumio[856]: info: Loading plugin "appearance"...
Apr 22 22:30:29 volumio systemd[1]: systemd-hostnamed.service: Succeeded.
Apr 22 22:30:29 volumio volumio[856]: info: Loading plugin "network"...
Apr 22 22:30:29 volumio volumio[856]: info: Refreshing Cached IP Addresses
Apr 22 22:30:29 volumio sudo[890]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Apr 22 22:30:29 volumio sudo[890]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:29 volumio sudo[890]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:29 volumio sudo[892]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Apr 22 22:30:29 volumio volumio[856]: info: Loading plugin "services"...
Apr 22 22:30:29 volumio sudo[892]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:29 volumio volumio[856]: info: Loading plugin "alsa_controller"...
Apr 22 22:30:29 volumio sudo[892]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:29 volumio sudo[895]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan
Apr 22 22:30:29 volumio sudo[895]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:30 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Apr 22 22:30:30 volumio volumio[856]: info: Loading plugin "wizard"...
Apr 22 22:30:30 volumio volumio[856]: info: Loading plugin "networkfs"...
Apr 22 22:30:30 volumio volumio[856]: info: Starting Udev Watcher for removable devices
Apr 22 22:30:30 volumio volumio[856]: info: Ignoring mount for partition: boot
Apr 22 22:30:30 volumio volumio[856]: info: Ignoring mount for partition: volumio
Apr 22 22:30:30 volumio volumio[856]: info: Ignoring mount for partition: volumio_data
Apr 22 22:30:30 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback
Apr 22 22:30:30 volumio volumio[856]: info: Loading plugin "volumio_command_line_client"...
Apr 22 22:30:30 volumio volumio[856]: info: Loading plugin "upnp"...
Apr 22 22:30:30 volumio volumio[856]: info: [1713814230256] Starting Upmpd Daemon
Apr 22 22:30:30 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback
Apr 22 22:30:30 volumio volumio[856]: info: Loading plugin "my_music"...
Apr 22 22:30:30 volumio volumio[856]: info: Loading plugin "mpd"...
Apr 22 22:30:30 volumio volumio-remote-updater[549]: [2024-04-22 22:30:30] [connect] Successful connection
Apr 22 22:30:30 volumio sudo[895]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:30 volumio volumio[856]: info: Loading plugin "upnp_browser"...
Apr 22 22:30:31 volumio volumio[856]: info: Loading plugin "alarm-clock"...
Apr 22 22:30:31 volumio volumio[856]: info: Loading plugin "airplay_emulation"...
Apr 22 22:30:31 volumio volumio[856]: info: Starting Shairport Sync
Apr 22 22:30:31 volumio volumio[856]: info: Loading plugin "last_100"...
Apr 22 22:30:31 volumio volumio[856]: info: Loading plugin "webradio"...
Apr 22 22:30:31 volumio volumio[856]: info: Loading plugin "i2s_dacs"...
Apr 22 22:30:31 volumio volumio[856]: info: Loading plugin "volumiodiscovery"...
Apr 22 22:30:31 volumio volumio[856]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi.
Apr 22 22:30:31 volumio volumio[856]: *** WARNING *** Please fix your application to use the native API of Avahi!
Apr 22 22:30:31 volumio volumio[856]: *** WARNING *** For more information see
Apr 22 22:30:31 volumio volumio[856]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi.
Apr 22 22:30:31 volumio node[856]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi.
Apr 22 22:30:31 volumio volumio[856]: *** WARNING *** Please fix your application to use the native API of Avahi!
Apr 22 22:30:31 volumio volumio[856]: *** WARNING *** For more information see
Apr 22 22:30:31 volumio node[856]: *** WARNING *** Please fix your application to use the native API of Avahi!
Apr 22 22:30:31 volumio node[856]: *** WARNING *** For more information see
Apr 22 22:30:31 volumio node[856]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi.
Apr 22 22:30:31 volumio node[856]: *** WARNING *** Please fix your application to use the native API of Avahi!
Apr 22 22:30:31 volumio node[856]: *** WARNING *** For more information see
Apr 22 22:30:31 volumio volumio[856]: info: Applying required configuration parameters for plugin volumiodiscovery
Apr 22 22:30:31 volumio volumio[856]: info: Discovery: Started advertising with name: Volumio
Apr 22 22:30:31 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback
Apr 22 22:30:31 volumio volumio[856]: info: Loading plugin "spop"...
Apr 22 22:30:33 volumio volumio[856]: info: Loading plugin "outputs"...
Apr 22 22:30:33 volumio volumio[856]: info: Loading plugin "albumart"...
Apr 22 22:30:33 volumio volumio[856]: info: Plugin example_plugin is not enabled
Apr 22 22:30:33 volumio volumio[856]: info: Loading plugin "inputs"...
Apr 22 22:30:33 volumio volumio[856]: info: Loading plugin "updater_comm"...
Apr 22 22:30:34 volumio volumio[856]: info: Plugin mpdemulation is not enabled
Apr 22 22:30:34 volumio volumio[856]: info: Loading plugin "rest_api"...
Apr 22 22:30:34 volumio volumio[856]: info: Loading plugin "websocket"...
Apr 22 22:30:34 volumio volumio[856]: info: Loading plugin "fusiondsp"...
Apr 22 22:30:34 volumio volumio[856]: Forking 3 albumart workers
Apr 22 22:30:34 volumio wpa_supplicant[774]: wlan0: CTRL-EVENT-SSID-REENABLED id=0 ssid="COSMOTE-9EE430-2"
Apr 22 22:30:34 volumio wpa_supplicant[774]: wlan0: Trying to associate with SSID 'COSMOTE-9EE430-2'
Apr 22 22:30:34 volumio volumio[856]: info: Applying required configuration parameters for plugin fusiondsp
Apr 22 22:30:34 volumio volumio[856]: info: Loading plugin "motherearthradio"...
Apr 22 22:30:35 volumio dhcpcd[785]: wlan0: carrier acquired
Apr 22 22:30:35 volumio wpa_supplicant[774]: wlan0: Associated with 10:3c:59:9d:58:d5
Apr 22 22:30:35 volumio wpa_supplicant[774]: wlan0: CTRL-EVENT-CONNECTED - Connection to 10:3c:59:9d:58:d5 completed [id=0 id_str=]
Apr 22 22:30:35 volumio wpa_supplicant[774]: wlan0: CTRL-EVENT-SUBNET-STATUS-UPDATE status=0
Apr 22 22:30:35 volumio dhcpcd[785]: wlan0: connected to Access Point `COSMOTE-9EE430-2'
Apr 22 22:30:35 volumio wpa_supplicant[774]: wlan0: CTRL-EVENT-REGDOM-CHANGE init=COUNTRY_IE type=COUNTRY alpha2=DE
Apr 22 22:30:35 volumio dhcpcd[785]: DUID 00:01:00:01:2d:69:1f:6e:b8:27:eb:ed:90:b4
Apr 22 22:30:35 volumio dhcpcd[785]: wlan0: IAID eb:b8:c5:e1
Apr 22 22:30:35 volumio dhcpcd[785]: wlan0: adding address fe80::c7c8:5553:f164:4495
Apr 22 22:30:35 volumio dhcpcd[785]: ipv6_addaddr1: Permission denied
Apr 22 22:30:35 volumio dhcpcd[785]: wlan0: carrier lost
Apr 22 22:30:35 volumio dhcpcd[785]: wlan0: carrier acquired
Apr 22 22:30:35 volumio dhcpcd[785]: wlan0: IAID eb:b8:c5:e1
Apr 22 22:30:35 volumio volumio[856]: Starting albumart workers
Apr 22 22:30:35 volumio volumio[856]: Starting albumart workers
Apr 22 22:30:35 volumio volumio[856]: info: Applying required configuration parameters for plugin motherearthradio
Apr 22 22:30:35 volumio volumio[856]: info: [1713814235543] [MotherEarth] API delay: 5
Apr 22 22:30:35 volumio volumio[856]: info: Plugin Systeminfo is not enabled
Apr 22 22:30:35 volumio volumio[856]: info: Loading plugin "touch_display"...
Apr 22 22:30:35 volumio volumio[856]: Starting albumart workers
Apr 22 22:30:35 volumio dhcpcd[785]: wlan0: rebinding lease of 192.168.1.158
Apr 22 22:30:36 volumio volumio[856]: info: Applying required configuration parameters for plugin touch_display
Apr 22 22:30:36 volumio dhcpcd[785]: wlan0: probing address 192.168.1.158/24
Apr 22 22:30:36 volumio dhcpcd[785]: wlan0: soliciting an IPv6 router
Apr 22 22:30:36 volumio volumio[856]: info: Loading i18n strings for locale en
Apr 22 22:30:36 volumio volumio[856]: Updating browse sources language
Apr 22 22:30:36 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Apr 22 22:30:36 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Apr 22 22:30:36 volumio volumio[856]: info: CoreCommandRouter::initPlayerControls
Apr 22 22:30:36 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Apr 22 22:30:36 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Apr 22 22:30:36 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Apr 22 22:30:36 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Apr 22 22:30:36 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Apr 22 22:30:36 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Apr 22 22:30:36 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Apr 22 22:30:36 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Apr 22 22:30:36 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Apr 22 22:30:36 volumio volumio[856]: Express server listening on port 3000
Apr 22 22:30:36 volumio volumio[856]: [Metrics] WebUI: 11s 257.89ms
Apr 22 22:30:36 volumio volumio[856]: info: CoreStateMachine::resetVolumioState
Apr 22 22:30:36 volumio volumio[856]: info: CoreStateMachine::getcurrentVolume
Apr 22 22:30:36 volumio volumio[856]: info: CoreCommandRouter::volumioRetrievevolume
Apr 22 22:30:37 volumio volumio[856]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Total Clients: 1
Apr 22 22:30:37 volumio volumio[856]: info: VolumeController:: Volume=45 Mute =false
Apr 22 22:30:37 volumio volumio[856]: info: CoreStateMachine::pushState
Apr 22 22:30:37 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:37 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Apr 22 22:30:37 volumio volumio[856]: info: CoreCommandRouter::volumioPushState
Apr 22 22:30:37 volumio volumio[856]: info: CoreStateMachine::updateTrackBlock
Apr 22 22:30:37 volumio volumio[856]: info: CorePlayQueue::getTrackBlock
Apr 22 22:30:37 volumio volumio[856]: info: CoreCommandRouter::volumioRetrievevolume
Apr 22 22:30:37 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Apr 22 22:30:37 volumio volumio[856]: info: Reloading queue from file
Apr 22 22:30:37 volumio volumio[856]: info: Setting Device type: Raspberry PI
Apr 22 22:30:37 volumio volumio[856]: info: CoreStateMachine::setRepeat null single undefined
Apr 22 22:30:37 volumio volumio[856]: info: CoreStateMachine::pushState
Apr 22 22:30:37 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:37 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Apr 22 22:30:37 volumio volumio[856]: info: CoreCommandRouter::volumioPushState
Apr 22 22:30:37 volumio volumio[856]: info: CoreStateMachine::setRandom null
Apr 22 22:30:37 volumio volumio[856]: info: CoreStateMachine::pushState
Apr 22 22:30:37 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:37 volumio volumio[856]: info: CoreCommandRouter::volumioPushState
Apr 22 22:30:37 volumio volumio[856]: info: VolumeController:: Volume=45 Mute =false
Apr 22 22:30:37 volumio volumio[856]: info: CoreStateMachine::pushState
Apr 22 22:30:37 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:37 volumio volumio[856]: info: CoreCommandRouter::volumioPushState
Apr 22 22:30:40 volumio sudo[979]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Apr 22 22:30:40 volumio sudo[979]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:40 volumio sudo[979]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:40 volumio sudo[981]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Apr 22 22:30:40 volumio sudo[981]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:40 volumio sudo[981]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:40 volumio sudo[985]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service
Apr 22 22:30:40 volumio sudo[985]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:40 volumio systemd[1]: Started UPnP Renderer front-end to MPD.
Apr 22 22:30:40 volumio sudo[985]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:40 volumio volumio[856]: info: Upmpdcli Daemon Started
Apr 22 22:30:40 volumio volumio[856]: error: Upnp client error: Error: connect ECONNREFUSED 127.0.0.1:6600
Apr 22 22:30:41 volumio dhcpcd[785]: wlan0: leased 192.168.1.158 for 86400 seconds
Apr 22 22:30:41 volumio avahi-daemon[523]: Joining mDNS multicast group on interface wlan0.IPv4 with address 192.168.1.158.
Apr 22 22:30:41 volumio avahi-daemon[523]: New relevant interface wlan0.IPv4 for mDNS.
Apr 22 22:30:41 volumio dhcpcd[785]: wlan0: adding route to 192.168.1.0/24
Apr 22 22:30:41 volumio avahi-daemon[523]: Registering new address record for 192.168.1.158 on wlan0.IPv4.
Apr 22 22:30:41 volumio dhcpcd[785]: wlan0: adding default route via 192.168.1.1
Apr 22 22:30:42 volumio volumio[856]: info: Discovery: adding cf89ec5a-a1a1-408f-ad4e-96ceb8640f17
Apr 22 22:30:42 volumio volumio[856]: info: Discovery: Found device Volumio
Apr 22 22:30:42 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:42 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:42 volumio ntpd[688]: Listen normally on 3 wlan0 192.168.1.158:123
Apr 22 22:30:42 volumio ntpd[688]: new interface(s) found: waking up resolver
Apr 22 22:30:43 volumio sudo[1009]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Apr 22 22:30:43 volumio sudo[1009]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:43 volumio sudo[1009]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:43 volumio sudo[1011]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Apr 22 22:30:43 volumio sudo[1011]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:30:43 volumio sudo[1011]: pam_unix(sudo:session): session closed for user root
Apr 22 22:30:44 volumio volumio[856]: error: Upnp client error: Error: connect ECONNREFUSED 127.0.0.1:6600
Apr 22 22:30:44 volumio systemd[1]: Started Samba NMB Daemon.
Apr 22 22:30:44 volumio nmbd[634]: [2024/04/22 22:30:44.594463, 0] ../lib/util/become_daemon.c:138(daemon_ready)
Apr 22 22:30:44 volumio nmbd[634]: daemon_ready: STATUS=daemon 'nmbd' finished starting up and ready to serve connections
Apr 22 22:30:44 volumio nmbd[634]: [2024/04/22 22:30:44.611728, 0] ../source3/nmbd/nmbd_namequery.c:109(query_name_response)
Apr 22 22:30:44 volumio nmbd[634]: query_name_response: Multiple (2) responses received for a query on subnet 192.168.1.158 for name WORKGROUP<1d>.
Apr 22 22:30:44 volumio nmbd[634]: This response was from IP 192.168.1.55, reporting an IP address of 192.168.1.55.
Apr 22 22:30:44 volumio systemd[1]: Starting Samba Winbind Daemon...
Apr 22 22:30:44 volumio winbindd[1014]: [2024/04/22 22:30:44.987872, 0] ../source3/winbindd/winbindd_cache.c:3160(initialize_winbindd_cache)
Apr 22 22:30:44 volumio winbindd[1014]: initialize_winbindd_cache: clearing cache and re-creating with version number 2
Apr 22 22:30:45 volumio winbindd[1014]: [2024/04/22 22:30:45.018811, 0] ../lib/util/become_daemon.c:138(daemon_ready)
Apr 22 22:30:45 volumio systemd[1]: Started Samba Winbind Daemon.
Apr 22 22:30:45 volumio winbindd[1014]: daemon_ready: STATUS=daemon 'winbindd' finished starting up and ready to serve connections
Apr 22 22:30:45 volumio systemd[1]: Starting Samba SMB Daemon...
Apr 22 22:30:45 volumio volumio[856]: verbose: New Socket.io Connection to 192.168.1.158 from 192.168.1.130 UA: Mozilla/5.0 (Macintosh; Intel Mac OS X 10_15_7) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/124.0.0.0 Safari/537.36 Total Clients: 2
Apr 22 22:30:45 volumio volumio[856]: verbose: New Socket.io Connection to 192.168.1.158 from 192.168.1.130 UA: Mozilla/5.0 (Macintosh; Intel Mac OS X 10_15_7) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/124.0.0.0 Safari/537.36 Total Clients: 3
Apr 22 22:30:45 volumio systemd[1]: Started Samba SMB Daemon.
Apr 22 22:30:45 volumio systemd[1]: Reached target Multi-User System.
Apr 22 22:30:45 volumio systemd[1]: Reached target Graphical Interface.
Apr 22 22:30:45 volumio smbd[1019]: [2024/04/22 22:30:45.593202, 0] ../lib/util/become_daemon.c:138(daemon_ready)
Apr 22 22:30:45 volumio smbd[1019]: daemon_ready: STATUS=daemon 'smbd' finished starting up and ready to serve connections
Apr 22 22:30:45 volumio volumio[856]: verbose: New Socket.io Connection to 192.168.1.158 from 192.168.1.130 UA: Mozilla/5.0 (Macintosh; Intel Mac OS X 10_15_7) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/124.0.0.0 Safari/537.36 Total Clients: 4
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
Apr 22 22:30:45 volumio volumio-remote-updater[549]: [2024-04-22 22:30:45] [connect] Successful connection
Apr 22 22:30:45 volumio systemd[1]: Starting Update UTMP about System Runlevel Changes...
Apr 22 22:30:45 volumio volumio-remote-updater[549]: [2024-04-22 22:30:45] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=4&transport=websocket&t=1713814245 101
Apr 22 22:30:45 volumio volumio[856]: verbose: New Socket.io Connection to 127.0.0.1:3000 from 127.0.0.1 UA: WebSocket++/0.8.2 Total Clients: 5
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
Apr 22 22:30:45 volumio systemd[1]: systemd-update-utmp-runlevel.service: Succeeded.
Apr 22 22:30:45 volumio systemd[1]: Started Update UTMP about System Runlevel Changes.
Apr 22 22:30:45 volumio systemd[1]: Startup finished in 10.211s (kernel) + 57.917s (userspace) = 1min 8.129s.
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::volumioGetVisibleSources
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:45 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
Apr 22 22:30:45 volumio volumio[856]: info: Received Get System Info
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Apr 22 22:30:45 volumio volumio[856]: info: Discovery: Getting this device information
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:45 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:45 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:45 volumio volumio[856]: info: Listing playlists
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:45 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Apr 22 22:30:45 volumio volumio[856]: info: Received Get System Info
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Apr 22 22:30:45 volumio volumio[856]: info: Discovery: Getting this device information
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:45 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::volumioGetVisibleSources
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:45 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:45 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
Apr 22 22:30:45 volumio volumio[856]: info: Received Get System Info
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Apr 22 22:30:45 volumio volumio[856]: info: Discovery: Getting this device information
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:45 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:45 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:45 volumio volumio[856]: info: Listing playlists
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::volumioGetVisibleSources
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:45 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:45 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:45 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:46 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:46 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:46 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:46 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
Apr 22 22:30:46 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:46 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: my_volumio , setMyVolumioToken
Apr 22 22:30:46 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Apr 22 22:30:47 volumio volumio[856]: info: Received Get System Info
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Apr 22 22:30:47 volumio volumio[856]: info: Discovery: Getting this device information
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:47 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Apr 22 22:30:47 volumio volumio[856]: info: Received Get System Info
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Apr 22 22:30:47 volumio volumio[856]: info: Discovery: Getting this device information
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:47 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:30:47 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:30:47 volumio volumio[856]: info: Listing playlists
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:47 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:48 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:48 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:48 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:48 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:48 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:49 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:49 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: my_volumio , setMyVolumioToken
Apr 22 22:30:49 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:49 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:49 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:49 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:50 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:50 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:50 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:50 volumio volumio[856]: error: Upnp client error: Error: connect ECONNREFUSED 127.0.0.1:6600
Apr 22 22:30:50 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:50 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:51 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:51 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Apr 22 22:30:51 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:51 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:51 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:51 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:51 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:52 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:52 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:30:53 volumio volumio[856]: info: CoreCommandRouter::Close All Modals sent
Apr 22 22:31:00 volumio volumio[856]: error: Upnp client error: Error: connect ECONNREFUSED 127.0.0.1:6600
Apr 22 22:31:00 volumio volumio[856]: info: Starting Uninstall of plugin user_interface - Systeminfo
Apr 22 22:31:00 volumio volumio[856]: info: Uninstalling plugin Systeminfo
Apr 22 22:31:00 volumio volumio[856]: info: Disabling plugin Systeminfo
Apr 22 22:31:00 volumio volumio[856]: info: Checking if uninstall.sh is present
Apr 22 22:31:00 volumio volumio[856]: info: Executing uninstall.sh
Apr 22 22:31:00 volumio sudo[1065]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/sh /data/plugins/user_interface/Systeminfo/uninstall.sh
Apr 22 22:31:00 volumio sudo[1065]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:31:01 volumio sudo[1068]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/rm /etc/systemd/system/playonconnect.*
Apr 22 22:31:01 volumio sudo[1068]: pam_unix(sudo:session): session opened for user root by (uid=0)
Apr 22 22:31:01 volumio sudo[1068]: pam_unix(sudo:session): session closed for user root
Apr 22 22:31:01 volumio sudo[1065]: pam_unix(sudo:session): session closed for user root
Apr 22 22:31:01 volumio volumio[856]: info: Uninstall script completed
Apr 22 22:31:01 volumio volumio[856]: info: Removing plugin Systeminfo from configuration
Apr 22 22:31:01 volumio volumio[856]: info: Successfully removed Systeminfo configuration files
Apr 22 22:31:01 volumio volumio[856]: info: Plugin folders cleanup
Apr 22 22:31:01 volumio volumio[856]: info: Scanning into folder /volumio/app/plugins/
Apr 22 22:31:01 volumio volumio[856]: info: Scanning category audio_interface
Apr 22 22:31:01 volumio volumio[856]: info: Scanning category miscellanea
Apr 22 22:31:01 volumio volumio[856]: info: Scanning category music_service
Apr 22 22:31:01 volumio volumio[856]: info: Scanning category plugins.json
Apr 22 22:31:01 volumio volumio[856]: info: Scanning category system_controller
Apr 22 22:31:01 volumio volumio[856]: info: Scanning category user_interface
Apr 22 22:31:01 volumio volumio[856]: info: Scanning into folder /data/plugins/
Apr 22 22:31:01 volumio volumio[856]: info: Scanning category audio_interface
Apr 22 22:31:01 volumio volumio[856]: info: Scanning category music_service
Apr 22 22:31:01 volumio volumio[856]: info: Scanning category user_interface
Apr 22 22:31:01 volumio volumio[856]: info: Cleaning folder for Systeminfo
Apr 22 22:31:01 volumio volumio[856]: info: Plugin folders cleanup completed
Apr 22 22:31:01 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Apr 22 22:31:01 volumio volumio[856]: info: [{"prettyName":"FusionDsp","name":"fusiondsp","category":"audio_interface","version":"1.0.53","icon":"fa-sliders fa-rotate-90","isManuallyInstalled":false,"enabled":true,"active":true},{"prettyName":"MotherEarthRadio","name":"motherearthradio","category":"music_service","version":"1.2.2","icon":"fa-lightbulb-o","isManuallyInstalled":false,"enabled":true,"active":true},{"prettyName":"Spotify","name":"spop","category":"music_service","version":"4.0.4","icon":"fa-spotify","isManuallyInstalled":false,"enabled":true,"active":true},{"prettyName":"Touch Display","name":"touch_display","category":"user_interface","version":"3.4.0","icon":"fa-hand-pointer-o","isManuallyInstalled":false,"enabled":true,"active":false}]
Apr 22 22:31:01 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:31:01 volumio volumio[856]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 22 22:31:02 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
Apr 22 22:31:02 volumio volumio[856]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined
Apr 22 22:31:02 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates
Apr 22 22:31:02 volumio volumio[856]: info: Received Get System Version
Apr 22 22:31:02 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Apr 22 22:31:02 volumio volumio[856]: info: Received Get System Info
Apr 22 22:31:02 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Apr 22 22:31:02 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Apr 22 22:31:02 volumio volumio[856]: info: Discovery: Getting this device information
Apr 22 22:31:02 volumio volumio[856]: info: CoreCommandRouter::volumioGetState
Apr 22 22:31:02 volumio volumio[856]: info: CorePlayQueue::getTrack 0
Apr 22 22:31:02 volumio volumio[856]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Apr 22 22:31:04 volumio ntpd[688]: Soliciting pool server 193.93.164.195
Apr 22 22:31:05 volumio volumio[856]: info: Starting Uninstall of plugin audio_interface - fusiondsp
Apr 22 22:31:05 volumio volumio[856]: info: Uninstalling plugin fusiondsp
Apr 22 22:31:05 volumio volumio[856]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Apr 22 22:31:05 volumio volumio[856]: TypeError: Cannot read property 'off' of undefined
Apr 22 22:31:05 volumio volumio[856]: at FusionDsp.onStop (/data/plugins/audio_interface/fusiondsp/index.js:107:15)
Apr 22 22:31:05 volumio volumio[856]: at PluginManager.stopPlugin (/volumio/app/pluginmanager.js:460:30)
Apr 22 22:31:05 volumio volumio[856]: at PluginManager.unInstallPlugin (/volumio/app/pluginmanager.js:1449:10)
Apr 22 22:31:05 volumio volumio[856]: at CoreCommandRouter.unInstallPlugin (/volumio/app/index.js:1459:22)
Apr 22 22:31:05 volumio volumio[856]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:1218:45)
Apr 22 22:31:05 volumio volumio[856]: at Socket.emit (events.js:315:20)
Apr 22 22:31:05 volumio volumio[856]: at /volumio/node_modules/socket.io/lib/socket.js:503:12
Apr 22 22:31:05 volumio volumio[856]: at processTicksAndRejections (internal/process/task_queues.js:75:11)
Apr 22 22:31:05 volumio volumio[856]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Apr 22 22:31:05 volumio ntpd[688]: Soliciting pool server 193.239.214.227
Apr 22 22:31:05 volumio sudo[1083]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-04-22 22:30
Apr 22 22:31:05 volumio sudo[1083]: 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="7f9f1bf001add7a8b19a4516e3c74ef598b2730d"
VOLUMIO_FE_VERSION="614d7b13ffdcb0cc5a6072e7d06f59d52e323e71"
VOLUMIO_FE3_VERSION="570aaed971c1346d45d1172dc445b086b258c6d1"
VOLUMIO_BE_VERSION="512433c3e91cdaed7ecd2808b21adeffc2137d7f"
VOLUMIO_ARCH="arm"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Wed 21 Feb 2024 09:37:22 PM CET"
VOLUMIO_VERSION="3.631"
VOLUMIO_HARDWARE="pi"
VOLUMIO_DEVICENAME="Raspberry Pi"
VOLUMIO_HASH="fdd9dd1169c06c1ad0a30ddd24c91b6b"