bwssytems / ha-bridge

Home automation bridge that emulates a Philips Hue light system and can control other systems such as a Vera, Harmony Hub, Nest, MiLight bulbs or any other system that has an http/https/tcp/udp interface. This is a compact impl to run on small format computers. This is impl started from this project https://github.com/armzilla/amazon-echo-ha-bridge.
Apache License 2.0
1.45k stars 198 forks source link

New set up discovery issues, UPNP discovery address not found? #1377

Closed shawn-lindberg closed 1 year ago

shawn-lindberg commented 1 year ago

Greetings, I am trying to set up habridge on a new Raspberry Pi but I'm running into some issues. It's been a really long time since I last did this, so I think I'm just missing something. I am getting the following warning in my log, and my Echo is not discovering any devices when I press the link button.

10-25-2022 02:46:33.556 | INFO | HA Bridge startup sequence... | com.bwssystems.HABridge.HABridge -- | -- | -- | -- 10-25-2022 02:46:33.652 | INFO | HA Bridge (v5.4.1) initializing.... | com.bwssystems.HABridge.HABridge 10-25-2022 02:46:33.659 | INFO | reading from config file: /home/sandman/ha-bridge/data/habridge.config | com.bwssystems.HABridge.BridgeSettings 10-25-2022 02:46:35.044 | WARN | The upnp config address, 192.168.68.125, does not match any known IP's on this host. Using default address: null | com.bwssystems.HABridge.BridgeSettings

I read somewhere that this might be because the device might not be using a static IP, but I edited the DHCP config to use this address as a static IP. I also tried changing the bridge settings to use 0.0.0.0 as the discovery address, but when I did that it said that it could not resolve the IP of the host. Hopefully someone can point me in the right direction.

bwssytems commented 1 year ago

So, that message is a warning. It should not change the functionality. Turn on Trace UPNP Calls in the Bridge Control Tab and then turn on debug for com.bwssystems.HABridge.BridgeSettings in the Logs tab at the bottom. Post the output of the info here

shawn-lindberg commented 1 year ago

Okay, thanks for the reply. I have turned on the logging as you requested and the output of the log is below. By the way, when I save the bridge set in sort reinitialize the bridge, the message about waiting for completion never goes away. I don't know if that's relevant, just thought I should mention it.

