-- Logs begin at Thu 2025-06-12 03:13:41 CEST, end at Thu 2025-06-12 13:20:00 CEST. -- Jun 12 13:19:41 volumio volumio[1114]: info: CALLMETHOD: system_controller network saveHotspotSettings [object Object] Jun 12 13:19:41 volumio volumio[1114]: info: CoreCommandRouter::executeOnPlugin: network , saveHotspotSettings Jun 12 13:19:42 volumio sudo[12586]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/hostapd/hostapd.conf Jun 12 13:19:42 volumio sudo[12586]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:42 volumio sudo[12586]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:42 volumio volumio[1114]: info: Permissions for /etc/hostapd/hostapd.conf Jun 12 13:19:42 volumio volumio[1114]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , onNetworkingRestart Jun 12 13:19:42 volumio volumio[1114]: info: Discovery: Restarting Advertising due to device name change Jun 12 13:19:42 volumio sudo[12596]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart wireless.service Jun 12 13:19:42 volumio sudo[12596]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:42 volumio systemd[1]: Stopping Wireless Services... Jun 12 13:19:42 volumio wpa_supplicant[2994]: wlan0: CTRL-EVENT-DISCONNECTED bssid=00:09:4f:96:ec:73 reason=3 locally_generated=1 Jun 12 13:19:42 volumio wpa_supplicant[2994]: nl80211: Failed to open /proc/sys/net/ipv4/conf/wlan0/drop_unicast_in_l2_multicast: No such file or directory Jun 12 13:19:42 volumio wpa_supplicant[2994]: nl80211: Failed to set IPv4 unicast in multicast filter Jun 12 13:19:42 volumio dhcpcd[1089]: wlan0: carrier lost Jun 12 13:19:42 volumio wpa_supplicant[2994]: nl80211: Failed to open /proc/sys/net/ipv4/conf/wlan0/drop_unicast_in_l2_multicast: No such file or directory Jun 12 13:19:42 volumio wpa_supplicant[2994]: nl80211: Failed to set IPv4 unicast in multicast filter Jun 12 13:19:42 volumio kernel: cfg80211: World regulatory domain updated: Jun 12 13:19:42 volumio kernel: cfg80211: DFS Master region: unset Jun 12 13:19:42 volumio kernel: cfg80211: (start_freq - end_freq @ bandwidth), (max_antenna_gain, max_eirp), (dfs_cac_time) Jun 12 13:19:42 volumio kernel: cfg80211: (2402000 KHz - 2472000 KHz @ 40000 KHz), (N/A, 2000 mBm), (N/A) Jun 12 13:19:42 volumio kernel: cfg80211: (2457000 KHz - 2482000 KHz @ 20000 KHz, 92000 KHz AUTO), (N/A, 2000 mBm), (N/A) Jun 12 13:19:42 volumio kernel: cfg80211: (2474000 KHz - 2494000 KHz @ 20000 KHz), (N/A, 2000 mBm), (N/A) Jun 12 13:19:42 volumio kernel: cfg80211: (5170000 KHz - 5250000 KHz @ 80000 KHz, 160000 KHz AUTO), (N/A, 2000 mBm), (N/A) Jun 12 13:19:42 volumio kernel: cfg80211: (5250000 KHz - 5330000 KHz @ 80000 KHz, 160000 KHz AUTO), (N/A, 2000 mBm), (0 s) Jun 12 13:19:42 volumio kernel: cfg80211: (5490000 KHz - 5730000 KHz @ 160000 KHz), (N/A, 2000 mBm), (0 s) Jun 12 13:19:42 volumio kernel: cfg80211: (5735000 KHz - 5835000 KHz @ 80000 KHz), (N/A, 2000 mBm), (N/A) Jun 12 13:19:42 volumio kernel: cfg80211: (57240000 KHz - 63720000 KHz @ 2160000 KHz), (N/A, 0 mBm), (N/A) Jun 12 13:19:42 volumio avahi-daemon[553]: Withdrawing address record for 192.168.2.166 on wlan0. Jun 12 13:19:42 volumio avahi-daemon[553]: Leaving mDNS multicast group on interface wlan0.IPv4 with address 192.168.2.166. Jun 12 13:19:42 volumio avahi-daemon[553]: Interface wlan0.IPv4 no longer relevant for mDNS. Jun 12 13:19:42 volumio volumio[1114]: info: Discovery: A device disappeared from network Jun 12 13:19:42 volumio volumio[1114]: info: Discovery: Device volumio disappeared from network Jun 12 13:19:42 volumio kernel: cfg80211: Regulatory domain changed to country: DE Jun 12 13:19:42 volumio kernel: cfg80211: DFS Master region: ETSI Jun 12 13:19:42 volumio kernel: cfg80211: (start_freq - end_freq @ bandwidth), (max_antenna_gain, max_eirp), (dfs_cac_time) Jun 12 13:19:42 volumio kernel: cfg80211: (2400000 KHz - 2483500 KHz @ 40000 KHz), (N/A, 2000 mBm), (N/A) Jun 12 13:19:42 volumio kernel: cfg80211: (5150000 KHz - 5250000 KHz @ 80000 KHz, 200000 KHz AUTO), (N/A, 2000 mBm), (N/A) Jun 12 13:19:42 volumio kernel: cfg80211: (5250000 KHz - 5350000 KHz @ 80000 KHz, 200000 KHz AUTO), (N/A, 2000 mBm), (0 s) Jun 12 13:19:42 volumio kernel: cfg80211: (5470000 KHz - 5725000 KHz @ 160000 KHz), (N/A, 2698 mBm), (0 s) Jun 12 13:19:42 volumio kernel: cfg80211: (5725000 KHz - 5875000 KHz @ 80000 KHz), (N/A, 1397 mBm), (N/A) Jun 12 13:19:42 volumio kernel: cfg80211: (57000000 KHz - 66000000 KHz @ 2160000 KHz), (N/A, 4000 mBm), (N/A) Jun 12 13:19:42 volumio dhcpcd[1089]: wlan0: deleting route to 192.168.2.0/24 Jun 12 13:19:42 volumio dhcpcd[1089]: wlan0: deleting default route via 192.168.2.1 Jun 12 13:19:42 volumio wpa_supplicant[2994]: nl80211: Failed to open /proc/sys/net/ipv4/conf/wlan0/drop_unicast_in_l2_multicast: No such file or directory Jun 12 13:19:42 volumio wpa_supplicant[2994]: nl80211: Failed to set IPv4 unicast in multicast filter Jun 12 13:19:42 volumio wpa_supplicant[2994]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 Jun 12 13:19:42 volumio ntpd[3175]: ntpd exiting on signal 15 (Terminated) Jun 12 13:19:42 volumio ntpd[3175]: 192.168.2.1 local addr 192.168.2.166 -> Jun 12 13:19:42 volumio systemd[1]: Stopping Network Time Service... Jun 12 13:19:42 volumio wpa_supplicant[2994]: wlan0: CTRL-EVENT-TERMINATING Jun 12 13:19:42 volumio systemd[1]: wireless.service: Succeeded. Jun 12 13:19:42 volumio systemd[1]: Stopped Wireless Services. Jun 12 13:19:42 volumio systemd[1]: Starting Wireless Services... Jun 12 13:19:42 volumio systemd[1]: ntp.service: Succeeded. Jun 12 13:19:42 volumio systemd[1]: Stopped Network Time Service. Jun 12 13:19:42 volumio systemd[1]: Starting Network Time Service... Jun 12 13:19:42 volumio ntpd[12647]: ntpd 4.2.8p12@1.3728-o (1): Starting Jun 12 13:19:42 volumio ntpd[12647]: Command line: /usr/sbin/ntpd -p /var/run/ntpd.pid -g -u 104:103 Jun 12 13:19:42 volumio systemd[1]: Started Network Time Service. Jun 12 13:19:42 volumio ntpd[12653]: proto: precision = 0.583 usec (-21) Jun 12 13:19:42 volumio ntpd[12653]: leapsecond file ('/usr/share/zoneinfo/leap-seconds.list'): good hash signature Jun 12 13:19:42 volumio ntpd[12653]: leapsecond file ('/usr/share/zoneinfo/leap-seconds.list'): loaded, expire=2022-12-28T00:00:00Z last=2017-01-01T00:00:00Z ofs=37 Jun 12 13:19:42 volumio ntpd[12653]: leapsecond file ('/usr/share/zoneinfo/leap-seconds.list'): expired less than 898 days ago Jun 12 13:19:42 volumio ntpd[12653]: Listen and drop on 0 v6wildcard [::]:123 Jun 12 13:19:42 volumio ntpd[12653]: Listen and drop on 1 v4wildcard 0.0.0.0:123 Jun 12 13:19:42 volumio ntpd[12653]: Listen normally on 2 lo 127.0.0.1:123 Jun 12 13:19:42 volumio ntpd[12653]: Listening on routing socket on fd #19 for interface updates Jun 12 13:19:42 volumio ntpd[12653]: kernel reports TIME_ERROR: 0x2041: Clock Unsynchronized Jun 12 13:19:42 volumio ntpd[12653]: kernel reports TIME_ERROR: 0x2041: Clock Unsynchronized Jun 12 13:19:42 volumio wireless.js[12638]: Cleaning previous... Jun 12 13:19:42 volumio sudo[12664]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ip addr flush dev wlan0 Jun 12 13:19:42 volumio sudo[12664]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:42 volumio sudo[12664]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:42 volumio sudo[12673]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 down Jun 12 13:19:42 volumio sudo[12673]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:42 volumio sudo[12673]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:42 volumio wireless.js[12638]: Stopped aP Jun 12 13:19:42 volumio sudo[12687]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 up Jun 12 13:19:42 volumio sudo[12687]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:42 volumio sudo[12687]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:42 volumio sudo[12696]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw reg get Jun 12 13:19:42 volumio sudo[12696]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:42 volumio sudo[12696]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:42 volumio sudo[12710]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 up Jun 12 13:19:42 volumio sudo[12710]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:42 volumio sudo[12710]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:43 volumio sudo[12719]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw wlan0 scan Jun 12 13:19:43 volumio sudo[12719]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:43 volumio volumio[1114]: info: Volumio Network Manager: Network status updated: 0 Jun 12 13:19:43 volumio ntpd[12653]: error resolving pool 0.debian.pool.ntp.org: System error (-11) Jun 12 13:19:44 volumio sudo[12719]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:44 volumio wireless.js[12638]: Start wireless flow Jun 12 13:19:44 volumio wireless.js[12638]: Stopped hotspot (if there).. Jun 12 13:19:44 volumio sudo[12745]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ip addr flush dev wlan0 Jun 12 13:19:44 volumio sudo[12745]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:44 volumio sudo[12745]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:44 volumio sudo[12754]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 down Jun 12 13:19:44 volumio sudo[12754]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:44 volumio sudo[12754]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:44 volumio wireless.js[12638]: DHCP IP Jun 12 13:19:44 volumio wireless.js[12638]: Start ap Jun 12 13:19:44 volumio wpa_supplicant[12763]: Successfully initialized wpa_supplicant Jun 12 13:19:44 volumio sudo[12764]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/dhcpcd Jun 12 13:19:44 volumio sudo[12764]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:44 volumio dhcpcd[12769]: sending commands to master dhcpcd process Jun 12 13:19:44 volumio dhcpcd[1089]: control command: /sbin/dhcpcd Jun 12 13:19:44 volumio sudo[12764]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:44 volumio ntpd[12653]: error resolving pool 1.debian.pool.ntp.org: System error (-11) Jun 12 13:19:45 volumio wireless.js[12638]: trying... Jun 12 13:19:45 volumio sudo[12775]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Jun 12 13:19:45 volumio sudo[12775]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:45 volumio sudo[12775]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:45 volumio ntpd[12653]: error resolving pool 2.debian.pool.ntp.org: System error (-11) Jun 12 13:19:45 volumio wpa_supplicant[12773]: wlan0: Trying to associate with 00:09:4f:96:ec:73 (SSID='Digibox-1527' freq=2462 MHz) Jun 12 13:19:45 volumio wpa_supplicant[12773]: wlan0: Associated with 00:09:4f:96:ec:73 Jun 12 13:19:45 volumio wpa_supplicant[12773]: wlan0: CTRL-EVENT-SUBNET-STATUS-UPDATE status=0 Jun 12 13:19:45 volumio wpa_supplicant[12773]: wlan0: CTRL-EVENT-REGDOM-CHANGE init=COUNTRY_IE type=COUNTRY alpha2=DE Jun 12 13:19:45 volumio kernel: cfg80211: Regulatory domain changed to country: DE Jun 12 13:19:45 volumio kernel: cfg80211: DFS Master region: ETSI Jun 12 13:19:45 volumio kernel: cfg80211: (start_freq - end_freq @ bandwidth), (max_antenna_gain, max_eirp), (dfs_cac_time) Jun 12 13:19:45 volumio kernel: cfg80211: (2400000 KHz - 2483500 KHz @ 40000 KHz), (N/A, 2000 mBm), (N/A) Jun 12 13:19:45 volumio kernel: cfg80211: (5150000 KHz - 5250000 KHz @ 80000 KHz, 200000 KHz AUTO), (N/A, 2000 mBm), (N/A) Jun 12 13:19:45 volumio kernel: cfg80211: (5250000 KHz - 5350000 KHz @ 80000 KHz, 200000 KHz AUTO), (N/A, 2000 mBm), (0 s) Jun 12 13:19:45 volumio kernel: cfg80211: (5470000 KHz - 5725000 KHz @ 160000 KHz), (N/A, 2698 mBm), (0 s) Jun 12 13:19:45 volumio kernel: cfg80211: (5725000 KHz - 5875000 KHz @ 80000 KHz), (N/A, 1397 mBm), (N/A) Jun 12 13:19:45 volumio kernel: cfg80211: (57000000 KHz - 66000000 KHz @ 2160000 KHz), (N/A, 4000 mBm), (N/A) Jun 12 13:19:45 volumio wpa_supplicant[12773]: wlan0: WPA: Key negotiation completed with 00:09:4f:96:ec:73 [PTK=CCMP GTK=TKIP] Jun 12 13:19:45 volumio wpa_supplicant[12773]: wlan0: CTRL-EVENT-CONNECTED - Connection to 00:09:4f:96:ec:73 completed [id=0 id_str=] Jun 12 13:19:45 volumio dhcpcd[1089]: wlan0: carrier acquired Jun 12 13:19:46 volumio dhcpcd[1089]: wlan0: IAID 55:e6:4a:69 Jun 12 13:19:46 volumio wireless.js[12638]: trying... Jun 12 13:19:46 volumio sudo[12788]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Jun 12 13:19:46 volumio sudo[12788]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:46 volumio sudo[12788]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:46 volumio ntpd[12653]: error resolving pool 3.debian.pool.ntp.org: System error (-11) Jun 12 13:19:46 volumio dhcpcd[1089]: wlan0: soliciting an IPv6 router Jun 12 13:19:46 volumio dhcpcd[1089]: wlan0: rebinding lease of 192.168.2.166 Jun 12 13:19:46 volumio dhcpcd[1089]: wlan0: probing address 192.168.2.166/24 Jun 12 13:19:47 volumio volumio[1114]: info: Discovery: Started advertising with name: Volumio Jun 12 13:19:47 volumio wireless.js[12638]: trying... Jun 12 13:19:47 volumio sudo[12799]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Jun 12 13:19:47 volumio sudo[12799]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:47 volumio sudo[12799]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:48 volumio wireless.js[12638]: trying... Jun 12 13:19:48 volumio sudo[12809]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Jun 12 13:19:48 volumio sudo[12809]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:48 volumio sudo[12809]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:49 volumio wireless.js[12638]: trying... Jun 12 13:19:49 volumio sudo[12819]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Jun 12 13:19:49 volumio sudo[12819]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:49 volumio sudo[12819]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:50 volumio wireless.js[12638]: trying... Jun 12 13:19:50 volumio sudo[12829]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Jun 12 13:19:50 volumio sudo[12829]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:50 volumio sudo[12829]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:51 volumio wireless.js[12638]: trying... Jun 12 13:19:51 volumio sudo[12839]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Jun 12 13:19:51 volumio sudo[12839]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:51 volumio sudo[12839]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:51 volumio dhcpcd[1089]: wlan0: leased 192.168.2.166 for 7200 seconds Jun 12 13:19:51 volumio dhcpcd[1089]: wlan0: adding route to 192.168.2.0/24 Jun 12 13:19:51 volumio dhcpcd[1089]: wlan0: adding default route via 192.168.2.1 Jun 12 13:19:51 volumio avahi-daemon[553]: Joining mDNS multicast group on interface wlan0.IPv4 with address 192.168.2.166. Jun 12 13:19:51 volumio avahi-daemon[553]: New relevant interface wlan0.IPv4 for mDNS. Jun 12 13:19:51 volumio avahi-daemon[553]: Registering new address record for 192.168.2.166 on wlan0.IPv4. Jun 12 13:19:51 volumio ntpd[12653]: ntpd exiting on signal 15 (Terminated) Jun 12 13:19:51 volumio systemd[1]: Stopping Network Time Service... Jun 12 13:19:51 volumio systemd[1]: ntp.service: Succeeded. Jun 12 13:19:51 volumio systemd[1]: Stopped Network Time Service. Jun 12 13:19:51 volumio systemd[1]: Starting Network Time Service... Jun 12 13:19:51 volumio ntpd[12883]: ntpd 4.2.8p12@1.3728-o (1): Starting Jun 12 13:19:51 volumio ntpd[12883]: Command line: /usr/sbin/ntpd -p /var/run/ntpd.pid -g -c /run/ntp.conf.dhcp -u 104:103 Jun 12 13:19:51 volumio systemd[1]: Started Network Time Service. Jun 12 13:19:51 volumio ntpd[12889]: proto: precision = 0.583 usec (-21) Jun 12 13:19:51 volumio ntpd[12889]: Listen and drop on 0 v6wildcard [::]:123 Jun 12 13:19:51 volumio ntpd[12889]: Listen and drop on 1 v4wildcard 0.0.0.0:123 Jun 12 13:19:51 volumio ntpd[12889]: Listen normally on 2 lo 127.0.0.1:123 Jun 12 13:19:51 volumio ntpd[12889]: Listen normally on 3 wlan0 192.168.2.166:123 Jun 12 13:19:51 volumio ntpd[12889]: Listening on routing socket on fd #20 for interface updates Jun 12 13:19:51 volumio ntpd[12889]: kernel reports TIME_ERROR: 0x2041: Clock Unsynchronized Jun 12 13:19:51 volumio ntpd[12889]: kernel reports TIME_ERROR: 0x2041: Clock Unsynchronized Jun 12 13:19:52 volumio wireless.js[12638]: trying... Jun 12 13:19:52 volumio sudo[12893]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Jun 12 13:19:52 volumio sudo[12893]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:52 volumio sudo[12893]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:52 volumio wireless.js[12638]: Connected to: ----Digibox-1527 Jun 12 13:19:52 volumio wireless.js[12638]: ---- Jun 12 13:19:52 volumio sudo[12903]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Jun 12 13:19:52 volumio sudo[12903]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:52 volumio sudo[12903]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:52 volumio wireless.js[12638]: ... joined AP, wlan0 IPv4 is 192.168.2.166, ipV6 is undefined Jun 12 13:19:52 volumio wireless.js[12638]: It's done! AP Jun 12 13:19:52 volumio iwconfig[12914]: Error for wireless request "Set Power Management" (8B2C) : Jun 12 13:19:52 volumio iwconfig[12914]: SET failed on device wlan0 ; Operation not permitted. Jun 12 13:19:52 volumio systemd[1]: Started Wireless Services. Jun 12 13:19:52 volumio sudo[12596]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:52 volumio volumio[1114]: info: Discovery: adding 83d0ceff-6359-47bc-8269-8ffb0074bd6f Jun 12 13:19:52 volumio volumio[1114]: info: Discovery: Found device Volumio Jun 12 13:19:52 volumio volumio[1114]: info: CoreCommandRouter::volumioGetState Jun 12 13:19:52 volumio volumio[1114]: info: CorePlayQueue::getTrack 1 Jun 12 13:19:52 volumio volumio[1114]: verbose: New Socket.io Connection to 192.168.2.166 from 192.168.2.148 UA: Mozilla/5.0 (Macintosh; Intel Mac OS X 10_15_7) AppleWebKit/605.1.15 (KHTML, like Gecko) Version/18.5 Safari/605.1.15 Engine version: 3 Transport: polling Total Clients: 5 Jun 12 13:19:52 volumio volumio[1114]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Jun 12 13:19:53 volumio volumio[1114]: info: CoreCommandRouter::volumioGetVisibleSources Jun 12 13:19:53 volumio volumio[1114]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Jun 12 13:19:53 volumio volumio[1114]: info: CoreCommandRouter::volumioGetState Jun 12 13:19:53 volumio volumio[1114]: info: CorePlayQueue::getTrack 1 Jun 12 13:19:53 volumio volumio[1114]: info: CoreCommandRouter::volumioGetState Jun 12 13:19:53 volumio volumio[1114]: info: CorePlayQueue::getTrack 1 Jun 12 13:19:53 volumio volumio[1114]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Jun 12 13:19:53 volumio volumio[1114]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Jun 12 13:19:53 volumio volumio[1114]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom Jun 12 13:19:53 volumio volumio[1114]: info: Received Get System Info Jun 12 13:19:53 volumio volumio[1114]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Jun 12 13:19:53 volumio volumio[1114]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Jun 12 13:19:53 volumio volumio[1114]: info: Discovery: Getting this device information Jun 12 13:19:53 volumio volumio[1114]: info: CoreCommandRouter::volumioGetState Jun 12 13:19:53 volumio volumio[1114]: info: CorePlayQueue::getTrack 1 Jun 12 13:19:53 volumio volumio[1114]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Jun 12 13:19:53 volumio volumio[1114]: info: CoreCommandRouter::volumioGetState Jun 12 13:19:53 volumio volumio[1114]: info: CorePlayQueue::getTrack 1 Jun 12 13:19:53 volumio volumio[1114]: info: Listing playlists Jun 12 13:19:53 volumio volumio[1114]: info: CoreCommandRouter::volumioGetQueue Jun 12 13:19:53 volumio volumio[1114]: info: CoreStateMachine::getQueue Jun 12 13:19:53 volumio volumio[1114]: info: CorePlayQueue::getQueue Jun 12 13:19:53 volumio volumio[1114]: info: Volumio Network Manager: Network status updated: 2 Jun 12 13:19:53 volumio volumio[1114]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Jun 12 13:19:55 volumio volumio[1114]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Jun 12 13:19:55 volumio volumio[1114]: info: CURURI: music-library Jun 12 13:19:55 volumio volumio[1114]: info: Preload queue cleared Jun 12 13:19:57 volumio volumio[1114]: info: CoreCommandRouter::executeOnPlugin: wizard , reportWirelessConnection Jun 12 13:19:57 volumio volumio[1114]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessInfo Jun 12 13:19:57 volumio sudo[12937]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Jun 12 13:19:57 volumio sudo[12937]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:57 volumio sudo[12937]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:57 volumio sudo[12947]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Jun 12 13:19:57 volumio sudo[12947]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 12 13:19:57 volumio sudo[12947]: pam_unix(sudo:session): session closed for user root Jun 12 13:19:57 volumio volumio[1114]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Jun 12 13:19:57 volumio volumio[1114]: info: CURURI: music-library/USB Jun 12 13:19:57 volumio volumio[1114]: info: Preload queue cleared Jun 12 13:19:58 volumio volumio[1114]: info: Preload queue cleared Jun 12 13:19:58 volumio volumio[1114]: info: CoreCommandRouter::volumioReplaceandPlayItems Jun 12 13:19:58 volumio volumio[1114]: info: CoreStateMachine::ClearQueue Jun 12 13:19:58 volumio volumio[1114]: info: CoreStateMachine::stop Jun 12 13:19:58 volumio volumio[1114]: info: CoreStateMachine::setConsumeUpdateService undefined Jun 12 13:19:58 volumio volumio[1114]: info: CorePlayQueue::clearPlayQueue Jun 12 13:19:58 volumio volumio[1114]: info: CorePlayQueue::saveQueue Jun 12 13:19:58 volumio volumio[1114]: info: CoreCommandRouter::volumioPushQueue Jun 12 13:19:58 volumio volumio[1114]: info: CoreStateMachine::addQueueItems Jun 12 13:19:58 volumio volumio[1114]: info: CorePlayQueue::addQueueItems Jun 12 13:19:58 volumio volumio[1114]: info: Preload queue cleared Jun 12 13:19:58 volumio volumio[1114]: info: Adding Item to queue: music-library/USB/BOMBIK2 Jun 12 13:19:58 volumio volumio[1114]: info: Exploding uri music-library/USB/BOMBIK2 in service mpd Jun 12 13:20:00 volumio volumio[1114]: info: ALBUMART /albumart?cacheid=256&web=//small&path=%2Fmnt%2FUSB%2FBOMBIK2%2F.Trashes%2F501%2F01.%20Black%20and%20Blue%20%5BSHM-SACD-24.88%5D.flac&metadata=false Jun 12 13:20:00 volumio volumio[1114]: info: URI /mnt/USB/BOMBIK2/.Trashes/501/01. Black and Blue [SHM-SACD-24.88].flac Jun 12 13:20:00 volumio volumio[1114]: info: ALBUMART /albumart?cacheid=256&web=//small&path=%2Fmnt%2FUSB%2FBOMBIK2%2F.Trashes%2F501%2F01.%20Pink%20Panther%20-%20Jazz%20Ensemble.flac&metadata=false Jun 12 13:20:00 volumio volumio[1114]: info: URI /mnt/USB/BOMBIK2/.Trashes/501/01. Pink Panther - Jazz Ensemble.flac Jun 12 13:20:00 volumio volumio[1114]: info: ALBUMART /albumart?cacheid=256&web=Miles%20Davis/In%20A%20Silent%20Way/small&path=%2Fmnt%2FUSB%2FBOMBIK2%2F.Trashes%2F501%2F0146_miles_davis_in_a_silent_way_1969__mlib-2.zip&metadata=false Jun 12 13:20:00 volumio volumio[1114]: info: URI /mnt/USB/BOMBIK2/.Trashes/501/0146_miles_davis_in_a_silent_way_1969__mlib-2.zip Jun 12 13:20:00 volumio volumio[1114]: info: ALBUMART /albumart?cacheid=256&web=Miles%20Davis/In%20A%20Silent%20Way/small&path=%2Fmnt%2FUSB%2FBOMBIK2%2F.Trashes%2F501%2F0146_miles_davis_in_a_silent_way_1969__mlib-2.zip&metadata=false Jun 12 13:20:00 volumio volumio[1114]: info: URI /mnt/USB/BOMBIK2/.Trashes/501/0146_miles_davis_in_a_silent_way_1969__mlib-2.zip Jun 12 13:20:00 volumio volumio[1114]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jun 12 13:20:00 volumio volumio[1114]: Error: Unable to resolve or reject the same promise twice Jun 12 13:20:00 volumio volumio[1114]: at Promise.resolve (/volumio/node_modules/kew/kew.js:140:43) Jun 12 13:20:00 volumio volumio[1114]: at /volumio/app/plugins/music_service/mpd/index.js:2569:21 Jun 12 13:20:00 volumio volumio[1114]: at MpdClient.handleMessage (/volumio/app/plugins/music_service/mpd/lib/mpd.js:77:3) Jun 12 13:20:00 volumio volumio[1114]: at MpdClient.receive (/volumio/app/plugins/music_service/mpd/lib/mpd.js:68:12) Jun 12 13:20:00 volumio volumio[1114]: at Socket. (/volumio/app/plugins/music_service/mpd/lib/mpd.js:43:12) Jun 12 13:20:00 volumio volumio[1114]: at Socket.emit (events.js:400:28) Jun 12 13:20:00 volumio volumio[1114]: at addChunk (internal/streams/readable.js:293:12) Jun 12 13:20:00 volumio volumio[1114]: at readableAddChunk (internal/streams/readable.js:263:11) Jun 12 13:20:00 volumio volumio[1114]: at Socket.Readable.push (internal/streams/readable.js:206:10) Jun 12 13:20:00 volumio volumio[1114]: at Pipe.onStreamRead (internal/stream_base_commons.js:188:23) Jun 12 13:20:00 volumio volumio[1114]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jun 12 13:20:00 volumio sudo[12967]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-06-12 13:19 Jun 12 13:20:00 volumio sudo[12967]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Debian GNU/Linux 10 (buster)" NAME="Debian GNU/Linux" VERSION_ID="10" VERSION="10 (buster)" VERSION_CODENAME=buster ID=debian HOME_URL="https://www.debian.org/" SUPPORT_URL="https://www.debian.org/support" BUG_REPORT_URL="https://bugs.debian.org/" VOLUMIO_BUILD_VERSION="a142ed2648fb91920de0dde3a60cd39b5d0ba4f6" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="04c18c158cc4bac70764c3360b25fcce0c69266a" VOLUMIO_ARCH="armv7" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 10 Jun 2025 05:12:56 PM CEST" VOLUMIO_VERSION="3.816" VOLUMIO_HARDWARE="tinkerboard" VOLUMIO_DEVICENAME="Asus Tinkerboard" VOLUMIO_HASH="f5ff903d28fee878b80ffec17b533674"