-- Logs begin at Thu 2019-02-14 11:12:10 CET, end at Thu 2019-02-14 11:14:04 CET. -- Feb 14 11:13:00 volumio10 sudo[697]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:00 volumio10 ntpd[674]: error resolving pool 2.debian.pool.ntp.org: System error (-11) Feb 14 11:13:00 volumio10 sudo[706]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:13:00 volumio10 sudo[706]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 up Feb 14 11:13:00 volumio10 sudo[706]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:00 volumio10 sudo[706]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:00 volumio10 sudo[708]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:13:00 volumio10 sudo[708]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw wlan0 scan Feb 14 11:13:00 volumio10 sudo[708]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:01 volumio10 ntpd[674]: error resolving pool 3.debian.pool.ntp.org: System error (-11) Feb 14 11:13:01 volumio10 sudo[708]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:01 volumio10 wireless.js[376]: SETTING APPROPRIATE REG DOMAIN: SK Feb 14 11:13:01 volumio10 sudo[713]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:13:01 volumio10 sudo[713]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 up Feb 14 11:13:01 volumio10 sudo[713]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:01 volumio10 sudo[713]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:01 volumio10 sudo[715]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:13:01 volumio10 sudo[715]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw reg set SK Feb 14 11:13:01 volumio10 sudo[715]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:02 volumio10 sudo[715]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:02 volumio10 wireless.js[376]: SUCCESSFULLY SET NEW REGDOMAIN: SK Feb 14 11:13:02 volumio10 wireless.js[376]: Start wireless flow Feb 14 11:13:02 volumio10 wireless.js[376]: Stopped hotspot (if there).. Feb 14 11:13:02 volumio10 nmbd[673]: [2019/02/14 11:13:02.324910, 0] ../source3/nmbd/asyncdns.c:158(start_async_dns) Feb 14 11:13:02 volumio10 nmbd[673]: started asyncdns process 721 Feb 14 11:13:02 volumio10 nmbd[673]: [2019/02/14 11:13:02.368969, 0] ../lib/util/become_daemon.c:149(daemon_status) Feb 14 11:13:02 volumio10 nmbd[673]: daemon_status: STATUS=daemon 'nmbd' : No local IPv4 non-loopback interfaces available, waiting for interface ... Feb 14 11:13:02 volumio10 nmbd[673]: [2019/02/14 11:13:02.371130, 0] ../source3/nmbd/nmbd_subnetdb.c:254(create_subnets) Feb 14 11:13:02 volumio10 nmbd[673]: NOTE: NetBIOS name resolution is not supported for Internet Protocol Version 6 (IPv6). Feb 14 11:13:02 volumio10 sudo[720]: pam_unix(sudo:account): account root has password changed in future Feb 14 11:13:02 volumio10 sudo[720]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ip addr flush dev wlan0 Feb 14 11:13:02 volumio10 sudo[720]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:02 volumio10 sudo[720]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:02 volumio10 sudo[723]: pam_unix(sudo:account): account root has password changed in future Feb 14 11:13:02 volumio10 sudo[723]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 down Feb 14 11:13:02 volumio10 sudo[723]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:03 volumio10 sudo[723]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:03 volumio10 wireless.js[376]: DHCP IP Feb 14 11:13:03 volumio10 wireless.js[376]: Start ap Feb 14 11:13:03 volumio10 wpa_supplicant[725]: Successfully initialized wpa_supplicant Feb 14 11:13:03 volumio10 kernel: brcmfmac: brcmf_cfg80211_set_power_mgmt: power save disabled Feb 14 11:13:03 volumio10 sudo[726]: pam_unix(sudo:account): account root has password changed in future Feb 14 11:13:03 volumio10 sudo[726]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/dhcpcd Feb 14 11:13:03 volumio10 sudo[726]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:03 volumio10 dhcpcd[727]: dev: loaded udev Feb 14 11:13:04 volumio10 kernel: 8021q: 802.1Q VLAN Support v1.8 Feb 14 11:13:04 volumio10 dhcpcd[727]: wlan0: connected to Access Point `' Feb 14 11:13:04 volumio10 wireless.js[376]: trying... Feb 14 11:13:04 volumio10 wpa_supplicant[732]: wlan0: Trying to associate with SSID 'povala' Feb 14 11:13:04 volumio10 sudo[748]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:13:04 volumio10 dhcpcd[727]: no interfaces have a carrier Feb 14 11:13:04 volumio10 sudo[748]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Feb 14 11:13:04 volumio10 dhcpcd[754]: wlan0: waiting for carrier Feb 14 11:13:04 volumio10 dhcpcd[727]: forked to background, child pid 754 Feb 14 11:13:04 volumio10 sudo[726]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:04 volumio10 sudo[748]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:04 volumio10 sudo[748]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:05 volumio10 wpa_supplicant[732]: wlan0: Associated with d8:07:b6:bf:cc:3e Feb 14 11:13:05 volumio10 wpa_supplicant[732]: wlan0: CTRL-EVENT-CONNECTED - Connection to d8:07:b6:bf:cc:3e completed [id=0 id_str=] Feb 14 11:13:05 volumio10 dhcpcd[754]: wlan0: carrier acquired Feb 14 11:13:05 volumio10 dhcpcd[754]: wlan0: connected to Access Point `povala' Feb 14 11:13:05 volumio10 wpa_supplicant[732]: wlan0: CTRL-EVENT-SUBNET-STATUS-UPDATE status=0 Feb 14 11:13:05 volumio10 wpa_supplicant[732]: wlan0: CTRL-EVENT-REGDOM-CHANGE init=COUNTRY_IE type=COUNTRY alpha2=SK Feb 14 11:13:05 volumio10 wireless.js[376]: trying... Feb 14 11:13:05 volumio10 dhcpcd[754]: DUID 00:01:00:01:2c:2b:49:09:b8:27:eb:1c:6f:9b Feb 14 11:13:05 volumio10 dhcpcd[754]: wlan0: IAID eb:1c:6f:9b Feb 14 11:13:05 volumio10 dhcpcd[754]: wlan0: adding address fe80::ba27:ebff:fe1c:6f9b Feb 14 11:13:05 volumio10 dhcpcd[754]: ipv6_addaddr1: Permission denied Feb 14 11:13:05 volumio10 dhcpcd[754]: wlan0: probing address 192.168.1.10/24 Feb 14 11:13:05 volumio10 dhcpcd[754]: wlan0: soliciting an IPv6 router Feb 14 11:13:05 volumio10 sudo[758]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:13:05 volumio10 sudo[758]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Feb 14 11:13:05 volumio10 sudo[758]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:05 volumio10 sudo[758]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:06 volumio10 wireless.js[376]: trying... Feb 14 11:13:06 volumio10 sudo[761]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:13:06 volumio10 sudo[761]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Feb 14 11:13:06 volumio10 sudo[761]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:06 volumio10 sudo[761]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:06 volumio10 volumio-remote-updater[462]: [2019-02-14 11:13:06] [info] asio async_connect error: system:111 (Connection refused) Feb 14 11:13:06 volumio10 volumio-remote-updater[462]: [2019-02-14 11:13:06] [info] Error getting remote endpoint: system:107 (Transport endpoint is not connected) Feb 14 11:13:06 volumio10 volumio-remote-updater[462]: [2019-02-14 11:13:06] [error] handle_connect error: Underlying Transport Error Feb 14 11:13:07 volumio10 wireless.js[376]: trying... Feb 14 11:13:07 volumio10 sudo[764]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:13:07 volumio10 sudo[764]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Feb 14 11:13:07 volumio10 sudo[764]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:07 volumio10 sudo[764]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:08 volumio10 wireless.js[376]: trying... Feb 14 11:13:08 volumio10 sudo[767]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:13:08 volumio10 sudo[767]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Feb 14 11:13:08 volumio10 sudo[767]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:08 volumio10 sudo[767]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:09 volumio10 wireless.js[376]: trying... Feb 14 11:13:09 volumio10 squeezeboxserver[675]: dirsFor: Didn't find a match request: [scprefs] Feb 14 11:13:09 volumio10 kernel: EXT4-fs error (device mmcblk0p3): ext4_lookup:1859: inode #47218369: comm squeezeboxserve: deleted inode referenced: 47202575 Feb 14 11:13:09 volumio10 kernel: EXT4-fs error (device mmcblk0p3): ext4_lookup:1859: inode #47218369: comm squeezeboxserve: deleted inode referenced: 47202575 Feb 14 11:13:09 volumio10 sudo[770]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:13:09 volumio10 sudo[770]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Feb 14 11:13:09 volumio10 sudo[770]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:09 volumio10 sudo[770]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:10 volumio10 dhcpcd[754]: wlan0: using static address 192.168.1.10/24 Feb 14 11:13:10 volumio10 avahi-daemon[387]: Joining mDNS multicast group on interface wlan0.IPv4 with address 192.168.1.10. Feb 14 11:13:10 volumio10 dhcpcd[754]: wlan0: adding route to 192.168.1.0/24 Feb 14 11:13:10 volumio10 avahi-daemon[387]: New relevant interface wlan0.IPv4 for mDNS. Feb 14 11:13:10 volumio10 avahi-daemon[387]: Registering new address record for 192.168.1.10 on wlan0.IPv4. Feb 14 11:13:10 volumio10 dhcpcd[754]: wlan0: adding default route via 192.168.1.1 Feb 14 11:13:10 volumio10 wireless.js[376]: trying... Feb 14 11:13:10 volumio10 sudo[779]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:13:10 volumio10 sudo[779]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Feb 14 11:13:10 volumio10 sudo[779]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:10 volumio10 sudo[779]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:10 volumio10 wireless.js[376]: Connected to: ----povala Feb 14 11:13:10 volumio10 wireless.js[376]: ---- Feb 14 11:13:10 volumio10 sudo[794]: pam_unix(sudo:account): account root has password changed in future Feb 14 11:13:10 volumio10 sudo[794]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Feb 14 11:13:10 volumio10 sudo[794]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:10 volumio10 sudo[794]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:10 volumio10 wireless.js[376]: ... joined AP, wlan0 IPv4 is 192.168.1.10, ipV6 is undefined Feb 14 11:13:10 volumio10 wireless.js[376]: It's done! AP Feb 14 11:13:11 volumio10 kernel: brcmfmac: brcmf_cfg80211_set_power_mgmt: power save disabled Feb 14 11:13:11 volumio10 systemd[1]: Started Wireless Services. Feb 14 11:13:11 volumio10 systemd[1]: Started Volumio Backend Module. Feb 14 11:13:11 volumio10 systemd[1]: Started Volumio Cpu Tweaker. Feb 14 11:13:11 volumio10 volumio-cpu-tweak[802]: Setting RT Priority for mpd Feb 14 11:13:11 volumio10 volumio-cpu-tweak[802]: pid 35's current scheduling policy: SCHED_OTHER Feb 14 11:13:11 volumio10 volumio-cpu-tweak[802]: pid 35's current scheduling priority: 0 Feb 14 11:13:11 volumio10 volumio-cpu-tweak[802]: Not enough cores to set MPD affinity Feb 14 11:13:11 volumio10 volumio-cpu-tweak[802]: /bin/volumio_cpu_tweak: line 27: warning: command substitution: ignored null byte in input Feb 14 11:13:11 volumio10 volumio-cpu-tweak[802]: VOLUMIO CPU TWEAK: Setting CPU Governor: performance Feb 14 11:13:12 volumio10 systemd[1]: volumio_cpu_tweak.service: Succeeded. Feb 14 11:13:12 volumio10 ntpd[674]: Listen normally on 3 wlan0 192.168.1.10:123 Feb 14 11:13:12 volumio10 ntpd[674]: new interface(s) found: waking up resolver Feb 14 11:13:12 volumio10 systemd[1]: Started Samba NMB Daemon. Feb 14 11:13:12 volumio10 nmbd[673]: [2019/02/14 11:13:12.430150, 0] ../lib/util/become_daemon.c:138(daemon_ready) Feb 14 11:13:12 volumio10 nmbd[673]: daemon_ready: STATUS=daemon 'nmbd' finished starting up and ready to serve connections Feb 14 11:13:12 volumio10 systemd[1]: Starting Samba Winbind Daemon... Feb 14 11:13:16 volumio10 winbindd[817]: [2019/02/14 11:13:16.036337, 0] ../source3/winbindd/winbindd_cache.c:3160(initialize_winbindd_cache) Feb 14 11:13:16 volumio10 winbindd[817]: initialize_winbindd_cache: clearing cache and re-creating with version number 2 Feb 14 11:13:16 volumio10 systemd[1]: Started Samba Winbind Daemon. Feb 14 11:13:16 volumio10 winbindd[817]: [2019/02/14 11:13:16.159866, 0] ../lib/util/become_daemon.c:138(daemon_ready) Feb 14 11:13:16 volumio10 winbindd[817]: daemon_ready: STATUS=daemon 'winbindd' finished starting up and ready to serve connections Feb 14 11:13:16 volumio10 systemd[1]: Starting Samba SMB Daemon... Feb 14 11:13:16 volumio10 volumio-remote-updater[462]: [2019-02-14 11:13:16] [info] asio async_connect error: system:111 (Connection refused) Feb 14 11:13:16 volumio10 volumio-remote-updater[462]: [2019-02-14 11:13:16] [info] Error getting remote endpoint: system:107 (Transport endpoint is not connected) Feb 14 11:13:16 volumio10 volumio-remote-updater[462]: [2019-02-14 11:13:16] [error] handle_connect error: Underlying Transport Error Feb 14 11:13:21 volumio10 systemd[1]: Started Samba SMB Daemon. Feb 14 11:13:21 volumio10 systemd[1]: Reached target Multi-User System. Feb 14 11:13:21 volumio10 smbd[822]: [2019/02/14 11:13:21.449285, 0] ../lib/util/become_daemon.c:138(daemon_ready) Feb 14 11:13:21 volumio10 smbd[822]: daemon_ready: STATUS=daemon 'smbd' finished starting up and ready to serve connections Feb 14 11:13:21 volumio10 systemd[1]: Reached target Graphical Interface. Feb 14 11:13:21 volumio10 systemd[1]: Starting Update UTMP about System Runlevel Changes... Feb 14 11:13:22 volumio10 systemd[1]: systemd-update-utmp-runlevel.service: Succeeded. Feb 14 11:13:22 volumio10 systemd[1]: Started Update UTMP about System Runlevel Changes. Feb 14 11:13:22 volumio10 systemd[1]: Startup finished in 27.438s (kernel) + 1min 24.236s (userspace) = 1min 51.674s. Feb 14 11:13:25 volumio10 systemd[1]: systemd-hostnamed.service: Succeeded. Feb 14 11:13:26 volumio10 volumio-remote-updater[462]: [2019-02-14 11:13:26] [info] asio async_connect error: system:111 (Connection refused) Feb 14 11:13:26 volumio10 volumio-remote-updater[462]: [2019-02-14 11:13:26] [info] Error getting remote endpoint: system:107 (Transport endpoint is not connected) Feb 14 11:13:26 volumio10 volumio-remote-updater[462]: [2019-02-14 11:13:26] [error] handle_connect error: Underlying Transport Error Feb 14 11:13:34 volumio10 volumio[801]: info: ------------------------------------------- Feb 14 11:13:34 volumio10 volumio[801]: info: ----- Volumio3 ---- Feb 14 11:13:34 volumio10 volumio[801]: info: ------------------------------------------- Feb 14 11:13:34 volumio10 volumio[801]: info: ----- System startup ---- Feb 14 11:13:34 volumio10 volumio[801]: info: ------------------------------------------- Feb 14 11:13:36 volumio10 volumio-remote-updater[462]: [2019-02-14 11:13:36] [connect] Successful connection Feb 14 11:13:40 volumio10 kernel: EXT4-fs error (device mmcblk0p3): ext4_lookup:1859: inode #47216378: comm squeezeboxserve: deleted inode referenced: 47202556 Feb 14 11:13:40 volumio10 kernel: EXT4-fs error (device mmcblk0p3): ext4_lookup:1859: inode #47216378: comm squeezeboxserve: deleted inode referenced: 47202556 Feb 14 11:13:40 volumio10 kernel: EXT4-fs error (device mmcblk0p3): ext4_lookup:1859: inode #47216378: comm squeezeboxserve: deleted inode referenced: 47202556 Feb 14 11:13:40 volumio10 kernel: EXT4-fs error (device mmcblk0p3): ext4_lookup:1859: inode #47216378: comm squeezeboxserve: deleted inode referenced: 47202556 Feb 14 11:13:40 volumio10 kernel: EXT4-fs error (device mmcblk0p3): ext4_lookup:1859: inode #47216378: comm squeezeboxserve: deleted inode referenced: 47202556 Feb 14 11:13:40 volumio10 kernel: EXT4-fs error (device mmcblk0p3): ext4_lookup:1859: inode #47216378: comm squeezeboxserve: deleted inode referenced: 47202556 Feb 14 11:13:40 volumio10 kernel: EXT4-fs error (device mmcblk0p3): ext4_lookup:1859: inode #47216378: comm squeezeboxserve: deleted inode referenced: 47202556 Feb 14 11:13:40 volumio10 kernel: EXT4-fs error (device mmcblk0p3): ext4_lookup:1859: inode #47216378: comm squeezeboxserve: deleted inode referenced: 47202556 Feb 14 11:13:40 volumio10 kernel: EXT4-fs error (device mmcblk0p3): ext4_lookup:1859: inode #47216378: comm squeezeboxserve: deleted inode referenced: 47202556 Feb 14 11:13:41 volumio10 kernel: EXT4-fs error (device mmcblk0p3): ext4_lookup:1859: inode #47218369: comm squeezeboxserve: deleted inode referenced: 47202575 Feb 14 11:13:41 volumio10 squeezeboxserver[675]: [19-02-14 11:13:34.1877] main::init (377) Starting Logitech Media Server (v8.3.1, 1676361197, Fri 17 Feb 2023 06:39:27 AM CET) perl 5.028001 - arm-linux-gnueabihf-thread-multi-64int Feb 14 11:13:41 volumio10 squeezeboxserver[675]: [19-02-14 11:13:40.9072] Slim::Utils::Misc::msg (1325) Warning: [11:13:40.9059] DBD::SQLite::db selectrow_array failed: unable to open database file at /usr/share/perl5/Slim/Utils/DbCache.pm line 238. Feb 14 11:13:41 volumio10 squeezeboxserver[675]: Delete the file /var/lib/squeezeboxserver/cache/cache.db and start from scratch. Feb 14 11:13:41 volumio10 squeezeboxserver[675]: [19-02-14 11:13:40.9885] Slim::Utils::DbCache::_init_db (289) Warning: Unable to read/create /var/lib/squeezeboxserver/cache/cache.db Feb 14 11:13:41 volumio10 systemd[1]: logitechmediaserver.service: Succeeded. Feb 14 11:13:41 volumio10 volumio[801]: info: MYVOLUMIO Environment detected Feb 14 11:13:42 volumio10 volumio[801]: info: Plugin folders cleanup Feb 14 11:13:42 volumio10 volumio[801]: info: Scanning into folder /volumio/app/plugins/ Feb 14 11:13:42 volumio10 volumio[801]: info: Scanning category audio_interface Feb 14 11:13:42 volumio10 volumio[801]: info: Scanning category miscellanea Feb 14 11:13:42 volumio10 volumio[801]: info: Scanning category music_service Feb 14 11:13:42 volumio10 volumio[801]: info: Scanning category plugins.json Feb 14 11:13:42 volumio10 volumio[801]: info: Scanning category system_controller Feb 14 11:13:42 volumio10 volumio[801]: info: Scanning category user_interface Feb 14 11:13:42 volumio10 volumio[801]: info: Scanning into folder /data/plugins/ Feb 14 11:13:42 volumio10 volumio[801]: info: Scanning category music_service Feb 14 11:13:42 volumio10 volumio[801]: info: Plugin folders cleanup completed Feb 14 11:13:42 volumio10 volumio[801]: info: ------------------------------------------- Feb 14 11:13:42 volumio10 volumio[801]: info: ----- Core plugins startup ---- Feb 14 11:13:42 volumio10 volumio[801]: info: ------------------------------------------- Feb 14 11:13:42 volumio10 volumio[801]: info: Loading plugins from folder /volumio/app/plugins/ Feb 14 11:13:42 volumio10 volumio[801]: info: Adding plugin upnp to MyMusic Plugins Feb 14 11:13:42 volumio10 volumio[801]: info: Adding plugin airplay_emulation to MyMusic Plugins Feb 14 11:13:42 volumio10 volumio[801]: info: Adding plugin upnp_browser to MyMusic Plugins Feb 14 11:13:42 volumio10 volumio[801]: info: Loading plugins from folder /data/plugins/ Feb 14 11:13:42 volumio10 volumio[801]: info: Loading plugin "system"... Feb 14 11:13:42 volumio10 volumio[801]: info: Loading plugin "appearance"... Feb 14 11:13:47 volumio10 volumio[801]: info: Loading plugin "network"... Feb 14 11:13:47 volumio10 volumio[801]: info: Refreshing Cached IP Addresses Feb 14 11:13:47 volumio10 volumio[801]: info: Loading plugin "services"... Feb 14 11:13:47 volumio10 sudo[879]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:13:47 volumio10 sudo[879]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Feb 14 11:13:47 volumio10 volumio[801]: info: Loading plugin "alsa_controller"... Feb 14 11:13:47 volumio10 sudo[879]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:48 volumio10 sudo[881]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:13:48 volumio10 sudo[881]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Feb 14 11:13:48 volumio10 sudo[881]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:48 volumio10 sudo[879]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:48 volumio10 sudo[883]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:13:48 volumio10 sudo[881]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:48 volumio10 sudo[883]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Feb 14 11:13:48 volumio10 sudo[883]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 14 11:13:48 volumio10 volumio[801]: ALSA lib conf.c:1887:(_snd_config_load_with_include) _toplevel_:1:332:Unexpected end of file Feb 14 11:13:48 volumio10 volumio[801]: ALSA lib conf.c:3650:(config_file_open) /etc/asound.conf may be old or corrupted: consider to remove or fix it Feb 14 11:13:48 volumio10 volumio[801]: ALSA lib conf.c:3572:(snd_config_hooks_call) function snd_config_hook_load returned error: Invalid argument Feb 14 11:13:48 volumio10 volumio[801]: ALSA lib conf.c:4026:(snd_config_update_r) hooks failed, removing configuration Feb 14 11:13:48 volumio10 volumio[801]: aplay: device_list:281: control open (0): Invalid argument Feb 14 11:13:48 volumio10 volumio[801]: ALSA lib conf.c:1887:(_snd_config_load_with_include) _toplevel_:1:332:Unexpected end of file Feb 14 11:13:48 volumio10 volumio[801]: ALSA lib conf.c:3650:(config_file_open) /etc/asound.conf may be old or corrupted: consider to remove or fix it Feb 14 11:13:48 volumio10 volumio[801]: ALSA lib conf.c:3572:(snd_config_hooks_call) function snd_config_hook_load returned error: Invalid argument Feb 14 11:13:48 volumio10 volumio[801]: ALSA lib conf.c:4026:(snd_config_update_r) hooks failed, removing configuration Feb 14 11:13:48 volumio10 volumio[801]: aplay: device_list:281: control open (1): Invalid argument Feb 14 11:13:48 volumio10 volumio[801]: ALSA lib conf.c:1887:(_snd_config_load_with_include) _toplevel_:1:332:Unexpected end of file Feb 14 11:13:48 volumio10 volumio[801]: ALSA lib conf.c:3650:(config_file_open) /etc/asound.conf may be old or corrupted: consider to remove or fix it Feb 14 11:13:48 volumio10 volumio[801]: ALSA lib conf.c:3572:(snd_config_hooks_call) function snd_config_hook_load returned error: Invalid argument Feb 14 11:13:48 volumio10 volumio[801]: ALSA lib conf.c:4026:(snd_config_update_r) hooks failed, removing configuration Feb 14 11:13:48 volumio10 volumio[801]: aplay: device_list:281: control open (2): Invalid argument Feb 14 11:13:48 volumio10 volumio[801]: warn: Unable to locate the audio output device HDMI Out. Please configure a valid output device. Feb 14 11:13:48 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Feb 14 11:13:48 volumio10 volumio[801]: info: Loading plugin "wizard"... Feb 14 11:13:48 volumio10 volumio[801]: info: Loading plugin "networkfs"... Feb 14 11:13:48 volumio10 volumio[801]: info: Starting Udev Watcher for removable devices Feb 14 11:13:48 volumio10 volumio[801]: info: Ignoring mount for partition: boot Feb 14 11:13:48 volumio10 volumio[801]: info: Ignoring mount for partition: volumio Feb 14 11:13:48 volumio10 volumio[801]: info: Ignoring mount for partition: volumio_data Feb 14 11:13:48 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Feb 14 11:13:48 volumio10 volumio[801]: info: Loading plugin "volumio_command_line_client"... Feb 14 11:13:48 volumio10 volumio[801]: info: Loading plugin "upnp"... Feb 14 11:13:48 volumio10 volumio[801]: info: [1550139228784] Starting Upmpd Daemon Feb 14 11:13:48 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Feb 14 11:13:48 volumio10 volumio[801]: info: Loading plugin "my_music"... Feb 14 11:13:48 volumio10 volumio[801]: info: Loading plugin "mpd"... Feb 14 11:13:49 volumio10 sudo[883]: pam_unix(sudo:session): session closed for user root Feb 14 11:13:50 volumio10 volumio[801]: info: Loading plugin "upnp_browser"... Feb 14 11:13:51 volumio10 volumio-remote-updater[462]: [2019-02-14 11:13:51] [connect] Successful connection Feb 14 11:13:52 volumio10 volumio[801]: info: Loading plugin "alarm-clock"... Feb 14 11:13:53 volumio10 volumio[801]: info: Loading plugin "airplay_emulation"... Feb 14 11:13:53 volumio10 volumio[801]: info: Starting Shairport Sync Feb 14 11:13:53 volumio10 volumio[801]: info: Loading plugin "last_100"... Feb 14 11:13:53 volumio10 volumio[801]: info: Loading plugin "webradio"... Feb 14 11:13:54 volumio10 volumio[801]: info: Loading plugin "i2s_dacs"... Feb 14 11:13:54 volumio10 volumio[801]: info: I2S DAC not set, start Auto-detection Feb 14 11:13:54 volumio10 volumio[801]: info: Loading plugin "volumiodiscovery"... Feb 14 11:13:54 volumio10 volumio[801]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Feb 14 11:13:54 volumio10 node[801]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Feb 14 11:13:54 volumio10 volumio[801]: *** WARNING *** Please fix your application to use the native API of Avahi! Feb 14 11:13:54 volumio10 node[801]: *** WARNING *** Please fix your application to use the native API of Avahi! Feb 14 11:13:54 volumio10 volumio[801]: *** WARNING *** For more information see Feb 14 11:13:54 volumio10 node[801]: *** WARNING *** For more information see Feb 14 11:13:54 volumio10 volumio[801]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Feb 14 11:13:54 volumio10 volumio[801]: *** WARNING *** Please fix your application to use the native API of Avahi! Feb 14 11:13:54 volumio10 volumio[801]: *** WARNING *** For more information see Feb 14 11:13:54 volumio10 node[801]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Feb 14 11:13:54 volumio10 node[801]: *** WARNING *** Please fix your application to use the native API of Avahi! Feb 14 11:13:54 volumio10 node[801]: *** WARNING *** For more information see Feb 14 11:13:54 volumio10 volumio[801]: info: Applying required configuration parameters for plugin volumiodiscovery Feb 14 11:13:54 volumio10 volumio[801]: info: Discovery: Started advertising with name: undefined Feb 14 11:13:54 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Feb 14 11:13:54 volumio10 volumio[801]: info: Plugin youtube2 is not enabled Feb 14 11:13:54 volumio10 volumio[801]: info: Plugin ytcr is not enabled Feb 14 11:13:54 volumio10 volumio[801]: info: Plugin ytmusic is not enabled Feb 14 11:13:54 volumio10 volumio[801]: info: Loading plugin "outputs"... Feb 14 11:13:54 volumio10 volumio[801]: info: Loading plugin "albumart"... Feb 14 11:13:54 volumio10 volumio[801]: info: Plugin example_plugin is not enabled Feb 14 11:13:54 volumio10 volumio[801]: info: Loading plugin "inputs"... Feb 14 11:13:54 volumio10 volumio[801]: info: Loading plugin "updater_comm"... Feb 14 11:13:56 volumio10 volumio[801]: info: Plugin mpdemulation is not enabled Feb 14 11:13:56 volumio10 volumio[801]: info: Loading plugin "rest_api"... Feb 14 11:13:56 volumio10 volumio[801]: info: Loading plugin "websocket"... Feb 14 11:13:56 volumio10 volumio[801]: info: Starting Socket.io Server version 2.3.0 Feb 14 11:13:56 volumio10 volumio[801]: info: Plugin 80s80s is not enabled Feb 14 11:13:56 volumio10 volumio[801]: info: Plugin lms is not enabled Feb 14 11:13:56 volumio10 volumio[801]: info: Loading i18n strings for locale sk Feb 14 11:13:57 volumio10 volumio[801]: Updating browse sources language Feb 14 11:13:57 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Feb 14 11:13:57 volumio10 volumio[801]: Forking 1 albumart workers Feb 14 11:13:59 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Feb 14 11:13:59 volumio10 volumio[801]: info: CoreCommandRouter::initPlayerControls Feb 14 11:13:59 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 14 11:13:59 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 14 11:13:59 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 14 11:13:59 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 14 11:13:59 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 14 11:13:59 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 14 11:13:59 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 14 11:13:59 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 14 11:13:59 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Feb 14 11:13:59 volumio10 volumio[801]: Express server listening on port 3000 Feb 14 11:13:59 volumio10 volumio[801]: [Metrics] WebUI: 31s 862.83ms Feb 14 11:13:59 volumio10 volumio[801]: info: CoreStateMachine::resetVolumioState Feb 14 11:13:59 volumio10 volumio[801]: info: CoreStateMachine::getcurrentVolume Feb 14 11:13:59 volumio10 volumio[801]: info: CoreCommandRouter::volumioRetrievevolume Feb 14 11:13:59 volumio10 volumio[801]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 14 11:13:59 volumio10 volumio[801]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Feb 14 11:13:59 volumio10 volumio[801]: TypeError: Cannot read property 'charAt' of undefined Feb 14 11:13:59 volumio10 volumio[801]: at Timeout._onTimeout (/volumio/app/plugins/audio_interface/upnp/index.js:199:24) Feb 14 11:13:59 volumio10 volumio[801]: at listOnTimeout (internal/timers.js:554:17) Feb 14 11:13:59 volumio10 volumio[801]: at processTimers (internal/timers.js:497:7) Feb 14 11:13:59 volumio10 volumio[801]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Feb 14 11:14:03 volumio10 ntpd[674]: Soliciting pool server 213.81.129.99 Feb 14 11:14:04 volumio10 volumio[801]: Starting albumart workers Feb 14 11:14:04 volumio10 ntpd[674]: Soliciting pool server 84.245.104.80 Feb 14 11:14:04 volumio10 ntpd[674]: Soliciting pool server 92.240.244.202 Feb 14 11:14:04 volumio10 ntpd[674]: Soliciting pool server 185.242.56.5 Feb 14 11:14:04 volumio10 sudo[919]: pam_unix(sudo:account): account volumio has password changed in future Feb 14 11:14:04 volumio10 sudo[919]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2019-02-14 11:13 Feb 14 11:14:04 volumio10 sudo[919]: 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="5fd3886148e72a9cecd88a772d1f6079fb64d11a" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="8bb23b009e91ae4c7ecd678f193e7d3b281fca0c" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Mon 22 Jul 2024 07:17:01 PM CEST" VOLUMIO_VERSION="3.742" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="2782e52360f70dfab079c82951ebbbb1"