Time | Level | Message | Component -- | -- | -- | -- 10-25-2022 02:46:33.556 | INFO | HA Bridge startup sequence... | com.bwssystems.HABridge.HABridge 10-25-2022 02:46:33.652 | INFO | HA Bridge (v5.4.1) initializing.... | com.bwssystems.HABridge.HABridge 10-25-2022 02:46:33.659 | INFO | reading from config file: /home/sandman/ha-bridge/data/habridge.config | com.bwssystems.HABridge.BridgeSettings 10-25-2022 02:46:35.044 | WARN | The upnp config address, 192.168.68.125, does not match any known IP's on this host. Using default address: null | com.bwssystems.HABridge.BridgeSettings 10-25-2022 02:46:35.653 | INFO | StaticResourceHandler configured with folder = /public | spark.staticfiles.StaticFilesConfiguration 10-25-2022 02:46:35.728 | INFO | System control service started.... | com.bwssystems.HABridge.SystemControl 10-25-2022 02:46:35.896 | INFO | Initializing UDP response Socket... | com.bwssystems.HABridge.util.UDPDatagramSender 10-25-2022 02:46:35.964 | INFO | UDP response Socket initialized to: 50000 | com.bwssystems.HABridge.util.UDPDatagramSender 10-25-2022 02:46:35.999 | INFO | HTTP Home created. | com.bwssystems.HABridge.plugins.http.HTTPHome 10-25-2022 02:46:36.030 | INFO | Harmony Home created. No Harmony devices configured. | com.bwssystems.HABridge.plugins.harmony.HarmonyHome 10-25-2022 02:46:36.055 | INFO | Nest Home created. No Nest configured. | com.bwssystems.HABridge.plugins.NestBridge.NestHome 10-25-2022 02:46:36.058 | INFO | Hue passthru Home created. No Hue passtrhu systems configured. | com.bwssystems.HABridge.plugins.hue.HueHome 10-25-2022 02:46:36.066 | INFO | HAL Home created. No HAL devices configured. | com.bwssystems.HABridge.plugins.hal.HalHome 10-25-2022 02:46:36.068 | INFO | MQTT Home created. No MQTT Clients configured. | com.bwssystems.HABridge.plugins.mqtt.MQTTHome 10-25-2022 02:46:36.070 | INFO | HomeAssistant Home created. No HomeAssistants configured. | com.bwssystems.HABridge.plugins.hass.HassHome 10-25-2022 02:46:36.081 | INFO | HomeWizard Home created. No HomeWizard gateways configured. | com.bwssystems.HABridge.plugins.homewizard.HomeWizardHome 10-25-2022 02:46:36.090 | INFO | Command Home for system program execution created. | com.bwssystems.HABridge.plugins.exec.CommandHome 10-25-2022 02:46:36.098 | INFO | TCP Home created. | com.bwssystems.HABridge.plugins.tcp.TCPHome 10-25-2022 02:46:36.132 | INFO | UDP Home created. | com.bwssystems.HABridge.plugins.udp.UDPHome 10-25-2022 02:46:36.139 | INFO | Vera Home created. No Veras configured. | com.bwssystems.HABridge.plugins.vera.VeraHome 10-25-2022 02:46:36.150 | INFO | Fibaro Home created. No Fibaros configured. | com.bwssystems.HABridge.plugins.fibaro.FibaroHome 10-25-2022 02:46:36.160 | INFO | Domoticz Home created. No Domoticz devices configured. | com.bwssystems.HABridge.plugins.domoticz.DomoticzHome 10-25-2022 02:46:36.168 | INFO | Somfy Home created. No Somfys configured. | com.bwssystems.HABridge.plugins.somfy.SomfyHome 10-25-2022 02:46:36.183 | INFO | LifxDevice Home created. No LifxDevices configured. | com.bwssystems.HABridge.plugins.lifx.LifxHome 10-25-2022 02:46:36.188 | INFO | OpenHAB Home created. No OpenHABs configured. | com.bwssystems.HABridge.plugins.openhab.OpenHABHome 10-25-2022 02:46:36.192 | INFO | FHEM Home created. No FHEMs configured. | com.bwssystems.HABridge.plugins.fhem.FHEMHome 10-25-2022 02:46:36.208 | INFO | Broadlink Home created. No Broadlinks configured. | com.bwssystems.HABridge.plugins.broadlink.BroadlinkHome 10-25-2022 02:46:36.212 | INFO | Mozilla IOT Home created. No Mozilla IOTs configured. | com.bwssystems.HABridge.plugins.moziot.MozIotHome 10-25-2022 02:46:36.217 | INFO | HomeGenie Home created. No HomeGenies configured. | com.bwssystems.HABridge.plugins.homegenie.HomeGenieHome 10-25-2022 02:46:36.330 | INFO | HABridge device management service started.... | com.bwssystems.HABridge.devicemanagmeent.DeviceResource 10-25-2022 02:46:36.464 | INFO | Hue emulator service started.... | com.bwssystems.HABridge.hue.HueMulator 10-25-2022 02:46:36.604 | INFO | == Spark has ignited ... | spark.embeddedserver.jetty.EmbeddedJettyServer 10-25-2022 02:46:36.606 | INFO | >> Listening on 0.0.0.0:80 | spark.embeddedserver.jetty.EmbeddedJettyServer 10-25-2022 02:46:36.926 | INFO | Description xml service started.... | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 02:46:36.939 | INFO | UPNP Discovery Listener starting.... | com.bwssystems.HABridge.upnp.UpnpListener 10-25-2022 02:46:36.941 | INFO | UPNP Discovery Listener running and ready.... | com.bwssystems.HABridge.upnp.UpnpListener 10-25-2022 02:51:39.966 | INFO | Link button pressed.... | com.bwssystems.HABridge.SystemControl 10-25-2022 02:52:24.968 | INFO | Link button time ended.... | com.bwssystems.HABridge.LinkButtonPressed 10-25-2022 02:52:51.648 | INFO | Link button pressed.... | com.bwssystems.HABridge.SystemControl 10-25-2022 02:53:36.650 | INFO | Link button time ended.... | com.bwssystems.HABridge.LinkButtonPressed 10-25-2022 17:11:24.230 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:24.231 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:26.248 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:26.249 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:28.263 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:28.264 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:30.277 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:30.277 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:32.292 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:32.293 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:34.306 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:34.307 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:36.320 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:36.320 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:38.337 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:38.338 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:40.349 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:40.349 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:42.361 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:42.362 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:44.376 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:44.376 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:46.392 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:46.394 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:48.415 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:48.416 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:50.428 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:50.429 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:52.441 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:52.442 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:54.456 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:54.457 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:56.561 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:56.561 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:11:58.599 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:11:58.600 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:00.613 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:00.613 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:02.630 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:02.631 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:04.661 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:04.662 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:06.729 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:06.729 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:08.876 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:08.877 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:10.890 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:10.890 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:12.903 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:12.903 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:14.913 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:14.914 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:16.924 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:16.924 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:18.936 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:18.936 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:20.949 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:20.949 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:22.962 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:22.962 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:24.976 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:24.977 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:26.992 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:26.992 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:29.012 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:29.013 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:31.029 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:31.030 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:33.045 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:33.046 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:35.062 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:35.063 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:37.076 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:37.077 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:39.092 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:39.093 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:41.110 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:41.110 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:43.125 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:43.126 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:45.138 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:45.140 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:47.158 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:47.158 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:49.198 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:49.199 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:51.213 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:51.214 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:53.240 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:53.241 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:55.276 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:55.277 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:57.291 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:57.292 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:12:59.303 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:12:59.303 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:01.314 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:01.315 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:03.326 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:03.327 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:05.344 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:05.344 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:07.358 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:07.359 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:09.433 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:09.434 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:11.472 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:11.472 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:13.484 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:13.485 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:15.649 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:15.650 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:17.792 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:17.793 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:19.809 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:19.810 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:21.821 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:21.821 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:23.833 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:23.833 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:25.855 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:25.856 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:27.868 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:27.868 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:29.882 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:29.882 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:31.896 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:31.897 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:33.908 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:33.909 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:35.922 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:35.924 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:37.934 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:37.934 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:39.947 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:39.948 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:41.964 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:41.964 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:43.984 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:43.984 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:45.999 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:46.000 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:48.014 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:48.014 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:50.036 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:50.037 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:52.050 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:52.050 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:54.063 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:54.063 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:56.081 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:56.082 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:13:58.095 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:13:58.096 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:00.110 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:00.111 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:02.126 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:02.126 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:04.138 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:04.138 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:06.151 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:06.151 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:06.518 | INFO | Link button pressed.... | com.bwssystems.HABridge.SystemControl 10-25-2022 17:14:08.204 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:08.205 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:10.229 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:10.229 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:12.239 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:12.239 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:14.251 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:14.251 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:16.265 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:16.266 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:18.279 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:18.279 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:20.294 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:20.296 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:22.315 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:22.316 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:24.332 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:24.333 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:26.344 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:26.345 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:28.380 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:28.381 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:30.408 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:30.409 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:32.420 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:32.421 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:34.439 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:34.439 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:36.450 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:36.451 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:38.466 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:38.466 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:40.499 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:40.500 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:42.512 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:42.513 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:44.526 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:44.526 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:46.539 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:46.540 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:48.551 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:48.552 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:50.567 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:50.567 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:51.519 | INFO | Link button time ended.... | com.bwssystems.HABridge.LinkButtonPressed 10-25-2022 17:14:52.581 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:52.581 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:54.595 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:54.596 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:56.729 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:56.730 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:14:58.762 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:14:58.763 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:00.776 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:00.777 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:02.788 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:02.789 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:04.804 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:04.804 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:06.818 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:06.818 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:08.833 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:08.833 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:10.947 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:10.948 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:12.960 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:12.961 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:14.972 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:14.972 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:16.987 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:16.988 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:19.001 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:19.002 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:21.015 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:21.016 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:23.035 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:23.036 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:25.053 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:25.053 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:27.066 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:27.066 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:29.077 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:29.078 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:31.092 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:31.092 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:33.102 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:33.103 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:35.118 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:35.119 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:37.129 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:37.129 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:39.142 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:39.142 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:41.158 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:41.159 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:43.188 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:43.188 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:45.201 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:45.201 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:47.215 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:47.216 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:49.227 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:49.228 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:51.240 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:51.240 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:53.253 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:53.254 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:55.267 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:55.268 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:57.278 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:57.279 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:15:59.294 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:15:59.294 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:01.306 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:01.306 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:03.320 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:03.320 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:05.335 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:05.336 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:07.350 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:07.350 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:09.360 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:09.361 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:11.383 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:11.384 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:13.398 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:13.398 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:15.475 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:15.475 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:17.491 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:17.491 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:19.507 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:19.507 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:21.542 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:21.542 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:23.565 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:23.566 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:25.581 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:25.581 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:27.595 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:27.595 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:29.611 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:29.611 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:31.622 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:31.622 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:33.638 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:33.638 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:35.652 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:35.653 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:37.670 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:37.671 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:39.706 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:39.706 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:41.729 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:41.729 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:43.741 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:43.741 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:45.755 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:45.755 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:47.769 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:47.770 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:49.796 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:49.797 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:51.817 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:51.817 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:53.829 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:53.829 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:55.846 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:55.847 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:57.924 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:57.925 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:16:59.937 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:16:59.938 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:17:01.949 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:17:01.949 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:17:03.964 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:17:03.965 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter 10-25-2022 17:17:05.980 | INFO | Get description.xml called while in re-init or stop state | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-25-2022 17:17:05.980 | INFO | The requested route [/description.xml] has not been mapped in Spark for Accept: [application/json, text/plain, */*] | spark.http.matching.MatcherFilter
shawn-lindberg commented 1 year ago

