-- Logs begin at Fri 2021-10-01 10:12:00 UTC, end at Sat 2024-11-30 16:45:00 UTC. -- Nov 30 16:44:00 volumio volumio[686]: info: CoreCommandRouter::executeOnPlugin: mpd , restartMpd Nov 30 16:44:00 volumio sudo[1870]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Nov 30 16:44:00 volumio sudo[1870]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:01 volumio volumio[686]: info: VolumeController::SetAlsaVolumeNaN Nov 30 16:44:01 volumio volumio[686]: info: CoreStateMachine::pushState Nov 30 16:44:01 volumio volumio[686]: info: CorePlayQueue::getTrack 0 Nov 30 16:44:01 volumio volumio[686]: info: CoreCommandRouter::volumioPushState Nov 30 16:44:01 volumio volumio[686]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 30 16:44:02 volumio systemd[1]: Starting Music Player Daemon... Nov 30 16:44:06 volumio systemd[1]: Started Music Player Daemon. Nov 30 16:44:06 volumio sudo[1721]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:06 volumio sudo[1804]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:06 volumio sudo[1734]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:06 volumio sudo[1870]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:06 volumio volumio[686]: error: MPD error: false == true Nov 30 16:44:06 volumio volumio[686]: error: MPD error: false == true Nov 30 16:44:06 volumio volumio[686]: error: MPD error: false == true Nov 30 16:44:06 volumio volumio[686]: error: updateQueue error: null Nov 30 16:44:11 volumio volumio[686]: error: MPD error: false == true Nov 30 16:44:11 volumio volumio[686]: error: updateQueue error: null Nov 30 16:44:11 volumio volumio[686]: error: updateQueue error: null Nov 30 16:44:15 volumio volumio[686]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 30 16:44:15 volumio volumio[686]: /bin/cat: /sys/class/net/wlan0/flags: No such file or directory Nov 30 16:44:15 volumio volumio[686]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Nov 30 16:44:15 volumio volumio[686]: info: CoreCommandRouter::executeOnPlugin: network , getInfoNetwork Nov 30 16:44:15 volumio sudo[1903]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ethtool eth0 Nov 30 16:44:15 volumio sudo[1903]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:15 volumio sudo[1908]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Nov 30 16:44:15 volumio sudo[1908]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:15 volumio sudo[1903]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:15 volumio sudo[1915]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Nov 30 16:44:15 volumio sudo[1915]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:15 volumio sudo[1920]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Nov 30 16:44:15 volumio sudo[1920]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:15 volumio volumio[686]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworksScanCache Nov 30 16:44:15 volumio volumio[686]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworks Nov 30 16:44:15 volumio sudo[1915]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:15 volumio sudo[1908]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:15 volumio sudo[1929]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Nov 30 16:44:15 volumio sudo[1929]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:15 volumio sudo[1929]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:15 volumio sudo[1949]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Nov 30 16:44:15 volumio sudo[1949]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:15 volumio sudo[1920]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:16 volumio sudo[1955]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Nov 30 16:44:16 volumio sudo[1955]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:16 volumio sudo[1949]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:16 volumio sudo[1955]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:16 volumio volumio[686]: error: An error occurred while scanning: Error: Command failed: sudo /sbin/iwlist wlan0 scan Nov 30 16:44:16 volumio volumio[686]: wlan0 Interface doesn't support scanning. Nov 30 16:44:16 volumio volumio[686]: info: Cannot use regular scanning, forcing with ap-force Nov 30 16:44:16 volumio sudo[1970]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw dev wlan0 scan ap-force Nov 30 16:44:16 volumio sudo[1970]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:16 volumio sudo[1970]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:16 volumio volumio[686]: command failed: No such device (-19) Nov 30 16:44:16 volumio volumio[686]: error: Cannot use fallback scanning method: Error: Command failed: /usr/bin/sudo /sbin/iw dev wlan0 scan ap-force Nov 30 16:44:16 volumio volumio[686]: command failed: No such device (-19) Nov 30 16:44:16 volumio volumio[686]: error: updateQueue error: null Nov 30 16:44:45 volumio volumio[686]: info: CALLMETHOD: system_controller network saveWirelessNet [object Object] Nov 30 16:44:45 volumio volumio[686]: info: CoreCommandRouter::executeOnPlugin: network , saveWirelessNet Nov 30 16:44:45 volumio sudo[2038]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/network/interfaces Nov 30 16:44:45 volumio sudo[2038]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:45 volumio sudo[2038]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:45 volumio sudo[2040]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/dhcpcd.conf Nov 30 16:44:45 volumio sudo[2040]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:45 volumio sudo[2040]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:45 volumio volumio[686]: info: Permissions for /etc/network/interfaces set Nov 30 16:44:45 volumio sudo[2043]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart wireless.service Nov 30 16:44:45 volumio sudo[2043]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:45 volumio sudo[2045]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/ip addr flush dev eth0 Nov 30 16:44:45 volumio sudo[2045]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:45 volumio systemd[1]: Starting Wireless Services... Nov 30 16:44:46 volumio avahi-daemon[552]: Withdrawing address record for 192.168.0.139 on eth0. Nov 30 16:44:46 volumio avahi-daemon[552]: Leaving mDNS multicast group on interface eth0.IPv4 with address 192.168.0.139. Nov 30 16:44:46 volumio avahi-daemon[552]: Interface eth0.IPv4 no longer relevant for mDNS. Nov 30 16:44:46 volumio sudo[2045]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:46 volumio kernel: ec_netdev_set_multicast_list 2741 Nov 30 16:44:46 volumio volumio[686]: info: mDNS: A device disapperared from network Nov 30 16:44:46 volumio sudo[2049]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw dev wlan0 set power_save off Nov 30 16:44:46 volumio sudo[2049]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:46 volumio volumio[686]: info: mDNS: Device volumio disapperared from network Nov 30 16:44:46 volumio sudo[2050]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 down Nov 30 16:44:46 volumio dhcpcd[786]: eth0: removing IP address 192.168.0.139/24 Nov 30 16:44:46 volumio dhcpcd[786]: eth0: removing route to 192.168.0.0/24 Nov 30 16:44:46 volumio sudo[2050]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:46 volumio sudo[2049]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:46 volumio wifistart.sh[2048]: command failed: No such device (-19) Nov 30 16:44:46 volumio kernel: ec_netdev_set_multicast_list 2741 Nov 30 16:44:46 volumio kernel: ec_netdev_close 2374 Nov 30 16:44:46 volumio dhcpcd[786]: eth0: carrier lost Nov 30 16:44:46 volumio dhcpcd[786]: eth0: deleting host route to 192.168.0.139 via 127.0.0.1 Nov 30 16:44:46 volumio dhcpcd[786]: eth0: deleting default route via 192.168.0.1 Nov 30 16:44:46 volumio sudo[2050]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:46 volumio sudo[2061]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 up Nov 30 16:44:46 volumio sudo[2061]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:46 volumio sudo[2061]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:46 volumio kernel: phy_reg_set_bits 339 write reg_val:0xb100 Nov 30 16:44:46 volumio kernel: phy_reg_set_bits 342 write after read reg_val:0x3100 Nov 30 16:44:46 volumio kernel: MII_ADVERTISE: 0x01e1 Nov 30 16:44:46 volumio kernel: phy_init 442 MII_BMCR: 0x3100 Nov 30 16:44:46 volumio kernel: phy_reg_set_bits 339 write reg_val:0x3300 Nov 30 16:44:46 volumio kernel: phy_reg_set_bits 342 write after read reg_val:0x3100 Nov 30 16:44:46 volumio kernel: start aneg... Nov 30 16:44:46 volumio kernel: phy_init 447 MII_BMCR: 0x3100 Nov 30 16:44:46 volumio kernel: link status is: false Nov 30 16:44:46 volumio kernel: eth0 link off. Nov 30 16:44:46 volumio kernel: IRQ 32 requested Nov 30 16:44:46 volumio kernel: ec_netdev_set_multicast_list 2741 Nov 30 16:44:46 volumio kernel: ec_netdev_set_multicast_list 2741 Nov 30 16:44:46 volumio kernel: ec_netdev_set_multicast_list 2741 Nov 30 16:44:46 volumio kernel: ec_netdev_set_multicast_list 2741 Nov 30 16:44:46 volumio kernel: IPv6: ADDRCONF(NETDEV_UP): eth0: link is not ready Nov 30 16:44:46 volumio dhcpcd[786]: eth0: carrier acquired Nov 30 16:44:46 volumio dhcpcd[786]: eth0: carrier lost Nov 30 16:44:46 volumio dhcpcd[786]: eth0: waiting for carrier Nov 30 16:44:46 volumio wireless.js[2060]: WIRELESS: No wireless interface, exiting Nov 30 16:44:46 volumio systemd[1]: wireless.service: control process exited, code=exited status=1 Nov 30 16:44:46 volumio systemd[1]: Failed to start Wireless Services. Nov 30 16:44:46 volumio systemd[1]: Unit wireless.service entered failed state. Nov 30 16:44:46 volumio sudo[2043]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:47 volumio ifplugd(eth0)[602]: Link beat lost. Nov 30 16:44:47 volumio ntpd[634]: Deleting interface #3 eth0, 192.168.0.139#123, interface stats: received=43, sent=46, dropped=0, active_time=280 secs Nov 30 16:44:47 volumio ntpd[634]: 123.204.232.128 interface 192.168.0.139 -> (none) Nov 30 16:44:47 volumio ntpd[634]: 183.177.72.202 interface 192.168.0.139 -> (none) Nov 30 16:44:47 volumio ntpd[634]: 218.35.163.245 interface 192.168.0.139 -> (none) Nov 30 16:44:47 volumio ntpd[634]: 210.243.152.152 interface 192.168.0.139 -> (none) Nov 30 16:44:47 volumio ntpd[634]: peers refreshed Nov 30 16:44:49 volumio nmbd[721]: [2024/11/30 16:44:49.362257, 0] ../source3/nmbd/nmbd.c:362(reload_interfaces) Nov 30 16:44:49 volumio nmbd[721]: reload_interfaces: No subnets to listen to. Waiting.. Nov 30 16:44:53 volumio dhcpcd[786]: eth0: carrier acquired Nov 30 16:44:53 volumio kernel: ethernet link state:disconnected Nov 30 16:44:53 volumio kernel: exit Nov 30 16:44:53 volumio kernel: ecp->autoneg:1 autoneg -> speed:100, duplex:full, pause: non-supported Nov 30 16:44:53 volumio kernel: set_mac_according_aneg Nov 30 16:44:53 volumio kernel: opmode regs old value - 0x2202 Nov 30 16:44:53 volumio kernel: old MII_BMCR: 0x3100 Nov 30 16:44:53 volumio kernel: new MII_BMCR: 0x3100 Nov 30 16:44:53 volumio kernel: hw_regs->er_opmode:0x2202 Nov 30 16:44:53 volumio kernel: link established. Nov 30 16:44:53 volumio kernel: ethernet link state:linked Nov 30 16:44:53 volumio kernel: IPv6: ADDRCONF(NETDEV_CHANGE): eth0: link becomes ready Nov 30 16:44:53 volumio kernel: ec_netdev_set_multicast_list 2741 Nov 30 16:44:53 volumio dhcpcd[786]: eth0: soliciting an IPv6 router Nov 30 16:44:53 volumio dhcpcd[786]: eth0: soliciting a DHCP lease Nov 30 16:44:53 volumio dhcpcd[786]: eth0: offered 192.168.0.139 from 192.168.0.1 Nov 30 16:44:54 volumio ifplugd(eth0)[602]: Link beat detected. Nov 30 16:44:56 volumio volumio[686]: info: CoreCommandRouter::executeOnPlugin: upnp , onRestart Nov 30 16:44:56 volumio volumio[686]: info: CoreCommandRouter::executeOnPlugin: network , onNetworkingRestart Nov 30 16:44:56 volumio volumio[686]: info: Refreshing Cached IP Addresses Nov 30 16:44:56 volumio sudo[2138]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/killall upmpdcli Nov 30 16:44:56 volumio sudo[2138]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:56 volumio sudo[2140]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Nov 30 16:44:56 volumio sudo[2140]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:56 volumio sudo[2140]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:56 volumio sudo[2138]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:56 volumio sudo[2143]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Nov 30 16:44:56 volumio sudo[2143]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 30 16:44:56 volumio sudo[2143]: pam_unix(sudo:session): session closed for user root Nov 30 16:44:58 volumio dhcpcd[786]: eth0: leased 192.168.0.139 for 7200 seconds Nov 30 16:44:58 volumio dhcpcd[786]: eth0: adding host route to 192.168.0.139 via 127.0.0.1 Nov 30 16:44:58 volumio avahi-daemon[552]: Joining mDNS multicast group on interface eth0.IPv4 with address 192.168.0.139. Nov 30 16:44:58 volumio dhcpcd[786]: eth0: adding route to 192.168.0.0/24 Nov 30 16:44:58 volumio avahi-daemon[552]: New relevant interface eth0.IPv4 for mDNS. Nov 30 16:44:58 volumio dhcpcd[786]: eth0: adding default route via 192.168.0.1 Nov 30 16:44:58 volumio avahi-daemon[552]: Registering new address record for 192.168.0.139 on eth0.IPv4. Nov 30 16:44:58 volumio kernel: ec_netdev_set_multicast_list 2741 Nov 30 16:44:59 volumio volumio[686]: Discovery: adding a7f52336-ddeb-4641-bd4f-0a08a827afe0 Nov 30 16:44:59 volumio volumio[686]: info: mDNS: Found device Volumio Nov 30 16:44:59 volumio volumio[686]: info: CoreCommandRouter::volumioGetState Nov 30 16:44:59 volumio volumio[686]: info: CorePlayQueue::getTrack 0 Nov 30 16:44:59 volumio volumio[686]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Nov 30 16:44:59 volumio volumio[686]: Error: The value NaN is not a number Nov 30 16:44:59 volumio volumio[686]: at Config.forceToType (/volumio/node_modules/v-conf/index.js:323:20) Nov 30 16:44:59 volumio volumio[686]: at Config.set (/volumio/node_modules/v-conf/index.js:154:25) Nov 30 16:44:59 volumio volumio[686]: at ControllerVolumioDiscovery.pushMultiRoomStatusUpdate (/volumio/app/plugins/system_controller/volumiodiscovery/index.js:287:25) Nov 30 16:44:59 volumio volumio[686]: at ControllerVolumioDiscovery.connectToRemoteVolumio (/volumio/app/plugins/system_controller/volumiodiscovery/index.js:276:10) Nov 30 16:44:59 volumio volumio[686]: at Browser. (/volumio/app/plugins/system_controller/volumiodiscovery/index.js:202:12) Nov 30 16:44:59 volumio volumio[686]: at emitTwo (events.js:126:13) Nov 30 16:44:59 volumio volumio[686]: at Browser.emit (events.js:214:7) Nov 30 16:44:59 volumio volumio[686]: at on_resolver_done (/volumio/node_modules/mdns/lib/browser.js:31:14) Nov 30 16:44:59 volumio volumio[686]: at next (/volumio/node_modules/mdns/lib/browser.js:106:7) Nov 30 16:44:59 volumio volumio[686]: at /volumio/node_modules/mdns/lib/resolver_sequence_tasks.js:160:11 Nov 30 16:44:59 volumio volumio[686]: at getaddrinfo_complete (/volumio/node_modules/mdns/lib/resolver_sequence_tasks.js:108:7) Nov 30 16:44:59 volumio volumio[686]: at GetAddrInfoReqWrap.oncomplete (/volumio/node_modules/mdns/lib/resolver_sequence_tasks.js:120:9) Nov 30 16:44:59 volumio volumio[686]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Nov 30 16:44:59 volumio ntpd[634]: Listen normally on 4 eth0 192.168.0.139 UDP 123 Nov 30 16:44:59 volumio ntpd[634]: peers refreshed Nov 30 16:45:00 volumio sudo[2218]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-11-30 16:44 Nov 30 16:45:00 volumio sudo[2218]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Raspbian GNU/Linux 8 (jessie)" NAME="Raspbian GNU/Linux" VERSION_ID="8" VERSION="8 (jessie)" 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="dd2a4339faaeb892c7f467e7dc8d424aefb0bd03" VOLUMIO_FE_VERSION="958dedc0edff114f244fa9acc70cf53089d9e5ae" VOLUMIO_BE_VERSION="307f91893fca011201acba9973e1c41bd3a0ad5d" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Fri Oct 1 12:12:00 CEST 2021" VOLUMIO_VERSION="2.916" VOLUMIO_HARDWARE="sparky" VOLUMIO_HASH="1507c65028120e16c14994c066bc5dd4"