-- Logs begin at Tue 2023-03-28 01:54:08 CST, end at Mon 2024-08-19 11:37:23 CST. -- Mar 28 01:54:13 volumio1234 systemd-timesyncd[2167]: System clock time unset or jumped backwards, restoring from recorded timestamp: Mon 2024-08-19 11:36:18 CST Aug 19 11:36:18 volumio1234 systemd[1]: Started Network Time Synchronization. Aug 19 11:36:18 volumio1234 systemd[1]: Reached target System Initialization. Aug 19 11:36:18 volumio1234 systemd[1]: Started Daily Cleanup of Temporary Directories. Aug 19 11:36:18 volumio1234 systemd[1]: Reached target System Time Set. Aug 19 11:36:18 volumio1234 systemd[1]: Reached target System Time Synchronized. Aug 19 11:36:18 volumio1234 systemd-resolved[2166]: Positive Trust Anchors: Aug 19 11:36:18 volumio1234 systemd-resolved[2166]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Aug 19 11:36:18 volumio1234 systemd-resolved[2166]: Negative trust anchors: 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa corp home internal intranet lan local private test Aug 19 11:36:18 volumio1234 systemd[1]: Started Daily apt download activities. Aug 19 11:36:18 volumio1234 systemd[1]: Started Daily apt upgrade and clean activities. Aug 19 11:36:18 volumio1234 systemd[1]: Started Periodic ext4 Online Metadata Check for All Filesystems. Aug 19 11:36:18 volumio1234 systemd[1]: Started Discard unused blocks once a week. Aug 19 11:36:19 volumio1234 systemd-resolved[2166]: Using system hostname 'volumio1234'. Aug 19 11:36:19 volumio1234 systemd[1]: Started Daily rotation of log files. Aug 19 11:36:19 volumio1234 systemd[1]: Started Message of the Day. Aug 19 11:36:19 volumio1234 systemd[1]: Reached target Timers. Aug 19 11:36:19 volumio1234 systemd[1]: Listening on Avahi mDNS/DNS-SD Stack Activation Socket. Aug 19 11:36:19 volumio1234 systemd[1]: Listening on D-Bus System Message Bus Socket. Aug 19 11:36:19 volumio1234 systemd[1]: Listening on mpd.socket. Aug 19 11:36:19 volumio1234 systemd[1]: Reached target Sockets. Aug 19 11:36:19 volumio1234 systemd[1]: Reached target Basic System. Aug 19 11:36:19 volumio1234 systemd[1]: Condition check resulted in Manage Sound Card State (restore and store) being skipped. Aug 19 11:36:19 volumio1234 systemd[1]: Starting Save/Restore Sound Card State... Aug 19 11:36:19 volumio1234 systemd[1]: Starting Avahi mDNS/DNS-SD Stack... Aug 19 11:36:19 volumio1234 systemd[1]: Started D-Bus System Message Bus. Aug 19 11:36:19 volumio1234 systemd-networkd[2061]: eth0: Gained carrier Aug 19 11:36:19 volumio1234 systemd-timesyncd[2167]: Network configuration changed, trying to establish connection. Aug 19 11:36:19 volumio1234 kernel: sunxi-gmac 4500000.eth eth0: Link is Up - 100Mbps/Full - flow control off Aug 19 11:36:19 volumio1234 kernel: IPv6: ADDRCONF(NETDEV_CHANGE): eth0: link becomes ready Aug 19 11:36:19 volumio1234 systemd[1]: Starting Remove Stale Online ext4 Metadata Check Snapshots... Aug 19 11:36:19 volumio1234 systemd[1]: Condition check resulted in getty on tty2-tty6 if dbus and logind are not available being skipped. Aug 19 11:36:19 volumio1234 systemd[1]: Started Volumio Iptables Module. Aug 19 11:36:19 volumio1234 avahi-daemon[2173]: Found user 'avahi' (UID 107) and group 'avahi' (GID 114). Aug 19 11:36:19 volumio1234 avahi-daemon[2173]: Successfully dropped root privileges. Aug 19 11:36:19 volumio1234 avahi-daemon[2173]: avahi-daemon 0.7 starting up. Aug 19 11:36:19 volumio1234 systemd[1]: Starting Dispatcher daemon for systemd-networkd... Aug 19 11:36:19 volumio1234 systemd[1]: Started Set the CPU Frequency Scaling governor. Aug 19 11:36:19 volumio1234 systemd[1]: Starting Login Service... Aug 19 11:36:19 volumio1234 systemd[1]: Starting LSB: Start busybox udhcpd at boot time... Aug 19 11:36:19 volumio1234 systemd[1]: Started mount disks automatically with standby. Aug 19 11:36:37 volumio1234 systemd-timesyncd[2167]: Initial synchronization to time server 185.125.190.58:123 (ntp.ubuntu.com). Aug 19 11:36:37 volumio1234 systemd[1]: Started UPnP Renderer front-end to MPD. Aug 19 11:36:37 volumio1234 systemd[1]: Started Volspotconnect2 Daemon. Aug 19 11:36:37 volumio1234 systemd[1]: Started Volumio Log Rotation Service. Aug 19 11:36:37 volumio1234 systemd[1]: Started Volumio SSH enabler. Aug 19 11:36:37 volumio1234 systemd[1]: Starting Wireless Services... Aug 19 11:36:37 volumio1234 systemd[1]: Starting WPA supplicant... Aug 19 11:36:37 volumio1234 systemd[1]: Started Network Name Resolution. Aug 19 11:36:37 volumio1234 systemd[1]: volumiossh.service: Succeeded. Aug 19 11:36:37 volumio1234 systemd[1]: Reached target Host and Network Name Lookups. Aug 19 11:36:37 volumio1234 systemd[1]: e2scrub_reap.service: Succeeded. Aug 19 11:36:37 volumio1234 systemd[1]: Finished Remove Stale Online ext4 Metadata Check Snapshots. Aug 19 11:36:37 volumio1234 systemd[1]: Finished Save/Restore Sound Card State. Aug 19 11:36:37 volumio1234 systemd-logind[2187]: New seat seat0. Aug 19 11:36:37 volumio1234 systemd[1]: Reached target Sound Card. Aug 19 11:36:37 volumio1234 systemd[1]: iptables.service: Succeeded. Aug 19 11:36:38 volumio1234 systemd-networkd[2061]: eth0: Gained IPv6LL Aug 19 11:36:38 volumio1234 udhcpd[2188]: udhcpd: Disabled. Edit /etc/default/udhcpd to enable it. Aug 19 11:36:38 volumio1234 systemd[1]: Started LSB: Start busybox udhcpd at boot time. Aug 19 11:36:38 volumio1234 systemd[1]: Started Login Service. Aug 19 11:36:38 volumio1234 avahi-daemon[2173]: Successfully called chroot(). Aug 19 11:36:38 volumio1234 avahi-daemon[2173]: Successfully dropped remaining capabilities. Aug 19 11:36:38 volumio1234 systemd[1]: Started Avahi mDNS/DNS-SD Stack. Aug 19 11:36:38 volumio1234 dbus-daemon[2174]: [system] Activating via systemd: service name='org.freedesktop.UDisks' unit='udisks.service' requested by ':1.6' (uid=1000 pid=2189 comm="/usr/bin/udisks-glue --foreground ") Aug 19 11:36:38 volumio1234 avahi-daemon[2173]: Loading service file /services/volumio.service. Aug 19 11:36:38 volumio1234 systemd[1]: Starting Disk Manager (legacy version)... Aug 19 11:36:38 volumio1234 avahi-daemon[2173]: Joining mDNS multicast group on interface eth0.IPv6 with address fe80::3089:3fff:fe7f:7f4f. Aug 19 11:36:38 volumio1234 avahi-daemon[2173]: New relevant interface eth0.IPv6 for mDNS. Aug 19 11:36:38 volumio1234 avahi-daemon[2173]: Joining mDNS multicast group on interface eth0.IPv4 with address 192.168.23.96. Aug 19 11:36:38 volumio1234 avahi-daemon[2173]: New relevant interface eth0.IPv4 for mDNS. Aug 19 11:36:38 volumio1234 avahi-daemon[2173]: Joining mDNS multicast group on interface lo.IPv4 with address 127.0.0.1. Aug 19 11:36:38 volumio1234 avahi-daemon[2173]: New relevant interface lo.IPv4 for mDNS. Aug 19 11:36:38 volumio1234 avahi-daemon[2173]: Network interface enumeration completed. Aug 19 11:36:38 volumio1234 avahi-daemon[2173]: Registering new address record for fe80::3089:3fff:fe7f:7f4f on eth0.*. Aug 19 11:36:38 volumio1234 avahi-daemon[2173]: Registering new address record for 192.168.23.96 on eth0.IPv4. Aug 19 11:36:38 volumio1234 avahi-daemon[2173]: Registering new address record for 127.0.0.1 on lo.IPv4. Aug 19 11:36:38 volumio1234 systemd[1]: Started WPA supplicant. Aug 19 11:36:38 volumio1234 wpa_supplicant[2203]: Successfully initialized wpa_supplicant Aug 19 11:36:38 volumio1234 systemd[1]: Reached target Network. Aug 19 11:36:38 volumio1234 systemd[1]: Reached target Network is Online. Aug 19 11:36:38 volumio1234 systemd[1]: Starting Music Player Daemon... Aug 19 11:36:38 volumio1234 volumio[2231]: vollibrespot v0.2.4 61563b7 2021-07-22 (librespot 08d8bcc 2020-10-07) -- Built On 2021-07-22 Aug 19 11:36:38 volumio1234 volumio[2231]: Reading Config from "volspotify.toml" Aug 19 11:36:38 volumio1234 systemd[1]: Starting Samba NMB Daemon... Aug 19 11:36:38 volumio1234 systemd[1]: Started NQPTP -- Not Quite PTP. Aug 19 11:36:38 volumio1234 volumio[2231]: [Vollibrespot] : Using Alsa backend with device: hw:1 Aug 19 11:36:38 volumio1234 systemd[1]: Starting /etc/rc.local Compatibility... Aug 19 11:36:38 volumio1234 dbus-daemon[2174]: [system] Successfully activated service 'org.freedesktop.UDisks' Aug 19 11:36:39 volumio1234 sudo[2202]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw dev wlan0 set power_save off Aug 19 11:36:39 volumio1234 systemd[1]: Starting OpenBSD Secure Shell server... Aug 19 11:36:39 volumio1234 rc.local[2285]: no find file Aug 19 11:36:39 volumio1234 systemd[1]: Starting Permit User Sessions... Aug 19 11:36:39 volumio1234 systemd[1]: Started /etc/rc.local Compatibility. Aug 19 11:36:39 volumio1234 sudo[2202]: pam_unix(sudo:session): session opened for user root by (uid=0) Aug 19 11:36:39 volumio1234 systemd[1]: Started Disk Manager (legacy version). Aug 19 11:36:39 volumio1234 systemd[1]: Finished Permit User Sessions. Aug 19 11:36:39 volumio1234 dbus-daemon[2174]: [system] Activating via systemd: service name='org.freedesktop.PolicyKit1' unit='polkit.service' requested by ':1.9' (uid=0 pid=2275 comm="/usr/lib/udisks/udisks-daemon --no-debug ") Aug 19 11:36:39 volumio1234 systemd[1]: Started Getty on tty1. Aug 19 11:36:39 volumio1234 systemd[1]: Starting Authorization Manager... Aug 19 11:36:39 volumio1234 avahi-daemon[2173]: Server startup complete. Host name is volumio1234.local. Local service cookie is 1883313847. Aug 19 11:36:39 volumio1234 systemd[1]: Started Serial Getty on ttyAS0. Aug 19 11:36:39 volumio1234 wifistart.sh[2303]: command failed: No such device (-19) Aug 19 11:36:39 volumio1234 sudo[2202]: pam_unix(sudo:session): session closed for user root Aug 19 11:36:39 volumio1234 systemd[1]: Reached target Login Prompts. Aug 19 11:36:39 volumio1234 rc.local[2309]: opt = r Aug 19 11:36:39 volumio1234 rc.local[2309]: optarg = 90 Aug 19 11:36:39 volumio1234 rc.local[2309]: optind = 3 Aug 19 11:36:39 volumio1234 rc.local[2309]: argv[optind - 1] = 90 Aug 19 11:36:39 volumio1234 rc.local[2309]: opt = t Aug 19 11:36:39 volumio1234 rc.local[2309]: optarg = /dev/ttyAS2 Aug 19 11:36:39 volumio1234 rc.local[2309]: optind = 5 Aug 19 11:36:39 volumio1234 rc.local[2309]: argv[optind - 1] = /dev/ttyAS2 Aug 19 11:36:39 volumio1234 rc.local[2309]: tty driver /dev/ttyAS2 Aug 19 11:36:39 volumio1234 sshd[2288]: /etc/ssh/sshd_config line 6: Deprecated option UsePrivilegeSeparation Aug 19 11:36:39 volumio1234 sshd[2288]: /etc/ssh/sshd_config line 7: Deprecated option KeyRegenerationInterval Aug 19 11:36:39 volumio1234 sshd[2288]: /etc/ssh/sshd_config line 8: Deprecated option ServerKeyBits Aug 19 11:36:39 volumio1234 sshd[2288]: /etc/ssh/sshd_config line 14: Deprecated option RSAAuthentication Aug 19 11:36:39 volumio1234 sshd[2288]: /etc/ssh/sshd_config line 17: Deprecated option RhostsRSAAuthentication Aug 19 11:36:39 volumio1234 rc.local[2290]: websocket connect Aug 19 11:36:39 volumio1234 rc.local[2290]: Error: No active session Aug 19 11:36:39 volumio1234 rc.local[2290]: [2024-08-19 11:36:39] [info] asio async_connect error: asio.system:111 (Connection refused) Aug 19 11:36:39 volumio1234 rc.local[2290]: [2024-08-19 11:36:39] [info] Error getting remote endpoint: asio.system:107 (Transport endpoint is not connected) Aug 19 11:36:39 volumio1234 rc.local[2290]: [2024-08-19 11:36:39] [error] handle_connect error: Connection refused Aug 19 11:36:40 volumio1234 rc.local[2309]: SCREEN_SIZE_960X376 Aug 19 11:36:40 volumio1234 systemd[1]: Started Authorization Manager. Aug 19 11:36:40 volumio1234 polkitd[2305]: started daemon version 0.105 using authority implementation `local' version `0.105' Aug 19 11:36:40 volumio1234 rc.local[2333]: cat: /workdir/version.txt: No such file or directory Aug 19 11:36:40 volumio1234 dbus-daemon[2174]: [system] Successfully activated service 'org.freedesktop.PolicyKit1' Aug 19 11:36:40 volumio1234 sshd[2345]: /etc/ssh/sshd_config line 6: Deprecated option UsePrivilegeSeparation Aug 19 11:36:40 volumio1234 sshd[2345]: /etc/ssh/sshd_config line 7: Deprecated option KeyRegenerationInterval Aug 19 11:36:40 volumio1234 sshd[2345]: /etc/ssh/sshd_config line 8: Deprecated option ServerKeyBits Aug 19 11:36:40 volumio1234 sshd[2345]: /etc/ssh/sshd_config line 14: Deprecated option RSAAuthentication Aug 19 11:36:40 volumio1234 sshd[2345]: /etc/ssh/sshd_config line 17: Deprecated option RhostsRSAAuthentication Aug 19 11:36:40 volumio1234 sshd[2345]: Server listening on 0.0.0.0 port 22. Aug 19 11:36:40 volumio1234 sshd[2345]: Server listening on :: port 22. Aug 19 11:36:40 volumio1234 systemd[1]: Started OpenBSD Secure Shell server. Aug 19 11:36:40 volumio1234 avahi-daemon[2173]: Service "Volumio1234" (/services/volumio.service) successfully established. Aug 19 11:36:40 volumio1234 rc.local[2344]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:40 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk1p8 inserted Aug 19 11:36:40 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk0p1 inserted Aug 19 11:36:40 volumio1234 udisks-glue[2189]: Trying to automount /dev/mmcblk0p1... Aug 19 11:36:40 volumio1234 volumio[2192]: Could not open config: /tmp/upmpdcli.conf Aug 19 11:36:41 volumio1234 systemd[1]: upmpdcli.service: Main process exited, code=exited, status=1/FAILURE Aug 19 11:36:41 volumio1234 systemd[1]: upmpdcli.service: Failed with result 'exit-code'. Aug 19 11:36:41 volumio1234 rc.local[2347]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:41 volumio1234 kernel: FAT-fs (mmcblk0p1): Volume was not properly unmounted. Some data may be corrupt. Please run fsck. Aug 19 11:36:41 volumio1234 udisks-glue[2189]: Successfully automounted /dev/mmcblk0p1 at /media/Volumn Aug 19 11:36:41 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk0p4 inserted Aug 19 11:36:41 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk1p3 inserted Aug 19 11:36:41 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk0p7 inserted Aug 19 11:36:41 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk1p6 inserted Aug 19 11:36:41 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk0p2 inserted Aug 19 11:36:41 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk0 inserted Aug 19 11:36:41 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk1p1 inserted Aug 19 11:36:41 volumio1234 udisks-glue[2189]: Trying to automount /dev/mmcblk1p1... Aug 19 11:36:42 volumio1234 rc.local[2350]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:42 volumio1234 set-cpufreq[2186]: Setting ondemand scheduler for all CPUs Aug 19 11:36:42 volumio1234 systemd[1]: ondemand.service: Succeeded. Aug 19 11:36:42 volumio1234 rc.local[2361]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:43 volumio1234 kernel: FAT-fs (mmcblk1p1): Volume was not properly unmounted. Some data may be corrupt. Please run fsck. Aug 19 11:36:43 volumio1234 udisks-glue[2189]: Successfully automounted /dev/mmcblk1p1 at /media/Volumn_ Aug 19 11:36:43 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk0p5 inserted Aug 19 11:36:43 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk1p4 inserted Aug 19 11:36:43 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk0p8 inserted Aug 19 11:36:43 volumio1234 rc.local[2364]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:43 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk1p7 inserted Aug 19 11:36:43 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk1 inserted Aug 19 11:36:43 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk0p3 inserted Aug 19 11:36:43 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk1p2 inserted Aug 19 11:36:43 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk0p6 inserted Aug 19 11:36:43 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk0p1 mounted at /media/Volumn Aug 19 11:36:43 volumio1234 udisks-glue[2189]: Device file /dev/mmcblk1p1 mounted at /media/Volumn_ Aug 19 11:36:43 volumio1234 rc.local[2370]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:44 volumio1234 nmbd[2281]: [2024/08/19 11:36:44.473579, 0] ../../source3/nmbd/nmbd.c:901(main) Aug 19 11:36:44 volumio1234 nmbd[2281]: nmbd version 4.15.13-Ubuntu started. Aug 19 11:36:44 volumio1234 nmbd[2281]: Copyright Andrew Tridgell and the Samba Team 1992-2021 Aug 19 11:36:44 volumio1234 nmbd[2281]: [2024/08/19 11:36:44.554836, 0] ../../source3/nmbd/asyncdns.c:158(start_async_dns) Aug 19 11:36:44 volumio1234 rc.local[2372]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:44 volumio1234 nmbd[2281]: started asyncdns process 2373 Aug 19 11:36:44 volumio1234 systemd[1]: Started Samba NMB Daemon. Aug 19 11:36:44 volumio1234 systemd[1]: Starting Samba SMB Daemon... Aug 19 11:36:44 volumio1234 nmbd[2281]: [2024/08/19 11:36:44.657938, 0] ../../source3/nmbd/nmbd_namequery.c:109(query_name_response) Aug 19 11:36:44 volumio1234 nmbd[2281]: query_name_response: Multiple (2) responses received for a query on subnet 192.168.23.96 for name WORKGROUP<1d>. Aug 19 11:36:44 volumio1234 nmbd[2281]: This response was from IP 192.168.23.83, reporting an IP address of 192.168.23.83. Aug 19 11:36:44 volumio1234 rc.local[2290]: IP is 127.0.0.1 Aug 19 11:36:44 volumio1234 rc.local[2290]: Port is 57728 Aug 19 11:36:44 volumio1234 rc.local[2290]: 8 Aug 19 11:36:44 volumio1234 rc.local[2290]: [2024-08-19 11:36:44] [info] asio async_connect error: asio.system:111 (Connection refused) Aug 19 11:36:44 volumio1234 rc.local[2290]: [2024-08-19 11:36:44] [info] Error getting remote endpoint: asio.system:107 (Transport endpoint is not connected) Aug 19 11:36:44 volumio1234 rc.local[2290]: [2024-08-19 11:36:44] [error] handle_connect error: Connection refused Aug 19 11:36:45 volumio1234 systemd[1]: Started Dispatcher daemon for systemd-networkd. Aug 19 11:36:45 volumio1234 rc.local[2380]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:45 volumio1234 rc.local[2382]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:45 volumio1234 smbd[2376]: [2024/08/19 11:36:45.929646, 0] ../../source3/smbd/server.c:1734(main) Aug 19 11:36:45 volumio1234 smbd[2376]: smbd version 4.15.13-Ubuntu started. Aug 19 11:36:45 volumio1234 smbd[2376]: Copyright Andrew Tridgell and the Samba Team 1992-2021 Aug 19 11:36:46 volumio1234 rc.local[2387]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:46 volumio1234 systemd[1]: Started Samba SMB Daemon. Aug 19 11:36:47 volumio1234 rc.local[2390]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:47 volumio1234 rc.local[2393]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:48 volumio1234 wireless.js[2313]: WIRELESS: No wireless interface, exiting Aug 19 11:36:48 volumio1234 systemd[1]: wireless.service: Control process exited, code=exited, status=1/FAILURE Aug 19 11:36:48 volumio1234 systemd[1]: wireless.service: Failed with result 'exit-code'. Aug 19 11:36:48 volumio1234 systemd[1]: Failed to start Wireless Services. Aug 19 11:36:48 volumio1234 systemd[1]: Started Volumio Backend Module. Aug 19 11:36:48 volumio1234 kernel: usb 1-1.4: device descriptor read/64, error -110 Aug 19 11:36:48 volumio1234 mpd[2280]: config_file: config parameter "gapless_mp3_playback" on line 19 is deprecated Aug 19 11:36:48 volumio1234 mpd[2280]: config_file: config parameter "buffer_before_play" on line 85 is deprecated Aug 19 11:36:48 volumio1234 mpd[2280]: config_file: config parameter "id3v1_encoding" on line 99 is deprecated Aug 19 11:36:48 volumio1234 kernel: usb 1-1.4: new high-speed USB device number 5 using sunxi-ehci Aug 19 11:36:48 volumio1234 rc.local[2406]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:48 volumio1234 mpd[2280]: Aug 19 11:36 : exception: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Aug 19 11:36:48 volumio1234 mpd[2280]: Aug 19 11:36 : exception: Input plugin 'tidal' is unavailable: No Tidal application token configured Aug 19 11:36:48 volumio1234 mpd[2280]: Aug 19 11:36 : exception: Input plugin 'qobuz' is unavailable: No Qobuz app_id configured Aug 19 11:36:48 volumio1234 systemd[1]: Started Music Player Daemon. Aug 19 11:36:48 volumio1234 systemd[1]: Reached target Multi-User System. Aug 19 11:36:48 volumio1234 systemd[1]: Reached target Graphical Interface. Aug 19 11:36:48 volumio1234 systemd[1]: Starting Update UTMP about System Runlevel Changes... Aug 19 11:36:48 volumio1234 udisks-glue[2368]: Updating DB (#1) ... Aug 19 11:36:48 volumio1234 udisks-glue[2368]: volume: n/a repeat: off random: off single: off consume: off Aug 19 11:36:48 volumio1234 udisks-glue[2366]: Updating DB (#1) ... Aug 19 11:36:48 volumio1234 udisks-glue[2366]: volume: n/a repeat: off random: off single: off consume: off Aug 19 11:36:48 volumio1234 systemd[1]: systemd-update-utmp-runlevel.service: Succeeded. Aug 19 11:36:48 volumio1234 systemd[1]: Finished Update UTMP about System Runlevel Changes. Aug 19 11:36:48 volumio1234 systemd[1]: Startup finished in 4.343s (kernel) + 19.682s (userspace) = 24.025s. Aug 19 11:36:49 volumio1234 rc.local[2414]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:49 volumio1234 rc.local[2416]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:50 volumio1234 rc.local[2418]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:51 volumio1234 rc.local[2420]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:51 volumio1234 rc.local[2422]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:52 volumio1234 rc.local[2290]: [2024-08-19 11:36:52] [info] asio async_connect error: asio.system:111 (Connection refused) Aug 19 11:36:52 volumio1234 rc.local[2290]: [2024-08-19 11:36:52] [info] Error getting remote endpoint: asio.system:107 (Transport endpoint is not connected) Aug 19 11:36:52 volumio1234 rc.local[2290]: [2024-08-19 11:36:52] [error] handle_connect error: Connection refused Aug 19 11:36:52 volumio1234 rc.local[2424]: curl: (7) Failed to connect to 127.0.0.1 port 3000: Connection refused Aug 19 11:36:53 volumio1234 kernel: usb 1-1.4: device descriptor read/64, error -110 Aug 19 11:36:54 volumio1234 volumio[2398]: info: ------------------------------------------- Aug 19 11:36:54 volumio1234 volumio[2398]: info: ----- Volumio2 ---- Aug 19 11:36:54 volumio1234 volumio[2398]: info: ------------------------------------------- Aug 19 11:36:54 volumio1234 volumio[2398]: info: ----- System startup ---- Aug 19 11:36:54 volumio1234 volumio[2398]: info: ------------------------------------------- Aug 19 11:36:56 volumio1234 volumio[2398]: info: File /data/configuration/plugins.json does not exist. Copying from Volumio Aug 19 11:36:57 volumio1234 volumio[2398]: info: Plugin folders cleanup Aug 19 11:36:57 volumio1234 volumio[2398]: info: Scanning into folder /volumio/app/plugins/ Aug 19 11:36:57 volumio1234 volumio[2398]: info: Scanning category audio_interface Aug 19 11:36:57 volumio1234 volumio[2398]: info: Scanning category miscellanea Aug 19 11:36:57 volumio1234 volumio[2398]: info: Scanning category music_service Aug 19 11:36:57 volumio1234 volumio[2398]: info: Scanning category plugins.json Aug 19 11:36:57 volumio1234 volumio[2398]: info: Scanning category system_controller Aug 19 11:36:57 volumio1234 volumio[2398]: info: Scanning category user_interface Aug 19 11:36:57 volumio1234 volumio[2398]: info: Scanning into folder /data/plugins/ Aug 19 11:36:57 volumio1234 volumio[2398]: info: Plugin folders cleanup completed Aug 19 11:36:57 volumio1234 volumio[2398]: info: ------------------------------------------- Aug 19 11:36:57 volumio1234 volumio[2398]: info: ----- Core plugins startup ---- Aug 19 11:36:57 volumio1234 volumio[2398]: info: ------------------------------------------- Aug 19 11:36:57 volumio1234 volumio[2398]: info: Loading plugins from folder /volumio/app/plugins/ Aug 19 11:36:57 volumio1234 volumio[2398]: info: Adding plugin upnp to MyMusic Plugins Aug 19 11:36:57 volumio1234 volumio[2398]: info: Adding plugin airplay_emulation to MyMusic Plugins Aug 19 11:36:57 volumio1234 volumio[2398]: info: Adding plugin upnp_browser to MyMusic Plugins Aug 19 11:36:57 volumio1234 volumio[2398]: info: Loading plugins from folder /data/plugins/ Aug 19 11:36:57 volumio1234 volumio[2398]: info: Loading plugin "system"... Aug 19 11:36:57 volumio1234 volumio[2398]: No id defined. Creating one Aug 19 11:36:57 volumio1234 volumio[2398]: info: Loading plugin "appearance"... Aug 19 11:36:58 volumio1234 kernel: usb0-vbus: disabling Aug 19 11:37:03 volumio1234 rc.local[2290]: [2024-08-19 11:37:03] [connect] Successful connection Aug 19 11:37:05 volumio1234 volumio[2398]: info: Loading plugin "network"... Aug 19 11:37:05 volumio1234 volumio[2398]: info: Refreshing Cached IP Addresses Aug 19 11:37:05 volumio1234 sudo[2438]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Aug 19 11:37:05 volumio1234 volumio[2398]: info: Loading plugin "services"... Aug 19 11:37:05 volumio1234 volumio[2398]: info: Loading plugin "alsa_controller"... Aug 19 11:37:05 volumio1234 sudo[2442]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Aug 19 11:37:05 volumio1234 sudo[2438]: pam_unix(sudo:session): session opened for user root by (uid=0) Aug 19 11:37:05 volumio1234 sudo[2444]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/hostapd/hostapd.conf Aug 19 11:37:05 volumio1234 sudo[2442]: pam_unix(sudo:session): session opened for user root by (uid=0) Aug 19 11:37:05 volumio1234 sudo[2438]: pam_unix(sudo:session): session closed for user root Aug 19 11:37:05 volumio1234 sudo[2444]: pam_unix(sudo:session): session opened for user root by (uid=0) Aug 19 11:37:05 volumio1234 sudo[2444]: pam_unix(sudo:session): session closed for user root Aug 19 11:37:05 volumio1234 sudo[2442]: pam_unix(sudo:session): session closed for user root Aug 19 11:37:06 volumio1234 volumio[2398]: info: Loading plugin "wizard"... Aug 19 11:37:06 volumio1234 volumio[2398]: info: Loading plugin "volumio_command_line_client"... Aug 19 11:37:06 volumio1234 volumio[2398]: info: Loading plugin "upnp"... Aug 19 11:37:06 volumio1234 volumio[2398]: info: [1724038626157] Starting Upmpd Daemon Aug 19 11:37:06 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Aug 19 11:37:06 volumio1234 volumio[2398]: info: Loading plugin "my_music"... Aug 19 11:37:06 volumio1234 volumio[2398]: info: Loading plugin "mpd"... Aug 19 11:37:07 volumio1234 volumio[2398]: info: Loading plugin "upnp_browser"... Aug 19 11:37:08 volumio1234 volumio[2398]: info: Loading plugin "networkfs"... Aug 19 11:37:09 volumio1234 kernel: usb 1-1.4: device descriptor read/64, error -110 Aug 19 11:37:09 volumio1234 kernel: usb 1-1-port4: attempt power cycle Aug 19 11:37:09 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Aug 19 11:37:09 volumio1234 volumio[2398]: info: Loading plugin "alarm-clock"... Aug 19 11:37:09 volumio1234 kernel: usb 1-1.4: new high-speed USB device number 6 using sunxi-ehci Aug 19 11:37:10 volumio1234 volumio[2398]: info: Loading plugin "airplay_emulation"... Aug 19 11:37:10 volumio1234 volumio[2398]: info: Starting Shairport Sync Aug 19 11:37:10 volumio1234 volumio[2398]: info: Loading plugin "last_100"... Aug 19 11:37:10 volumio1234 volumio[2398]: info: Loading plugin "webradio"... Aug 19 11:37:10 volumio1234 volumio[2398]: info: Plugin youtube2 is not enabled Aug 19 11:37:10 volumio1234 volumio[2398]: info: Loading plugin "i2s_dacs"... Aug 19 11:37:10 volumio1234 volumio[2398]: info: I2S DAC not set, start Auto-detection Aug 19 11:37:10 volumio1234 volumio[2398]: info: Loading plugin "volumiodiscovery"... Aug 19 11:37:11 volumio1234 volumio[2398]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Aug 19 11:37:11 volumio1234 volumio[2398]: *** WARNING *** Please fix your application to use the native API of Avahi! Aug 19 11:37:11 volumio1234 node[2398]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Aug 19 11:37:11 volumio1234 volumio[2398]: *** WARNING *** For more information see Aug 19 11:37:11 volumio1234 volumio[2398]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Aug 19 11:37:11 volumio1234 volumio[2398]: *** WARNING *** Please fix your application to use the native API of Avahi! Aug 19 11:37:11 volumio1234 volumio[2398]: *** WARNING *** For more information see Aug 19 11:37:11 volumio1234 node[2398]: *** WARNING *** Please fix your application to use the native API of Avahi! Aug 19 11:37:11 volumio1234 node[2398]: *** WARNING *** For more information see Aug 19 11:37:11 volumio1234 node[2398]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Aug 19 11:37:11 volumio1234 node[2398]: *** WARNING *** Please fix your application to use the native API of Avahi! Aug 19 11:37:11 volumio1234 node[2398]: *** WARNING *** For more information see Aug 19 11:37:11 volumio1234 volumio[2398]: Discovery: StartAdv! undefined Aug 19 11:37:11 volumio1234 volumio[2398]: Discovery: Started advertising... Volumio - undefined Aug 19 11:37:11 volumio1234 volumio[2398]: Name conflict due to Shairport Sync, discarding error Aug 19 11:37:11 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Aug 19 11:37:11 volumio1234 volumio[2398]: info: Loading plugin "outputs"... Aug 19 11:37:11 volumio1234 volumio[2398]: info: Loading plugin "albumart"... Aug 19 11:37:11 volumio1234 volumio[2398]: info: Plugin example_plugin is not enabled Aug 19 11:37:11 volumio1234 volumio[2398]: info: Loading plugin "inputs"... Aug 19 11:37:11 volumio1234 volumio[2398]: info: Loading plugin "pandora"... Aug 19 11:37:12 volumio1234 volumio[2398]: info: Loading plugin "qobuz"... Aug 19 11:37:12 volumio1234 volumio[2398]: error: ATTENTION!!!: Plugin qobuz does not return adequate promise from onVolumioStart: please update! Aug 19 11:37:12 volumio1234 volumio[2398]: info: Loading plugin "tidal"... Aug 19 11:37:13 volumio1234 volumio[2398]: info: [1724038633503] ControllerTidalPlugin::constructor Aug 19 11:37:13 volumio1234 volumio[2398]: info: [1724038633506] ControllerTidalPlugin::onVolumioStart Aug 19 11:37:13 volumio1234 volumio[2398]: info: Loading plugin "volspotconnect2"... Aug 19 11:37:15 volumio1234 volumio[2398]: [SpotifyConnect2] Creating VLS config file Aug 19 11:37:15 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:15 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:15 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:15 volumio1234 volumio[2398]: [SpotifyConnect2] <> or Mixer found, using softvol Aug 19 11:37:15 volumio1234 volumio[2398]: info: Loading plugin "updater_comm"... Aug 19 11:37:16 volumio1234 volumio[2398]: info: Plugin mpdemulation is not enabled Aug 19 11:37:16 volumio1234 volumio[2398]: info: Loading plugin "rest_api"... Aug 19 11:37:16 volumio1234 volumio[2398]: info: Loading plugin "websocket"... Aug 19 11:37:16 volumio1234 volumio[2398]: info: ___________ START PLUGINS ___________ Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Aug 19 11:37:16 volumio1234 volumio[2398]: info: [1724038636275] CoreMusicLibrary::Adding element Media Servers Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Aug 19 11:37:16 volumio1234 volumio[2398]: info: [1724038636461] CoreMusicLibrary::Adding element Last_100 Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Aug 19 11:37:16 volumio1234 volumio[2398]: info: [1724038636469] CoreMusicLibrary::Adding element Webradio Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Aug 19 11:37:16 volumio1234 volumio[2398]: info: [1724038636495] CoreMusicLibrary::Adding element Pandora Radio Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Aug 19 11:37:16 volumio1234 volumio[2398]: info: [1724038636501] ControllerPandora::initializeMQTT Aug 19 11:37:16 volumio1234 volumio[2398]: info: [1724038636503] [Pandora] initializeMQTT: MQTT is not enabled in Plugin Configuration Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Aug 19 11:37:16 volumio1234 volumio[2398]: info: [1724038636507] CoreMusicLibrary::Adding element Qobuz Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Aug 19 11:37:16 volumio1234 volumio[2398]: info: [1724038636524] ControllerTidalPlugin::onStart Aug 19 11:37:16 volumio1234 volumio[2398]: info: [1724038636526] ControllerTidalPlugin::addToBrowseSources Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Aug 19 11:37:16 volumio1234 volumio[2398]: info: [1724038636528] CoreMusicLibrary::Adding element Tidal Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Aug 19 11:37:16 volumio1234 volumio[2398]: Loading session from tidal-session-oauth.json... Aug 19 11:37:16 volumio1234 volumio[2398]: Could not load session from tidal-session-oauth.json: Error: ENOENT: no such file or directory, open 'tidal-session-oauth.json' Aug 19 11:37:16 volumio1234 volumio[2398]: [SpotifyConnect2] Creating VLS config file Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: [SpotifyConnect2] <> or Mixer found, using softvol Aug 19 11:37:16 volumio1234 volumio[2398]: [SpotifyConnect2] Starting metadata listener Aug 19 11:37:16 volumio1234 sudo[2489]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start volspotconnect2.service Aug 19 11:37:16 volumio1234 volumio[2398]: info: Loading i18n strings for locale en Aug 19 11:37:16 volumio1234 volumio[2398]: Updating browse sources language Aug 19 11:37:16 volumio1234 volumio[2398]: Cannot find translation for sourceMedia Servers Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Aug 19 11:37:16 volumio1234 sudo[2489]: pam_unix(sudo:session): session opened for user root by (uid=0) Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::initPlayerControls Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Aug 19 11:37:16 volumio1234 sudo[2489]: pam_unix(sudo:session): session closed for user root Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: info: BOOT COMPLETED Aug 19 11:37:16 volumio1234 volumio[2398]: [Metrics] CommandRouter: 22s 172.64ms Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Aug 19 11:37:16 volumio1234 volumio[2398]: ALSA lib pcm.c:2642:(snd_pcm_open_noupdate) Unknown PCM softvolume Aug 19 11:37:16 volumio1234 volumio[2398]: aplay: main:852: audio open error: No such file or directory Aug 19 11:37:16 volumio1234 volumio[2398]: Cannot play startup sound Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::Close All Modals sent Aug 19 11:37:16 volumio1234 volumio[2398]: info: CoreCommandRouter::Close All Modals sent Aug 19 11:37:16 volumio1234 volumio[2398]: Express server listening on port 3000 Aug 19 11:37:16 volumio1234 volumio[2398]: [Metrics] WebUI: 24s 260.22ms Aug 19 11:37:17 volumio1234 volumio[2398]: info: [1724038637042] ControllerPandora::validateAndSetAccountOptions Aug 19 11:37:17 volumio1234 volumio[2398]: error: [1724038637045] [Pandora] validateAndSetAccountOptions: Need email address and password. See plugin settings. Aug 19 11:37:17 volumio1234 volumio[2398]: info: CoreStateMachine::resetVolumioState Aug 19 11:37:17 volumio1234 volumio[2398]: info: CoreStateMachine::getcurrentVolume Aug 19 11:37:17 volumio1234 volumio[2398]: info: CoreCommandRouter::volumioRetrievevolume Aug 19 11:37:17 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Aug 19 11:37:17 volumio1234 sudo[2513]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Aug 19 11:37:17 volumio1234 volumio[2398]: error: Cannot read config.txt file: Error: ENOENT: no such file or directory, open '/boot/config.txt' Aug 19 11:37:17 volumio1234 volumio[2398]: info: Cannot read play queue from file Aug 19 11:37:17 volumio1234 sudo[2513]: pam_unix(sudo:session): session opened for user root by (uid=0) Aug 19 11:37:17 volumio1234 sudo[2515]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Aug 19 11:37:17 volumio1234 sudo[2515]: pam_unix(sudo:session): session opened for user root by (uid=0) Aug 19 11:37:17 volumio1234 sudo[2513]: pam_unix(sudo:session): session closed for user root Aug 19 11:37:17 volumio1234 sudo[2515]: pam_unix(sudo:session): session closed for user root Aug 19 11:37:17 volumio1234 volumio[2398]: info: CoreStateMachine::pushState Aug 19 11:37:17 volumio1234 volumio[2398]: info: CoreCommandRouter::volumioPushState Aug 19 11:37:17 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Aug 19 11:37:17 volumio1234 volumio[2398]: info: CoreStateMachine::updateTrackBlock Aug 19 11:37:17 volumio1234 volumio[2398]: info: CorePlayQueue::getTrackBlock Aug 19 11:37:17 volumio1234 volumio[2398]: info: CoreCommandRouter::volumioRetrievevolume Aug 19 11:37:17 volumio1234 volumio[2398]: [SpotifyConnect2] Vollibrespot Daemon service started! Aug 19 11:37:17 volumio1234 volumio[2398]: [Metrics] SpotifyConnect: 1s 361.73ms Aug 19 11:37:18 volumio1234 volumio[2398]: info: MPD running with PID2280 Aug 19 11:37:18 volumio1234 volumio[2398]: ,establishing connection Aug 19 11:37:18 volumio1234 volumio[2398]: info: Permissions for /etc/hostapd/hostapd.conf Aug 19 11:37:18 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkAudioDeviceAvailable Aug 19 11:37:18 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Aug 19 11:37:18 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: system , versionChangeDetect Aug 19 11:37:18 volumio1234 sudo[2552]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart wireless.service Aug 19 11:37:18 volumio1234 sudo[2552]: pam_unix(sudo:session): session opened for user root by (uid=0) Aug 19 11:37:18 volumio1234 systemd[1]: Starting Wireless Services... Aug 19 11:37:18 volumio1234 volumio[2398]: info: CoreStateMachine::pushState Aug 19 11:37:18 volumio1234 volumio[2398]: info: CoreCommandRouter::volumioPushState Aug 19 11:37:18 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Aug 19 11:37:18 volumio1234 sudo[2560]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw dev wlan0 set power_save off Aug 19 11:37:18 volumio1234 sudo[2560]: pam_unix(sudo:session): session opened for user root by (uid=0) Aug 19 11:37:18 volumio1234 wifistart.sh[2565]: command failed: No such device (-19) Aug 19 11:37:18 volumio1234 sudo[2560]: pam_unix(sudo:session): session closed for user root Aug 19 11:37:18 volumio1234 rc.local[2290]: command_len 9 Aug 19 11:37:18 volumio1234 rc.local[2290]: getQueue Aug 19 11:37:18 volumio1234 rc.local[2290]: Aug 19 11:37:18 volumio1234 volumio[2398]: info: Aug 19 11:37:18 volumio1234 volumio[2398]: ---------------------------- Client requests Volume 100 Aug 19 11:37:18 volumio1234 volumio[2398]: info: VolumeController::SetAlsaVolume100 Aug 19 11:37:18 volumio1234 volumio[2398]: info: CoreStateMachine::pushState Aug 19 11:37:18 volumio1234 volumio[2398]: info: CoreCommandRouter::volumioPushState Aug 19 11:37:18 volumio1234 volumio[2398]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Aug 19 11:37:19 volumio1234 volumio[2398]: info: Cannot read I2C interface or I2C interface not presentError: Command failed: /usr/bin/sudo /usr/sbin/i2cdetect -y 1 Aug 19 11:37:19 volumio1234 volumio[2398]: sudo: /usr/sbin/i2cdetect: command not found Aug 19 11:37:19 volumio1234 volumio[2398]: error: updateQueue error: null Aug 19 11:37:19 volumio1234 volumio[2540]: Forking 1 albumart workers Aug 19 11:37:20 volumio1234 volumio[2398]: error: Cannot set ALSA Volume: Error: Alsa Mixer Error: amixer: Unable to find simple control 'SoftMaster',0 Aug 19 11:37:20 volumio1234 volumio[2398]: info: Setting volume on startup at 100 Aug 19 11:37:20 volumio1234 volumio[2398]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Aug 19 11:37:20 volumio1234 volumio[2398]: TypeError: Cannot read property 'UUID' of undefined Aug 19 11:37:20 volumio1234 volumio[2398]: at Browser. (/volumio/app/plugins/system_controller/volumiodiscovery/index.js:172:53) Aug 19 11:37:20 volumio1234 volumio[2398]: at Browser.emit (events.js:198:13) Aug 19 11:37:20 volumio1234 volumio[2398]: at on_resolver_done (/volumio/node_modules/mdns/lib/browser.js:31:14) Aug 19 11:37:20 volumio1234 volumio[2398]: at next (/volumio/node_modules/mdns/lib/browser.js:106:7) Aug 19 11:37:20 volumio1234 volumio[2398]: at /volumio/node_modules/mdns/lib/resolver_sequence_tasks.js:160:11 Aug 19 11:37:20 volumio1234 volumio[2398]: at getaddrinfo_complete (/volumio/node_modules/mdns/lib/resolver_sequence_tasks.js:108:7) Aug 19 11:37:20 volumio1234 volumio[2398]: at GetAddrInfoReqWrap.oncomplete (/volumio/node_modules/mdns/lib/resolver_sequence_tasks.js:120:9) Aug 19 11:37:20 volumio1234 volumio[2398]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Aug 19 11:37:20 volumio1234 kernel: usb 1-1.4: device not accepting address 6, error -110 Aug 19 11:37:20 volumio1234 kernel: usb 1-1.4: new high-speed USB device number 7 using sunxi-ehci Aug 19 11:37:21 volumio1234 wireless.js[2571]: WIRELESS: No wireless interface, exiting Aug 19 11:37:21 volumio1234 systemd[1]: wireless.service: Control process exited, code=exited, status=1/FAILURE Aug 19 11:37:21 volumio1234 systemd[1]: wireless.service: Failed with result 'exit-code'. Aug 19 11:37:21 volumio1234 systemd[1]: Failed to start Wireless Services. Aug 19 11:37:21 volumio1234 sudo[2552]: pam_unix(sudo:session): session closed for user root Aug 19 11:37:22 volumio1234 volumio[2583]: Starting albumart workers Aug 19 11:37:23 volumio1234 sudo[2606]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-08-19 11:36 Aug 19 11:37:23 volumio1234 sudo[2606]: pam_unix(sudo:session): session opened for user root by (uid=0) NAME="Ubuntu" VERSION="20.04.5 LTS (Focal Fossa)" ID=ubuntu ID_LIKE=debian PRETTY_NAME="Ubuntu 20.04.5 LTS" VERSION_ID="20.04" HOME_URL="https://www.ubuntu.com/" SUPPORT_URL="https://help.ubuntu.com/" BUG_REPORT_URL="https://bugs.launchpad.net/ubuntu/" PRIVACY_POLICY_URL="https://www.ubuntu.com/legal/terms-and-policies/privacy-policy" VERSION_CODENAME=focal UBUNTU_CODENAME=focal VOLUMIO_BUILD_VERSION="" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_BE_VERSION="3e944f35d34b575025d16b976b4cb4d9aed53b66" VOLUMIO_ARCH="armv7"