@bwssytems Please let me know if there's anything else you would like me to try or other information I can provide.

shawn-lindberg commented 1 year ago

@bwssytems Apologies, it appears that some of the settings didn't take effect until I restarted the Raspberry Pi. So here is a fresh log.

Time | Level | Message | Component -- | -- | -- | -- 10-28-2022 02:30:45.691 | INFO | HA Bridge startup sequence... | com.bwssystems.HABridge.HABridge 10-28-2022 02:30:45.823 | INFO | HA Bridge (v5.4.1) initializing.... | com.bwssystems.HABridge.HABridge 10-28-2022 02:30:45.830 | INFO | reading from config file: /home/sandman/ha-bridge/data/habridge.config | com.bwssystems.HABridge.BridgeSettings 10-28-2022 02:30:46.726 | WARN | The upnp config address, 192.168.68.125, does not match any known IP's on this host. Using default address: null | com.bwssystems.HABridge.BridgeSettings 10-28-2022 02:30:47.462 | INFO | StaticResourceHandler configured with folder = /public | spark.staticfiles.StaticFilesConfiguration 10-28-2022 02:30:47.515 | INFO | System control service started.... | com.bwssystems.HABridge.SystemControl 10-28-2022 02:30:47.765 | INFO | Initializing UDP response Socket... | com.bwssystems.HABridge.util.UDPDatagramSender 10-28-2022 02:30:47.849 | INFO | UDP response Socket initialized to: 50000 | com.bwssystems.HABridge.util.UDPDatagramSender 10-28-2022 02:30:47.899 | INFO | HTTP Home created. | com.bwssystems.HABridge.plugins.http.HTTPHome 10-28-2022 02:30:47.950 | INFO | Harmony Home created. No Harmony devices configured. | com.bwssystems.HABridge.plugins.harmony.HarmonyHome 10-28-2022 02:30:47.961 | INFO | Nest Home created. No Nest configured. | com.bwssystems.HABridge.plugins.NestBridge.NestHome 10-28-2022 02:30:47.965 | INFO | Hue passthru Home created. No Hue passtrhu systems configured. | com.bwssystems.HABridge.plugins.hue.HueHome 10-28-2022 02:30:47.980 | INFO | HAL Home created. No HAL devices configured. | com.bwssystems.HABridge.plugins.hal.HalHome 10-28-2022 02:30:47.983 | INFO | MQTT Home created. No MQTT Clients configured. | com.bwssystems.HABridge.plugins.mqtt.MQTTHome 10-28-2022 02:30:47.986 | INFO | HomeAssistant Home created. No HomeAssistants configured. | com.bwssystems.HABridge.plugins.hass.HassHome 10-28-2022 02:30:47.995 | INFO | HomeWizard Home created. No HomeWizard gateways configured. | com.bwssystems.HABridge.plugins.homewizard.HomeWizardHome 10-28-2022 02:30:48.000 | INFO | Command Home for system program execution created. | com.bwssystems.HABridge.plugins.exec.CommandHome 10-28-2022 02:30:48.007 | INFO | TCP Home created. | com.bwssystems.HABridge.plugins.tcp.TCPHome 10-28-2022 02:30:48.016 | INFO | UDP Home created. | com.bwssystems.HABridge.plugins.udp.UDPHome 10-28-2022 02:30:48.020 | INFO | Vera Home created. No Veras configured. | com.bwssystems.HABridge.plugins.vera.VeraHome 10-28-2022 02:30:48.023 | INFO | Fibaro Home created. No Fibaros configured. | com.bwssystems.HABridge.plugins.fibaro.FibaroHome 10-28-2022 02:30:48.027 | INFO | Domoticz Home created. No Domoticz devices configured. | com.bwssystems.HABridge.plugins.domoticz.DomoticzHome 10-28-2022 02:30:48.030 | INFO | Somfy Home created. No Somfys configured. | com.bwssystems.HABridge.plugins.somfy.SomfyHome 10-28-2022 02:30:48.051 | INFO | LifxDevice Home created. No LifxDevices configured. | com.bwssystems.HABridge.plugins.lifx.LifxHome 10-28-2022 02:30:48.054 | INFO | OpenHAB Home created. No OpenHABs configured. | com.bwssystems.HABridge.plugins.openhab.OpenHABHome 10-28-2022 02:30:48.063 | INFO | FHEM Home created. No FHEMs configured. | com.bwssystems.HABridge.plugins.fhem.FHEMHome 10-28-2022 02:30:48.110 | INFO | Broadlink Home created. No Broadlinks configured. | com.bwssystems.HABridge.plugins.broadlink.BroadlinkHome 10-28-2022 02:30:48.114 | INFO | Mozilla IOT Home created. No Mozilla IOTs configured. | com.bwssystems.HABridge.plugins.moziot.MozIotHome 10-28-2022 02:30:48.120 | INFO | HomeGenie Home created. No HomeGenies configured. | com.bwssystems.HABridge.plugins.homegenie.HomeGenieHome 10-28-2022 02:30:48.198 | INFO | HABridge device management service started.... | com.bwssystems.HABridge.devicemanagmeent.DeviceResource 10-28-2022 02:30:48.352 | INFO | Hue emulator service started.... | com.bwssystems.HABridge.hue.HueMulator 10-28-2022 02:30:48.373 | INFO | == Spark has ignited ... | spark.embeddedserver.jetty.EmbeddedJettyServer 10-28-2022 02:30:48.382 | INFO | >> Listening on 0.0.0.0:80 | spark.embeddedserver.jetty.EmbeddedJettyServer 10-28-2022 02:30:48.820 | INFO | Traceupnp: upnp config address: 192.168.68.125 -useIface: false on web server: 0.0.0.0:80 | com.bwssystems.HABridge.HABridge 10-28-2022 02:30:48.823 | INFO | Description xml service started.... | com.bwssystems.HABridge.upnp.UpnpSettingsResource 10-28-2022 02:30:48.851 | INFO | UPNP Discovery Listener starting.... | com.bwssystems.HABridge.upnp.UpnpListener 10-28-2022 02:30:48.854 | INFO | Traceupnp: Interface: docker0 valid usable IP address: /172.17.0.1 | com.bwssystems.HABridge.upnp.UpnpListener 10-28-2022 02:30:48.855 | INFO | Traceupnp: Adding docker0 to our upnp join interface set. | com.bwssystems.HABridge.upnp.UpnpListener 10-28-2022 02:30:48.862 | INFO | Traceupnp: Interface: lo valid usable IP address: /127.0.0.1 | com.bwssystems.HABridge.upnp.UpnpListener 10-28-2022 02:30:48.863 | INFO | Traceupnp: Adding lo to our upnp join interface set. | com.bwssystems.HABridge.upnp.UpnpListener 10-28-2022 02:30:48.866 | INFO | UPNP Discovery Listener running and ready.... | com.bwssystems.HABridge.upnp.UpnpListener 10-28-20v22 02:33:19.969 | INFO | Link button pressed.... | com.bwssystems.HABridge.SystemControl 10-28-2022 02:34:04.980 | INFO | Link button time ended.... | com.bwssystems.HABridge.LinkButtonPressed
shawn-lindberg commented 1 year ago

