Announcement

Collapse
No announcement yet.

Plugin Stopped working?

Collapse
X
 
  • Filter
  • Time
  • Show
Clear All
new posts

  • #16
    Here's my helpdesk screen if that helps:


    Current Date/Time: 10/19/2019 9:29:20 AM
    HomeSeer Version: HS3 Pro Edition 3.0.0.534
    Linux version: Linux hometrollerSEL 3.16.0-031600-generic #201408031935 SMP Sun Aug 3 23:56:17 UTC 2014 i686 i686 i686 GNU/Linux System Uptime: 0 Days 0 Hours 11 Minutes 10 Seconds
    IP Address: 127.0.0.1
    Number of Devices: 716
    Number of Events: 41
    Available Threads: 199
    HSTouch Enabled: True
    Event Threads: 1
    Event Trigger Eval Queue: 0
    Event Trigger Priority Eval Queue: 0
    Device Exec Queue: 0
    HSTouch Event Queue: 0
    Email Send Queue: 0
    License: Registered
    License: 100940
    User Name and Access Level: barrascaHm20 (Admin)
    WAN IP Address: 69.136.122.40
    Web Server Port: 80
    Location: (Latitude) 32.22 (Longitude) -110.97 City/State-US-Arizona,Tucson,-110.97,32.22

    Enabled Plug-Ins
    2.0.11.0: BLEditor
    3.0.28.0: BLLock
    3.0.0.34: Nest
    3.0.2.20: OMNI
    3.1.0.36: Sonos
    3.0.1.262: Z-Wave

    Comment


    • #17
      Originally posted by bbos View Post
      Oh, i just noticed two other things;
      1. On my plugin page, the Sonos plugin was showing "INFO: Plugin start is pending" in the Plug-in Status column. Was that way for a hour or so...
      2. On the Log page, the ONLY choices in the dropdown were SONOS related (which is what i attached to the last post). The rest were gone!

      So, I rebooted the system. Once it was back up, the two conditions above cleared (the plugin page was clear and the log functionality returned to normal), but now NO Sonos functionality works. the device page controls have an effect and my test TTS event does not appear to affect anything either, although I did see some log entries. I'm reposting my log since the reboot.

      I'm seeing a lot of "Error in MySSDP.CreateMulticastListener. No Client! " entries as well as other errors.

      Any suggestions on where I go from here?
      Sorry to hear.

      The first log file in, 2 posting ago, is all about UPNP which is not what we're interested in right now. So ONLY set the DEBUG flag, DON'T set the SUPERDEBUG flag and DON'T raise the UPNP DEBUG LEVEL above errors only. If you are on version .37 then set PI debug level to events.

      The log attached to your latest posting, appears corrupt so no idea what's in there. I would recommend that you also set the log to disk flag. Then restart the system, wait for a few minutes until all should be initialized. Clear the "log to disk" flag and now go to <hs root>\html\sonos\logs and grab the log file and post that one here so I don''t have issue with formatting or incomplete logs.

      As to your posting, not sure what exactly you are referring to with the loopback address but this PI DOES use the loopback address, which is very standard for any device. I suspect on a Linux system you could disable that but that would be very uncommon and probably just wrong.
      I think this is running on a SEL but for the sake of completeness, which OS is this running on, which version of HS, which version of the PI.

      Last but not least, when you said you started from a virgin system, did the system remain a virgin :-) Sorry for the levity here but after you installed HS from fresh, did you install all PI from fresh or attempted to copy certain things (files, subdirectories, DBs, backups) from another system?

      Shouldn't be too hard to figure out.

      Dirk

      Comment


      • #18
        Originally posted by bbos View Post
        Here's my helpdesk screen if that helps:


        Current Date/Time: 10/19/2019 9:29:20 AM
        HomeSeer Version: HS3 Pro Edition 3.0.0.534
        Linux version: Linux hometrollerSEL 3.16.0-031600-generic #201408031935 SMP Sun Aug 3 23:56:17 UTC 2014 i686 i686 i686 GNU/Linux System Uptime: 0 Days 0 Hours 11 Minutes 10 Seconds
        IP Address: 127.0.0.1
        Number of Devices: 716
        Number of Events: 41
        Available Threads: 199
        HSTouch Enabled: True
        Event Threads: 1
        Event Trigger Eval Queue: 0
        Event Trigger Priority Eval Queue: 0
        Device Exec Queue: 0
        HSTouch Event Queue: 0
        Email Send Queue: 0
        License: Registered
        License: 100940
        User Name and Access Level: barrascaHm20 (Admin)
        WAN IP Address: 69.136.122.40
        Web Server Port: 80
        Location: (Latitude) 32.22 (Longitude) -110.97 City/State-US-Arizona,Tucson,-110.97,32.22

        Enabled Plug-Ins
        2.0.11.0: BLEditor
        3.0.28.0: BLLock
        3.0.0.34: Nest
        3.0.2.20: OMNI
        3.1.0.36: Sonos
        3.0.1.262: Z-Wave
        I think our post crossed each other in the night. Now I see what you mean about the loopback address. I guess we need to focus on that log.

        Comment


        • #19
          Originally posted by bbos View Post
          Here's my helpdesk screen if that helps:


          Current Date/Time: 10/19/2019 9:29:20 AM
          HomeSeer Version: HS3 Pro Edition 3.0.0.534
          Linux version: Linux hometrollerSEL 3.16.0-031600-generic #201408031935 SMP Sun Aug 3 23:56:17 UTC 2014 i686 i686 i686 GNU/Linux System Uptime: 0 Days 0 Hours 11 Minutes 10 Seconds
          IP Address: 127.0.0.1
          Number of Devices: 716
          Number of Events: 41
          Available Threads: 199
          HSTouch Enabled: True
          Event Threads: 1
          Event Trigger Eval Queue: 0
          Event Trigger Priority Eval Queue: 0
          Device Exec Queue: 0
          HSTouch Event Queue: 0
          Email Send Queue: 0
          License: Registered
          License: 100940
          User Name and Access Level: barrascaHm20 (Admin)
          WAN IP Address: 69.136.122.40
          Web Server Port: 80
          Location: (Latitude) 32.22 (Longitude) -110.97 City/State-US-Arizona,Tucson,-110.97,32.22

          Enabled Plug-Ins
          2.0.11.0: BLEditor
          3.0.28.0: BLLock
          3.0.0.34: Nest
          3.0.2.20: OMNI
          3.1.0.36: Sonos
          3.0.1.262: Z-Wave
          You seem to have access to this system, is it via a browser on the same device? I quickly checked my linux deployment and it shows the proper IP address. Given you pulled this info of the system, is the network binding perhaps set to loopback? If you pulled this info off the system through a browser running on the system, are you sure you have proper network connectivity (I would think so but just checking)

          Comment


          • #20
            Ok, upgraded the plugin to .37. Then I reset the "log to file" flag, restarted, let it run for a few, then disabled the flag. It is attached.

            This unit is on my direct network, so I have physical access to the machine. I just don't have a keyboard, mouse and monitor connected (but can if needed).

            My access is via direct browser.

            My Linux skills are not very strong, so I installed the BLEditor PI from Blade. it lets you view and change files on the system, but NOT export them as is. So, I had to view them, then copy paste. If you tell me another format that would work better, i'd be happy to try and accommodate. In the attached Log, i highlighted the system is definately looking for connection on the loopback IP.

            Currently, nothing seems to work...

            When I started "virgin", I installed all the plugins via fresh downloads. the only thing carried over was my ZWave stick and it's assoc db of Zwave devices. Close to virgin?

            I don't know how to "set my system's network binding from loopback to another value". Is that what needs to be done? Any advice?
            Attached Files

            Comment


            • #21
              This is the result when I run 'ip addr show' on the linux command line. 10.100.100.178 is the correct IP of the system:

              running command ip addr show
              1: lo: <LOOPBACK,UP,LOWER_UP> mtu 65536 qdisc noqueue state UNKNOWN group default link/loopback 00:00:00:00:00:00 brd 00:00:00:00:00:00 inet 127.0.0.1/8 scope host lo valid_lft forever preferred_lft forever inet6 ::1/128 scope host valid_lft forever preferred_lft forever 2: eth1: <BROADCAST,MULTICAST,UP,LOWER_UP> mtu 1500 qdisc pfifo_fast state UP group default qlen 1000 link/ether e0:d5:5e:9c:43:2b brd ff:ff:ff:ff:ff:ff inet 10.100.100.178/24 brd 10.100.100.255 scope global eth1 valid_lft forever preferred_lft forever inet6 fe80::e2d5:5eff:fe9c:432b/64 scope link valid_lft forever preferred_lft forever 3: wlan1: <NO-CARRIER,BROADCAST,MULTICAST,UP> mtu 1500 qdisc mq state DOWN group default qlen 1000 link/ether 80:c5:f2:1b:3f:f1 brd ff:ff:ff:ff:ff:ff

              Comment


              • #22
                ugh... formatting. trying again: Click image for larger version

