-- Logs begin at Wed 2026-01-21 21:52:08 JST, end at Mon 2026-01-26 23:50:05 JST. -- Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preload queue cleared Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P0R5309185 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P1R5308929 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P2R5308673 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P3R5308417 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P4R5308161 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P5R5307905 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P6R3349761 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P7R3349505 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P8R3349249 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P9R6663169 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P10R6662913 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P11R6663681 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P12R6663425 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P13R6662657 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P14R6662401 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P15R6662145 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P16R6661889 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P17R6661633 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P18R6661377 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P19R4646401 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P20R4652545 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P21R4649985 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P22R4646145 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P23R6496769 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P24R6510849 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P25R6510593 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P26R6510337 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P27R6510081 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P28R6509825 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P29R6509569 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P30R6509313 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P31R6509057 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P32R6508801 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P33R6508545 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P34R6508289 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P35R6508033 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P36R6507777 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P37R6507521 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P38R6507265 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P39R6507009 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P40R6506753 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P41R6506497 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P42R6506241 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P43R6505985 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P44R6505729 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P45R26113 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P46R6797569 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P47R6797313 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P48R6797057 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P49R6796801 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P50R2634497 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P51R2634241 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P52R2633985 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P53R2633729 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P54R2633473 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P55R2633217 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P56R2632961 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P57R2632705 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P58R2632449 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P59R2632193 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P60R2631937 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P61R2631681 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P62R2631425 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P63R2631169 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P64R2630913 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P65R2630657 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P66R2578433 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P67R2578177 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P68R2577921 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P69R2577665 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P70R2587905 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P71R6086657 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P72R2272513 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P73R2272257 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P74R2271745 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P75R2271233 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P76R2272001 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P77R2271489 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P78R2251521 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P79R2251265 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P80R2251009 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P81R2250753 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P82R2250497 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P83R2247681 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P84R2247425 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P85R2246401 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P86R6167809 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P87R6167553 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P88R6167297 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P89R6167041 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P90R6166529 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P91R591361 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P92R591105 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P93R590849 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P94R590593 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P95R590337 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P96R590081 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P97R589825 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P98R589569 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P99R589313 Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P0R5309185 in service upnp_browser Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P1R5308929 in service upnp_browser Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P2R5308673 in service upnp_browser Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P3R5308417 in service upnp_browser Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P4R5308161 in service upnp_browser Jan 26 23:49:15 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P5R5307905 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P6R3349761 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P7R3349505 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P8R3349249 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P9R6663169 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P10R6662913 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P11R6663681 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P12R6663425 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P13R6662657 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P14R6662401 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P15R6662145 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P16R6661889 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P17R6661633 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P18R6661377 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P19R4646401 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P20R4652545 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P21R4649985 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P22R4646145 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P23R6496769 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P24R6510849 in service upnp_browser Jan 26 23:49:16 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P25R6510593 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P26R6510337 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P27R6510081 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P28R6509825 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P29R6509569 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P30R6509313 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P31R6509057 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P32R6508801 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P33R6508545 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P34R6508289 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P35R6508033 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P36R6507777 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P37R6507521 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P38R6507265 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P39R6507009 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P40R6506753 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P41R6506497 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P42R6506241 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P43R6505985 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P44R6505729 in service upnp_browser Jan 26 23:49:17 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P45R26113 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P46R6797569 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P47R6797313 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P48R6797057 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P49R6796801 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P50R2634497 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P51R2634241 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P52R2633985 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P53R2633729 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P54R2633473 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P55R2633217 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P56R2632961 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P57R2632705 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P58R2632449 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P59R2632193 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P60R2631937 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P61R2631681 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P62R2631425 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P63R2631169 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P64R2630913 in service upnp_browser Jan 26 23:49:18 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P65R2630657 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P66R2578433 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P67R2578177 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P68R2577921 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P69R2577665 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P70R2587905 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P71R6086657 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P72R2272513 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P73R2272257 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P74R2271745 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P75R2271233 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P76R2272001 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P77R2271489 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P78R2251521 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P79R2251265 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P80R2251009 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P81R2250753 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P82R2250497 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P83R2247681 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P84R2247425 in service upnp_browser Jan 26 23:49:19 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P85R2246401 in service upnp_browser Jan 26 23:49:20 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P86R6167809 in service upnp_browser Jan 26 23:49:20 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P87R6167553 in service upnp_browser Jan 26 23:49:20 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P88R6167297 in service upnp_browser Jan 26 23:49:20 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P89R6167041 in service upnp_browser Jan 26 23:49:20 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P90R6166529 in service upnp_browser Jan 26 23:49:20 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P91R591361 in service upnp_browser Jan 26 23:49:20 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P92R591105 in service upnp_browser Jan 26 23:49:20 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P93R590849 in service upnp_browser Jan 26 23:49:20 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P94R590593 in service upnp_browser Jan 26 23:49:20 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P95R590337 in service upnp_browser Jan 26 23:49:20 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P96R590081 in service upnp_browser Jan 26 23:49:20 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P97R589825 in service upnp_browser Jan 26 23:49:20 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P98R589569 in service upnp_browser Jan 26 23:49:20 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$1690P99R589313 in service upnp_browser Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preload queue cleared Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P0R3350273 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P1R3351041 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P2R3349505 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P3R3349761 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P4R3351297 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P5R3349249 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P6R3350785 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P7R3350017 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P8R3351553 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P9R3350529 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P10R7223553 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P11R7223041 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P12R7221249 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P13R7220481 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P14R7219969 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P15R7221505 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P16R7222017 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P17R7221761 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P18R7222529 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P19R7222785 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P20R7220737 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P21R7220225 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P22R7223297 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P23R7220993 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P24R7222273 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P25R7219201 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P26R7219713 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P27R7210753 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P28R7210497 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P29R7210241 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P30R7209985 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P31R7208961 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P32R7209217 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P33R7209729 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P34R7209473 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P35R7208705 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P36R7208193 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P37R7208449 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P38R7207937 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P39R7207169 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P40R7207425 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P41R7207681 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P42R7206657 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P43R7206913 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P44R7206145 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P45R7206401 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P46R7205889 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P47R7205633 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P48R7205377 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P49R7204609 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P50R7205121 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P51R7204865 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P52R7204353 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P53R7204097 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P54R7203841 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P55R7203329 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P56R7203585 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P57R7203073 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P58R7202817 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P59R7202561 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P60R7202049 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P61R7202305 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P62R7200257 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P63R7199745 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P64R7200001 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P65R7200513 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P66R7201025 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P67R7201793 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P68R7200769 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P69R7201281 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P70R7201537 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P71R7196161 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P72R7192065 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P73R7193089 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P74R7192577 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P75R7196417 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P76R7194369 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P77R7198209 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P78R7192833 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P79R7195905 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P80R7199489 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P81R7197953 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P82R7193601 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P83R7198977 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P84R7193857 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P85R7192321 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P86R7194113 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P87R7197441 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P88R7195137 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P89R7191297 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P90R7191553 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P91R7190785 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P92R7190529 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P93R7191041 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P94R7190017 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P95R7189761 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P96R7190273 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P97R7196673 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P98R7196929 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P99R7193345 Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P0R3350273 in service upnp_browser Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P1R3351041 in service upnp_browser Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P2R3349505 in service upnp_browser Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P3R3349761 in service upnp_browser Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P4R3351297 in service upnp_browser Jan 26 23:49:21 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P5R3349249 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P6R3350785 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P7R3350017 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P8R3351553 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P9R3350529 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P10R7223553 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P11R7223041 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P12R7221249 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P13R7220481 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P14R7219969 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P15R7221505 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P16R7222017 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P17R7221761 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P18R7222529 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P19R7222785 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P20R7220737 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P21R7220225 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P22R7223297 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P23R7220993 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P24R7222273 in service upnp_browser Jan 26 23:49:22 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P25R7219201 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P26R7219713 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P27R7210753 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P28R7210497 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P29R7210241 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P30R7209985 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P31R7208961 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P32R7209217 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P33R7209729 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P34R7209473 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P35R7208705 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P36R7208193 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P37R7208449 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P38R7207937 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P39R7207169 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P40R7207425 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P41R7207681 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P42R7206657 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P43R7206913 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P44R7206145 in service upnp_browser Jan 26 23:49:23 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P45R7206401 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P46R7205889 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P47R7205633 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P48R7205377 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P49R7204609 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P50R7205121 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P51R7204865 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P52R7204353 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P53R7204097 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P54R7203841 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P55R7203329 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P56R7203585 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P57R7203073 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P58R7202817 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P59R7202561 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P60R7202049 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P61R7202305 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P62R7200257 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P63R7199745 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P64R7200001 in service upnp_browser Jan 26 23:49:24 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P65R7200513 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P66R7201025 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P67R7201793 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P68R7200769 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P69R7201281 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P70R7201537 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P71R7196161 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P72R7192065 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P73R7193089 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P74R7192577 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P75R7196417 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P76R7194369 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P77R7198209 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P78R7192833 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P79R7195905 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P80R7199489 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P81R7197953 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P82R7193601 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P83R7198977 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P84R7193857 in service upnp_browser Jan 26 23:49:25 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P85R7192321 in service upnp_browser Jan 26 23:49:26 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P86R7194113 in service upnp_browser Jan 26 23:49:26 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P87R7197441 in service upnp_browser Jan 26 23:49:26 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P88R7195137 in service upnp_browser Jan 26 23:49:26 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P89R7191297 in service upnp_browser Jan 26 23:49:26 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P90R7191553 in service upnp_browser Jan 26 23:49:26 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P91R7190785 in service upnp_browser Jan 26 23:49:26 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P92R7190529 in service upnp_browser Jan 26 23:49:26 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P93R7191041 in service upnp_browser Jan 26 23:49:26 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P94R7190017 in service upnp_browser Jan 26 23:49:26 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P95R7189761 in service upnp_browser Jan 26 23:49:26 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P96R7190273 in service upnp_browser Jan 26 23:49:26 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P97R7196673 in service upnp_browser Jan 26 23:49:26 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P98R7196929 in service upnp_browser Jan 26 23:49:26 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P99R7193345 in service upnp_browser Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Preload queue cleared Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioReplaceandPlayItems Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::ClearQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::stop Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::stPlaybackTimer Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::updateTrackBlock Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrackBlock Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 0 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::serviceStop Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 0 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::serviceStop Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: [1769438974003] ControllerWebradio::stop Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand stop Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::clearPlayQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::saveQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::addQueueItems Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::addQueueItems Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Preload queue cleared Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P0R3350273 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P0R3350273 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P1R3351041 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P1R3351041 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P2R3349505 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P2R3349505 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P3R3349761 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P3R3349761 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P4R3351297 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P4R3351297 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P5R3349249 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P5R3349249 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P6R3350785 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P6R3350785 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P7R3350017 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P7R3350017 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P8R3351553 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P8R3351553 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P9R3350529 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P9R3350529 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P10R7223553 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P10R7223553 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P11R7223041 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P11R7223041 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P12R7221249 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P12R7221249 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P13R7220481 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P13R7220481 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P14R7219969 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P14R7219969 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::saveQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::updateTrackBlock Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrackBlock Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPlay Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::play index 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::addQueueItems Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::addQueueItems Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Preload queue cleared Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P15R7221505 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P15R7221505 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P16R7222017 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P16R7222017 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P17R7221761 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P17R7221761 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P18R7222529 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P18R7222529 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P19R7222785 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P19R7222785 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P20R7220737 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P20R7220737 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P21R7220225 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P21R7220225 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P22R7223297 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P22R7223297 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P23R7220993 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P23R7220993 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P24R7222273 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P24R7222273 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P25R7219201 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P25R7219201 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P26R7219713 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P26R7219713 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P27R7210753 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P27R7210753 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P28R7210497 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P28R7210497 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P29R7210241 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P29R7210241 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P30R7209985 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P30R7209985 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P31R7208961 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P31R7208961 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P32R7209217 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P32R7209217 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P33R7209729 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P33R7209729 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P34R7209473 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P34R7209473 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P35R7208705 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P35R7208705 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P36R7208193 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P36R7208193 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P37R7208449 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P37R7208449 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P38R7207937 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P38R7207937 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P39R7207169 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P39R7207169 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P40R7207425 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P40R7207425 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P41R7207681 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P41R7207681 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P42R7206657 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P42R7206657 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P43R7206913 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P43R7206913 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P44R7206145 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P44R7206145 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P45R7206401 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P45R7206401 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P46R7205889 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P46R7205889 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P47R7205633 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P47R7205633 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P48R7205377 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P48R7205377 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P49R7204609 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P49R7204609 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P50R7205121 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P50R7205121 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P51R7204865 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P51R7204865 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P52R7204353 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P52R7204353 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P53R7204097 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P53R7204097 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P54R7203841 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P54R7203841 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P55R7203329 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P55R7203329 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P56R7203585 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P56R7203585 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P57R7203073 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P57R7203073 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P58R7202817 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P58R7202817 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P59R7202561 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P59R7202561 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P60R7202049 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P60R7202049 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P61R7202305 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P61R7202305 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P62R7200257 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P62R7200257 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P63R7199745 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P63R7199745 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P64R7200001 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P64R7200001 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P65R7200513 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P65R7200513 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P66R7201025 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P66R7201025 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P67R7201793 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P67R7201793 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P68R7200769 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P68R7200769 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P69R7201281 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P69R7201281 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P70R7201537 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P70R7201537 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P71R7196161 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P71R7196161 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P72R7192065 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P72R7192065 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P73R7193089 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P73R7193089 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P74R7192577 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P74R7192577 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P75R7196417 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P75R7196417 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P76R7194369 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P76R7194369 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P77R7198209 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P77R7198209 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P78R7192833 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P78R7192833 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P79R7195905 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P79R7195905 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P80R7199489 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P80R7199489 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P81R7197953 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P81R7197953 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P82R7193601 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P82R7193601 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P83R7198977 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P83R7198977 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P84R7193857 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P84R7193857 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P85R7192321 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P85R7192321 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P86R7194113 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P86R7194113 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P87R7197441 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P87R7197441 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P88R7195137 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P88R7195137 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P89R7191297 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P89R7191297 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P90R7191553 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P90R7191553 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P91R7190785 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P91R7190785 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P92R7190529 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P92R7190529 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P93R7191041 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P93R7191041 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P94R7190017 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P94R7190017 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P95R7189761 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P95R7189761 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P96R7190273 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P96R7190273 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P97R7196673 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P97R7196673 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P98R7196929 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P98R7196929 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P99R7193345 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P99R7193345 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::stop Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::saveQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::play index undefined Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::updateTrackBlock Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrackBlock Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::startPlaybackTimer Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: [1769438974055] ControllerUPNPBrowser::clearAddPlayTrack Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand stop Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand stop took 73 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand stop took 21 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand clear Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 8 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand clear took 7 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 6 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 5 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand load "http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219969.flac" Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService stop Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus stop Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: No code Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService stop Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus stop Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: No code Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 33ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 33ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: error: updateQueue error: null Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: error: updateQueue error: null Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: error: updateQueue error: null Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 36ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 33 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand add "http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219969.flac" Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 8ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 7ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 46ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand add "http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219969.flac" took 13 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::setConsumeUpdateService mpd Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 9ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand play took 7 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 6ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 5ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 20 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 19 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 17 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 17 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 15 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 16 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 15 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 14 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":175,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"I Feel Free","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219969.flac","trackType":"flac"} Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus stop Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":175,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"I Feel Free","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219969.flac","trackType":"flac"} Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Received an update from plugin. extracting info from payload Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":175,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"I Feel Free","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219969.flac","trackType":"flac"} Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Received an update from plugin. extracting info from payload Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 67ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 81ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 81ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 68 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 67ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 66 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 66 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 65 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 21ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 22 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 21ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 19 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":175,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"I Feel Free","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219969.flac","trackType":"flac"} Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Received an update from plugin. extracting info from payload Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":869,"duration":175,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"I Feel Free","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219969.flac","trackType":"flac"} Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Received an update from plugin. extracting info from payload Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 149ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 145ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 161 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 160 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 158 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 156 milliseconds Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":869,"duration":175,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"I Feel Free","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219969.flac","trackType":"flac"} Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Received an update from plugin. extracting info from payload Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":869,"duration":175,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"I Feel Free","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219969.flac","trackType":"flac"} Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Received an update from plugin. extracting info from payload Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":869,"duration":175,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"I Feel Free","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219969.flac","trackType":"flac"} Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Received an update from plugin. extracting info from payload Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":869,"duration":175,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"I Feel Free","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219969.flac","trackType":"flac"} Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 14 Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus play Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: Received an update from plugin. extracting info from payload Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 312ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 311ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 259ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: ------------------------------ 257ms Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:34 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Preload queue cleared Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioReplaceandPlayItems Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::ClearQueue Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::stop Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::stPlaybackTimer Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::updateTrackBlock Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrackBlock Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::serviceStop Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 14 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::serviceStop Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: [1769438983930] ControllerUPNPBrowser::stop Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand stop Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::clearPlayQueue Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::saveQueue Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushQueue Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::addQueueItems Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::addQueueItems Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Preload queue cleared Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P0R3350273 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P0R3350273 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P1R3351041 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P1R3351041 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P2R3349505 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P2R3349505 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P3R3349761 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P3R3349761 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P4R3351297 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P4R3351297 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P5R3349249 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P5R3349249 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P6R3350785 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P6R3350785 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P7R3350017 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P7R3350017 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P8R3351553 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P8R3351553 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P9R3350529 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P9R3350529 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P10R7223553 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P10R7223553 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P11R7223041 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P11R7223041 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P12R7221249 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P12R7221249 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P13R7220481 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P13R7220481 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P14R7219969 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P14R7219969 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P15R7221505 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P15R7221505 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P16R7222017 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P16R7222017 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P17R7221761 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P17R7221761 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P18R7222529 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P18R7222529 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P19R7222785 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P19R7222785 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P20R7220737 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P20R7220737 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P21R7220225 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P21R7220225 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P22R7223297 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P22R7223297 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P23R7220993 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P23R7220993 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P24R7222273 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P24R7222273 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P25R7219201 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P25R7219201 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushQueue Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::saveQueue Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::updateTrackBlock Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrackBlock Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPlay Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::play index 25 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::addQueueItems Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::addQueueItems Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Preload queue cleared Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P26R7219713 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P26R7219713 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P27R7210753 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P27R7210753 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P28R7210497 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P28R7210497 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P29R7210241 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P29R7210241 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P30R7209985 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P30R7209985 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P31R7208961 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P31R7208961 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P32R7209217 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P32R7209217 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P33R7209729 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P33R7209729 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P34R7209473 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P34R7209473 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P35R7208705 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P35R7208705 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P36R7208193 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P36R7208193 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P37R7208449 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P37R7208449 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P38R7207937 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P38R7207937 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P39R7207169 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P39R7207169 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P40R7207425 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P40R7207425 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P41R7207681 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P41R7207681 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P42R7206657 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P42R7206657 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P43R7206913 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P43R7206913 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P44R7206145 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P44R7206145 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P45R7206401 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P45R7206401 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P46R7205889 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P46R7205889 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P47R7205633 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P47R7205633 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P48R7205377 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P48R7205377 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P49R7204609 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P49R7204609 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P50R7205121 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P50R7205121 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P51R7204865 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P51R7204865 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P52R7204353 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P52R7204353 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P53R7204097 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P53R7204097 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P54R7203841 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P54R7203841 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P55R7203329 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P55R7203329 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P56R7203585 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P56R7203585 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P57R7203073 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P57R7203073 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P58R7202817 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P58R7202817 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P59R7202561 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P59R7202561 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P60R7202049 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P60R7202049 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P61R7202305 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P61R7202305 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P62R7200257 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P62R7200257 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P63R7199745 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P63R7199745 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P64R7200001 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P64R7200001 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P65R7200513 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P65R7200513 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P66R7201025 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P66R7201025 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P67R7201793 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P67R7201793 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P68R7200769 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P68R7200769 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P69R7201281 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P69R7201281 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P70R7201537 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P70R7201537 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P71R7196161 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P71R7196161 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P72R7192065 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P72R7192065 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P73R7193089 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P73R7193089 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P74R7192577 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P74R7192577 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P75R7196417 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P75R7196417 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P76R7194369 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P76R7194369 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P77R7198209 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P77R7198209 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P78R7192833 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P78R7192833 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P79R7195905 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P79R7195905 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P80R7199489 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P80R7199489 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P81R7197953 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P81R7197953 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P82R7193601 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P82R7193601 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P83R7198977 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P83R7198977 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P84R7193857 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P84R7193857 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P85R7192321 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P85R7192321 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P86R7194113 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P86R7194113 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P87R7197441 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P87R7197441 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P88R7195137 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P88R7195137 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P89R7191297 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P89R7191297 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P90R7191553 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P90R7191553 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P91R7190785 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P91R7190785 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P92R7190529 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P92R7190529 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P93R7191041 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P93R7191041 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P94R7190017 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P94R7190017 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P95R7189761 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P95R7189761 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P96R7190273 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P96R7190273 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P97R7196673 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P97R7196673 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P98R7196929 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P98R7196929 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Adding Item to queue: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P99R7193345 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Using cached record of: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$6909P99R7193345 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::stop Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushQueue Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::saveQueue Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::play index undefined Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::updateTrackBlock Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrackBlock Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::startPlaybackTimer Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: [1769438983980] ControllerUPNPBrowser::clearAddPlayTrack Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand stop Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: sendMpdCommand stop took 64 milliseconds Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: sendMpdCommand stop took 15 milliseconds Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand clear Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:43 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 10 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand clear took 9 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 8 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 6 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand load "http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219201.flac" Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService stop Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus stop Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: No code Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService stop Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus stop Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: No code Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 24ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 24ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: error: updateQueue error: null Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 21ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 21 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 32ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand add "http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219201.flac" Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: error: updateQueue error: null Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: error: updateQueue error: null Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 72ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 71ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand add "http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219201.flac" took 2 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::setConsumeUpdateService mpd Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand play Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 6ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand play took 5 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 5ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 3ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 29 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 13 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 10 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces system playlist update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Ignoring MPD Status Update Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: ---------------------------- MPD announces state update: player Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ControllerMpd::getState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand status Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 33ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 29 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 26 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 24 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 22 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 20ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 16 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 15ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand status took 13 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":430,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Layla","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219201.flac","trackType":"flac"} Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus stop Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":869,"duration":430,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"Layla","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219201.flac","trackType":"flac"} Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus play Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Received an update from plugin. extracting info from payload Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":869,"duration":430,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"Layla","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219201.flac","trackType":"flac"} Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus play Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Received an update from plugin. extracting info from payload Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 110ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 122ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 106ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 62 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 58 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: sendMpdCommand playlistinfo took 57 milliseconds Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: ControllerMpd::parseTrackInfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":869,"duration":430,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"Layla","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219201.flac","trackType":"flac"} Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus play Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Received an update from plugin. extracting info from payload Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":869,"duration":430,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"Layla","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219201.flac","trackType":"flac"} Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus play Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Received an update from plugin. extracting info from payload Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ControllerMpd::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::servicePushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getTrack 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: STATE SERVICE {"status":"play","position":0,"seek":869,"duration":430,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"Layla","artist":"Eric Clapton","album":"The Cream Of Clapton","uri":"http://192.168.1.116:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I7219201.flac","trackType":"flac"} Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: verbose: CURRENT POSITION 25 Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState stateService play Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::syncState currentStatus play Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: Received an update from plugin. extracting info from payload Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::pushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioPushState Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 155ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 140ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: ------------------------------ 134ms Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::volumioGetQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CoreStateMachine::getQueue Jan 26 23:49:44 zeus-volumio-3b volumio[1136]: info: CorePlayQueue::getQueue Jan 26 23:49:58 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri Jan 26 23:49:58 zeus-volumio-3b volumio[1136]: info: Preload queue cleared Jan 26 23:49:58 zeus-volumio-3b volumio[1136]: info: Preloading song: upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$35055P0R5580289 Jan 26 23:49:59 zeus-volumio-3b volumio[1136]: info: Exploding uri upnp/http://192.168.1.116:9000/dev0/srv1/control@0$1$9$35055P0R5580289 in service upnp_browser Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: TypeError: Cannot read property 'length' of undefined Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at /volumio/app/plugins/music_service/upnp_browser/index.js:341:25 Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at /volumio/app/plugins/music_service/upnp_browser/dlna-browser.js:131:13 Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at Parser. (/volumio/node_modules/xml2js/lib/parser.js:304:18) Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at Parser.emit (events.js:315:20) Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at SAXParser.onclosetag (/volumio/node_modules/xml2js/lib/parser.js:262:26) Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at emit (/volumio/node_modules/sax/lib/sax.js:624:35) Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at emitNode (/volumio/node_modules/sax/lib/sax.js:629:5) Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at closeTag (/volumio/node_modules/sax/lib/sax.js:889:7) Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at SAXParser.write (/volumio/node_modules/sax/lib/sax.js:1436:13) Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at Parser.exports.Parser.Parser.parseString (/volumio/node_modules/xml2js/lib/parser.js:323:31) Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at Parser.parseString (/volumio/node_modules/xml2js/lib/parser.js:5:59) Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at Object.exports.parseString (/volumio/node_modules/xml2js/lib/parser.js:369:19) Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at IncomingMessage. (/volumio/app/plugins/music_service/upnp_browser/dlna-browser.js:92:15) Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at IncomingMessage.emit (events.js:327:22) Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at endReadableNT (internal/streams/readable.js:1327:12) Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: at processTicksAndRejections (internal/process/task_queues.js:80:21) Jan 26 23:50:05 zeus-volumio-3b volumio[1136]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jan 26 23:50:05 zeus-volumio-3b sudo[6640]: volumio : unable to resolve host zeus-volumio-3b Jan 26 23:50:05 zeus-volumio-3b sudo[6640]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Jan 26 23:50:05 zeus-volumio-3b sudo[6640]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2026-01-26 23:49 Jan 26 23:50:05 zeus-volumio-3b sudo[6640]: 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="29866754e5f1d7e4d0f581c10d9f22852f6f21db" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="fc4c820ddd3b5fc1a7a6b54ef112273ebd122010" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Sat 26 Jul 2025 10:25:36 AM CEST" VOLUMIO_VERSION="3.832" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="cf6e14681b2ecbbdc9a62186b0f3114c"