I have confirmed that UPNP is enabled on my router, as well.

shawn-lindberg commented 1 year ago

Actually, to follow up on that, I am able to discover other devices with my Echo Show, so it's probably not the network settings, I'm guessing.

shawn-lindberg commented 1 year ago

@bwssytems I tried deleting the configuration file and starting up the bridge from the command line. I re-enabled the link button and the UPNP traces. I'm now definitely seeing queries from the Echo, but for some reason it's not discovering the devices. I did also try changing the seed and renumbering the devices. I don't know if it matters, but I'm using an Echo Show 5 (I believe it is second-generation). Is there any reason to believe that I need to try with an Echo Dot instead? Also, I noticed that the device IDs have a hyphen in between the last two set of numbers, rather than a colon. But I can't recall whether that's normal.

11-06-2022 03:14:26.484 | INFO | Link button pressed.... | com.bwssystems.HABridge.SystemControl -- | -- | -- | -- 11-06-2022 03:14:26.523 | INFO | Traceupnp: send upnp discovery template 1 with response address: 192.168.68.125:80 to address: 192.168.68.76:50000 | com.bwssystems.HABridge.upnp.UpnpListener 11-06-2022 03:14:26.524 | INFO | Traceupnp: SSDP M-SEARCH packet from 192.168.68.85:54164 | com.bwssystems.HABridge.upnp.UpnpListener 11-06-2022 03:14:27.174 | INFO | Traceupnp: send upnp discovery template 1 with response address: 192.168.68.125:80 to address: 192.168.68.85:54164 | com.bwssystems.HABridge.upnp.UpnpListener 11-06-2022 03:14:28.618 | INFO | Traceupnp: hue api user create requested: {"devicetype": "Echo"} from address: 192.168.68.69 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:28.631 | INFO | Traceupnp: hue api user create requested for device type: Echo#192.168.68.69 and username: da68511ff550448eb69dc7785f89d50b | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:28.658 | INFO | Traceupnp: hue lights list requested by user: da68511ff550448eb69dc7785f89d50b from address: 192.168.68.69 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:29.914 | INFO | Traceupnp: hue api user create requested: {"devicetype": "Echo"} from address: 192.168.68.76 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:29.915 | INFO | Traceupnp: hue api user create requested for device type: Echo#192.168.68.76 and username: 8ba05fee375540e585559cb45549d88a | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:29.929 | INFO | Traceupnp: hue lights list requested by user: 8ba05fee375540e585559cb45549d88a from address: 192.168.68.76 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:33.691 | INFO | Traceupnp: hue api user create requested: {"devicetype": "Echo"} from address: 192.168.68.69 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:33.691 | INFO | Traceupnp: hue api user create requested for device type: Echo#192.168.68.69 and username: da68511ff550448eb69dc7785f89d50b | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:33.813 | INFO | Traceupnp: hue lights list requested by user: da68511ff550448eb69dc7785f89d50b from address: 192.168.68.69 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:34.973 | INFO | Traceupnp: hue api user create requested: {"devicetype": "Echo"} from address: 192.168.68.76 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:34.974 | INFO | Traceupnp: hue api user create requested for device type: Echo#192.168.68.76 and username: 8ba05fee375540e585559cb45549d88a | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:34.990 | INFO | Traceupnp: hue lights list requested by user: 8ba05fee375540e585559cb45549d88a from address: 192.168.68.76 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:38.835 | INFO | Traceupnp: hue api user create requested: {"devicetype": "Echo"} from address: 192.168.68.69 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:38.836 | INFO | Traceupnp: hue api user create requested for device type: Echo#192.168.68.69 and username: da68511ff550448eb69dc7785f89d50b | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:38.866 | INFO | Traceupnp: hue lights list requested by user: da68511ff550448eb69dc7785f89d50b from address: 192.168.68.69 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:40.014 | INFO | Traceupnp: hue api user create requested: {"devicetype": "Echo"} from address: 192.168.68.76 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:40.014 | INFO | Traceupnp: hue api user create requested for device type: Echo#192.168.68.76 and username: 8ba05fee375540e585559cb45549d88a | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:40.037 | INFO | Traceupnp: hue lights list requested by user: 8ba05fee375540e585559cb45549d88a from address: 192.168.68.76 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:44.004 | INFO | Traceupnp: hue api user create requested: {"devicetype": "Echo"} from address: 192.168.68.69 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:44.005 | INFO | Traceupnp: hue api user create requested for device type: Echo#192.168.68.69 and username: da68511ff550448eb69dc7785f89d50b | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:44.047 | INFO | Traceupnp: hue lights list requested by user: da68511ff550448eb69dc7785f89d50b from address: 192.168.68.69 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:45.064 | INFO | Traceupnp: hue api user create requested: {"devicetype": "Echo"} from address: 192.168.68.76 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:45.064 | INFO | Traceupnp: hue api user create requested for device type: Echo#192.168.68.76 and username: 8ba05fee375540e585559cb45549d88a | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:45.085 | INFO | Traceupnp: hue lights list requested by user: 8ba05fee375540e585559cb45549d88a from address: 192.168.68.76 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:45.628 | INFO | Traceupnp: SSDP M-SEARCH packet from 192.168.68.85:54164 | com.bwssystems.HABridge.upnp.UpnpListener 11-06-2022 03:14:46.279 | INFO | Traceupnp: send upnp discovery template 1 with response address: 192.168.68.125:80 to address: 192.168.68.85:54164 | com.bwssystems.HABridge.upnp.UpnpListener 11-06-2022 03:14:49.120 | INFO | Traceupnp: hue api user create requested: {"devicetype": "Echo"} from address: 192.168.68.69 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:49.120 | INFO | Traceupnp: hue api user create requested for device type: Echo#192.168.68.69 and username: da68511ff550448eb69dc7785f89d50b | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:49.136 | INFO | Traceupnp: hue lights list requested by user: da68511ff550448eb69dc7785f89d50b from address: 192.168.68.69 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:50.112 | INFO | Traceupnp: hue api user create requested: {"devicetype": "Echo"} from address: 192.168.68.76 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:50.112 | INFO | Traceupnp: hue api user create requested for device type: Echo#192.168.68.76 and username: 8ba05fee375540e585559cb45549d88a | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:50.129 | INFO | Traceupnp: hue lights list requested by user: 8ba05fee375540e585559cb45549d88a from address: 192.168.68.76 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:54.251 | INFO | Traceupnp: hue api user create requested: {"devicetype": "Echo"} from address: 192.168.68.69 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:54.252 | INFO | Traceupnp: hue api user create requested for device type: Echo#192.168.68.69 and username: da68511ff550448eb69dc7785f89d50b | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:54.286 | INFO | Traceupnp: hue lights list requested by user: da68511ff550448eb69dc7785f89d50b from address: 192.168.68.69 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:55.161 | INFO | Traceupnp: hue api user create requested: {"devicetype": "Echo"} from address: 192.168.68.76 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:55.162 | INFO | Traceupnp: hue api user create requested for device type: Echo#192.168.68.76 and username: 8ba05fee375540e585559cb45549d88a | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:55.177 | INFO | Traceupnp: hue lights list requested by user: 8ba05fee375540e585559cb45549d88a from address: 192.168.68.76 | com.bwssystems.HABridge.hue.HueMulator 11-06-2022 03:14:55.662 | INFO | Traceupnp: SSDP M-SEARCH packet from 192.168.68.85:54164 | com.bwssystems.HABridge.upnp.UpnpListener 11-06-2022 03:14:56.313 | INFO | Traceupnp: send upnp discovery template 1 with response address: 192.168.68.125:80 to address: 192.168.68.85:54164 | com.bwssystems.HABridge.upnp.UpnpListener 11-06-2022 03:15:05.596 | INFO | Traceupnp: SSDP M-SEARCH packet from 192.168.68.85:54164 | com.bwssystems.HABridge.upnp.UpnpListener 11-06-2022 03:15:06.247 | INFO | Traceupnp: send upnp discovery template 1 with response address: 192.168.68.125:80 to address: 192.168.68.85:54164 | com.bwssystems.HABridge.upnp.UpnpListener 11-06-2022 03:15:11.485 | INFO | Link button time ended.... | com.bwssystems.HABridge.LinkButtonPressed
shawn-lindberg commented 1 year ago

I was able to resolve this. I had to disable the HA bridge service, and then start it manually from the command line. This appears to be because the static IP addresses not known when the service starts, so discovery will not work if running the service from boot. Then, I also had to enable the nine octet option for the unique device IDs, after which discovery was successful.