Name:	Screen Shot 2019-10-19 at 12.46.44 PM.png
Views:	78
Size:	55.3 KB
ID:	1334240
                Attached Files

                Comment


                • #23
                  Originally posted by bbos View Post
                  Ok, upgraded the plugin to .37. Then I reset the "log to file" flag, restarted, let it run for a few, then disabled the flag. It is attached.

                  This unit is on my direct network, so I have physical access to the machine. I just don't have a keyboard, mouse and monitor connected (but can if needed).

                  My access is via direct browser.

                  My Linux skills are not very strong, so I installed the BLEditor PI from Blade. it lets you view and change files on the system, but NOT export them as is. So, I had to view them, then copy paste. If you tell me another format that would work better, i'd be happy to try and accommodate. In the attached Log, i highlighted the system is definately looking for connection on the loopback IP.

                  Currently, nothing seems to work...

                  When I started "virgin", I installed all the plugins via fresh downloads. the only thing carried over was my ZWave stick and it's assoc db of Zwave devices. Close to virgin?

                  I don't know how to "set my system's network binding from loopback to another value". Is that what needs to be done? Any advice?
                  I think the loopback interface is in "unknown state", not sure what's up with that. This is what I have

                  Code:
                  lo: flags=73<UP,LOOPBACK,RUNNING>  mtu 65536
                          inet 127.0.0.1  netmask 255.0.0.0
                          inet6 ::1  prefixlen 128  scopeid 0x10<host>
                          loop  txqueuelen 1000  (Local Loopback)
                          RX packets 30593636  bytes 5456955706 (5.4 GB)
                          RX errors 0  dropped 0  overruns 0  frame 0
                          TX packets 30593636  bytes 5456955706 (5.4 GB)
                          TX errors 0  dropped 0 overruns 0  carrier 0  collisions 0

                  Comment


                  • #24
                    Originally posted by dcorsus View Post

                    I think the loopback interface is in "unknown state", not sure what's up with that. This is what I have

                    Code:
                    lo: flags=73<UP,LOOPBACK,RUNNING> mtu 65536
                    inet 127.0.0.1 netmask 255.0.0.0
                    inet6 ::1 prefixlen 128 scopeid 0x10<host>
                    loop txqueuelen 1000 (Local Loopback)
                    RX packets 30593636 bytes 5456955706 (5.4 GB)
                    RX errors 0 dropped 0 overruns 0 frame 0
                    TX packets 30593636 bytes 5456955706 (5.4 GB)
                    TX errors 0 dropped 0 overruns 0 carrier 0 collisions 0
                    Ignore my quote, the interface is up.

                    Do you have a network binding set in HS? You can find it by clicking on Tools->Setup->Labs and look at the "bind server to Ip Address"? Whatever you have selected there, the PI will try to follow. I recommend setting to no binding.
                    If you take more traces, please do not edit things out, and don't copy to word docs. If you feel uncomfortable posting the logs here them PM them to me. Could you post at least the full log to see if there is anything else I can spot.

                    Comment


                    • #25
                      Server is set to "no binding". I have never changed that setting. It was not my intent to "edit" the logs, other than I highlighted some entries I saw of interest. Here is the actual log, as is, since I rebooted:
                      Oct-19 1:39:15 PM Info Plugin Nest with instance: has disconnected
                      Oct-19 1:38:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:38:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:37:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:37:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:36:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:36:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:35:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:35:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:34:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:34:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:33:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:33:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:32:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:32:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:31:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:31:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:30:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:30:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:30:25 PM Z-Wave Device: Lights Guest House Gst Living Room Desk Light Set to OFF
                      Oct-19 1:30:24 PM Z-Wave Device: Lights Guest House Gst Living Room Desk Light Set to 26%
                      Oct-19 1:30:24 PM Z-Wave Device: Lights Guest House Gst Living Room Desk Light Central Scene Set to 2000
                      Oct-19 1:30:22 PM Z-Wave Warning No response from device when getting level: Lights Guest House Gst Living Room Desk Light, Node: 121
                      Oct-19 1:30:21 PM Z-Wave Device: Lights Guest House Gst Living Room Desk Light Set to 98%
                      Oct-19 1:30:21 PM Z-Wave Device: Lights Guest House Gst Living Room Desk Light Central Scene Set to 1001
                      Oct-19 1:30:18 PM Z-Wave Device: Lights Guest House Gst Living Room Desk Light Central Scene Set to 1002
                      Oct-19 1:30:18 PM Z-Wave Device: Lights Guest House Gst Living Room Desk Light Set to 1%
                      Oct-19 1:30:18 PM Z-Wave Device: Lights Guest House Gst Living Room Desk Light Central Scene Set to 1000
                      Oct-19 1:29:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:29:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:29:04 PM Starting Plug-In Plugin BLEditor started successfully in 177 milliseconds
                      Oct-19 1:29:04 PM BLEditor start BLEditor plugin has been initialized
                      Oct-19 1:29:04 PM BLEditor start Directories have been loaded.
                      Oct-19 1:29:04 PM BLEditor start Loaded configuration successfully
                      Oct-19 1:29:04 PM BLEditor start BLEditor version is: 2.0.11.0
                      Oct-19 1:29:04 PM BLEditor start Initializing BLEditor...
                      Oct-19 1:29:04 PM Starting Plug-In Initializing plugin BLEditor ...
                      Oct-19 1:29:04 PM Starting Plug-In BLEditor loaded in 15094 milliseconds
                      Oct-19 1:28:49 PM Info Plugin BLEditor has connected. IP:127.0.0.1:41462
                      Oct-19 1:28:48 PM Info Plugin BLEditor with instance: has disconnected
                      Oct-19 1:28:48 PM Warning I/O interface BLEditor is down, executable is not running, restarting ...
                      Oct-19 1:28:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:28:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:27:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:27:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:27:22 PM Warning Plugin BLEditor is not responding but it is still running, not restarting yet.
                      Oct-19 1:26:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:26:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:25:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:25:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:24:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:24:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:23:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:23:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:22:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:22:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:22:36 PM Z-Wave Device: Lights Guest House Motion Sensor Set to NOTIFICATION for type Home Security, Event: Unknown
                      Oct-19 1:21:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:21:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:20:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:20:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:19:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:19:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:19:22 PM Warning Plugin BLEditor is not responding but it is still running, not restarting yet.
                      Oct-19 1:18:58 PM Z-Wave Device: Lights South Bedroom South Bedroom Fan Lights Set to OFF
                      Oct-19 1:18:58 PM Z-Wave Device: Lights South Bedroom South Bedroom Fan Lights Central Scene Set to 2000
                      Oct-19 1:18:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:18:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:17:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:17:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:16:48 PM Z-Wave Device: Lights South Bedroom South Bedroom Closet Light Set to OFF
                      Oct-19 1:16:47 PM Z-Wave Device: Lights South Bedroom South Bedroom Closet Light Central Scene Set to 2000
                      Oct-19 1:16:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:16:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:15:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:15:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:15:00 PM Log Info The log database is currently 31.54MB in size.
                      Oct-19 1:14:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:14:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:13:59 PM Z-Wave Device: Lights South Bedroom South Bedroom Closet Light Set to 84%
                      Oct-19 1:13:58 PM Z-Wave Device: Lights South Bedroom South Bedroom Closet Light Central Scene Set to 1001
                      Oct-19 1:13:57 PM Z-Wave Device: Lights South Bedroom South Bedroom Closet Light Central Scene Set to 1002
                      Oct-19 1:13:48 PM Z-Wave Device: Lights South Bedroom South Bedroom Fan Lights Set to 36%
                      Oct-19 1:13:48 PM Z-Wave Device: Lights South Bedroom South Bedroom Fan Lights Central Scene Set to 1000
                      Oct-19 1:13:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:13:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:12:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:12:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:11:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:11:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:11:22 PM Warning Plugin BLEditor is not responding but it is still running, not restarting yet.
                      Oct-19 1:10:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:10:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:09:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:09:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:08:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:08:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:07:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:07:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:06:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:06:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:06:00 PM Energy DB Info All energy database compacting routines completed.
                      Oct-19 1:06:00 PM Energy DB Database is 0.0390625 MB in size. No further compaction needed.
                      Oct-19 1:06:00 PM Energy DB Info Compacting remaining data...
                      Oct-19 1:06:00 PM Energy DB Info Compacting data older than 4 months...
                      Oct-19 1:06:00 PM Energy DB Info Compacting data older than 1 year...
                      Oct-19 1:06:00 PM Energy DB Info Compacting data older than 3 years...
                      Oct-19 1:06:00 PM Energy DB Info Compacting data older than 5 years...
                      Oct-19 1:06:00 PM Energy DB Info Compacting data older than 10 years...
                      Oct-19 1:06:00 PM Energy DB Info Energy database compaction initiated.
                      Oct-19 1:05:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:05:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:04:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:04:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:03:40 PM Error Getting plugin GenPage: Object reference not set to an instance of an object
                      Oct-19 1:03:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:03:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:03:35 PM Error Getting plugin in PagePut: Object reference not set to an instance of an object
                      Oct-19 1:03:21 PM Warning Plugin BLEditor is not responding but it is still running, not restarting yet.
                      Oct-19 1:02:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:02:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:01:51 PM Z-Wave Device: Lights Guest House Guest House FloodLights Set to OFF
                      Oct-19 1:01:49 PM Z-Wave Device: Lights Guest House Motion Sensor Set to NOTIFICATION for type Home Security, Event: No Event
                      Oct-19 1:01:46 PM Z-Wave Device: Lights Guest House Guest House FloodLights Set to ON
                      Oct-19 1:01:44 PM Z-Wave Device: Lights Guest House Motion Sensor Set to NOTIFICATION for type Home Security, Event: Motion Detected
                      Oct-19 1:01:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:01:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 1:00:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 1:00:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:59:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:59:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:58:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:58:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:57:52 PM Z-Wave Device: Lights Kids Hall / Bath Kids Hall Lights Set to 80%
                      Oct-19 12:57:52 PM Z-Wave Device: Lights Kids Hall / Bath Kids Hall Lites Central Scene Set to 1001
                      Oct-19 12:57:50 PM Z-Wave Device: Lights Kids Hall / Bath Kids Hall Lites Central Scene Set to 1002
                      Oct-19 12:57:49 PM Z-Wave Device: Lights Kids Hall / Bath Kids Hall Lights Set to 20%
                      Oct-19 12:57:48 PM Z-Wave Device: Lights Kids Hall / Bath Kids Hall Lites Central Scene Set to 1000
                      Oct-19 12:57:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:57:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:56:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:56:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:56:08 PM Error Getting plugin GenPage: Object reference not set to an instance of an object
                      Oct-19 12:56:08 PM Error Getting plugin GenPage: Object reference not set to an instance of an object
                      Oct-19 12:56:07 PM Error Getting plugin GenPage: Object reference not set to an instance of an object
                      Oct-19 12:56:06 PM Error Getting plugin GenPage: Object reference not set to an instance of an object
                      Oct-19 12:55:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:55:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:55:21 PM Warning Plugin BLEditor is not responding but it is still running, not restarting yet.
                      Oct-19 12:54:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:54:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:53:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:53:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:52:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:52:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:51:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:51:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:50:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:50:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:49:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:49:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:48:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:48:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:47:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:47:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:47:26 PM Error Getting plugin GenPage: Object reference not set to an instance of an object
                      Oct-19 12:47:21 PM Warning Plugin BLEditor is not responding but it is still running, not restarting yet.
                      Oct-19 12:46:59 PM Error Getting plugin in PagePut: Object reference not set to an instance of an object
                      Oct-19 12:46:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:46:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:45:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:45:36 PM Sonos ConnectSocket called with mcastAddress = 239.255.255.250 and mcastPort = 1900 and LocalIpAddress = 0.0.0.0 and LocalIPPort = 1900
                      Oct-19 12:45:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:45:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:45:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:45:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:44:36 PM Sonos Warning ReceiveCallback for RemoteEP = 239.255.255.250 and RemoteEP.port = 1900 and LocalIEP = 0.0.0.0 and LocalIEP.Port = 1900 has a closed Socket
                      Oct-19 12:44:36 PM Sonos Error Error in MySSDP.HandleMCastSocketCloseEvent received Close Socket Event. Will try to restart
                      Oct-19 12:44:36 PM Sonos Error Error in ReceiveCallback3 for mcastAddress = 239.255.255.250, RemoteEP = 239.255.255.250, RemoteEP.port = 1900, LocalIEP = 0.0.0.0, LocalIEP.Port = 1900 and Bytes read = 0; start receiving with error = The object was used after being disposed.
                      Oct-19 12:44:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:44:36 PM Sonos ConnectSocket called with mcastAddress = 239.255.255.250 and mcastPort = 1900 and LocalIpAddress = 0.0.0.0 and LocalIPPort = 1900
                      Oct-19 12:44:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:43:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:43:36 PM Sonos ConnectSocket called with mcastAddress = 239.255.255.250 and mcastPort = 1900 and LocalIpAddress = 0.0.0.0 and LocalIPPort = 1900
                      Oct-19 12:43:36 PM Sonos ConnectSocket called with mcastAddress = 239.255.255.250 and mcastPort = 1900 and LocalIpAddress = 0.0.0.0 and LocalIPPort = 1900
                      Oct-19 12:43:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:43:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:43:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:43:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:42:36 PM Sonos Warning ReceiveCallback for RemoteEP = 239.255.255.250 and RemoteEP.port = 1900 and LocalIEP = 0.0.0.0 and LocalIEP.Port = 1900 has a closed Socket
                      Oct-19 12:42:36 PM Sonos Error Error in MySSDP.HandleMCastSocketCloseEvent received Close Socket Event. Will try to restart
                      Oct-19 12:42:36 PM Sonos Error Error in ReceiveCallback3 for mcastAddress = 239.255.255.250, RemoteEP = 239.255.255.250, RemoteEP.port = 1900, LocalIEP = 0.0.0.0, LocalIEP.Port = 1900 and Bytes read = 0; start receiving with error = The object was used after being disposed.
                      Oct-19 12:42:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:42:36 PM Sonos ConnectSocket called with mcastAddress = 239.255.255.250 and mcastPort = 1900 and LocalIpAddress = 0.0.0.0 and LocalIPPort = 1900
                      Oct-19 12:42:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the Listener
                      Oct-19 12:41:36 PM Sonos Error Error in Receive for mcastAddress = 239.255.255.250. No Socket
                      Oct-19 12:41:36 PM Sonos ConnectSocket called with mcastAddress = 239.255.255.250 and mcastPort = 1900 and LocalIpAddress = 0.0.0.0 and LocalIPPort = 1900
                      Oct-19 12:41:36 PM Sonos Error MyTcpListener.Start had an error while start listening on HostAddress = 127.0.0.1 and HostIPPort = 36306 with Error = Address already in use
                      Oct-19 12:41:36 PM Sonos ConnectSocket called with mcastAddress = 239.255.255.250 and mcastPort = 1900 and LocalIpAddress = 0.0.0.0 and LocalIPPort = 1900
                      Oct-19 12:41:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:41:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:40:36 PM Sonos Warning ReceiveCallback for RemoteEP = 239.255.255.250 and RemoteEP.port = 1900 and LocalIEP = 0.0.0.0 and LocalIEP.Port = 1900 has a closed Socket
                      Oct-19 12:40:36 PM Sonos Error Error in MySSDP.HandleMCastSocketCloseEvent received Close Socket Event. Will try to restart
                      Oct-19 12:40:36 PM Sonos Error Error in ReceiveCallback3 for mcastAddress = 239.255.255.250, RemoteEP = 239.255.255.250, RemoteEP.port = 1900, LocalIEP = 0.0.0.0, LocalIEP.Port = 1900 and Bytes read = 0; start receiving with error = The object was used after being disposed.
                      Oct-19 12:40:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:40:36 PM Sonos ConnectSocket called with mcastAddress = 239.255.255.250 and mcastPort = 1900 and LocalIpAddress = 0.0.0.0 and LocalIPPort = 1900
                      Oct-19 12:40:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:39:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:39:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:39:36 PM Sonos ConnectSocket called with mcastAddress = 239.255.255.250 and mcastPort = 1900 and LocalIpAddress = 0.0.0.0 and LocalIPPort = 1900
                      Oct-19 12:39:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:38:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:38:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:38:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:37:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:37:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:37:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:36:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:36:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:36:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:35:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:35:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:35:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:34:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:34:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:34:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:33:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:33:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:33:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:32:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:32:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:32:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:31:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:31:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:31:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:31:30 PM Z-Wave Device: Lights Master Bedroom Master Bedroom Pendant Lights Set to 255
                      Oct-19 12:31:30 PM Z-Wave Device: Lights Master Bedroom Master Bedroom Pendant Lights Central Scene Set to 1000
                      Oct-19 12:31:28 PM Z-Wave Device: Lights Master Bedroom Master Bedroom Entry Can Light Central Scene Set to 1000
                      Oct-19 12:30:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:30:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:30:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:29:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:29:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:29:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:28:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:28:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:28:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:27:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:27:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:27:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:26:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:26:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:26:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:26:26 PM Device Control Device: Office Sonos Player to Play (1001) by/from: CAPI Control Handler
                      Oct-19 12:25:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:25:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:25:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:24:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:24:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:24:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:23:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:23:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:23:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:22:54 PM Z-Wave Device: Lights Guest House Gst Bath Passthru Closet Light Set to 0
                      Oct-19 12:22:54 PM Z-Wave Device: Lights Guest House Gst Bath Passthru Closet Light Central Scene Set to 2000
                      Oct-19 12:22:51 PM Z-Wave Device: Lights Guest House Gst Bath Passthru Closet Light Set to 255
                      Oct-19 12:22:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:22:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:22:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:21:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:21:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:21:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:20:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:20:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:20:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:19:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:19:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:19:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:18:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:18:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:18:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:17:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:17:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:17:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:16:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:16:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:16:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:15:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:15:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:15:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:14:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:14:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:14:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:13:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:13:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:13:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:12:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:12:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:12:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:11:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:11:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:11:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:11:00 PM BLLock 3 locks have been loaded
                      Oct-19 12:10:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:10:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:10:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:09:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:09:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:09:36 PM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                      Oct-19 12:09:12 PM TTS Speak: ():Welcome to Home-Seer
                      Oct-19 12:08:58 PM Z-Wave Starting Z-Wave Polling for Network FFEFCAED...
                      Oct-19 12:08:53 PM Info System connected to MyHS Service successfully with license ID 100940.
                      Oct-19 12:08:53 PM Info System connected to MyHS Service, waiting for acknowledge...
                      Oct-19 12:08:45 PM Sonos Registered SpeakerProxy
                      Oct-19 12:08:45 PM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Playroom/Garage with index 8
                      Oct-19 12:08:44 PM Starting Plug-In Plugin Sonos started successfully in 5 milliseconds
                      Oct-19 12:08:44 PM Sonos InitIO Called for Instance = RINCON_949F3EB84C1601400 and running on OS = Unix
                      Oct-19 12:08:44 PM Starting Plug-In Initializing plugin Sonos ...
                      Oct-19 12:08:44 PM Info Plugin Sonos with instance RINCON_949F3EB84C1601400 has connected. IP:127.0.0.1:40995
                      Oct-19 12:08:44 PM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Office with index 7
                      Oct-19 12:08:44 PM Web Server Web Server authorized local login successful from: 127.0.0.1 User: barrascaHm20
                      Oct-19 12:08:44 PM BLLock Searching for Z-Wave locks...
                      Oct-19 12:08:43 PM Starting Plug-In Plugin Sonos started successfully in 5 milliseconds
                      Oct-19 12:08:43 PM Sonos InitIO Called for Instance = RINCON_347E5C00313201400 and running on OS = Unix
                      Oct-19 12:08:43 PM Starting Plug-In Initializing plugin Sonos ...
                      Oct-19 12:08:43 PM Info Plugin Sonos with instance RINCON_347E5C00313201400 has connected. IP:127.0.0.1:40992
                      Oct-19 12:08:43 PM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Kitchen with index 6
                      Oct-19 12:08:42 PM Starting Plug-In Plugin Sonos started successfully in 5 milliseconds
                      Oct-19 12:08:42 PM Sonos InitIO Called for Instance = RINCON_347E5C00315601400 and running on OS = Unix
                      Oct-19 12:08:42 PM Starting Plug-In Initializing plugin Sonos ...
                      Oct-19 12:08:42 PM Info Plugin Sonos with instance RINCON_347E5C00315601400 has connected. IP:127.0.0.1:40990
                      Oct-19 12:08:42 PM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Outdoors with index 5
                      Oct-19 12:08:42 PM Starting Plug-In Plugin Sonos started successfully in 7 milliseconds
                      Oct-19 12:08:42 PM Sonos InitIO Called for Instance = RINCON_949F3EB828F801400 and running on OS = Unix
                      Oct-19 12:08:42 PM Starting Plug-In Initializing plugin Sonos ...
                      Oct-19 12:08:42 PM Starting Plug-In Plugin Sonos started successfully in 5 milliseconds
                      Oct-19 12:08:42 PM Sonos InitIO Called for Instance = RINCON_347E5C00DBAE01400 and running on OS = Unix
                      Oct-19 12:08:42 PM Starting Plug-In Initializing plugin Sonos ...
                      Oct-19 12:08:42 PM Starting Plug-In Plugin Sonos started successfully in 6 milliseconds
                      Oct-19 12:08:42 PM Sonos InitIO Called for Instance = RINCON_949F3EB8265801400 and running on OS = Unix
                      Oct-19 12:08:42 PM Starting Plug-In Initializing plugin Sonos ...
                      Oct-19 12:08:41 PM Z-Wave ************************************************************ *******************
                      Oct-19 12:08:41 PM Z-Wave STARTUP COMPLETE: All configured interfaces were successfully initialized.
                      Oct-19 12:08:41 PM Z-Wave ************************************************************ *******************
                      Oct-19 12:08:41 PM Startup Start up complete.
                      Oct-19 12:08:41 PM Info No device issues found
                      Oct-19 12:08:41 PM Warning Device (383) Lights Front Yard Street Cul-de-Sac Lights references a parent, but the parent does not reference this child
                      Oct-19 12:08:41 PM Warning Issue checking child device (383) Lights Front Yard Street Cul-de-Sac Lights
                      Oct-19 12:08:41 PM Warning Device (382) Lights Front Yard Street Cul-de-Sac Lights Central Scene references a parent, but the parent does not reference this child
                      Oct-19 12:08:41 PM Warning Issue checking child device (382) Lights Front Yard Street Cul-de-Sac Lights Central Scene
                      Oct-19 12:08:41 PM Info Checking device parent child relationships...
                      Oct-19 12:08:41 PM Error Downloading update control file: Error: NameResolutionFailure
                      Oct-19 12:08:41 PM Info Checking for updates...
                      Oct-19 12:08:41 PM Warning MyHS could not connect to server: Could not resolve host 'connected2.homeseer.com'
                      Oct-19 12:08:41 PM Startup Starting the HS3 Sentry EXE
                      Oct-19 12:08:41 PM Startup (Startup.vb script) No speaker clients detected, waiting up to 30 seconds for any to connect...
                      Oct-19 12:08:41 PM Startup (Startup.vb script) Scripting is OK and is now running Startup.vb
                      Oct-19 12:08:41 PM Startup Starting HSSentry watchdog.
                      Oct-19 12:08:41 PM Startup Starting Event Scheduler...
                      Oct-19 12:08:41 PM Info Plugin Sonos with instance RINCON_949F3EB828F801400 has connected. IP:127.0.0.1:40988
                      Oct-19 12:08:41 PM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Studio with index 4
                      Oct-19 12:08:40 PM Info Plugin Sonos with instance RINCON_347E5C00DBAE01400 has connected. IP:127.0.0.1:40986
                      Oct-19 12:08:40 PM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Living Room with index 3
                      Oct-19 12:08:39 PM Info Plugin Sonos with instance RINCON_949F3EB8265801400 has connected. IP:127.0.0.1:40984
                      Oct-19 12:08:39 PM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Master Bedroom with index 2
                      Oct-19 12:08:38 PM Startup Running the startup script Startup.vb
                      Oct-19 12:08:38 PM Starting Plug-In Plugin Sonos started successfully in 405 milliseconds
                      Oct-19 12:08:38 PM Sonos InitIO Called for Instance = RINCON_347E5C00316B01400 and running on OS = Unix
                      Oct-19 12:08:38 PM Startup Starting Find service...
                      Oct-19 12:08:38 PM Startup Updater services starting...
                      Oct-19 12:08:38 PM Starting Plug-In Initializing plugin Sonos ...
                      Oct-19 12:08:37 PM Info Plugin Sonos with instance RINCON_347E5C00316B01400 has connected. IP:127.0.0.1:40982
                      Oct-19 12:08:37 PM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Dining / Laundry with index 1
                      Oct-19 12:08:36 PM Starting Plug-In Plugin Sonos started successfully in 9 milliseconds
                      Oct-19 12:08:36 PM Sonos InitIO Called for Instance = RINCON_347E5C0030FC01400 and running on OS = Unix
                      Oct-19 12:08:36 PM Starting Plug-In Initializing plugin Sonos ...
                      Oct-19 12:08:36 PM Info Plugin Sonos with instance RINCON_347E5C0030FC01400 has connected. IP:127.0.0.1:40980
                      Oct-19 12:08:36 PM Sonos Error ERROR in FindZonePlayers. Error = Object reference not set to an instance of an object
                      Oct-19 12:08:36 PM Sonos Warning No UPnPDevices found. Please ensure the network is functional and that UPnPDevices devices are attached.
                      Oct-19 12:08:36 PM Sonos Error Error in MySSDP.StartSSDPDiscovery. No Loopback Client!
                      Oct-19 12:08:36 PM Sonos Error Error in ConnectSocket for mcastAddress = 239.255.255.250 with error = Network subsystem is down
                      Oct-19 12:08:36 PM Sonos ConnectSocket called with mcastAddress = 239.255.255.250 and mcastPort = 1900 and LocalIpAddress = 0.0.0.0 and LocalIPPort = 0
                      Oct-19 12:08:36 PM Sonos ConnectSocket called with mcastAddress = 239.255.255.250 and mcastPort = 1900 and LocalIpAddress = 127.0.0.1 and LocalIPPort = 0
                      Oct-19 12:08:36 PM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                      Oct-19 12:08:36 PM Sonos Error Error in ConnectSocket for mcastAddress = 239.255.255.250 with error = Network subsystem is down
                      Oct-19 12:08:36 PM Sonos ConnectSocket called with mcastAddress = 239.255.255.250 and mcastPort = 1900 and LocalIpAddress = 0.0.0.0 and LocalIPPort = 1900
                      Oct-19 12:08:36 PM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                      Oct-19 12:08:36 PM Database Opening (Mode=Read/Write) up HomeSeer Energy database /usr/local/HomeSeer/Data/Energy/Energy.hsd
                      Oct-19 12:08:36 PM Speech Listening for remote speaker connections on port 10401
                      Oct-19 12:08:36 PM Z-Wave Zwave Stick: ............................................................ ..........
                      Oct-19 12:08:36 PM Z-Wave Zwave Stick: .............................. FINISHED ..............................
                      Oct-19 12:08:36 PM Z-Wave Zwave Stick: ............................................................ ..........
                      Oct-19 12:08:36 PM Z-Wave Zwave Stick is the SIS for the network.
                      Oct-19 12:08:36 PM Z-Wave Zwave Stick There is a SUC/SIS in the network.
                      Oct-19 12:08:36 PM Z-Wave Zwave Stick Controller is static lib.
                      Oct-19 12:08:36 PM Z-Wave Zwave Stick Controller chip type is ZW050x.
                      Oct-19 12:08:36 PM Startup Initializing Speaker Client Interface
                      Oct-19 12:08:36 PM Startup Start automation engine...
                      Oct-19 12:08:36 PM Startup HStouch server started, waiting for clients to connect.
                      Oct-19 12:08:36 PM Z-Wave The interface's security support has been set.
                      Oct-19 12:08:36 PM Z-Wave Zwave Stick: Found 133 Z-Wave nodes in interface node ID 1 (Zwave Stick)
                      Oct-19 12:08:36 PM Z-Wave Zwave Stick: Z-Wave interface node ID: 1, Home ID: FFEFCAED
                      Oct-19 12:08:36 PM Z-Wave Zwave Stick: Z-Wave Serial API version: 5
                      Oct-19 12:08:36 PM Z-Wave Zwave Stick: Z-Wave services for the SECURITY COMMAND CLASS were successfully started.
                      Oct-19 12:08:33 PM HSTouch Server Server started on port 10200
                      Oct-19 12:08:33 PM Plug-In Finished initializing plug-in Sonos
                      Oct-19 12:08:33 PM Starting Plug-In Sonos loaded in 1303 milliseconds
                      Oct-19 12:08:33 PM Starting Plug-In Plugin Sonos started successfully in 352 milliseconds
                      Oct-19 12:08:33 PM Sonos Sonos Plugin Initialized
                      Oct-19 12:08:33 PM Sonos InitIO Called for Instance = and running on OS = Unix
                      Oct-19 12:08:33 PM Starting Plug-In Initializing plugin Sonos ...
                      Oct-19 12:08:33 PM Info Plugin Sonos has connected. IP:127.0.0.1:40978
                      Oct-19 12:08:32 PM Plug-In Finished initializing plug-in OMNI
                      Oct-19 12:08:32 PM Starting Plug-In OMNI loaded in 3004 milliseconds
                      Oct-19 12:08:32 PM Starting Plug-In Plugin OMNI started successfully in 2157 milliseconds
                      Oct-19 12:08:30 PM Z-Wave Zwave Stick: Controller firmware version: 4.32
                      Oct-19 12:08:30 PM Starting Plug-In Initializing plugin OMNI ...
                      Oct-19 12:08:29 PM Info Plugin OMNI has connected. IP:127.0.0.1:40976
                      Oct-19 12:08:29 PM Plug-In Finished initializing plug-in BLEditor
                      Oct-19 12:08:29 PM Starting Plug-In BLEditor loaded in 1005 milliseconds
                      Oct-19 12:08:29 PM Starting Plug-In Plugin BLEditor started successfully in 169 milliseconds
                      Oct-19 12:08:29 PM BLEditor start BLEditor plugin has been initialized
                      Oct-19 12:08:29 PM BLEditor start Directories have been loaded.
                      Oct-19 12:08:29 PM BLEditor start Loaded configuration successfully
                      Oct-19 12:08:29 PM BLEditor start BLEditor version is: 2.0.11.0
                      Oct-19 12:08:29 PM BLEditor start Initializing BLEditor...
                      Oct-19 12:08:29 PM Starting Plug-In Initializing plugin BLEditor ...
                      Oct-19 12:08:28 PM Info Plugin BLEditor has connected. IP:127.0.0.1:40974
                      Oct-19 12:08:28 PM Z-Wave Device: Lights Master Bedroom Master Bedroom Entry Can Light Set to 79%
                      Oct-19 12:08:28 PM Z-Wave Zwave Stick: Getting node information from controller...
                      Oct-19 12:08:28 PM Z-Wave 465 Simple AV Control Command Class Control Commands have been loaded successfully.
                      Oct-19 12:08:28 PM Z-Wave Device: Lights Master Bedroom Master Bedroom Entry Can Light Central Scene Set to 1001
                      Oct-19 12:08:28 PM Z-Wave Zwave Stick: The Z-Wave API Execution Thread was Started or Restarted.
                      Oct-19 12:08:28 PM Z-Wave Zwave Stick: The Z-Wave Command Execution Thread was Started or Restarted.
                      Oct-19 12:08:28 PM Z-Wave Zwave Stick: ----------------------------------------------------------------------
                      Oct-19 12:08:28 PM Z-Wave Initializing Z-Wave interface Zwave Stick (HomeSeer SmartStick +) on /dev/ttyACM0
                      Oct-19 12:08:28 PM Z-Wave Zwave Stick: ----------------------------------------------------------------------
                      Oct-19 12:08:28 PM Z-Wave Zwave Stick: ============================================================ ==========
                      Oct-19 12:08:28 PM Z-Wave 0 event triggers were loaded from HomeSeer.
                      Oct-19 12:08:28 PM Z-Wave 0 event actions were loaded from HomeSeer.
                      Oct-19 12:08:28 PM Plug-In Finished initializing plug-in Z-Wave
                      Oct-19 12:08:28 PM Starting Plug-In Z-Wave loaded in 3104 milliseconds
                      Oct-19 12:08:28 PM Starting Plug-In Plugin Z-Wave started successfully in 2391 milliseconds
                      Oct-19 12:08:27 PM Z-Wave 352 total Z-Wave Data Objects loaded.
                      Oct-19 12:08:27 PM Z-Wave Network FFEFCAED has 352 device data elements.
                      Oct-19 12:08:27 PM Z-Wave 1 Networks were restored from the data in the database... Building data connections.
                      Oct-19 12:08:27 PM Z-Wave Loading Z-Wave Data Objects...
                      Oct-19 12:08:26 PM Z-Wave 1 total Z-Wave Network Objects loaded.
                      Oct-19 12:08:26 PM Z-Wave Loading Z-Wave Network Objects...
                      Oct-19 12:08:26 PM Z-Wave Database: Opening (Mode=Read Only) up HomeSeer database /usr/local/HomeSeer/Data/Z-Wave/Z-Wave2.db
                      Oct-19 12:08:25 PM Z-Wave InitIO called, plug-in version 3.0.1.262 is being initialized...
                      Oct-19 12:08:25 PM Starting Plug-In Initializing plugin Z-Wave ...
                      Oct-19 12:08:25 PM Info Plugin Z-Wave has connected. IP:127.0.0.1:40972
                      Oct-19 12:08:25 PM Plug-In Finished initializing plug-in Nest
                      Oct-19 12:08:25 PM Starting Plug-In Nest loaded in 1002 milliseconds
                      Oct-19 12:08:25 PM Starting Plug-In Plugin Nest started successfully in 150 milliseconds
                      Oct-19 12:08:24 PM Starting Plug-In Initializing plugin Nest ...
                      Oct-19 12:08:24 PM Info Plugin Nest has connected. IP:127.0.0.1:40970
                      Oct-19 12:08:24 PM Plug-In Finished initializing plug-in BLLock
                      Oct-19 12:08:24 PM Starting Plug-In BLLock loaded in 2005 milliseconds
                      Oct-19 12:08:24 PM Starting Plug-In Plugin BLLock started successfully in 1189 milliseconds
                      Oct-19 12:08:24 PM BLLock start BLLock plugin has been initialized
                      Oct-19 12:08:23 PM BLLock start Loaded configuration successfully
                      Oct-19 12:08:22 PM BLLock start BLLock version is: 3.0.28.0
                      Oct-19 12:08:22 PM BLLock start Initializing BLLock...
                      Oct-19 12:08:22 PM Starting Plug-In Initializing plugin BLLock ...
                      Oct-19 12:08:22 PM Info Plugin BLLock has connected. IP:127.0.0.1:40968
                      Oct-19 12:08:22 PM Startup Initializing Plug-Ins
                      Oct-19 12:08:22 PM Plug-In Found plug-in: Z-Wave, version: 3.0.1.262
                      Oct-19 12:08:21 PM Plug-In Found plug-in: Sonos, version: 3.1.0.37
                      Oct-19 12:08:21 PM Plug-In Found plug-in: OMNI, version: 3.0.2.20
                      Oct-19 12:08:20 PM Plug-In Found plug-in: Nest, version: 3.0.0.34
                      Oct-19 12:08:20 PM Plug-In Found plug-in: BLLock, version: 3.0.28.0
                      Oct-19 12:08:19 PM Plug-In Found plug-in: BLEditor, version: 2.0.11.0
                      Oct-19 12:08:19 PM Plug-In Found plug-in: BLBackup, version: 2.0.61.0
                      Oct-19 12:08:18 PM Startup Checking for available plug-ins
                      Oct-19 12:08:18 PM Info Remote plug-in API interface started on port 10400
                      Oct-19 12:08:18 PM Web Server Web Server started on port 80
                      Oct-19 12:08:18 PM Web Server Local IP address is: 127.0.0.1
                      Oct-19 12:08:18 PM Startup This version of HomeSeer is registered as a HS3PRO version.
                      Oct-19 12:08:18 PM Startup Creating Speaker Client Interface Object...
                      Oct-19 12:08:18 PM Startup HomeSeer version is: 3.0.0.534
                      Oct-19 12:08:18 PM Load Config Loading TIMERS...
                      Oct-19 12:08:18 PM Load Config Loading COUNTERS...
                      Oct-19 12:08:18 PM Load Config 41 total events loaded.
                      Oct-19 12:08:18 PM Load Config Loading Events...
                      Oct-19 12:08:18 PM Warning Unable to load event group, name: Lights &amp; Fans Off
                      Oct-19 12:08:18 PM Error DeSerializing object (byte): Could not find type 'System.Collections.SortedList+KeyList'. Source=mscorlib
                      Oct-19 12:08:18 PM Warning Unable to load event group, name: Test
                      Oct-19 12:08:18 PM Error DeSerializing object (byte): Could not find type 'System.Collections.SortedList+KeyList'. Source=mscorlib
                      Oct-19 12:08:18 PM Warning Unable to load event group, name: OmniPro Events
                      Oct-19 12:08:18 PM Error DeSerializing object (byte): Could not find type 'System.Collections.SortedList+KeyList'. Source=mscorlib
                      Oct-19 12:08:18 PM Warning Unable to load event group, name: Lighting Events
                      Oct-19 12:08:18 PM Error DeSerializing object (byte): Could not find type 'System.Collections.SortedList+KeyList'. Source=mscorlib
                      Oct-19 12:08:18 PM Load Config Loading Event Groups...
                      Oct-19 12:08:18 PM Load Config 716 total devices loaded.
                      Oct-19 12:08:18 PM Database Loading Devices...
                      Oct-19 12:08:15 PM Database Opening (Mode=Read Only) up HomeSeer database /usr/local/HomeSeer/Data/HomeSeerData.hsd
                      Oct-19 12:08:15 PM Startup Loading configuration file ...
                      Oct-19 12:08:15 PM Startup Database SAVE process started.
                      Oct-19 12:08:15 PM Startup Local voice recognition class started.
                      Oct-19 12:08:15 PM Startup Plug-In Interface class started.
                      Oct-19 12:08:15 PM Startup E-Mail RECEIVE class started.
                      Oct-19 12:08:15 PM Startup E-Mail SEND class started.
                      Oct-19 12:08:15 PM Startup Web server class started.
                      Oct-19 12:08:15 PM Startup Application interface class started.
                      Oct-19 12:08:15 PM Startup COM port classes started.
                      Oct-19 12:08:15 PM Startup Creating Class Objects...
                      Oct-19 12:08:15 PM Startup
                      Oct-19 12:08:15 PM Startup ************************************************************ ********************
                      Oct-19 12:08:15 PM Startup HomeSeer version 3.0.0.534 Edition: HS3 Pro (SEL) Starting Now
                      Oct-19 12:08:15 PM Startup ************************************************************ ********************

                      Comment


                      • #26
                        Still have no idea what is going on but I rewrote the multicast listener function recently for cross vlan work. Try the latest version in the BETA section of the updater. It should be v41 or higher.
                        Dirk

                        Comment


                        • #27
                          Wow, that must have been a big rewrite! The log messaging has changed substantially. I downloaded and installed .41. then I stopped and restarted the plugin. I don't see any of the same error msgs. Right now, the device mgmt page appears to be working. I can stop, start, and change volume successfully. Feels like progress! Then I tried to fire a simple TTS event. The music stopped in my OFFICE zone, but nothing happened. Feels like we're getting close. Any further insights? Thanks so much for the help! log entries are below.
                          Oct-21 6:36:48 AM Sonos Error Error in DoCheckAnnouncementQueue. 100 seconds expired since the announcement started and no end was received.
                          Oct-21 6:35:57 AM Warning File does not exist: /usr/local/HomeSeer/html/Sonos/Announcements/Ann_OFFICE_0.wav
                          Oct-21 6:35:57 AM Event Event Trigger "Announcements Test Voice"
                          Oct-21 6:35:57 AM Event Event Announcements Test Voice triggered by the event page 'Run' button.
                          Oct-21 6:35:37 AM Z-Wave Device: Lights Guest House Luminance Set to 250 (Lux)
                          Oct-21 6:35:07 AM Device Control Device: Office Sonos Player to Play (1001) by/from: CAPI Control Handler
                          Oct-21 6:34:59 AM Device Control Device: Office Sonos Player to Play (1001) by/from: CAPI Control Handler
                          Oct-21 6:34:55 AM Device Control Device: Office Sonos Volume to Volume (value)% (23) by/from: CAPI Control Handler
                          Oct-21 6:34:23 AM Warning File does not exist: /usr/local/HomeSeer/html/images/myq/hidden.png
                          Oct-21 6:34:23 AM Warning File does not exist: /usr/local/HomeSeer/html/images/myq/open.png
                          Oct-21 6:34:23 AM Warning File does not exist: /usr/local/HomeSeer/html/images/myq/close.png
                          Oct-21 6:33:41 AM Sonos Registered SpeakerProxy
                          Oct-21 6:33:41 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Playroom/Garage with index 8
                          Oct-21 6:33:40 AM Sonos DirectConnect called for Zone Playroom/Garage with device name = uuid:RINCON_949F3EB84C1601400 and Model = S15
                          Oct-21 6:33:39 AM Starting Plug-In Plugin Sonos started successfully in 10 milliseconds
                          Oct-21 6:33:39 AM Sonos InitIO Called for Instance = RINCON_949F3EB84C1601400 and running on OS = Unix
                          Oct-21 6:33:39 AM Starting Plug-In Initializing plugin Sonos ...
                          Oct-21 6:33:39 AM Info Plugin Sonos with instance RINCON_949F3EB84C1601400 has connected. IP:127.0.0.1:34141
                          Oct-21 6:33:39 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Office with index 7
                          Oct-21 6:33:37 AM Sonos DirectConnect called for Zone Office with device name = uuid:RINCON_347E5C00313201400 and Model = S16
                          Oct-21 6:33:36 AM Starting Plug-In Plugin Sonos started successfully in 8 milliseconds
                          Oct-21 6:33:36 AM Sonos InitIO Called for Instance = RINCON_347E5C00313201400 and running on OS = Unix
                          Oct-21 6:33:36 AM Starting Plug-In Initializing plugin Sonos ...
                          Oct-21 6:33:36 AM Info Plugin Sonos with instance RINCON_347E5C00313201400 has connected. IP:127.0.0.1:34113
                          Oct-21 6:33:36 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Kitchen with index 6
                          Oct-21 6:33:35 AM Sonos DirectConnect called for Zone Kitchen with device name = uuid:RINCON_347E5C00315601400 and Model = S16
                          Oct-21 6:33:34 AM Starting Plug-In Plugin Sonos started successfully in 5 milliseconds
                          Oct-21 6:33:34 AM Sonos InitIO Called for Instance = RINCON_347E5C00315601400 and running on OS = Unix
                          Oct-21 6:33:34 AM Starting Plug-In Initializing plugin Sonos ...
                          Oct-21 6:33:33 AM Info Plugin Sonos with instance RINCON_347E5C00315601400 has connected. IP:127.0.0.1:34086
                          Oct-21 6:33:33 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Outdoors with index 5
                          Oct-21 6:33:32 AM Sonos DirectConnect called for Zone Outdoors with device name = uuid:RINCON_949F3EB828F801400 and Model = S15
                          Oct-21 6:33:31 AM Starting Plug-In Plugin Sonos started successfully in 7 milliseconds
                          Oct-21 6:33:31 AM Sonos InitIO Called for Instance = RINCON_949F3EB828F801400 and running on OS = Unix
                          Oct-21 6:33:31 AM Starting Plug-In Initializing plugin Sonos ...
                          Oct-21 6:33:31 AM Info Plugin Sonos with instance RINCON_949F3EB828F801400 has connected. IP:127.0.0.1:34058
                          Oct-21 6:33:31 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Studio with index 4
                          Oct-21 6:33:30 AM Sonos DirectConnect called for Zone Studio with device name = uuid:RINCON_347E5C00DBAE01400 and Model = S16
                          Oct-21 6:33:29 AM Starting Plug-In Plugin Sonos started successfully in 8 milliseconds
                          Oct-21 6:33:29 AM Sonos InitIO Called for Instance = RINCON_347E5C00DBAE01400 and running on OS = Unix
                          Oct-21 6:33:29 AM Starting Plug-In Initializing plugin Sonos ...
                          Oct-21 6:33:29 AM Info Plugin Sonos with instance RINCON_347E5C00DBAE01400 has connected. IP:127.0.0.1:34030
                          Oct-21 6:33:29 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Living Room with index 3
                          Oct-21 6:33:28 AM Sonos DirectConnect called for Zone Living Room with device name = uuid:RINCON_949F3EB8265801400 and Model = S15
                          Oct-21 6:33:27 AM Starting Plug-In Plugin Sonos started successfully in 8 milliseconds
                          Oct-21 6:33:27 AM Sonos InitIO Called for Instance = RINCON_949F3EB8265801400 and running on OS = Unix
                          Oct-21 6:33:27 AM Starting Plug-In Initializing plugin Sonos ...
                          Oct-21 6:33:26 AM Info Plugin Sonos with instance RINCON_949F3EB8265801400 has connected. IP:127.0.0.1:34003
                          Oct-21 6:33:26 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Master Bedroom with index 2
                          Oct-21 6:33:25 AM Sonos DirectConnect called for Zone Master Bedroom with device name = uuid:RINCON_347E5C00316B01400 and Model = S16
                          Oct-21 6:33:24 AM Starting Plug-In Plugin Sonos started successfully in 8 milliseconds
                          Oct-21 6:33:24 AM Sonos InitIO Called for Instance = RINCON_347E5C00316B01400 and running on OS = Unix
                          Oct-21 6:33:24 AM Starting Plug-In Initializing plugin Sonos ...
                          Oct-21 6:33:24 AM Info Plugin Sonos with instance RINCON_347E5C00316B01400 has connected. IP:127.0.0.1:33975
                          Oct-21 6:33:24 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Dining / Laundry with index 1
                          Oct-21 6:33:22 AM Sonos DirectConnect called for Zone Dining / Laundry with device name = uuid:RINCON_347E5C0030FC01400 and Model = S16
                          Oct-21 6:33:21 AM Starting Plug-In Plugin Sonos started successfully in 9 milliseconds
                          Oct-21 6:33:21 AM Sonos InitIO Called for Instance = RINCON_347E5C0030FC01400 and running on OS = Unix
                          Oct-21 6:33:21 AM Starting Plug-In Initializing plugin Sonos ...
                          Oct-21 6:33:21 AM Info Plugin Sonos with instance RINCON_347E5C0030FC01400 has connected. IP:127.0.0.1:33942
                          Oct-21 6:33:21 AM Sonos MySSDP.StartSSDPDiscovery found 8 Devices. Still 6 Entries awaiting processing .....
                          Oct-21 6:32:49 AM Sonos MySSDP.StartSSDPDiscovery waiting for an additional 30 seconds while receiving and processing the UPnP Device Info .....
                          Oct-21 6:32:49 AM Sonos MySSDP.StartSSDPDiscovery found so far 8 Devices. Still 0 Entries awaiting processing .....
                          Oct-21 6:32:40 AM Sonos MySSDP.StartSSDPDiscovery, waiting for 9 seconds while discovering UPnP Devices .....
                          Oct-21 6:32:40 AM Sonos MySSDP.StartEventListener started listening on port = 55646
                          Oct-21 6:32:40 AM Sonos MCastSocket.ConnectSocket called with mcastAddress = 239.255.255.250 and mcastPort = 1900 and LocalIpAddress = 0.0.0.0 and LocalIPPort = 1900
                          Oct-21 6:32:40 AM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 10.100.100.178
                          Oct-21 6:32:37 AM Plug-In Finished initializing plug-in Sonos
                          Oct-21 6:32:37 AM Starting Plug-In Sonos loaded in 1005 milliseconds
                          Oct-21 6:32:37 AM Starting Plug-In Plugin Sonos started successfully in 163 milliseconds
                          Oct-21 6:32:37 AM Sonos Sonos Plugin Initialized
                          Oct-21 6:32:37 AM Sonos InitIO Called for Instance = and running on OS = Unix
                          Oct-21 6:32:37 AM Starting Plug-In Initializing plugin Sonos ...
                          Oct-21 6:32:37 AM Info Plugin Sonos has connected. IP:127.0.0.1:3378
                          Attached Files

                          Comment


                          • #28
                            Uh oh. I remembered that if I restart the system, it behaves differently than just restarting the plugin. So... i restarted the system and lo and behold, the Sonos PI is no longer working at all. And... you can see there are now error msgs. So, my previous excitement may have been misplaced...?
                            Oct-21 6:57:39 AM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                            Oct-21 6:57:39 AM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                            Oct-21 6:57:39 AM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                            Oct-21 6:57:26 AM Device Control Device: Office Sonos Player to Stop (1002) by/from: CAPI Control Handler
                            Oct-21 6:57:25 AM Device Control Device: Office Sonos Player to Stop (1002) by/from: CAPI Control Handler
                            Oct-21 6:57:25 AM Device Control Device: Office Sonos Player to Stop (1002) by/from: CAPI Control Handler
                            Oct-21 6:57:25 AM Device Control Device: Office Sonos Player to Stop (1002) by/from: CAPI Control Handler
                            Oct-21 6:57:25 AM Device Control Device: Office Sonos Player to Stop (1002) by/from: CAPI Control Handler
                            Oct-21 6:57:25 AM Device Control Device: Office Sonos Player to Stop (1002) by/from: CAPI Control Handler
                            Oct-21 6:57:24 AM Device Control Device: Office Sonos Player to Stop (1002) by/from: CAPI Control Handler
                            Oct-21 6:57:24 AM Device Control Device: Office Sonos Player to Stop (1002) by/from: CAPI Control Handler
                            Oct-21 6:57:23 AM Device Control Device: Office Sonos Player to Stop (1002) by/from: CAPI Control Handler
                            Oct-21 6:57:20 AM Device Control Device: Office Sonos Player to Stop (1002) by/from: CAPI Control Handler
                            Oct-21 6:56:39 AM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                            Oct-21 6:56:39 AM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                            Oct-21 6:56:39 AM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                            Oct-21 6:56:01 AM OMNI ---------------------------
                            Oct-21 6:56:01 AM OMNI Plugin startup is complete.
                            Oct-21 6:56:01 AM OMNI ---------------------------
                            Oct-21 6:56:01 AM OMNI Synchronization complete.
                            Oct-21 6:55:39 AM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                            Oct-21 6:55:39 AM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                            Oct-21 6:55:39 AM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                            Oct-21 6:54:39 AM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                            Oct-21 6:54:39 AM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                            Oct-21 6:54:39 AM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                            Oct-21 6:53:39 AM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                            Oct-21 6:53:39 AM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                            Oct-21 6:53:39 AM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                            Oct-21 6:52:40 AM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                            Oct-21 6:52:40 AM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                            Oct-21 6:52:40 AM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                            Oct-21 6:52:25 AM OMNI Synchronizing OMNI devices with HomeSeer...
                            Oct-21 6:52:24 AM OMNI Requesting initial system troubles
                            Oct-21 6:52:18 AM OMNI Requesting Output status...
                            Oct-21 6:52:14 AM OMNI Requesting Area status...
                            Oct-21 6:52:14 AM OMNI All configuration and properties retrieved.
                            Oct-21 6:52:13 AM OMNI -->Reading properties...
                            Oct-21 6:52:09 AM BLLock 3 locks have been loaded
                            Oct-21 6:51:40 AM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                            Oct-21 6:51:40 AM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                            Oct-21 6:51:40 AM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                            Oct-21 6:51:23 AM OMNI Reading panel configuration...
                            Oct-21 6:51:07 AM Starting Plug-In Plugin OMNI started successfully in 2243 milliseconds
                            Oct-21 6:51:04 AM Starting Plug-In Initializing plugin OMNI ...
                            Oct-21 6:50:51 AM Starting Plug-In OMNI loaded in 15072 milliseconds
                            Oct-21 6:50:40 AM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                            Oct-21 6:50:40 AM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                            Oct-21 6:50:40 AM Sonos MySSDP.MyControllerTimer_Elapsed called with restart the MulicastListener
                            Oct-21 6:50:37 AM Info Plugin OMNI has connected. IP:127.0.0.1:58095
                            Oct-21 6:50:20 AM Warning I/O interface OMNI is down, executable is not running, restarting ...
                            Oct-21 6:50:15 AM TTS Speak: ():Welcome to Home-Seer
                            Oct-21 6:50:07 AM Info System connected to MyHS Service successfully with license ID 100940.
                            Oct-21 6:50:07 AM Info System connected to MyHS Service, waiting for acknowledge...
                            Oct-21 6:50:02 AM Z-Wave Starting Z-Wave Polling for Network FFEFCAED...
                            Oct-21 6:49:52 AM Info Plugin OMNI with instance: has disconnected
                            Oct-21 6:49:49 AM Sonos Registered SpeakerProxy
                            Oct-21 6:49:49 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Playroom/Garage with index 8
                            Oct-21 6:49:48 AM Starting Plug-In Plugin Sonos started successfully in 5 milliseconds
                            Oct-21 6:49:48 AM Sonos InitIO Called for Instance = RINCON_949F3EB84C1601400 and running on OS = Unix
                            Oct-21 6:49:48 AM Starting Plug-In Initializing plugin Sonos ...
                            Oct-21 6:49:48 AM Info Plugin Sonos with instance RINCON_949F3EB84C1601400 has connected. IP:127.0.0.1:58084
                            Oct-21 6:49:47 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Office with index 7
                            Oct-21 6:49:47 AM Web Server Web Server authorized local login successful from: 127.0.0.1 User: barrascaHm20
                            Oct-21 6:49:47 AM BLLock Searching for Z-Wave locks...
                            Oct-21 6:49:47 AM Starting Plug-In Plugin Sonos started successfully in 5 milliseconds
                            Oct-21 6:49:47 AM Sonos InitIO Called for Instance = RINCON_347E5C00313201400 and running on OS = Unix
                            Oct-21 6:49:47 AM Starting Plug-In Initializing plugin Sonos ...
                            Oct-21 6:49:46 AM Info Plugin Sonos with instance RINCON_347E5C00313201400 has connected. IP:127.0.0.1:58081
                            Oct-21 6:49:46 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Kitchen with index 6
                            Oct-21 6:49:45 AM Starting Plug-In Plugin Sonos started successfully in 6 milliseconds
                            Oct-21 6:49:45 AM Sonos InitIO Called for Instance = RINCON_347E5C00315601400 and running on OS = Unix
                            Oct-21 6:49:45 AM Starting Plug-In Initializing plugin Sonos ...
                            Oct-21 6:49:45 AM Info Plugin Sonos with instance RINCON_347E5C00315601400 has connected. IP:127.0.0.1:58079
                            Oct-21 6:49:45 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Outdoors with index 5
                            Oct-21 6:49:45 AM Starting Plug-In Plugin Sonos started successfully in 6 milliseconds
                            Oct-21 6:49:45 AM Sonos InitIO Called for Instance = RINCON_949F3EB828F801400 and running on OS = Unix
                            Oct-21 6:49:45 AM Starting Plug-In Initializing plugin Sonos ...
                            Oct-21 6:49:45 AM Starting Plug-In Plugin Sonos started successfully in 5 milliseconds
                            Oct-21 6:49:45 AM Sonos InitIO Called for Instance = RINCON_347E5C00DBAE01400 and running on OS = Unix
                            Oct-21 6:49:45 AM Starting Plug-In Initializing plugin Sonos ...
                            Oct-21 6:49:45 AM Starting Plug-In Plugin Sonos started successfully in 5 milliseconds
                            Oct-21 6:49:45 AM Sonos InitIO Called for Instance = RINCON_949F3EB8265801400 and running on OS = Unix
                            Oct-21 6:49:45 AM Starting Plug-In Initializing plugin Sonos ...
                            Oct-21 6:49:45 AM Z-Wave ************************************************************ *******************
                            Oct-21 6:49:45 AM Z-Wave STARTUP COMPLETE: All configured interfaces were successfully initialized.
                            Oct-21 6:49:45 AM Z-Wave ************************************************************ *******************
                            Oct-21 6:49:45 AM Startup Start up complete.
                            Oct-21 6:49:45 AM Info No device issues found
                            Oct-21 6:49:45 AM Warning Device (383) Lights Front Yard Street Cul-de-Sac Lights references a parent, but the parent does not reference this child
                            Oct-21 6:49:45 AM Warning Issue checking child device (383) Lights Front Yard Street Cul-de-Sac Lights
                            Oct-21 6:49:45 AM Warning Device (382) Lights Front Yard Street Cul-de-Sac Lights Central Scene references a parent, but the parent does not reference this child
                            Oct-21 6:49:45 AM Warning Issue checking child device (382) Lights Front Yard Street Cul-de-Sac Lights Central Scene
                            Oct-21 6:49:45 AM Warning MyHS could not connect to server: Could not resolve host 'connected2.homeseer.com'
                            Oct-21 6:49:45 AM Info Checking device parent child relationships...
                            Oct-21 6:49:45 AM Error Downloading update control file: Error: NameResolutionFailure
                            Oct-21 6:49:45 AM Info Checking for updates...
                            Oct-21 6:49:45 AM Startup Starting the HS3 Sentry EXE
                            Oct-21 6:49:44 AM Startup (Startup.vb script) No speaker clients detected, waiting up to 30 seconds for any to connect...
                            Oct-21 6:49:44 AM Startup (Startup.vb script) Scripting is OK and is now running Startup.vb
                            Oct-21 6:49:44 AM Startup Starting HSSentry watchdog.
                            Oct-21 6:49:44 AM Startup Starting Event Scheduler...
                            Oct-21 6:49:44 AM Info Plugin Sonos with instance RINCON_949F3EB828F801400 has connected. IP:127.0.0.1:58077
                            Oct-21 6:49:44 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Studio with index 4
                            Oct-21 6:49:43 AM Info Plugin Sonos with instance RINCON_347E5C00DBAE01400 has connected. IP:127.0.0.1:58075
                            Oct-21 6:49:43 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Living Room with index 3
                            Oct-21 6:49:42 AM Info Plugin Sonos with instance RINCON_949F3EB8265801400 has connected. IP:127.0.0.1:58073
                            Oct-21 6:49:42 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Master Bedroom with index 2
                            Oct-21 6:49:41 AM Startup Running the startup script Startup.vb
                            Oct-21 6:49:41 AM Starting Plug-In Plugin Sonos started successfully in 249 milliseconds
                            Oct-21 6:49:41 AM Sonos InitIO Called for Instance = RINCON_347E5C00316B01400 and running on OS = Unix
                            Oct-21 6:49:41 AM Startup Starting Find service...
                            Oct-21 6:49:41 AM Startup Updater services starting...
                            Oct-21 6:49:41 AM Starting Plug-In Initializing plugin Sonos ...
                            Oct-21 6:49:41 AM Info Plugin Sonos with instance RINCON_347E5C00316B01400 has connected. IP:127.0.0.1:58071
                            Oct-21 6:49:41 AM Sonos CreateOneSonosController: Created instance of ZonePlayerController for Zoneplayer = Dining / Laundry with index 1
                            Oct-21 6:49:40 AM Starting Plug-In Plugin Sonos started successfully in 9 milliseconds
                            Oct-21 6:49:40 AM Sonos InitIO Called for Instance = RINCON_347E5C0030FC01400 and running on OS = Unix
                            Oct-21 6:49:40 AM Starting Plug-In Initializing plugin Sonos ...
                            Oct-21 6:49:40 AM Info Plugin Sonos with instance RINCON_347E5C0030FC01400 has connected. IP:127.0.0.1:58069
                            Oct-21 6:49:40 AM Sonos Error ERROR in FindZonePlayers. Error = Object reference not set to an instance of an object
                            Oct-21 6:49:40 AM Sonos Warning No UPnPDevices found. Please ensure the network is functional and that UPnPDevices devices are attached.
                            Oct-21 6:49:40 AM Sonos Error Error in MySSDP.StartSSDPDiscovery. No Client!
                            Oct-21 6:49:40 AM Sonos Error MyUdpClient.Start had an error joining the multicast group groupAddress = 239.255.255.250, local port = 1901 and Error = Network subsystem is down
                            Oct-21 6:49:40 AM Sonos Error Error in MySSDP.CreateMulticastListener. No Client!
                            Oct-21 6:49:40 AM Sonos Error Error in MCastSocket.ConnectSocket for mcastAddress = 239.255.255.250 with error = Network subsystem is down
                            Oct-21 6:49:40 AM Sonos MCastSocket.ConnectSocket called with mcastAddress = 239.255.255.250 and mcastPort = 1900 and LocalIpAddress = 0.0.0.0 and LocalIPPort = 1900
                            Oct-21 6:49:40 AM Sonos MySSDP.CreateMulticastListener called for PlugInIPAddress = 127.0.0.1
                            Oct-21 6:49:40 AM Database Opening (Mode=Read/Write) up HomeSeer Energy database /usr/local/HomeSeer/Data/Energy/Energy.hsd
                            Oct-21 6:49:40 AM Speech Listening for remote speaker connections on port 10401
                            Oct-21 6:49:40 AM Startup Initializing Speaker Client Interface
                            Oct-21 6:49:40 AM Startup Start automation engine...
                            Oct-21 6:49:40 AM Z-Wave Zwave Stick: ............................................................ ..........
                            Oct-21 6:49:40 AM Z-Wave Zwave Stick: .............................. FINISHED ..............................
                            Oct-21 6:49:40 AM Z-Wave Zwave Stick: ............................................................ ..........
                            Oct-21 6:49:40 AM Z-Wave Zwave Stick is the SIS for the network.
                            Oct-21 6:49:40 AM Z-Wave Zwave Stick There is a SUC/SIS in the network.
                            Oct-21 6:49:40 AM Z-Wave Zwave Stick Controller is static lib.
                            Oct-21 6:49:40 AM Z-Wave Zwave Stick Controller chip type is ZW050x.
                            Oct-21 6:49:40 AM Startup HStouch server started, waiting for clients to connect.
                            Oct-21 6:49:40 AM Z-Wave The interface's security support has been set.
                            Oct-21 6:49:39 AM Z-Wave Zwave Stick: Found 133 Z-Wave nodes in interface node ID 1 (Zwave Stick)
                            Oct-21 6:49:39 AM Z-Wave Zwave Stick: Z-Wave interface node ID: 1, Home ID: FFEFCAED
                            Oct-21 6:49:39 AM Z-Wave Zwave Stick: Z-Wave Serial API version: 5
                            Oct-21 6:49:39 AM Z-Wave Zwave Stick: Z-Wave services for the SECURITY COMMAND CLASS were successfully started.
                            Oct-21 6:49:36 AM HSTouch Server Server started on port 10200
                            Oct-21 6:49:36 AM Plug-In Finished initializing plug-in Sonos
                            Oct-21 6:49:36 AM Starting Plug-In Sonos loaded in 1137 milliseconds
                            Oct-21 6:49:36 AM Starting Plug-In Plugin Sonos started successfully in 271 milliseconds
                            Oct-21 6:49:36 AM Sonos Sonos Plugin Initialized
                            Oct-21 6:49:36 AM Sonos InitIO Called for Instance = and running on OS = Unix
                            Oct-21 6:49:36 AM Starting Plug-In Initializing plugin Sonos ...
                            Oct-21 6:49:36 AM Info Plugin Sonos has connected. IP:127.0.0.1:58067
                            Oct-21 6:49:35 AM Plug-In Finished initializing plug-in OMNI
                            Oct-21 6:49:35 AM Starting Plug-In OMNI loaded in 2910 milliseconds
                            Oct-21 6:49:35 AM Starting Plug-In Plugin OMNI started successfully in 2172 milliseconds
                            Oct-21 6:49:34 AM Z-Wave Zwave Stick: Controller firmware version: 4.32
                            Oct-21 6:49:33 AM Starting Plug-In Initializing plugin OMNI ...
                            Oct-21 6:49:33 AM Info Plugin OMNI has connected. IP:127.0.0.1:58065
                            Oct-21 6:49:32 AM Plug-In Finished initializing plug-in BLEditor
                            Oct-21 6:49:32 AM Starting Plug-In BLEditor loaded in 1001 milliseconds
                            Oct-21 6:49:32 AM Starting Plug-In Plugin BLEditor started successfully in 174 milliseconds
                            Oct-21 6:49:32 AM BLEditor start BLEditor plugin has been initialized
                            Oct-21 6:49:32 AM BLEditor start Directories have been loaded.
                            Oct-21 6:49:32 AM BLEditor start Loaded configuration successfully
                            Oct-21 6:49:32 AM BLEditor start BLEditor version is: 2.0.11.0
                            Oct-21 6:49:32 AM BLEditor start Initializing BLEditor...
                            Oct-21 6:49:32 AM Starting Plug-In Initializing plugin BLEditor ...
                            Oct-21 6:49:32 AM Info Plugin BLEditor has connected. IP:127.0.0.1:58063
                            Oct-21 6:49:32 AM Z-Wave Zwave Stick: Getting node information from controller...
                            Oct-21 6:49:32 AM Z-Wave 465 Simple AV Control Command Class Control Commands have been loaded successfully.
                            Oct-21 6:49:31 AM Z-Wave Zwave Stick: The Z-Wave API Execution Thread was Started or Restarted.
                            Oct-21 6:49:31 AM Z-Wave Zwave Stick: The Z-Wave Command Execution Thread was Started or Restarted.
                            Oct-21 6:49:31 AM Z-Wave Zwave Stick: ----------------------------------------------------------------------
                            Oct-21 6:49:31 AM Z-Wave Initializing Z-Wave interface Zwave Stick (HomeSeer SmartStick +) on /dev/ttyACM0
                            Oct-21 6:49:31 AM Z-Wave Zwave Stick: ----------------------------------------------------------------------
                            Oct-21 6:49:31 AM Z-Wave Zwave Stick: ============================================================ ==========
                            Oct-21 6:49:31 AM Plug-In Finished initializing plug-in Z-Wave
                            Oct-21 6:49:31 AM Starting Plug-In Z-Wave loaded in 3105 milliseconds
                            Oct-21 6:49:31 AM Z-Wave 0 event triggers were loaded from HomeSeer.
                            Oct-21 6:49:31 AM Z-Wave 0 event actions were loaded from HomeSeer.
                            Oct-21 6:49:31 AM Starting Plug-In Plugin Z-Wave started successfully in 2370 milliseconds
                            Oct-21 6:49:31 AM Z-Wave 352 total Z-Wave Data Objects loaded.
                            Oct-21 6:49:31 AM Z-Wave Network FFEFCAED has 352 device data elements.
                            Oct-21 6:49:31 AM Z-Wave 1 Networks were restored from the data in the database... Building data connections.
                            Oct-21 6:49:31 AM Z-Wave Loading Z-Wave Data Objects...
                            Oct-21 6:49:30 AM Z-Wave 1 total Z-Wave Network Objects loaded.
                            Oct-21 6:49:30 AM Z-Wave Loading Z-Wave Network Objects...
                            Oct-21 6:49:29 AM Z-Wave Database: Opening (Mode=Read Only) up HomeSeer database /usr/local/HomeSeer/Data/Z-Wave/Z-Wave2.db
                            Oct-21 6:49:29 AM Z-Wave InitIO called, plug-in version 3.0.1.262 is being initialized...
                            Oct-21 6:49:29 AM Starting Plug-In Initializing plugin Z-Wave ...
                            Oct-21 6:49:29 AM Info Plugin Z-Wave has connected. IP:127.0.0.1:58061
                            Oct-21 6:49:28 AM Plug-In Finished initializing plug-in Nest
                            Oct-21 6:49:28 AM Starting Plug-In Nest loaded in 1002 milliseconds
                            Oct-21 6:49:28 AM Starting Plug-In Plugin Nest started successfully in 149 milliseconds
                            Oct-21 6:49:28 AM Starting Plug-In Initializing plugin Nest ...
                            Oct-21 6:49:28 AM Info Plugin Nest has connected. IP:127.0.0.1:58059
                            Oct-21 6:49:27 AM Plug-In Finished initializing plug-in BLLock
                            Oct-21 6:49:27 AM Starting Plug-In BLLock loaded in 2006 milliseconds
                            Oct-21 6:49:27 AM Starting Plug-In Plugin BLLock started successfully in 1183 milliseconds
                            Oct-21 6:49:27 AM BLLock start BLLock plugin has been initialized
                            Oct-21 6:49:26 AM BLLock start Loaded configuration successfully
                            Oct-21 6:49:26 AM BLLock start BLLock version is: 3.0.28.0
                            Oct-21 6:49:26 AM BLLock start Initializing BLLock...
                            Oct-21 6:49:26 AM Starting Plug-In Initializing plugin BLLock ...
                            Oct-21 6:49:26 AM Info Plugin BLLock has connected. IP:127.0.0.1:58057
                            Oct-21 6:49:25 AM Startup Initializing Plug-Ins
                            Oct-21 6:49:25 AM Plug-In Found plug-in: Z-Wave, version: 3.0.1.262
                            Oct-21 6:49:25 AM Plug-In Found plug-in: Sonos, version: 3.1.0.41
                            Oct-21 6:49:24 AM Plug-In Found plug-in: OMNI, version: 3.0.2.20
                            Oct-21 6:49:24 AM Plug-In Found plug-in: Nest, version: 3.0.0.34
                            Oct-21 6:49:23 AM Plug-In Found plug-in: BLLock, version: 3.0.28.0
                            Oct-21 6:49:23 AM Plug-In Found plug-in: BLEditor, version: 2.0.11.0
                            Oct-21 6:49:23 AM Plug-In Found plug-in: BLBackup, version: 2.0.61.0
                            Oct-21 6:49:22 AM Startup Checking for available plug-ins
                            Oct-21 6:49:22 AM Info Remote plug-in API interface started on port 10400
                            Oct-21 6:49:22 AM Web Server Web Server started on port 80
                            Oct-21 6:49:22 AM Web Server Local IP address is: 127.0.0.1
                            Oct-21 6:49:22 AM Startup This version of HomeSeer is registered as a HS3PRO version.
                            Oct-21 6:49:22 AM Startup Creating Speaker Client Interface Object...
                            Oct-21 6:49:22 AM Startup HomeSeer version is: 3.0.0.534
                            Oct-21 6:49:22 AM Load Config Loading TIMERS...
                            Oct-21 6:49:22 AM Load Config Loading COUNTERS...
                            Oct-21 6:49:22 AM Load Config 41 total events loaded.
                            Oct-21 6:49:22 AM Load Config Loading Events...
                            Oct-21 6:49:22 AM Warning Unable to load event group, name: Lights & Fans Off
                            Oct-21 6:49:22 AM Error DeSerializing object (byte): Could not find type 'System.Collections.SortedList+KeyList'. Source=mscorlib
                            Oct-21 6:49:22 AM Warning Unable to load event group, name: Test
                            Oct-21 6:49:22 AM Error DeSerializing object (byte): Could not find type 'System.Collections.SortedList+KeyList'. Source=mscorlib
                            Oct-21 6:49:22 AM Warning Unable to load event group, name: OmniPro Events
                            Oct-21 6:49:22 AM Error DeSerializing object (byte): Could not find type 'System.Collections.SortedList+KeyList'. Source=mscorlib
                            Oct-21 6:49:22 AM Warning Unable to load event group, name: Lighting Events
                            Oct-21 6:49:22 AM Error DeSerializing object (byte): Could not find type 'System.Collections.SortedList+KeyList'. Source=mscorlib
                            Oct-21 6:49:22 AM Load Config Loading Event Groups...
                            Oct-21 6:49:22 AM Load Config 717 total devices loaded.
                            Oct-21 6:49:22 AM Database Loading Devices...
                            Oct-21 6:49:19 AM Database Opening (Mode=Read Only) up HomeSeer database /usr/local/HomeSeer/Data/HomeSeerData.hsd
                            Oct-21 6:49:19 AM Startup Loading configuration file ...
                            Oct-21 6:49:19 AM Startup Database SAVE process started.
                            Oct-21 6:49:19 AM Startup Local voice recognition class started.
                            Oct-21 6:49:19 AM Startup Plug-In Interface class started.
                            Oct-21 6:49:19 AM Startup E-Mail RECEIVE class started.
                            Oct-21 6:49:19 AM Startup E-Mail SEND class started.
                            Oct-21 6:49:19 AM Startup Web server class started.
                            Oct-21 6:49:19 AM Startup Application interface class started.
                            Oct-21 6:49:19 AM Startup COM port classes started.
                            Oct-21 6:49:19 AM Startup Creating Class Objects...
                            Oct-21 6:49:19 AM Startup
                            Oct-21 6:49:19 AM Startup ************************************************************ ********************
                            Oct-21 6:49:19 AM Startup HomeSeer version 3.0.0.534 Edition: HS3 Pro (SEL) Starting Now
                            Oct-21 6:49:19 AM Startup ************************************************************ ********************
                            Oct-21 6:49:19 AM Startup
                            Oct-21 6:49:19 AM Startup Settings Loaded.
                            Oct-21 6:49:19 AM Startup Loading Settings

                            Comment


                            • #29
                              After the restart, if I then stop and restart the plugin, i'm back to the PI working without TTS announcements.

                              Comment


                              • #30
                                I now suspect that there is something wrong with this autostart of HS. It is not just the Sonos PI which seems to struggle; you have a bunch of errors which would make me very concerned. How did you configure HS to start at restart of the system? It appears to me, that HS is coming up when other Linux subsystems are not on-line yet, such as the network subsystem. The other thing to try is to disable all other PIs and see is there is perhaps another PI behaving badly or part of the problem.

                                The TTS error, *could* be because there is no speakerclient is installed (flite) or the speaktofile.sh file is missing.

                                Comment

                                Working...
                                X