Hey there,
since a few months I have a problem. My D735 is getting any ntp server. The D785 is working properly.Â
The logs just show:
Aug 14 11:44:25.803 [ERROR ] PHN: Ntp failure
The settings are as following (same on D735 and D785 - only D785 work):

Could you please resolve this issue?
Kind regards,
Lars
4 Comments
Snom Sidaty Khalihina
Hello,
Are both phones running the same firmware version?
Best regagards
End user Lars Kusch
Hey,
both are using the lastest public available firmware 10.1.119.10
Snom Sidaty Khalihina
Hello,
what do the logs say?
Syslog:
 # Login to the Web User Interface
 # Select "Log" from the menu on the left
 # Set the Log level to "9 DEBUG2" and <Apply>
 # Click on the <Clear> button
 # Reproduce the issue
 # Select "Log" and click <Reload>, copy the content of the log into a text file, and attach it here to so that we can take a look at it.
Best regards
End user Lars Kusch
Here are the logs. One thing that iritates me, is that the phone can't get the firmware-config file, even though the server answers the request with an 200 code, an the D785can requests that file successfully.
Sep 5 06:13:24.778 [NOTICE] PHN: last prov successful:1; uri: >https://telefon.steuerberater-bayreuth.com/provisioning/C6L3MNQY23D2/{mac}<; default uri: >https://secure-provisioning.snom.com:443/snomD735/{mac}.htm< Sep 5 06:13:24.873 [NOTICE] PHN: Fetching URL: https://Administrator:...@127.0.0.1:443/dummy.htm Sep 5 06:13:24.874 [DEBUG2] WEBCLIENT: Send TCP none Sep 5 06:13:24.877 [DEBUG2] WEBCLIENT: Socket 20 connecting Sep 5 06:13:24.877 [ERROR ] PHN: TPL: Socket Error: 20/32/connecting, connect_cb -> Operation now in progress (115) Sep 5 06:13:24.878 [DEBUG2] WEBCLIENT: webclient OnConnectionFailed Sep 5 06:13:24.879 [DEBUG2] PHN: TplSocket::SetNextIp: ip_list_ is empty Sep 5 06:13:24.879 [DEBUG2] WEBCLIENT: Socket 20 disconnected Sep 5 06:13:24.879 [DEBUG2] WEBCLIENT: socket:20 conn_id:2 disconnected Tls:127.0.0.1:443 Sep 5 06:13:24.880 [NOTICE] WEBCLIENT: on_tcp_close conn_id:2 Sep 5 06:13:24.880 [DEBUG2] WEBCLIENT: Socket 20 deleted Sep 5 06:13:24.881 [INFO ] PHN: Config setup: code: 500, uri: https://Administrator:...@127.0.0.1:443/dummy.htm Sep 5 06:13:24.882 [WARN ] PHN: Config setup: code: 500, uri: https://Administrator:...@127.0.0.1:443/dummy.htm Sep 5 06:13:24.883 [INFO ] PHN: Config setup: finished true Sep 5 06:13:24.884 [INFO ] PHN: ProvisioningReplacements: URL >https://telefon.steuerberater-bayreuth.com/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml< Sep 5 06:13:24.885 [DEBUG0] PHN: Uri Replace >{mac}< in >https://telefon.steuerberater-bayreuth.com/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml< Sep 5 06:13:24.886 [DEBUG0] PHN: Uri Replaced result: >https://telefon.steuerberater-bayreuth.com/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml< Sep 5 06:13:24.887 [DEBUG0] PHN: Uri Replace >{phone_type}< in >https://telefon.steuerberater-bayreuth.com/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml< Sep 5 06:13:24.887 [DEBUG0] PHN: Uri Replaced result: >https://telefon.steuerberater-bayreuth.com/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml< Sep 5 06:13:24.888 [DEBUG0] PHN: Uri Replace >{firmware_version}< in >https://telefon.steuerberater-bayreuth.com/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml< Sep 5 06:13:24.888 [DEBUG0] PHN: Uri Replaced result: >https://telefon.steuerberater-bayreuth.com/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml< Sep 5 06:13:24.889 [DEBUG0] PHN: ReplaceQueryVariables in >https://telefon.steuerberater-bayreuth.com/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml< Sep 5 06:13:24.890 [DEBUG0] PHN: ReplaceQueryVariables replaced: >https://telefon.steuerberater-bayreuth.com/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml< Sep 5 06:13:24.893 [NOTICE] PHN: Fetching FW URL: https://telefon.steuerberater-bayreuth.com:443/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml Sep 5 06:13:24.893 [NOTICE] PHN: Fetching URL: https://telefon.steuerberater-bayreuth.com:443/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml Sep 5 06:13:24.894 [DEBUG2] WEBCLIENT: Send TCP none Sep 5 06:13:24.896 [DEBUG2] PHN: TplSocket::SetNextIp: ip_list_.size()=2, ip_list_.front()=83.171.236.91 Sep 5 06:13:24.897 [DEBUG2] WEBCLIENT: Socket 21 connecting Sep 5 06:13:24.898 [NOTICE] PHN: Last provisioning was successful, thus stop here! Sep 5 06:13:24.898 [NOTICE] PHN: Go to wizzard if all settings have been read. Sep 5 06:13:24.899 [NOTICE] PHN: SetProvisioningDone Sep 5 06:13:24.899 [DEBUG0] MEDIA: MediaIpc::setLogLevel: 9 Sep 5 06:13:24.908 [INFO ] PHN: SwitchDevice::SetPortProperties() Port:LAN | Properties:auto Sep 5 06:13:24.917 [INFO ] PHN: SwitchDevice::SetPortProperties() Port:PC | Properties:auto Sep 5 06:13:24.926 [DEBUG0] UXM: Request contrast for module -1 with value 8 Sep 5 06:13:24.927 [DEBUG0] UXM: Request backlight for module -1 with value 15 Sep 5 06:13:24.928 [DEBUG0] CFG: apply_value: utc_offset = '3600', need_apply: 0, provisioning (progress:0/finished:0), need reboot: 0 Sep 5 08:13:24.930 [NOTICE] PHN: DST start 27.03.2022 02:00:00 end 30.10.2022 03:00:00 offset 3600 Sep 5 08:13:24.963 [DEBUG0] MEDIA: MediaIpc::allowRtpOnMute Sep 5 08:13:24.965 [NOTICE] PHN: Setting automatic settings refresh timer with 3600 seconds Sep 5 08:13:24.966 [NOTICE] TOOLS: Disabling core dump succeeded Sep 5 08:13:24.966 [INFO ] PHN: WEBSV: init https, protected 0 Sep 5 08:13:24.968 [DEBUG2] PHN: NTP Handler ReInitializeNtpServerList Sep 5 08:13:24.968 [DEBUG2] PHN: NTP Handler Start Sep 5 08:13:24.969 [DEBUG2] PHN: NTP Handler Start ntpServerStr de.pool.ntp.org. Sep 5 08:13:24.969 [DEBUG2] PHN: NTP Handler Start ntp_server_= set to ntp_service_domain=de.pool.ntp.org Sep 5 08:13:24.970 [DEBUG2] PHN: NTP Handler Query Sep 5 08:13:24.970 [DEBUG2] PHN: NTP Handler StartTimeQuery Sep 5 08:13:24.970 [DEBUG2] PHN: NTP Handler NTP Client StartTimeQuery Sep 5 08:13:24.971 [DEBUG2] NTP: StartTimeQuery entered Sep 5 08:13:24.971 [DEBUG2] NTP: StopTimeQuery remoteIP Sep 5 08:13:24.971 [DEBUG1] NTP: State none -> trying Sep 5 08:13:24.972 [DEBUG2] NTP: Socket 11/0 dns_resolving, remote Udp:0.0.0.0:123 Sep 5 08:13:24.973 [DEBUG2] NTP: SocketStateCb remoteIP: 0.0.0.0 Sep 5 08:13:24.979 [DEBUG2] NTP: StartTimeQuery remoteIP 0.0.0.0 Sep 5 08:13:25.155 [DEBUG0] PHN: Using contact storage type 1 Sep 5 08:13:25.165 [INFO ] PHN: Entering setup_language(): gui:1, web:1, add:1 Sep 5 08:13:25.166 [INFO ] PHN: Gui lang old:Deutsch, new:Deutsch Sep 5 08:13:25.166 [INFO ] PHN: Web lang old:Deutsch, new:Deutsch Sep 5 08:13:25.167 [INFO ] PHN: Currently displaying: gui:Deutsch, web:Deutsch Sep 5 08:13:25.167 [INFO ] PHN: No gui lang changes, skipping it! Sep 5 08:13:25.167 [INFO ] PHN: No web lang changes, skipping it! Sep 5 08:13:26.019 [INFO ] PHN: RE dialplan initialized Sep 5 08:13:26.021 [DEBUG2] SIP: sip::send_register: reg=0, ttl=600 Sep 5 08:13:26.021 [DEBUG2] PHN: SipRedirectTargets::PopExpired Sep 5 08:13:26.025 [DEBUG1] SIP: Routing to outbound proxy: sip:pbx.sipbase.de:5060;transport=udp Sep 5 08:13:26.026 [DEBUG1] SIP: RoutePendingPacket 1000001: entry=url ? sip:pbx.sipbase.de:5060;transport=udp all 1 Sep 5 08:13:26.027 [DEBUG1] SIP: RoutePendingPacket 1000001: entry=a Udp:pbx.sipbase.de:5060 all 1 Sep 5 08:13:26.032 [DEBUG2] SIP: Registration Metrics start Sep 5 08:13:26.034 [DEBUG1] SIP: Routing to outbound proxy: sip:pbx.sipbase.de:5060;transport=udp Sep 5 08:13:26.035 [DEBUG1] SIP: RoutePendingPacket 1000002: entry=url ? sip:pbx.sipbase.de:5060;transport=udp all 2 Sep 5 08:13:26.035 [DEBUG1] SIP: RoutePendingPacket 1000002: entry=a Udp:pbx.sipbase.de:5060 all 2 Sep 5 08:13:26.036 [DEBUG1] PHN: Request 66 for 'pbx.sipbase.de' already pending Sep 5 08:13:26.039 [INFO ] VISION: ConnectToPairedVisionViaRarp() mac: >< ip: >< Sep 5 08:13:26.044 [DEBUG0] CFG: apply_value: call_screen_fkeys_on_connected = 'F_LEFT F_RIGHT F_CONF_ON F_HOLD transfer(not:Transfer) F_DUAL_AUDIO(not:Conference) F_DELETE_MSG F_REC ', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:26.049 [DEBUG1] PHN: Parsing color string >242 242 242 255< Sep 5 08:13:26.050 [INFO ] PHN: color parsed as: 242 242 242 255 Sep 5 08:13:26.050 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.051 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.051 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.051 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.052 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.053 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.053 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.053 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.054 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.055 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.055 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.055 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.056 [DEBUG1] PHN: Parsing color string >242 242 242 255< Sep 5 08:13:26.056 [INFO ] PHN: color parsed as: 242 242 242 255 Sep 5 08:13:26.057 [DEBUG1] PHN: Parsing color string >43 49 56 40< Sep 5 08:13:26.057 [INFO ] PHN: color parsed as: 43 49 56 40 Sep 5 08:13:26.057 [DEBUG1] PHN: Parsing color string >0 0 0 0< Sep 5 08:13:26.058 [INFO ] PHN: color parsed as: 0 0 0 0 Sep 5 08:13:26.058 [DEBUG1] PHN: Parsing color string >43 49 56 40< Sep 5 08:13:26.059 [INFO ] PHN: color parsed as: 43 49 56 40 Sep 5 08:13:26.059 [DEBUG1] PHN: Parsing color string >43 49 56 140< Sep 5 08:13:26.059 [INFO ] PHN: color parsed as: 43 49 56 140 Sep 5 08:13:26.060 [DEBUG1] PHN: Parsing color string >43 49 56 140< Sep 5 08:13:26.060 [INFO ] PHN: color parsed as: 43 49 56 140 Sep 5 08:13:26.061 [DEBUG1] PHN: Parsing color string >43 49 56 40< Sep 5 08:13:26.061 [INFO ] PHN: color parsed as: 43 49 56 40 Sep 5 08:13:26.061 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.062 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.062 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.063 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.063 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.063 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.064 [DEBUG1] PHN: Parsing color string >0 0 0 0< Sep 5 08:13:26.064 [INFO ] PHN: color parsed as: 0 0 0 0 Sep 5 08:13:26.065 [DEBUG1] PHN: Parsing color string >43 49 56 40< Sep 5 08:13:26.065 [INFO ] PHN: color parsed as: 43 49 56 40 Sep 5 08:13:26.066 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.066 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.067 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.067 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.067 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.068 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.068 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.068 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.069 [DEBUG1] PHN: Parsing color string >0 0 0 0< Sep 5 08:13:26.069 [INFO ] PHN: color parsed as: 0 0 0 0 Sep 5 08:13:26.070 [DEBUG1] PHN: Parsing color string >0 0 0 0< Sep 5 08:13:26.070 [INFO ] PHN: color parsed as: 0 0 0 0 Sep 5 08:13:26.071 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.071 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.071 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.072 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.072 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.073 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.073 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.073 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.074 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.075 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.075 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.076 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.076 [DEBUG1] PHN: Parsing color string >43 49 56 40< Sep 5 08:13:26.076 [INFO ] PHN: color parsed as: 43 49 56 40 Sep 5 08:13:26.077 [DEBUG1] PHN: Parsing color string >43 49 56 40< Sep 5 08:13:26.077 [INFO ] PHN: color parsed as: 43 49 56 40 Sep 5 08:13:26.078 [DEBUG1] PHN: Parsing color string >43 49 56 140< Sep 5 08:13:26.078 [INFO ] PHN: color parsed as: 43 49 56 140 Sep 5 08:13:26.078 [DEBUG1] PHN: Parsing color string >43 49 56 140< Sep 5 08:13:26.079 [INFO ] PHN: color parsed as: 43 49 56 140 Sep 5 08:13:26.079 [DEBUG1] PHN: Parsing color string >0 0 0 0< Sep 5 08:13:26.080 [INFO ] PHN: color parsed as: 0 0 0 0 Sep 5 08:13:26.080 [DEBUG1] PHN: Parsing color string >0 0 0 0< Sep 5 08:13:26.080 [INFO ] PHN: color parsed as: 0 0 0 0 Sep 5 08:13:26.081 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.081 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.082 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.082 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.083 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.083 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.084 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.084 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.085 [DEBUG1] PHN: Parsing color string >43 49 56 40< Sep 5 08:13:26.085 [INFO ] PHN: color parsed as: 43 49 56 40 Sep 5 08:13:26.085 [DEBUG1] PHN: Parsing color string >43 49 56 40< Sep 5 08:13:26.086 [INFO ] PHN: color parsed as: 43 49 56 40 Sep 5 08:13:26.086 [DEBUG1] PHN: Parsing color string >43 49 56 140< Sep 5 08:13:26.087 [INFO ] PHN: color parsed as: 43 49 56 140 Sep 5 08:13:26.087 [DEBUG1] PHN: Parsing color string >43 49 56 140< Sep 5 08:13:26.087 [INFO ] PHN: color parsed as: 43 49 56 140 Sep 5 08:13:26.088 [DEBUG1] PHN: Parsing color string >0 0 0 0< Sep 5 08:13:26.088 [INFO ] PHN: color parsed as: 0 0 0 0 Sep 5 08:13:26.088 [DEBUG1] PHN: Parsing color string >0 0 0 0< Sep 5 08:13:26.089 [INFO ] PHN: color parsed as: 0 0 0 0 Sep 5 08:13:26.089 [DEBUG1] PHN: Parsing color string >242 242 242 255< Sep 5 08:13:26.090 [INFO ] PHN: color parsed as: 242 242 242 255 Sep 5 08:13:26.090 [DEBUG1] PHN: Parsing color string >242 242 242 255< Sep 5 08:13:26.091 [INFO ] PHN: color parsed as: 242 242 242 255 Sep 5 08:13:26.091 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.091 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.092 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.092 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.092 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.093 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.094 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.094 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.095 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.095 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.096 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.096 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.096 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.097 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.097 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.097 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.098 [DEBUG1] PHN: Parsing color string >193 37 63 255< Sep 5 08:13:26.098 [INFO ] PHN: color parsed as: 193 37 63 255 Sep 5 08:13:26.099 [DEBUG1] PHN: Parsing color string >193 37 63 255< Sep 5 08:13:26.099 [INFO ] PHN: color parsed as: 193 37 63 255 Sep 5 08:13:26.099 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.100 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.100 [DEBUG1] PHN: Parsing color string >224 224 224 255< Sep 5 08:13:26.101 [INFO ] PHN: color parsed as: 224 224 224 255 Sep 5 08:13:26.701 [DEBUG1] PHN: Parsing color string >193 37 63 255< Sep 5 08:13:26.701 [INFO ] PHN: color parsed as: 193 37 63 255 Sep 5 08:13:26.702 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.702 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.703 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.703 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.704 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.705 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.705 [DEBUG1] PHN: Parsing color string >61 133 198 255< Sep 5 08:13:26.705 [INFO ] PHN: color parsed as: 61 133 198 255 Sep 5 08:13:26.818 [DEBUG1] GUI: No fkey key name defined for fkey enum 0. Sep 5 08:13:26.819 [DEBUG1] GUI: No fkey key name defined for fkey enum 27. Sep 5 08:13:26.820 [DEBUG1] GUI: No fkey key name defined for fkey enum 28. Sep 5 08:13:26.820 [DEBUG1] GUI: No fkey key name defined for fkey enum 29. Sep 5 08:13:26.822 [DEBUG1] GUI: No fkey key name defined for fkey enum 120. Sep 5 08:13:26.824 [DEBUG1] GUI: No fkey key name defined for fkey enum 142. Sep 5 08:13:26.824 [DEBUG1] GUI: No fkey key name defined for fkey enum 143. Sep 5 08:13:26.825 [DEBUG1] GUI: No fkey key name defined for fkey enum 144. Sep 5 08:13:26.825 [DEBUG1] GUI: No fkey key name defined for fkey enum 145. Sep 5 08:13:26.825 [DEBUG1] GUI: No fkey key name defined for fkey enum 146. Sep 5 08:13:26.825 [DEBUG1] GUI: No fkey key name defined for fkey enum 147. Sep 5 08:13:26.826 [DEBUG1] GUI: No fkey key name defined for fkey enum 148. Sep 5 08:13:26.826 [DEBUG1] GUI: No fkey key name defined for fkey enum 149. Sep 5 08:13:26.826 [DEBUG1] GUI: No fkey key name defined for fkey enum 150. Sep 5 08:13:26.827 [DEBUG1] GUI: No fkey key name defined for fkey enum 151. Sep 5 08:13:26.827 [DEBUG1] GUI: No fkey key name defined for fkey enum 152. Sep 5 08:13:26.827 [DEBUG1] GUI: No fkey key name defined for fkey enum 153. Sep 5 08:13:26.828 [DEBUG1] GUI: No fkey key name defined for fkey enum 159. Sep 5 08:13:27.670 [INFO ] PHN: MessageTrace::InitTrace: SIP Trace initialized: enabled=1, max_trace_size=100, max_body_size=-1 Sep 5 08:13:27.675 [NOTICE] PHN: ExpansionDisplay::InitAll: loading fonts Sep 5 08:13:27.715 [DEBUG0] PHN: MonochromeFontInterface::LoadFont: font_id=1, font_path_name=./fonts/iconfont.bdf, size=14, real_size=18, pixel_size=0, base_line=-2, space_width=8 Sep 5 08:13:27.910 [DEBUG0] PHN: MonochromeFontInterface::LoadFont: font_id=2, font_path_name=./fonts/mono-bold-de.ttf, size=14, real_size=14, pixel_size=14, base_line=-2, space_width=4 Sep 5 08:13:27.911 [DEBUG0] PHN: MonochromeFontInterface::LoadFont: font_id=1, font_path_name=./fonts/iconfont.bdf, size=14, real_size=18, pixel_size=0, base_line=-2, space_width=8 Sep 5 08:13:27.912 [DEBUG0] PHN: MonochromeFontInterface::LoadFont: font_id=2, font_path_name=./fonts/mono-bold-de.ttf, size=14, real_size=14, pixel_size=14, base_line=-2, space_width=4 Sep 5 08:13:28.253 [DEBUG1] PHN: Goto State 'Wizard' (4) from' Idle' (26), MB 0, blocked 0 caller:PrepareProvisioning-1679 Sep 5 08:13:28.363 [DEBUG0] UXM: Request backlight for module -1 with value 15 Sep 5 08:13:28.379 [DEBUG1] PHN: Goto Best State from 'pWizard' (4), force 1 called-by enter_on_wizard-1137 Sep 5 08:13:28.379 [DEBUG1] PHN: Goto State 'Idle' (26) from' Wizard' (4), MB 0, blocked 0 caller:goto_best_state-608 Sep 5 08:13:28.408 [DEBUG0] UXM: Request backlight for module -1 with value 15 Sep 5 08:13:28.489 [DEBUG0] PHN: conference off TodosWhenPhoneTurnsIdle Sep 5 08:13:28.490 [DEBUG0] MEDIA: MediaIpc::setSpeakerDefault: 6 0 Sep 5 08:13:28.495 [DEBUG0] PHN: TaskMon: LCS/1168 PollEvent took 3617 msecs, started Sep 5 06:13:24 Sep 5 08:13:28.495 [DEBUG0] PHN: LoopMon: LCS/1168 took 3715 (91) msecs, started Sep 5 06:13:24, 10 tasks Sep 5 08:13:28.528 [NOTICE] SIP: sip:Subscriptions::PushFront callid:889315630e81-sz681w6usrqw id:25 guiid: contact:sip:1000-94968112@pbx.sipbase.de exp:600 renew:1 Sep 5 08:13:28.532 [NOTICE] SIP: sip:Subscriptions::PushFront callid:889315636481-b9ejf41jzd2q id:26 guiid: contact:sip:1010-94968112@pbx.sipbase.de exp:600 renew:1 Sep 5 08:13:28.533 [NOTICE] SIP: sip:Subscriptions::PushFront callid:889315634b82-o2od7zezu9s8 id:27 guiid: contact:sip:1020-94968112@pbx.sipbase.de exp:600 renew:1 Sep 5 08:13:28.535 [NOTICE] SIP: sip:Subscriptions::PushFront callid:88931563a082-5xr8ve0ai8c6 id:28 guiid: contact:sip:1040-94968112@pbx.sipbase.de exp:600 renew:1 Sep 5 08:13:28.536 [NOTICE] SIP: sip:Subscriptions::PushFront callid:88931563ea82-rdjmua44q91h id:29 guiid: contact:sip:2000-94968112@pbx.sipbase.de exp:600 renew:1 Sep 5 08:13:28.537 [NOTICE] SIP: sip:Subscriptions::PushFront callid:889315633483-ryke2xejnpw7 id:30 guiid: contact:sip:1090-94968112@pbx.sipbase.de exp:600 renew:1 Sep 5 08:13:28.538 [NOTICE] SIP: sip:Subscriptions::PushFront callid:889315637683-xoxo6rcvrntv id:31 guiid: contact:sip:2200-94968112@pbx.sipbase.de exp:600 renew:1 Sep 5 08:13:28.539 [ALERT ] WEBCLIENT: request https://telefon.steuerberater-bayreuth.com:443/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml stopped due to no response from server for con_id:3; resending with timeout 6000 ms Sep 5 08:13:28.540 [DEBUG2] WEBCLIENT: Send TCP connecting Sep 5 08:13:28.553 [DEBUG0] UXM: Request backlight for module -1 with value 15 Sep 5 08:13:28.555 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:28.556 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:28.658 [DEBUG2] PHN: KMSG: <7>[ 132.865902] auto Sep 5 08:13:28.659 [DEBUG2] PHN: KMSG: <7>[ 132.866257] auto_speed Sep 5 08:13:28.659 [DEBUG2] PHN: KMSG: <7>[ 132.874758] auto Sep 5 08:13:28.659 [DEBUG2] PHN: KMSG: <7>[ 132.874792] auto_speed Sep 5 08:13:28.660 [INFO ] PHN: ALS_VALUE:1259 Sep 5 08:13:28.661 [INFO ] PHN: ALS_KEY:4 Sep 5 08:13:28.662 [DEBUG2] UDEV: Udev monitor read event Sep 5 08:13:28.663 [ERROR ] PHN: TPL: Socket Error: 21/32/connecting, connect_cb -> Success (0) Sep 5 08:13:28.664 [DEBUG2] WEBCLIENT: webclient OnConnectionFailed Sep 5 08:13:28.664 [DEBUG2] PHN: TplSocket::SetNextIp: ip_list_.size()=1, ip_list_.front()=2a05:8b81:1000:1:0:0:726e:1df0 Sep 5 08:13:28.830 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.831 [DEBUG0] CFG: apply_value: callrecord_missed_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.832 [DEBUG0] CFG: apply_value: callrecord_missed_remote = '"Tür" <sip:2100@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.833 [DEBUG0] CFG: apply_value: callrecord_missed_period = '2022-03-21T14:39:59ZPT0S', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.835 [DEBUG0] CFG: apply_value: callrecord_missed_displayname = 'Tür', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.836 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.837 [DEBUG0] CFG: apply_value: callrecord_missed_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.837 [DEBUG0] CFG: apply_value: callrecord_missed_remote = '"Tür" <sip:2100@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.838 [DEBUG0] CFG: apply_value: callrecord_missed_period = '2022-03-21T14:02:59ZPT0S', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.839 [DEBUG0] CFG: apply_value: callrecord_missed_displayname = 'Tür', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.840 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.841 [DEBUG0] CFG: apply_value: callrecord_missed_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.842 [DEBUG0] CFG: apply_value: callrecord_missed_remote = '"Tür" <sip:2100@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.843 [DEBUG0] CFG: apply_value: callrecord_missed_period = '2022-03-21T13:32:02ZPT0S', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.843 [DEBUG0] CFG: apply_value: callrecord_missed_displayname = 'Tür', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.844 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.845 [DEBUG0] CFG: apply_value: callrecord_missed_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.846 [DEBUG0] CFG: apply_value: callrecord_missed_remote = '"Tür" <sip:2100@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.847 [DEBUG0] CFG: apply_value: callrecord_missed_period = '2022-03-21T11:22:44ZPT0S', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.848 [DEBUG0] CFG: apply_value: callrecord_missed_displayname = 'Tür', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.849 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.850 [DEBUG0] CFG: apply_value: callrecord_missed_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.851 [DEBUG0] CFG: apply_value: callrecord_missed_remote = '"00499274433" <sip:00499274433@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.852 [DEBUG0] CFG: apply_value: callrecord_missed_period = '2022-03-21T10:48:10ZPT0S', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.853 [DEBUG0] CFG: apply_value: callrecord_missed_displayname = '00499274433', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.856 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.857 [DEBUG0] CFG: apply_value: callrecord_dialed_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.858 [DEBUG0] PHN: ContactUtils::GetVcard: identity=1 Sep 5 08:13:28.860 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.861 [DEBUG0] CFG: apply_value: callrecord_dialed_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.862 [DEBUG0] PHN: ContactUtils::GetVcard: identity=1 Sep 5 08:13:28.863 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.865 [DEBUG0] CFG: apply_value: callrecord_dialed_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.866 [DEBUG0] PHN: ContactUtils::GetVcard: identity=1 Sep 5 08:13:28.867 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.868 [DEBUG0] CFG: apply_value: callrecord_dialed_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.869 [DEBUG0] PHN: ContactUtils::GetVcard: identity=1 Sep 5 08:13:28.871 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.871 [DEBUG0] CFG: apply_value: callrecord_dialed_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.872 [DEBUG0] PHN: ContactUtils::GetVcard: identity=1 Sep 5 08:13:28.876 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.877 [DEBUG0] CFG: apply_value: callrecord_received_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.879 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.880 [DEBUG0] CFG: apply_value: callrecord_received_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.881 [DEBUG0] PHN: ContactUtils::GetVcard: identity=1 Sep 5 08:13:28.882 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.884 [DEBUG0] CFG: apply_value: callrecord_received_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.886 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.887 [DEBUG0] CFG: apply_value: callrecord_received_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.889 [DEBUG2] PHN: UriUtils: Missing host in Identity uri (). Use user_host instead -> (1030-94968112@pbx.sipbase.de). Sep 5 08:13:28.889 [DEBUG0] CFG: apply_value: callrecord_received_local = '"Mitarbeiter 2" <sip:1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:13:28.906 [INFO ] TOOLS: Going to write file ./snomconfig/config.xml. Sep 5 08:13:28.919 [NOTICE] PHN: Std-Settings stored Sep 5 08:13:29.531 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=137, has_policy=0, timestamp=0, elapsed=137 Sep 5 08:13:29.674 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:29.674 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:30.788 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:30.789 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:31.253 [INFO ] PHN: ALS_VALUE:1258 Sep 5 08:13:31.254 [INFO ] PHN: ALS_KEY:4 Sep 5 08:13:31.660 [ERROR ] PHN: TPL: Socket Error: 21/32/connecting, connect_cb -> No such file or directory (2) Sep 5 08:13:31.661 [DEBUG2] WEBCLIENT: webclient OnConnectionFailed Sep 5 08:13:31.661 [DEBUG2] PHN: TplSocket::SetNextIp: ip_list_ is empty Sep 5 08:13:31.661 [DEBUG2] WEBCLIENT: Socket 21 disconnected Sep 5 08:13:31.662 [DEBUG2] WEBCLIENT: socket:21 conn_id:3 disconnected Tls:[2a05:8b81:1000:1::726e:1df0]:443 Sep 5 08:13:31.662 [NOTICE] WEBCLIENT: on_tcp_close conn_id:3 Sep 5 08:13:31.662 [DEBUG2] WEBCLIENT: Socket 21 deleted Sep 5 08:13:31.663 [ALERT ] WEBCLIENT: request https://telefon.steuerberater-bayreuth.com:443/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml failed due to no response from server (Connection timed out) for con_id:3; waiting to timeout so we can resend with BOTV Sep 5 08:13:31.666 [ALERT ] WEBCLIENT: request https://telefon.steuerberater-bayreuth.com:443/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml stopped due to no response from server for con_id:3; resending with timeout 6000 ms Sep 5 08:13:31.667 [DEBUG2] WEBCLIENT: Send TCP none Sep 5 08:13:31.669 [DEBUG2] PHN: TplSocket::SetNextIp: ip_list_.size()=2, ip_list_.front()=83.171.236.91 Sep 5 08:13:31.670 [DEBUG2] WEBCLIENT: Socket 22 connecting Sep 5 08:13:31.899 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:31.899 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:33.014 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:33.015 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:34.129 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:34.129 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:34.670 [ERROR ] PHN: TPL: Socket Error: 22/32/connecting, connect_cb -> No such file or directory (2) Sep 5 08:13:34.671 [DEBUG2] PHN: TplSocket OnConnectionFailed Sep 5 08:13:34.671 [DEBUG2] PHN: TplSocket::SetNextIp: ip_list_.size()=1, ip_list_.front()=2a05:8b81:1000:1:0:0:726e:1df0 Sep 5 08:13:35.241 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:35.241 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:35.327 [INFO ] PHN: ALS_VALUE:1256 Sep 5 08:13:35.327 [INFO ] PHN: ALS_KEY:4 Sep 5 08:13:36.355 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:36.355 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:37.468 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:37.469 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:37.685 [ALERT ] WEBCLIENT: request https://telefon.steuerberater-bayreuth.com:443/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml stopped due to no response from server for con_id:3; resending with timeout 12000 ms Sep 5 08:13:37.686 [DEBUG2] WEBCLIENT: Send TCP connecting Sep 5 08:13:38.587 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:38.588 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:38.669 [DEBUG0] UXM: Request backlight for module -1 with value 1 Sep 5 08:13:38.669 [DEBUG2] UDEV: Udev monitor read event Sep 5 08:13:39.273 [INFO ] PHN: ALS_VALUE:1257 Sep 5 08:13:39.274 [INFO ] PHN: ALS_KEY:4 Sep 5 08:13:39.528 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=147, has_policy=0, timestamp=0, elapsed=147 Sep 5 08:13:39.696 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:39.697 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:40.812 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:40.813 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:41.921 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:41.921 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:42.047 [DEBUG2] PHN: LLDP: send lldp advertisment Sep 5 08:13:42.920 [DEBUG1] PHN: Sending Keepalive to Watchdog Sep 5 08:13:42.924 [INFO ] PHN: HandleWatchdog: status: 1 -> 1, timeout: 60, dog_fd: 7, setting set: 0 value: Sep 5 08:13:42.925 [INFO ] PHN: Watchdog: new timing: 60 Sep 5 08:13:43.030 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:43.030 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:43.283 [INFO ] PHN: ALS_VALUE:1256 Sep 5 08:13:43.284 [INFO ] PHN: ALS_KEY:4 Sep 5 08:13:44.138 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:44.139 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:45.252 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:45.252 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:46.361 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:46.361 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:47.293 [INFO ] PHN: ALS_VALUE:1258 Sep 5 08:13:47.294 [INFO ] PHN: ALS_KEY:4 Sep 5 08:13:47.469 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:47.470 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:48.581 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:48.582 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:49.529 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=157, has_policy=0, timestamp=0, elapsed=157 Sep 5 08:13:49.691 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:49.691 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:49.794 [ALERT ] WEBCLIENT: request https://telefon.steuerberater-bayreuth.com:443/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml stopped due to no response from server for con_id:3; resending with timeout 24000 ms Sep 5 08:13:49.794 [DEBUG2] WEBCLIENT: Send TCP connecting Sep 5 08:13:50.800 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:50.800 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:51.303 [INFO ] PHN: ALS_VALUE:1259 Sep 5 08:13:51.304 [INFO ] PHN: ALS_KEY:4 Sep 5 08:13:51.909 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:51.909 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:53.018 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:53.019 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:54.128 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:54.128 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:54.969 [DEBUG2] PHN: NTP Handler Start Sep 5 08:13:54.970 [DEBUG2] NTP: StopTimeQuery remoteIP 0.0.0.0 Sep 5 08:13:54.970 [DEBUG2] NTP: Socket 11/0 disconnected, remote Udp:0.0.0.0:123 Sep 5 08:13:54.971 [DEBUG1] NTP: State trying -> failure Sep 5 08:13:54.971 [ERROR ] PHN: Ntp failure Sep 5 08:13:54.971 [DEBUG2] NTP: SocketStateCb remoteIP: 0.0.0.0 Sep 5 08:13:54.972 [DEBUG1] NTP: State failure -> none Sep 5 08:13:54.972 [DEBUG2] PHN: NTP Handler Start ntpServerStr de.pool.ntp.org. Sep 5 08:13:54.973 [DEBUG2] PHN: NTP Handler Start ntp_server_= set to ntp_service_domain=de.pool.ntp.org Sep 5 08:13:54.973 [DEBUG2] PHN: NTP Handler Query Sep 5 08:13:54.973 [DEBUG2] PHN: NTP Handler StartTimeQuery Sep 5 08:13:54.973 [DEBUG2] PHN: NTP Handler NTP Client StartTimeQuery Sep 5 08:13:54.974 [DEBUG2] NTP: StartTimeQuery entered Sep 5 08:13:54.975 [DEBUG2] NTP: StopTimeQuery remoteIP Sep 5 08:13:54.975 [DEBUG1] NTP: State none -> trying Sep 5 08:13:54.976 [DEBUG2] NTP: Socket 11/0 dns_resolving, remote Udp:0.0.0.0:123 Sep 5 08:13:54.976 [DEBUG2] NTP: SocketStateCb remoteIP: 0.0.0.0 Sep 5 08:13:54.976 [DEBUG1] PHN: Request 37 for 'de.pool.ntp.org' already pending Sep 5 08:13:54.977 [DEBUG2] NTP: StartTimeQuery remoteIP 0.0.0.0 Sep 5 08:13:55.238 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:55.239 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:55.337 [INFO ] PHN: ALS_VALUE:1260 Sep 5 08:13:55.337 [INFO ] PHN: ALS_KEY:4 Sep 5 08:13:56.348 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:56.348 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:57.459 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:57.459 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:58.568 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:58.569 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:13:59.323 [INFO ] PHN: ALS_VALUE:1262 Sep 5 08:13:59.324 [INFO ] PHN: ALS_KEY:4 Sep 5 08:13:59.529 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=167, has_policy=0, timestamp=0, elapsed=167 Sep 5 08:13:59.679 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:13:59.679 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:14:00.788 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:14:00.789 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:14:01.899 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:14:01.899 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:14:02.287 [DEBUG2] PHN: [PROXY] Caching direct answer at \007telefon\026steuerberater-bayreuth\003com\000\000\001 Sep 5 08:14:02.288 [DEBUG2] PHN: [PROXY] Looking in cache for query \007telefon\026steuerberater-bayreuth\003com\000\000\001 Sep 5 08:14:02.288 [DEBUG2] PHN: [PROXY] Fetching \007telefon\026steuerberater-bayreuth\003com\000\000\001 from cache Sep 5 08:14:02.289 [DEBUG2] PHN: [PROXY] Got DNS query for \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.289 [DEBUG2] PHN: [PROXY] Looking in cache for query \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.289 [DEBUG2] PHN: [PROXY] Nothing found for \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.290 [DEBUG2] PHN: [PROXY] Got DNS query for \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.291 [DEBUG2] PHN: [PROXY] Looking in cache for query \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.292 [DEBUG2] PHN: [PROXY] Nothing found for \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.292 [DEBUG2] PHN: [PROXY] Got DNS query for \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.292 [DEBUG2] PHN: [PROXY] Looking in cache for query \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.293 [DEBUG2] PHN: [PROXY] Nothing found for \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.293 [DEBUG2] PHN: [PROXY] Got DNS query for \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:02.293 [DEBUG2] PHN: [PROXY] Looking in cache for query \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:02.294 [DEBUG2] PHN: [PROXY] Nothing found for \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:02.295 [DEBUG2] PHN: [PROXY] Sending SERVER FAIL for query \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.295 [DEBUG2] PHN: [PROXY] Sending SERVER FAIL for query \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.296 [DEBUG2] PHN: [PROXY] Sending SERVER FAIL for query \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.296 [DEBUG2] PHN: [PROXY] Sending SERVER FAIL for query \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:02.296 [DEBUG2] PHN: [PROXY] Got DNS query for \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.297 [DEBUG2] PHN: [PROXY] Looking in cache for query \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.297 [DEBUG2] PHN: [PROXY] Nothing found for \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.298 [DEBUG2] PHN: [PROXY] Got DNS query for \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.298 [DEBUG2] PHN: [PROXY] Looking in cache for query \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.298 [DEBUG2] PHN: [PROXY] Nothing found for \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.299 [DEBUG2] PHN: [PROXY] Got DNS query for \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.299 [DEBUG2] PHN: [PROXY] Looking in cache for query \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.300 [DEBUG2] PHN: [PROXY] Nothing found for \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.300 [DEBUG2] PHN: [PROXY] Got DNS query for \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:02.301 [DEBUG2] PHN: [PROXY] Looking in cache for query \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:02.301 [DEBUG2] PHN: [PROXY] Nothing found for \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:02.301 [DEBUG2] PHN: [PROXY] Sending SERVER FAIL for query \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.302 [DEBUG2] PHN: [PROXY] Sending SERVER FAIL for query \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.302 [DEBUG2] PHN: [PROXY] Sending SERVER FAIL for query \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.303 [DEBUG2] PHN: [PROXY] Sending SERVER FAIL for query \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:02.303 [DEBUG2] PHN: [PROXY] Got DNS query for \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.304 [DEBUG2] PHN: [PROXY] Looking in cache for query \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.304 [DEBUG2] PHN: [PROXY] Nothing found for \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.305 [DEBUG2] PHN: [PROXY] Got DNS query for \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.305 [DEBUG2] PHN: [PROXY] Looking in cache for query \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.306 [DEBUG2] PHN: [PROXY] Nothing found for \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.306 [DEBUG2] PHN: [PROXY] Got DNS query for \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.306 [DEBUG2] PHN: [PROXY] Looking in cache for query \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.307 [DEBUG2] PHN: [PROXY] Nothing found for \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.307 [DEBUG2] PHN: [PROXY] Got DNS query for \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:02.308 [DEBUG2] PHN: [PROXY] Looking in cache for query \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:02.308 [DEBUG2] PHN: [PROXY] Nothing found for \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:02.308 [DEBUG2] PHN: [PROXY] Sending SERVER FAIL for query \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.309 [DEBUG2] PHN: [PROXY] Sending SERVER FAIL for query \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.310 [DEBUG2] PHN: [PROXY] Sending SERVER FAIL for query \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.310 [DEBUG2] PHN: [PROXY] Sending SERVER FAIL for query \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:02.311 [DEBUG2] PHN: [PROXY] Got DNS query for \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.311 [DEBUG2] PHN: [PROXY] Looking in cache for query \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.311 [DEBUG2] PHN: [PROXY] Nothing found for \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:02.312 [DEBUG2] PHN: [PROXY] Got DNS query for \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.312 [DEBUG2] PHN: [PROXY] Looking in cache for query \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.313 [DEBUG2] PHN: [PROXY] Nothing found for \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:02.313 [DEBUG2] PHN: [PROXY] Got DNS query for \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.314 [DEBUG2] PHN: [PROXY] Looking in cache for query \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.314 [DEBUG2] PHN: [PROXY] Nothing found for \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:02.315 [DEBUG2] PHN: [PROXY] Got DNS query for \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:02.315 [DEBUG2] PHN: [PROXY] Looking in cache for query \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:02.316 [DEBUG2] PHN: [PROXY] Nothing found for \003pbx\007sipbase\002de\000\000\034 Sep 5 08:14:03.009 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:14:03.009 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:14:03.315 [DEBUG2] PHN: [PROXY] Caching direct answer at \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:03.316 [DEBUG2] PHN: [PROXY] Looking in cache for query \003pbx\007sipbase\002de\000\000\001 Sep 5 08:14:03.316 [DEBUG2] PHN: [PROXY] Fetching \003pbx\007sipbase\002de\000\000\001 from cache Sep 5 08:14:03.333 [INFO ] PHN: ALS_VALUE:1264 Sep 5 08:14:03.334 [INFO ] PHN: ALS_KEY:4 Sep 5 08:14:03.339 [DEBUG1] PHN: Add Cache: de.pool.ntp.org=90.187.148.77 (ttl=60, type=5) Sep 5 08:14:03.340 [DEBUG1] PHN: Add Cache: de.pool.ntp.org=90.187.148.77 (ttl=60, type=5) Sep 5 08:14:03.340 [DEBUG1] PHN: Add Cache: de.pool.ntp.org=90.187.148.77 (ttl=60, type=5) Sep 5 08:14:03.340 [DEBUG1] PHN: Add Cache: de.pool.ntp.org=136.243.7.20 (ttl=60, type=5) Sep 5 08:14:03.341 [DEBUG1] PHN: Add Cache: de.pool.ntp.org=136.243.7.20 (ttl=60, type=5) Sep 5 08:14:03.341 [DEBUG1] PHN: Add Cache: de.pool.ntp.org=136.243.7.20 (ttl=60, type=5) Sep 5 08:14:03.342 [DEBUG1] PHN: Add Cache: de.pool.ntp.org=141.98.136.83 (ttl=60, type=5) Sep 5 08:14:03.342 [DEBUG1] PHN: Add Cache: de.pool.ntp.org=141.98.136.83 (ttl=60, type=5) Sep 5 08:14:03.343 [DEBUG1] PHN: Add Cache: de.pool.ntp.org=141.98.136.83 (ttl=60, type=5) Sep 5 08:14:03.343 [DEBUG1] PHN: Add Cache: de.pool.ntp.org=162.159.200.123 (ttl=60, type=5) Sep 5 08:14:03.344 [DEBUG1] PHN: Add Cache: de.pool.ntp.org=162.159.200.123 (ttl=60, type=5) Sep 5 08:14:03.344 [DEBUG1] PHN: Add Cache: de.pool.ntp.org=162.159.200.123 (ttl=60, type=5) Sep 5 08:14:03.345 [DEBUG2] PHN: TplSocket::SetNextIp: ip_list_.size()=4, ip_list_.front()=162.159.200.123 Sep 5 08:14:03.345 [DEBUG2] NTP: Socket 11/0 dns_resolved, remote Udp:162.159.200.123:123 Sep 5 08:14:03.346 [DEBUG2] NTP: SocketStateCb connecting to remoteIP: 162.159.200.123 Sep 5 08:14:03.346 [DEBUG2] NTP: Socket 11/43336 connected, remote Udp:162.159.200.123:123 Sep 5 08:14:03.347 [DEBUG1] NTP: State trying -> refreshing Sep 5 08:14:03.348 [DEBUG2] NTP: Sending packet remoteIP 162.159.200.123 Sep 5 08:14:03.348 [DEBUG2] NTP: SocketStateCb remoteIP: 162.159.200.123 Sep 5 08:14:03.349 [DEBUG2] NTP: SocketStateCb remoteIP: 162.159.200.123 Sep 5 08:14:03.349 [DEBUG2] NTP: Socket 11/43336 dns_resolved, remote Udp:162.159.200.123:123 Sep 5 08:14:03.350 [DEBUG2] NTP: SocketStateCb connecting to remoteIP: 162.159.200.123 Sep 5 08:14:03.350 [DEBUG2] NTP: Socket 11/59816 connected, remote Udp:162.159.200.123:123 Sep 5 08:14:03.351 [DEBUG2] NTP: Sending packet remoteIP 162.159.200.123 Sep 5 08:14:03.351 [DEBUG2] NTP: SocketStateCb remoteIP: 162.159.200.123 Sep 5 08:14:03.352 [DEBUG2] NTP: SocketStateCb remoteIP: 162.159.200.123 Sep 5 08:14:03.352 [DEBUG2] PHN: [PROXY] Caching direct answer at \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:03.353 [DEBUG2] PHN: [PROXY] Looking in cache for query \002de\004pool\003ntp\003org\000\000\001 Sep 5 08:14:03.353 [DEBUG2] PHN: [PROXY] Fetching \002de\004pool\003ntp\003org\000\000\001 from cache Sep 5 08:14:03.376 [DEBUG2] NTP: SocketDataCb remoteIP: 162.159.200.123 Sep 5 08:14:03.377 [DEBUG1] NTP: State refreshing -> received Sep 5 08:14:03.377 [DEBUG1] PHN: New time received 3871347299 Sep 5 08:14:59.000 [INFO ] PHN: Setting system time: 1662358499 (Mon Sep 5 06:14:59 2022 ) Sep 5 08:14:59.001 [NOTICE] PHN: DST start 27.03.2022 02:00:00 end 30.10.2022 03:00:00 offset 3600 Sep 5 08:14:59.000 [INFO ] PHN: Setting system time: 1662358499 (Mon Sep 5 06:14:59 2022 ) Sep 5 08:14:59.000 [DEBUG0] CFG: apply_value: system_time = '1662358499', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.086 [DEBUG1] PHN: Add Cache: pbx.sipbase.de=212.87.45.206 (ttl=60, type=5) Sep 5 08:14:59.087 [DEBUG1] PHN: Add Cache: pbx.sipbase.de=212.87.45.206 (ttl=60, type=5) Sep 5 08:14:59.087 [DEBUG1] PHN: Add Cache: pbx.sipbase.de=212.87.45.206 (ttl=60, type=5) Sep 5 08:14:59.088 [DEBUG1] SIP: RoutePendingPacket 1000001: entry=a Udp:pbx.sipbase.de:5060 all 2 Sep 5 08:14:59.088 [DEBUG1] SIP: RoutePendingPacket 1000001: entry=Udp:212.87.45.206:5060 all 2 Sep 5 08:14:59.089 [DEBUG2] SIP: Socket 23/connecting Udp:10.137.14.44:54109 -> Udp:212.87.45.206:5060 Sep 5 08:14:59.090 [DEBUG1] SIP: RoutePendingPacket 1000002: entry=a Udp:pbx.sipbase.de:5060 all 2 Sep 5 08:14:59.090 [DEBUG1] SIP: RoutePendingPacket 1000002: entry=Udp:212.87.45.206:5060 all 2 Sep 5 08:14:59.091 [DEBUG2] SIP: Trusted IP Addresses: Udp:212.87.45.206 Sep 5 08:14:59.092 [DEBUG2] PHN: [PROXY] Caching direct answer at \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:59.092 [DEBUG2] PHN: [PROXY] Looking in cache for query \002de\004pool\003ntp\003org\000\000\034 Sep 5 08:14:59.092 [DEBUG2] PHN: [PROXY] Fetching \002de\004pool\003ntp\003org\000\000\034 from cache Sep 5 08:14:59.093 [DEBUG2] SIP: Socket 23/connected Udp:10.137.14.44:54109 -> Udp:212.87.45.206:5060 Sep 5 08:14:59.094 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 256000 Sep 5 08:14:59.094 [DEBUG1] SIP: RoutePendingPacket 1000001: entry=Udp:212.87.45.206:5060 all 2 Sep 5 08:14:59.095 [DEBUG1] SIP: Identity 4maxlawb connection id Udp:212.87.45.206:5060 Sep 5 08:14:59.095 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000001 Sep 5 08:14:59.096 [DEBUG0] SIP: send REGISTER (1: 869315631505-mex71oiszu4j) -> Udp:212.87.45.206:5060 Sep 5 08:14:59.099 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 256000 Sep 5 08:14:59.131 [DEBUG1] SIP: recv 401 REGISTER (1: 869315631505-mex71oiszu4j) <- Udp:212.87.45.206:5060 Sep 5 08:14:59.132 [DEBUG2] SIP: clear message repetition 1000001 869315631505-mex71oiszu4j Sep 5 08:14:59.133 [DEBUG2] SIP: sip::ProcessChallenge Identity=0, sip:pbx.sipbase.de Sep 5 08:14:59.134 [NOTICE] SIP: process auth: Match challenge for user=1030-94968112, realm=pbx.sipbase.de Sep 5 08:14:59.136 [DEBUG1] SIP: Routing to explicit plan Udp:212.87.45.206:5060 Sep 5 08:14:59.137 [DEBUG1] SIP: RoutePendingPacket 1000003: entry=Udp:212.87.45.206:5060 all 3 Sep 5 08:14:59.137 [DEBUG1] SIP: Identity 4maxlawb connection id Udp:212.87.45.206:5060 Sep 5 08:14:59.138 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000003 Sep 5 08:14:59.138 [DEBUG0] SIP: send REGISTER (2: 869315631505-mex71oiszu4j) -> Udp:212.87.45.206:5060 Sep 5 08:14:59.141 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 256000 Sep 5 08:14:59.178 [DEBUG1] SIP: recv 200 REGISTER (2: 869315631505-mex71oiszu4j) <- Udp:212.87.45.206:5060 Sep 5 08:14:59.179 [DEBUG2] SIP: clear message repetition 1000003 869315631505-mex71oiszu4j Sep 5 08:14:59.179 [DEBUG0] SIP: sip::process_registrar_packet: Received 200 OK Sep 5 08:14:59.181 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:14:59.181 [INFO ] SIP: Registered at registrar as 1030-94968112@pbx.sipbase.de (Expires: 600 secs) Sep 5 08:14:59.182 [DEBUG2] GUI: If_Registration(CONFIRMED, 0, 1030-94968112@pbx.sipbase.de,OK) Sep 5 08:14:59.183 [NOTICE] SIP: Subscription_refresh delay: rnd_delay: 1, delay: 0 Sep 5 08:14:59.184 [NOTICE] SIP: Subscription_refresh delay: rnd_delay: 1, delay: 0 Sep 5 08:14:59.185 [NOTICE] SIP: Subscription_refresh delay: rnd_delay: 1, delay: 0 Sep 5 08:14:59.185 [NOTICE] SIP: Subscription_refresh delay: rnd_delay: 1, delay: 0 Sep 5 08:14:59.185 [NOTICE] SIP: Subscription_refresh delay: rnd_delay: 1, delay: 0 Sep 5 08:14:59.186 [NOTICE] SIP: Subscription_refresh delay: rnd_delay: 1, delay: 0 Sep 5 08:14:59.187 [NOTICE] SIP: Subscription_refresh delay: rnd_delay: 1, delay: 0 Sep 5 08:14:59.188 [DEBUG2] SIP: Registration Metrics: 200, sip:1030-94968112@10.137.14.44:54109;line=4maxlawb, 600, 300 Sep 5 08:14:59.188 [DEBUG2] SIP: registration report 200/191: 'x-RegData: RPN=pbx.sipbase.de RCN=sip:1030-94968112@10.137.14.44:54109;line=4maxlawb x-RegMetrics: FRG RRD=37537 RRS=200 x-UserAgent:snomD735/10.1.119.10 CallID:869315631505-mex71oiszu4j ' Sep 5 08:14:59.195 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:14:59.196 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:14:59.336 [DEBUG0] CFG: apply_value: callrecord_missed_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.337 [DEBUG0] CFG: apply_value: callrecord_missed_remote = '"Tür" <sip:2100@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.338 [DEBUG0] CFG: apply_value: callrecord_missed_period = '2022-03-21T14:39:59ZPT0S', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.342 [DEBUG0] CFG: apply_value: callrecord_missed_displayname = 'Tür', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.343 [DEBUG0] CFG: apply_value: callrecord_missed_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.344 [DEBUG0] CFG: apply_value: callrecord_missed_remote = '"Tür" <sip:2100@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.344 [DEBUG0] CFG: apply_value: callrecord_missed_period = '2022-03-21T14:02:59ZPT0S', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.345 [DEBUG0] CFG: apply_value: callrecord_missed_displayname = 'Tür', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.346 [DEBUG0] CFG: apply_value: callrecord_missed_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.347 [DEBUG0] CFG: apply_value: callrecord_missed_remote = '"Tür" <sip:2100@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.348 [DEBUG0] CFG: apply_value: callrecord_missed_period = '2022-03-21T13:32:02ZPT0S', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.349 [DEBUG0] CFG: apply_value: callrecord_missed_displayname = 'Tür', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.350 [DEBUG0] CFG: apply_value: callrecord_missed_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.351 [DEBUG0] CFG: apply_value: callrecord_missed_remote = '"Tür" <sip:2100@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.352 [DEBUG0] CFG: apply_value: callrecord_missed_period = '2022-03-21T11:22:44ZPT0S', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.353 [DEBUG0] CFG: apply_value: callrecord_missed_displayname = 'Tür', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.354 [DEBUG0] CFG: apply_value: callrecord_missed_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.355 [DEBUG0] CFG: apply_value: callrecord_missed_remote = '"00499274433" <sip:00499274433@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.356 [DEBUG0] CFG: apply_value: callrecord_missed_period = '2022-03-21T10:48:10ZPT0S', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.356 [DEBUG0] CFG: apply_value: callrecord_missed_displayname = '00499274433', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.359 [DEBUG0] CFG: apply_value: callrecord_dialed_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.360 [DEBUG0] PHN: ContactUtils::GetVcard: identity=1 Sep 5 08:14:59.362 [DEBUG0] CFG: apply_value: callrecord_dialed_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.363 [DEBUG0] PHN: ContactUtils::GetVcard: identity=1 Sep 5 08:14:59.365 [DEBUG0] CFG: apply_value: callrecord_dialed_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.366 [DEBUG0] PHN: ContactUtils::GetVcard: identity=1 Sep 5 08:14:59.367 [DEBUG0] CFG: apply_value: callrecord_dialed_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.369 [DEBUG0] PHN: ContactUtils::GetVcard: identity=1 Sep 5 08:14:59.370 [DEBUG0] CFG: apply_value: callrecord_dialed_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.371 [DEBUG0] PHN: ContactUtils::GetVcard: identity=1 Sep 5 08:14:59.375 [DEBUG0] CFG: apply_value: callrecord_received_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.377 [DEBUG0] CFG: apply_value: callrecord_received_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.378 [DEBUG0] PHN: ContactUtils::GetVcard: identity=1 Sep 5 08:14:59.379 [DEBUG0] CFG: apply_value: callrecord_received_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.381 [DEBUG0] CFG: apply_value: callrecord_received_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.382 [DEBUG0] CFG: apply_value: callrecord_received_local = '"Mitarbeiter 2" <1030-94968112@pbx.sipbase.de>', need_apply: 0, provisioning (progress:0/finished:1), need reboot: 0 Sep 5 08:14:59.400 [INFO ] TOOLS: Going to write file ./snomconfig/config.xml. Sep 5 08:14:59.413 [NOTICE] PHN: Std-Settings stored Sep 5 08:14:59.540 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:14:59.541 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:00.185 [DEBUG0] SIP: refresh subscription 31 in 334 sec Sep 5 08:15:00.187 [DEBUG1] SIP: Routing to outbound proxy: sip:pbx.sipbase.de:5060;transport=udp Sep 5 08:15:00.189 [DEBUG0] SIP: refresh subscription 30 in 348 sec Sep 5 08:15:00.191 [DEBUG1] SIP: Routing to outbound proxy: sip:pbx.sipbase.de:5060;transport=udp Sep 5 08:15:00.193 [DEBUG0] SIP: refresh subscription 29 in 346 sec Sep 5 08:15:00.196 [DEBUG1] SIP: Routing to outbound proxy: sip:pbx.sipbase.de:5060;transport=udp Sep 5 08:15:00.197 [DEBUG0] SIP: refresh subscription 28 in 328 sec Sep 5 08:15:00.199 [DEBUG1] SIP: Routing to outbound proxy: sip:pbx.sipbase.de:5060;transport=udp Sep 5 08:15:00.201 [DEBUG0] SIP: refresh subscription 27 in 313 sec Sep 5 08:15:00.203 [DEBUG1] SIP: Routing to outbound proxy: sip:pbx.sipbase.de:5060;transport=udp Sep 5 08:15:00.205 [DEBUG0] SIP: refresh subscription 26 in 329 sec Sep 5 08:15:00.207 [DEBUG1] SIP: Routing to outbound proxy: sip:pbx.sipbase.de:5060;transport=udp Sep 5 08:15:00.208 [DEBUG0] SIP: refresh subscription 25 in 332 sec Sep 5 08:15:00.211 [DEBUG1] SIP: Routing to outbound proxy: sip:pbx.sipbase.de:5060;transport=udp Sep 5 08:15:00.212 [DEBUG1] SIP: RoutePendingPacket 1000004: entry=url ? sip:pbx.sipbase.de:5060;transport=udp all 10 Sep 5 08:15:00.213 [DEBUG1] SIP: RoutePendingPacket 1000004: entry=a Udp:pbx.sipbase.de:5060 all 10 Sep 5 08:15:00.214 [DEBUG1] SIP: RoutePendingPacket 1000004: entry=Udp:212.87.45.206:5060 all 10 Sep 5 08:15:00.214 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000004 Sep 5 08:15:00.215 [DEBUG0] SIP: send SUBSCRIBE (1: 889315637683-xoxo6rcvrntv) -> Udp:212.87.45.206:5060 Sep 5 08:15:00.217 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:00.218 [DEBUG1] SIP: RoutePendingPacket 1000005: entry=url ? sip:pbx.sipbase.de:5060;transport=udp all 10 Sep 5 08:15:00.218 [DEBUG1] SIP: RoutePendingPacket 1000005: entry=a Udp:pbx.sipbase.de:5060 all 10 Sep 5 08:15:00.219 [DEBUG1] SIP: RoutePendingPacket 1000005: entry=Udp:212.87.45.206:5060 all 10 Sep 5 08:15:00.219 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000005 Sep 5 08:15:00.220 [DEBUG0] SIP: send SUBSCRIBE (1: 889315633483-ryke2xejnpw7) -> Udp:212.87.45.206:5060 Sep 5 08:15:00.222 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:00.223 [DEBUG1] SIP: RoutePendingPacket 1000006: entry=url ? sip:pbx.sipbase.de:5060;transport=udp all 10 Sep 5 08:15:00.223 [DEBUG1] SIP: RoutePendingPacket 1000006: entry=a Udp:pbx.sipbase.de:5060 all 10 Sep 5 08:15:00.224 [DEBUG1] SIP: RoutePendingPacket 1000006: entry=Udp:212.87.45.206:5060 all 10 Sep 5 08:15:00.224 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000006 Sep 5 08:15:00.225 [DEBUG0] SIP: send SUBSCRIBE (1: 88931563ea82-rdjmua44q91h) -> Udp:212.87.45.206:5060 Sep 5 08:15:00.227 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:00.228 [DEBUG1] SIP: RoutePendingPacket 1000007: entry=url ? sip:pbx.sipbase.de:5060;transport=udp all 10 Sep 5 08:15:00.229 [DEBUG1] SIP: RoutePendingPacket 1000007: entry=a Udp:pbx.sipbase.de:5060 all 10 Sep 5 08:15:00.229 [DEBUG1] SIP: RoutePendingPacket 1000007: entry=Udp:212.87.45.206:5060 all 10 Sep 5 08:15:00.230 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000007 Sep 5 08:15:00.230 [DEBUG0] SIP: send SUBSCRIBE (1: 88931563a082-5xr8ve0ai8c6) -> Udp:212.87.45.206:5060 Sep 5 08:15:00.233 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:00.234 [DEBUG1] SIP: RoutePendingPacket 1000008: entry=url ? sip:pbx.sipbase.de:5060;transport=udp all 10 Sep 5 08:15:00.234 [DEBUG1] SIP: RoutePendingPacket 1000008: entry=a Udp:pbx.sipbase.de:5060 all 10 Sep 5 08:15:00.234 [DEBUG1] SIP: RoutePendingPacket 1000008: entry=Udp:212.87.45.206:5060 all 10 Sep 5 08:15:00.235 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000008 Sep 5 08:15:00.235 [DEBUG0] SIP: send SUBSCRIBE (1: 889315634b82-o2od7zezu9s8) -> Udp:212.87.45.206:5060 Sep 5 08:15:00.238 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:00.238 [DEBUG1] SIP: RoutePendingPacket 1000009: entry=url ? sip:pbx.sipbase.de:5060;transport=udp all 10 Sep 5 08:15:00.239 [DEBUG1] SIP: RoutePendingPacket 1000009: entry=a Udp:pbx.sipbase.de:5060 all 10 Sep 5 08:15:00.239 [DEBUG1] SIP: RoutePendingPacket 1000009: entry=Udp:212.87.45.206:5060 all 10 Sep 5 08:15:00.240 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000009 Sep 5 08:15:00.240 [DEBUG0] SIP: send SUBSCRIBE (1: 889315636481-b9ejf41jzd2q) -> Udp:212.87.45.206:5060 Sep 5 08:15:00.243 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:00.244 [DEBUG1] SIP: RoutePendingPacket 1000010: entry=url ? sip:pbx.sipbase.de:5060;transport=udp all 10 Sep 5 08:15:00.244 [DEBUG1] SIP: RoutePendingPacket 1000010: entry=a Udp:pbx.sipbase.de:5060 all 10 Sep 5 08:15:00.245 [DEBUG1] SIP: RoutePendingPacket 1000010: entry=Udp:212.87.45.206:5060 all 10 Sep 5 08:15:00.245 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000010 Sep 5 08:15:00.246 [DEBUG0] SIP: send SUBSCRIBE (1: 889315630e81-sz681w6usrqw) -> Udp:212.87.45.206:5060 Sep 5 08:15:00.249 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:00.253 [DEBUG1] SIP: recv 200 SUBSCRIBE (1: 889315637683-xoxo6rcvrntv) <- Udp:212.87.45.206:5060 Sep 5 08:15:00.254 [DEBUG2] SIP: clear message repetition 1000004 889315637683-xoxo6rcvrntv Sep 5 08:15:00.259 [DEBUG1] SIP: recv NOTIFY (1: 889315637683-xoxo6rcvrntv) <- Udp:212.87.45.206:5060 Sep 5 08:15:00.261 [INFO ] SIP: ClearRefreshNotifyTimeout 889315637683-xoxo6rcvrntv Sep 5 08:15:00.264 [DEBUG1] SIP: Received full dialog information Sep 5 08:15:00.266 [DEBUG1] SIP: RoutePendingPacket 1000011: entry=Udp:212.87.45.206:5060 all 11 Sep 5 08:15:00.267 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000011 Sep 5 08:15:00.268 [DEBUG0] SIP: send 200 NOTIFY (1: 889315637683-xoxo6rcvrntv) -> Udp:212.87.45.206:5060 Sep 5 08:15:00.270 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:00.275 [DEBUG1] SIP: recv 200 SUBSCRIBE (1: 889315633483-ryke2xejnpw7) <- Udp:212.87.45.206:5060 Sep 5 08:15:00.275 [DEBUG2] SIP: clear message repetition 1000005 889315633483-ryke2xejnpw7 Sep 5 08:15:00.276 [DEBUG1] SIP: remove pending packet: 1000011, all 11 Sep 5 08:15:00.281 [DEBUG1] SIP: recv NOTIFY (1: 889315633483-ryke2xejnpw7) <- Udp:212.87.45.206:5060 Sep 5 08:15:00.282 [INFO ] SIP: ClearRefreshNotifyTimeout 889315633483-ryke2xejnpw7 Sep 5 08:15:00.284 [DEBUG1] SIP: Received full dialog information Sep 5 08:15:00.287 [DEBUG1] SIP: RoutePendingPacket 1000012: entry=Udp:212.87.45.206:5060 all 11 Sep 5 08:15:00.288 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000012 Sep 5 08:15:00.288 [DEBUG0] SIP: send 200 NOTIFY (1: 889315633483-ryke2xejnpw7) -> Udp:212.87.45.206:5060 Sep 5 08:15:00.290 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:00.294 [DEBUG1] SIP: recv 200 SUBSCRIBE (1: 88931563ea82-rdjmua44q91h) <- Udp:212.87.45.206:5060 Sep 5 08:15:00.295 [DEBUG2] SIP: clear message repetition 1000006 88931563ea82-rdjmua44q91h Sep 5 08:15:00.300 [DEBUG1] SIP: recv NOTIFY (1: 88931563ea82-rdjmua44q91h) <- Udp:212.87.45.206:5060 Sep 5 08:15:00.301 [INFO ] SIP: ClearRefreshNotifyTimeout 88931563ea82-rdjmua44q91h Sep 5 08:15:00.303 [DEBUG1] SIP: Received full dialog information Sep 5 08:15:00.305 [DEBUG1] SIP: RoutePendingPacket 1000013: entry=Udp:212.87.45.206:5060 all 12 Sep 5 08:15:00.306 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000013 Sep 5 08:15:00.307 [DEBUG0] SIP: send 200 NOTIFY (1: 88931563ea82-rdjmua44q91h) -> Udp:212.87.45.206:5060 Sep 5 08:15:00.308 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:00.309 [DEBUG1] SIP: remove pending packet: 1000012, all 12 Sep 5 08:15:00.314 [DEBUG1] SIP: recv 200 SUBSCRIBE (1: 88931563a082-5xr8ve0ai8c6) <- Udp:212.87.45.206:5060 Sep 5 08:15:00.314 [DEBUG2] SIP: clear message repetition 1000007 88931563a082-5xr8ve0ai8c6 Sep 5 08:15:00.315 [DEBUG1] SIP: remove pending packet: 1000013, all 11 Sep 5 08:15:00.320 [DEBUG1] SIP: recv NOTIFY (1: 88931563a082-5xr8ve0ai8c6) <- Udp:212.87.45.206:5060 Sep 5 08:15:00.321 [INFO ] SIP: ClearRefreshNotifyTimeout 88931563a082-5xr8ve0ai8c6 Sep 5 08:15:00.323 [DEBUG1] SIP: Received full dialog information Sep 5 08:15:00.325 [DEBUG1] SIP: RoutePendingPacket 1000014: entry=Udp:212.87.45.206:5060 all 11 Sep 5 08:15:00.326 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000014 Sep 5 08:15:00.326 [DEBUG0] SIP: send 200 NOTIFY (1: 88931563a082-5xr8ve0ai8c6) -> Udp:212.87.45.206:5060 Sep 5 08:15:00.328 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:00.332 [DEBUG1] SIP: recv 200 SUBSCRIBE (1: 889315634b82-o2od7zezu9s8) <- Udp:212.87.45.206:5060 Sep 5 08:15:00.333 [DEBUG2] SIP: clear message repetition 1000008 889315634b82-o2od7zezu9s8 Sep 5 08:15:00.405 [DEBUG1] SIP: recv NOTIFY (1: 889315634b82-o2od7zezu9s8) <- Udp:212.87.45.206:5060 Sep 5 08:15:00.406 [INFO ] SIP: ClearRefreshNotifyTimeout 889315634b82-o2od7zezu9s8 Sep 5 08:15:00.408 [DEBUG1] SIP: Received full dialog information Sep 5 08:15:00.410 [DEBUG1] SIP: RoutePendingPacket 1000015: entry=Udp:212.87.45.206:5060 all 12 Sep 5 08:15:00.411 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000015 Sep 5 08:15:00.411 [DEBUG0] SIP: send 200 NOTIFY (1: 889315634b82-o2od7zezu9s8) -> Udp:212.87.45.206:5060 Sep 5 08:15:00.414 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:00.418 [DEBUG1] SIP: remove pending packet: 1000014, all 12 Sep 5 08:15:00.425 [DEBUG1] SIP: recv 200 SUBSCRIBE (1: 889315636481-b9ejf41jzd2q) <- Udp:212.87.45.206:5060 Sep 5 08:15:00.425 [DEBUG2] SIP: clear message repetition 1000009 889315636481-b9ejf41jzd2q Sep 5 08:15:00.426 [DEBUG1] SIP: remove pending packet: 1000015, all 11 Sep 5 08:15:00.431 [DEBUG1] SIP: recv NOTIFY (1: 889315636481-b9ejf41jzd2q) <- Udp:212.87.45.206:5060 Sep 5 08:15:00.432 [INFO ] SIP: ClearRefreshNotifyTimeout 889315636481-b9ejf41jzd2q Sep 5 08:15:00.434 [DEBUG1] SIP: Received full dialog information Sep 5 08:15:00.437 [DEBUG1] SIP: RoutePendingPacket 1000016: entry=Udp:212.87.45.206:5060 all 11 Sep 5 08:15:00.437 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000016 Sep 5 08:15:00.438 [DEBUG0] SIP: send 200 NOTIFY (1: 889315636481-b9ejf41jzd2q) -> Udp:212.87.45.206:5060 Sep 5 08:15:00.441 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:00.446 [DEBUG1] SIP: recv 200 SUBSCRIBE (1: 889315630e81-sz681w6usrqw) <- Udp:212.87.45.206:5060 Sep 5 08:15:00.446 [DEBUG2] SIP: clear message repetition 1000010 889315630e81-sz681w6usrqw Sep 5 08:15:00.447 [DEBUG1] SIP: remove pending packet: 1000016, all 11 Sep 5 08:15:00.452 [DEBUG1] SIP: recv NOTIFY (1: 889315630e81-sz681w6usrqw) <- Udp:212.87.45.206:5060 Sep 5 08:15:00.453 [INFO ] SIP: ClearRefreshNotifyTimeout 889315630e81-sz681w6usrqw Sep 5 08:15:00.455 [DEBUG1] SIP: Received full dialog information Sep 5 08:15:00.458 [DEBUG1] SIP: RoutePendingPacket 1000017: entry=Udp:212.87.45.206:5060 all 11 Sep 5 08:15:00.458 [DEBUG0] SIP: Use Connection Udp:212.87.45.206:5060 for packet 1000017 Sep 5 08:15:00.459 [DEBUG0] SIP: send 200 NOTIFY (1: 889315630e81-sz681w6usrqw) -> Udp:212.87.45.206:5060 Sep 5 08:15:00.460 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:00.467 [DEBUG1] SIP: remove pending packet: 1000017, all 11 Sep 5 08:15:00.627 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:00.628 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:01.712 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:01.713 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:02.798 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:02.798 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:02.962 [INFO ] PHN: ALS_VALUE:1267 Sep 5 08:15:02.963 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:03.883 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:03.883 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:04.968 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:04.968 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:05.148 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=177, has_policy=0, timestamp=0, elapsed=177 Sep 5 08:15:06.052 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:06.053 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:06.972 [INFO ] PHN: ALS_VALUE:1269 Sep 5 08:15:06.973 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:07.137 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:07.137 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:08.222 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:08.222 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:08.542 [DEBUG1] PHN: Sending Keepalive to Watchdog Sep 5 08:15:08.546 [INFO ] PHN: HandleWatchdog: status: 1 -> 1, timeout: 60, dog_fd: 7, setting set: 0 value: Sep 5 08:15:09.307 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:09.308 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:09.438 [ALERT ] WEBCLIENT: request https://telefon.steuerberater-bayreuth.com:443/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml stopped due to no response from server for con_id:3; resending with timeout 48000 ms Sep 5 08:15:09.439 [DEBUG2] WEBCLIENT: Send TCP connecting Sep 5 08:15:10.397 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:10.398 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:10.982 [INFO ] PHN: ALS_VALUE:1271 Sep 5 08:15:10.983 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:11.483 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:11.483 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:12.568 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:12.568 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:13.652 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:13.653 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:14.738 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:14.739 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:14.992 [INFO ] PHN: ALS_VALUE:1272 Sep 5 08:15:14.993 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:15.149 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=187, has_policy=0, timestamp=0, elapsed=187 Sep 5 08:15:15.824 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:15.825 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:16.908 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:16.909 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:17.994 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:17.994 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:19.002 [INFO ] PHN: ALS_VALUE:1273 Sep 5 08:15:19.003 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:19.078 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:19.078 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:20.135 [DEBUG1] PHN: Removing addrinfo telefon.steuerberater-bayreuth.com: 2a05:8b81:1000:1::726e:1df0 Sep 5 08:15:20.135 [DEBUG1] PHN: Removing addrinfo telefon.steuerberater-bayreuth.com: 83.171.236.91 Sep 5 08:15:20.163 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:20.163 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:21.248 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:21.249 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:21.640 [DEBUG1] SIP: Sending Keepalive (CRLF) to Udp:212.87.45.206:5060 Sep 5 08:15:21.641 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:22.333 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:22.333 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:23.012 [INFO ] PHN: ALS_VALUE:1274 Sep 5 08:15:23.013 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:23.417 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:23.418 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:24.502 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:24.502 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:25.149 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=197, has_policy=0, timestamp=0, elapsed=197 Sep 5 08:15:25.587 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:25.588 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:26.673 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:26.673 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:27.022 [INFO ] PHN: ALS_VALUE:1276 Sep 5 08:15:27.024 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:27.757 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:27.757 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:28.842 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:28.843 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:29.933 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:29.933 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:31.018 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:31.018 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:31.100 [INFO ] PHN: ALS_VALUE:1277 Sep 5 08:15:31.100 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:32.105 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:32.106 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:33.189 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:33.189 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:33.429 [ERROR ] PHN: TPL: Socket Error: 22/32/connecting, connect_cb -> No such file or directory (2) Sep 5 08:15:33.429 [DEBUG2] PHN: TplSocket OnConnectionFailed Sep 5 08:15:33.430 [DEBUG2] PHN: TplSocket::SetNextIp: ip_list_ is empty Sep 5 08:15:33.430 [DEBUG2] WEBCLIENT: Socket 22 disconnected Sep 5 08:15:33.431 [DEBUG2] WEBCLIENT: socket:22 conn_id:3 disconnected Tls:[2a05:8b81:1000:1::726e:1df0]:443 Sep 5 08:15:33.431 [NOTICE] WEBCLIENT: on_tcp_close conn_id:3 Sep 5 08:15:33.431 [DEBUG2] WEBCLIENT: Socket 22 deleted Sep 5 08:15:33.432 [ALERT ] WEBCLIENT: request https://telefon.steuerberater-bayreuth.com:443/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml failed due to no response from server (Connection timed out) for con_id:3; waiting to timeout so we can resend with BOTV Sep 5 08:15:34.274 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:34.274 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:35.042 [INFO ] PHN: ALS_VALUE:1278 Sep 5 08:15:35.043 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:35.149 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=207, has_policy=0, timestamp=0, elapsed=207 Sep 5 08:15:35.358 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:35.358 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:36.048 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50341 Sep 5 08:15:36.050 [DEBUG2] PHN: WEB: HTTP 24/443 accepted from Tls:10.137.12.131:50341 Sep 5 08:15:36.051 [DEBUG2] TLS: 0x1b1fe98 handshake start Sep 5 08:15:36.052 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:36.052 [DEBUG2] PHN: WEB: HTTP 24/443 connected Sep 5 08:15:36.053 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50342 Sep 5 08:15:36.054 [DEBUG2] PHN: WEB: HTTP 25/443 accepted from Tls:10.137.12.131:50342 Sep 5 08:15:36.054 [DEBUG2] TLS: 0x1b32b38 handshake start Sep 5 08:15:36.055 [DEBUG2] TLS: 0x1b32b38 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:36.055 [DEBUG2] PHN: WEB: HTTP 25/443 connected Sep 5 08:15:36.056 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:36.058 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:15:36.068 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:15:36.071 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:15:36.072 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:15:36.073 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS write certificate request (0) Sep 5 08:15:36.089 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS write certificate (0) Sep 5 08:15:36.261 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 TLSv1.3 write server certificate verify (0) Sep 5 08:15:36.264 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:15:36.264 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:36.266 [DEBUG2] TLS: 0x1b32b38 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:36.267 [DEBUG2] TLS: 0x1b32b38 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:15:36.277 [DEBUG2] TLS: 0x1b32b38 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:15:36.280 [DEBUG2] TLS: 0x1b32b38 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:15:36.281 [DEBUG2] TLS: 0x1b32b38 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:15:36.282 [DEBUG2] TLS: 0x1b32b38 SSL_accept/0 SSLv3/TLS write certificate request (0) Sep 5 08:15:36.294 [DEBUG2] TLS: 0x1b32b38 SSL_accept/0 SSLv3/TLS write certificate (0) Sep 5 08:15:36.441 [DEBUG2] TLS: 0x1b32b38 SSL_accept/0 TLSv1.3 write server certificate verify (0) Sep 5 08:15:36.444 [DEBUG2] TLS: 0x1b32b38 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:15:36.444 [DEBUG2] TLS: 0x1b32b38 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:36.483 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:36.484 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:36.562 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50343 Sep 5 08:15:36.563 [DEBUG2] PHN: WEB: HTTP 26/443 accepted from Tls:10.137.12.131:50343 Sep 5 08:15:36.564 [DEBUG2] TLS: 0x1b48800 handshake start Sep 5 08:15:36.565 [DEBUG2] TLS: 0x1b48800 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:36.565 [DEBUG2] PHN: WEB: HTTP 26/443 connected Sep 5 08:15:36.565 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50344 Sep 5 08:15:36.566 [DEBUG2] PHN: WEB: HTTP 27/443 accepted from Tls:10.137.12.131:50344 Sep 5 08:15:36.567 [DEBUG2] TLS: 0x1b5b140 handshake start Sep 5 08:15:36.567 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:36.568 [DEBUG2] PHN: WEB: HTTP 27/443 connected Sep 5 08:15:36.569 [DEBUG1] TLS: 0x1b1fe98 SSL Alert read/0:fatal:certificate unknown Sep 5 08:15:36.570 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 error in error Sep 5 08:15:36.570 [ERROR ] TLS: OSSL error (GetDecryptedInput ssl error): code 336151574, error:14094416:SSL routines:ssl3_read_bytes:sslv3 alert certificate unknown Sep 5 08:15:36.571 [ERROR ] PHN: TPL: Socket Error: 24/32/connected, Tls error, closing Sep 5 08:15:36.571 [DEBUG2] PHN: WEB: HTTP 24/443 disconnected Sep 5 08:15:36.572 [DEBUG2] PHN: WEB: HTTP 24/443 deleted Sep 5 08:15:36.573 [DEBUG1] TLS: 0x1b32b38 SSL Alert read/0:fatal:certificate unknown Sep 5 08:15:36.574 [DEBUG2] TLS: 0x1b32b38 SSL_accept/0 error in error Sep 5 08:15:36.574 [ERROR ] TLS: OSSL error (GetDecryptedInput ssl error): code 336151574, error:14094416:SSL routines:ssl3_read_bytes:sslv3 alert certificate unknown Sep 5 08:15:36.575 [ERROR ] PHN: TPL: Socket Error: 25/42/connected, Tls error, closing Sep 5 08:15:36.576 [DEBUG2] PHN: WEB: HTTP 25/443 disconnected Sep 5 08:15:36.576 [DEBUG2] PHN: WEB: HTTP 25/443 deleted Sep 5 08:15:36.620 [DEBUG2] TLS: 0x1b48800 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:36.621 [DEBUG2] TLS: 0x1b48800 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:15:36.631 [DEBUG2] TLS: 0x1b48800 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:15:36.634 [DEBUG2] TLS: 0x1b48800 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:15:36.635 [DEBUG2] TLS: 0x1b48800 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:15:36.636 [DEBUG2] TLS: 0x1b48800 SSL_accept/0 SSLv3/TLS write certificate request (0) Sep 5 08:15:36.648 [DEBUG2] TLS: 0x1b48800 SSL_accept/0 SSLv3/TLS write certificate (0) Sep 5 08:15:36.789 [DEBUG2] TLS: 0x1b48800 SSL_accept/0 TLSv1.3 write server certificate verify (0) Sep 5 08:15:36.792 [DEBUG2] TLS: 0x1b48800 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:15:36.792 [DEBUG2] TLS: 0x1b48800 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:36.794 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:36.795 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:15:36.805 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:15:36.808 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:15:36.809 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:15:36.809 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 SSLv3/TLS write certificate request (0) Sep 5 08:15:36.822 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 SSLv3/TLS write certificate (0) Sep 5 08:15:36.966 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 TLSv1.3 write server certificate verify (0) Sep 5 08:15:36.969 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:15:36.970 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:36.971 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50345 Sep 5 08:15:36.972 [DEBUG2] PHN: WEB: HTTP 28/443 accepted from Tls:10.137.12.131:50345 Sep 5 08:15:36.973 [DEBUG2] TLS: 0x1b1fe98 handshake start Sep 5 08:15:36.974 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:36.975 [DEBUG2] PHN: WEB: HTTP 28/443 connected Sep 5 08:15:36.976 [DEBUG1] TLS: 0x1b48800 SSL Alert read/0:fatal:certificate unknown Sep 5 08:15:36.977 [DEBUG2] TLS: 0x1b48800 SSL_accept/0 error in error Sep 5 08:15:36.977 [ERROR ] TLS: OSSL error (GetDecryptedInput ssl error): code 336151574, error:14094416:SSL routines:ssl3_read_bytes:sslv3 alert certificate unknown Sep 5 08:15:36.978 [ERROR ] PHN: TPL: Socket Error: 26/43/connected, Tls error, closing Sep 5 08:15:36.978 [DEBUG2] PHN: WEB: HTTP 26/443 disconnected Sep 5 08:15:36.979 [DEBUG2] PHN: WEB: HTTP 26/443 deleted Sep 5 08:15:36.980 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:36.982 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 SSLv3/TLS read client certificate (0) Sep 5 08:15:36.984 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 SSLv3/TLS read finished (0) Sep 5 08:15:36.984 [DEBUG2] TLS: 0x1b5b140 handshake done Sep 5 08:15:36.985 [DEBUG2] TLS: 0x1b5b140 Flag SSL3_FLAGS_NO_RENEGOTIATE_CIPHERS set. Sep 5 08:15:36.985 [DEBUG2] TLS: 0x1b5b140 SetHandshakeFinished() Sep 5 08:15:36.988 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 SSLv3/TLS write session ticket (0) Sep 5 08:15:36.990 [DEBUG2] TLS: 0x1b5b140 SSL_accept/0 SSLv3/TLS write session ticket (0) Sep 5 08:15:36.993 [INFO ] PHN: WEB: Request 27/988/0: GET / HTTP/1.1 Sep 5 08:15:36.995 [INFO ] PHN: WEB: 27 Digest authentication Sep 5 08:15:37.036 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:37.037 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:15:37.048 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:15:37.050 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:15:37.051 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:15:37.052 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS write certificate request (0) Sep 5 08:15:37.065 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS write certificate (0) Sep 5 08:15:37.206 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 TLSv1.3 write server certificate verify (0) Sep 5 08:15:37.209 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:15:37.209 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:37.256 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:37.257 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS read client certificate (0) Sep 5 08:15:37.260 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS read finished (0) Sep 5 08:15:37.260 [DEBUG2] TLS: 0x1b1fe98 handshake done Sep 5 08:15:37.260 [DEBUG2] TLS: 0x1b1fe98 Flag SSL3_FLAGS_NO_RENEGOTIATE_CIPHERS set. Sep 5 08:15:37.261 [DEBUG2] TLS: 0x1b1fe98 SetHandshakeFinished() Sep 5 08:15:37.263 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS write session ticket (0) Sep 5 08:15:37.265 [DEBUG2] TLS: 0x1b1fe98 SSL_accept/0 SSLv3/TLS write session ticket (0) Sep 5 08:15:37.299 [INFO ] PHN: WEB: Request 27/855/0: GET /fox.css HTTP/1.1 Sep 5 08:15:37.302 [INFO ] PHN: WEB: 27 Digest authentication Sep 5 08:15:37.315 [INFO ] PHN: WEB: Request 28/898/0: GET /img/clr.gif HTTP/1.1 Sep 5 08:15:37.317 [INFO ] PHN: WEB: 28 Digest authentication Sep 5 08:15:37.368 [INFO ] PHN: WEB: Request 28/910/0: GET /img/snom_logo.png HTTP/1.1 Sep 5 08:15:37.370 [INFO ] PHN: WEB: 28 Digest authentication Sep 5 08:15:37.381 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50347 Sep 5 08:15:37.381 [DEBUG2] PHN: WEB: HTTP 29/443 accepted from Tls:10.137.12.131:50347 Sep 5 08:15:37.382 [DEBUG2] TLS: 0x1b5ed50 handshake start Sep 5 08:15:37.383 [DEBUG2] TLS: 0x1b5ed50 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:37.383 [DEBUG2] PHN: WEB: HTTP 29/443 connected Sep 5 08:15:37.384 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50346 Sep 5 08:15:37.384 [DEBUG2] PHN: WEB: HTTP 30/443 accepted from Tls:10.137.12.131:50346 Sep 5 08:15:37.386 [DEBUG2] TLS: 0x1b51a18 handshake start Sep 5 08:15:37.386 [DEBUG2] TLS: 0x1b51a18 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:37.387 [DEBUG2] PHN: WEB: HTTP 30/443 connected Sep 5 08:15:37.387 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50348 Sep 5 08:15:37.388 [DEBUG2] PHN: WEB: HTTP 31/443 accepted from Tls:10.137.12.131:50348 Sep 5 08:15:37.388 [DEBUG2] TLS: 0x1b3ab30 handshake start Sep 5 08:15:37.389 [DEBUG2] TLS: 0x1b3ab30 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:37.390 [DEBUG2] PHN: WEB: HTTP 31/443 connected Sep 5 08:15:37.390 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50349 Sep 5 08:15:37.391 [DEBUG2] PHN: WEB: HTTP 32/443 accepted from Tls:10.137.12.131:50349 Sep 5 08:15:37.391 [DEBUG2] TLS: 0x1b73ee0 handshake start Sep 5 08:15:37.392 [DEBUG2] TLS: 0x1b73ee0 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:37.392 [DEBUG2] PHN: WEB: HTTP 32/443 connected Sep 5 08:15:37.395 [INFO ] PHN: WEB: Request 27/910/0: GET /img/separater.png HTTP/1.1 Sep 5 08:15:37.396 [INFO ] PHN: WEB: 27 Digest authentication Sep 5 08:15:37.406 [INFO ] PHN: WEB: Request 28/907/0: GET /img/head.png HTTP/1.1 Sep 5 08:15:37.408 [INFO ] PHN: WEB: 28 Digest authentication Sep 5 08:15:37.417 [DEBUG2] TLS: 0x1b5ed50 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:37.418 [DEBUG2] TLS: 0x1b5ed50 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:15:37.428 [DEBUG2] TLS: 0x1b5ed50 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:15:37.431 [DEBUG2] TLS: 0x1b5ed50 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:15:37.432 [DEBUG2] TLS: 0x1b5ed50 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:15:37.433 [DEBUG2] TLS: 0x1b5ed50 SSL_accept/0 SSLv3/TLS write certificate request (0) Sep 5 08:15:37.445 [DEBUG2] TLS: 0x1b5ed50 SSL_accept/0 SSLv3/TLS write certificate (0) Sep 5 08:15:37.587 [DEBUG2] TLS: 0x1b5ed50 SSL_accept/0 TLSv1.3 write server certificate verify (0) Sep 5 08:15:37.590 [DEBUG2] TLS: 0x1b5ed50 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:15:37.590 [DEBUG2] TLS: 0x1b5ed50 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:37.592 [DEBUG2] TLS: 0x1b51a18 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:37.595 [DEBUG2] TLS: 0x1b51a18 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:15:37.605 [DEBUG2] TLS: 0x1b51a18 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:15:37.608 [DEBUG2] TLS: 0x1b51a18 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:15:37.608 [DEBUG2] TLS: 0x1b51a18 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:15:37.611 [DEBUG2] TLS: 0x1b51a18 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:15:37.611 [DEBUG2] TLS: 0x1b51a18 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:37.612 [DEBUG2] TLS: 0x1b3ab30 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:37.615 [DEBUG2] TLS: 0x1b3ab30 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:15:37.625 [DEBUG2] TLS: 0x1b3ab30 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:15:37.628 [DEBUG2] TLS: 0x1b3ab30 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:15:37.629 [DEBUG2] TLS: 0x1b3ab30 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:15:37.631 [DEBUG2] TLS: 0x1b3ab30 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:15:37.632 [DEBUG2] TLS: 0x1b3ab30 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:37.633 [DEBUG2] TLS: 0x1b73ee0 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:37.634 [DEBUG2] TLS: 0x1b73ee0 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:15:37.644 [DEBUG2] TLS: 0x1b73ee0 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:15:37.647 [DEBUG2] TLS: 0x1b73ee0 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:15:37.647 [DEBUG2] TLS: 0x1b73ee0 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:15:37.648 [DEBUG2] TLS: 0x1b73ee0 SSL_accept/0 SSLv3/TLS write certificate request (0) Sep 5 08:15:37.670 [DEBUG2] TLS: 0x1b73ee0 SSL_accept/0 SSLv3/TLS write certificate (0) Sep 5 08:15:37.812 [DEBUG2] TLS: 0x1b73ee0 SSL_accept/0 TLSv1.3 write server certificate verify (0) Sep 5 08:15:37.815 [DEBUG2] TLS: 0x1b73ee0 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:15:37.815 [DEBUG2] TLS: 0x1b73ee0 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:37.816 [DEBUG0] PHN: LoopMon: LCS/3331 took 412 (105) msecs, started Sep 5 08:15:37, 5 tasks Sep 5 08:15:37.853 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:37.854 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:37.984 [DEBUG2] PHN: LLDP: send lldp advertisment Sep 5 08:15:37.985 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50350 Sep 5 08:15:37.985 [DEBUG2] PHN: WEB: HTTP 33/443 accepted from Tls:10.137.12.131:50350 Sep 5 08:15:37.986 [DEBUG2] TLS: 0x1b8a6d0 handshake start Sep 5 08:15:37.987 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:37.987 [DEBUG2] PHN: WEB: HTTP 33/443 connected Sep 5 08:15:37.988 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50351 Sep 5 08:15:37.988 [DEBUG2] PHN: WEB: HTTP 34/443 accepted from Tls:10.137.12.131:50351 Sep 5 08:15:37.989 [DEBUG2] TLS: 0x1b9d5c0 handshake start Sep 5 08:15:37.990 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:37.990 [DEBUG2] PHN: WEB: HTTP 34/443 connected Sep 5 08:15:37.991 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50352 Sep 5 08:15:37.991 [DEBUG2] PHN: WEB: HTTP 35/443 accepted from Tls:10.137.12.131:50352 Sep 5 08:15:37.992 [DEBUG2] TLS: 0x1bb0620 handshake start Sep 5 08:15:37.992 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:37.993 [DEBUG2] PHN: WEB: HTTP 35/443 connected Sep 5 08:15:37.995 [INFO ] PHN: WEB: Request 27/902/0: GET /img/corul.gif HTTP/1.1 Sep 5 08:15:37.997 [INFO ] PHN: WEB: 27 Digest authentication Sep 5 08:15:38.005 [INFO ] PHN: WEB: Request 28/902/0: GET /img/corur.gif HTTP/1.1 Sep 5 08:15:38.007 [INFO ] PHN: WEB: 28 Digest authentication Sep 5 08:15:38.014 [DEBUG1] TLS: 0x1b5ed50 SSL Alert read/0:fatal:certificate unknown Sep 5 08:15:38.014 [DEBUG2] TLS: 0x1b5ed50 SSL_accept/0 error in error Sep 5 08:15:38.015 [ERROR ] TLS: OSSL error (GetDecryptedInput ssl error): code 336151574, error:14094416:SSL routines:ssl3_read_bytes:sslv3 alert certificate unknown Sep 5 08:15:38.015 [ERROR ] PHN: TPL: Socket Error: 29/42/connected, Tls error, closing Sep 5 08:15:38.016 [DEBUG2] PHN: WEB: HTTP 29/443 disconnected Sep 5 08:15:38.016 [DEBUG2] PHN: WEB: HTTP 29/443 deleted Sep 5 08:15:38.017 [DEBUG1] TLS: 0x1b51a18 SSL Alert read/0:fatal:certificate unknown Sep 5 08:15:38.018 [DEBUG2] TLS: 0x1b51a18 SSL_accept/0 error in error Sep 5 08:15:38.019 [ERROR ] TLS: OSSL error (GetDecryptedInput ssl error): code 336151574, error:14094416:SSL routines:ssl3_read_bytes:sslv3 alert certificate unknown Sep 5 08:15:38.019 [ERROR ] PHN: TPL: Socket Error: 30/43/connected, Tls error, closing Sep 5 08:15:38.020 [DEBUG2] PHN: WEB: HTTP 30/443 disconnected Sep 5 08:15:38.021 [DEBUG2] PHN: WEB: HTTP 30/443 deleted Sep 5 08:15:38.021 [DEBUG1] TLS: 0x1b3ab30 SSL Alert read/0:fatal:certificate unknown Sep 5 08:15:38.022 [DEBUG2] TLS: 0x1b3ab30 SSL_accept/0 error in error Sep 5 08:15:38.023 [ERROR ] TLS: OSSL error (GetDecryptedInput ssl error): code 336151574, error:14094416:SSL routines:ssl3_read_bytes:sslv3 alert certificate unknown Sep 5 08:15:38.024 [ERROR ] PHN: TPL: Socket Error: 31/45/connected, Tls error, closing Sep 5 08:15:38.024 [DEBUG2] PHN: WEB: HTTP 31/443 disconnected Sep 5 08:15:38.025 [DEBUG2] PHN: WEB: HTTP 31/443 deleted Sep 5 08:15:38.025 [DEBUG1] TLS: 0x1b73ee0 SSL Alert read/0:fatal:certificate unknown Sep 5 08:15:38.026 [DEBUG2] TLS: 0x1b73ee0 SSL_accept/0 error in error Sep 5 08:15:38.026 [ERROR ] TLS: OSSL error (GetDecryptedInput ssl error): code 336151574, error:14094416:SSL routines:ssl3_read_bytes:sslv3 alert certificate unknown Sep 5 08:15:38.027 [ERROR ] PHN: TPL: Socket Error: 32/46/connected, Tls error, closing Sep 5 08:15:38.028 [DEBUG2] PHN: WEB: HTTP 32/443 disconnected Sep 5 08:15:38.028 [DEBUG2] PHN: WEB: HTTP 32/443 deleted Sep 5 08:15:38.033 [INFO ] PHN: WEB: Request 27/902/0: GET /img/corlr.gif HTTP/1.1 Sep 5 08:15:38.035 [INFO ] PHN: WEB: 27 Digest authentication Sep 5 08:15:38.043 [INFO ] PHN: WEB: Request 28/902/0: GET /img/corll.gif HTTP/1.1 Sep 5 08:15:38.044 [INFO ] PHN: WEB: 28 Digest authentication Sep 5 08:15:38.051 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:38.053 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:15:38.062 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:15:38.065 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:15:38.066 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:15:38.067 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 SSLv3/TLS write certificate request (0) Sep 5 08:15:38.079 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 SSLv3/TLS write certificate (0) Sep 5 08:15:38.221 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 TLSv1.3 write server certificate verify (0) Sep 5 08:15:38.224 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:15:38.224 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:38.226 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:38.227 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:15:38.237 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:15:38.241 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:15:38.241 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:15:38.242 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 SSLv3/TLS write certificate request (0) Sep 5 08:15:38.254 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 SSLv3/TLS write certificate (0) Sep 5 08:15:38.395 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 TLSv1.3 write server certificate verify (0) Sep 5 08:15:38.398 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:15:38.398 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:38.400 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 before SSL initialization (0) Sep 5 08:15:38.402 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:15:38.411 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:15:38.414 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:15:38.415 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:15:38.416 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 SSLv3/TLS write certificate request (0) Sep 5 08:15:38.428 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 SSLv3/TLS write certificate (0) Sep 5 08:15:38.569 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 TLSv1.3 write server certificate verify (0) Sep 5 08:15:38.571 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:15:38.572 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:38.597 [DEBUG1] PHN: Sending Keepalive to Watchdog Sep 5 08:15:38.601 [INFO ] PHN: HandleWatchdog: status: 1 -> 1, timeout: 60, dog_fd: 7, setting set: 0 value: Sep 5 08:15:38.603 [INFO ] PHN: WEB: Request 28/898/0: GET /favicon.ico HTTP/1.1 Sep 5 08:15:38.605 [INFO ] PHN: WEB: 28 Digest authentication Sep 5 08:15:38.623 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:38.624 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 SSLv3/TLS read client certificate (0) Sep 5 08:15:38.626 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 SSLv3/TLS read finished (0) Sep 5 08:15:38.626 [DEBUG2] TLS: 0x1b8a6d0 handshake done Sep 5 08:15:38.627 [DEBUG2] TLS: 0x1b8a6d0 Flag SSL3_FLAGS_NO_RENEGOTIATE_CIPHERS set. Sep 5 08:15:38.627 [DEBUG2] TLS: 0x1b8a6d0 SetHandshakeFinished() Sep 5 08:15:38.629 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 SSLv3/TLS write session ticket (0) Sep 5 08:15:38.631 [DEBUG2] TLS: 0x1b8a6d0 SSL_accept/0 SSLv3/TLS write session ticket (0) Sep 5 08:15:38.633 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:38.634 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 SSLv3/TLS read client certificate (0) Sep 5 08:15:38.636 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 SSLv3/TLS read finished (0) Sep 5 08:15:38.636 [DEBUG2] TLS: 0x1b9d5c0 handshake done Sep 5 08:15:38.637 [DEBUG2] TLS: 0x1b9d5c0 Flag SSL3_FLAGS_NO_RENEGOTIATE_CIPHERS set. Sep 5 08:15:38.637 [DEBUG2] TLS: 0x1b9d5c0 SetHandshakeFinished() Sep 5 08:15:38.639 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 SSLv3/TLS write session ticket (0) Sep 5 08:15:38.641 [DEBUG2] TLS: 0x1b9d5c0 SSL_accept/0 SSLv3/TLS write session ticket (0) Sep 5 08:15:38.690 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:15:38.691 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 SSLv3/TLS read client certificate (0) Sep 5 08:15:38.693 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 SSLv3/TLS read finished (0) Sep 5 08:15:38.694 [DEBUG2] TLS: 0x1bb0620 handshake done Sep 5 08:15:38.695 [DEBUG2] TLS: 0x1bb0620 Flag SSL3_FLAGS_NO_RENEGOTIATE_CIPHERS set. Sep 5 08:15:38.695 [DEBUG2] TLS: 0x1bb0620 SetHandshakeFinished() Sep 5 08:15:38.697 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 SSLv3/TLS write session ticket (0) Sep 5 08:15:38.699 [DEBUG2] TLS: 0x1bb0620 SSL_accept/0 SSLv3/TLS write session ticket (0) Sep 5 08:15:38.948 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:38.949 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:39.052 [INFO ] PHN: ALS_VALUE:1279 Sep 5 08:15:39.053 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:40.033 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:40.033 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:40.152 [INFO ] PHN: WEB: Request 28/1041/0: GET /advanced_network.htm HTTP/1.1 Sep 5 08:15:40.154 [INFO ] PHN: WEB: 28 Digest authentication Sep 5 08:15:40.382 [INFO ] PHN: WEB: Request 28/924/0: GET /img/corul2.gif HTTP/1.1 Sep 5 08:15:40.384 [INFO ] PHN: WEB: 28 Digest authentication Sep 5 08:15:40.392 [INFO ] PHN: WEB: Request 27/924/0: GET /img/corur2.gif HTTP/1.1 Sep 5 08:15:40.394 [INFO ] PHN: WEB: 27 Digest authentication Sep 5 08:15:40.404 [INFO ] PHN: WEB: Request 33/859/0: GET /fox.js HTTP/1.1 Sep 5 08:15:40.405 [INFO ] PHN: WEB: 33 Digest authentication Sep 5 08:15:41.117 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:41.118 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:42.202 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:42.202 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:42.976 [INFO ] PHN: WEB: Request 33/1035/0: GET /log.htm HTTP/1.1 Sep 5 08:15:42.978 [INFO ] PHN: WEB: 33 Digest authentication Sep 5 08:15:43.113 [INFO ] PHN: ALS_VALUE:1280 Sep 5 08:15:43.114 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:43.286 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:43.287 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:44.372 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:44.373 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:45.150 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=217, has_policy=0, timestamp=0, elapsed=217 Sep 5 08:15:45.457 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:45.457 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:46.541 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:46.542 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:47.072 [INFO ] PHN: ALS_VALUE:1281 Sep 5 08:15:47.073 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:47.627 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:47.628 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:48.713 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:48.714 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:49.798 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:49.798 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:50.390 [NOTICE] PHN: TPL: Socket 28 idle/connect timeout Sep 5 08:15:50.391 [DEBUG1] TLS: 0x1b1fe98 SSL Alert write/0:warning:close notify Sep 5 08:15:50.392 [DEBUG2] PHN: WEB: HTTP 28/443 disconnecting Sep 5 08:15:50.393 [DEBUG2] PHN: WEB: HTTP 28/443 disconnected Sep 5 08:15:50.394 [DEBUG2] PHN: WEB: HTTP 28/443 deleted Sep 5 08:15:50.401 [NOTICE] PHN: TPL: Socket 27 idle/connect timeout Sep 5 08:15:50.402 [DEBUG1] TLS: 0x1b5b140 SSL Alert write/0:warning:close notify Sep 5 08:15:50.402 [DEBUG2] PHN: WEB: HTTP 27/443 disconnecting Sep 5 08:15:50.404 [DEBUG2] PHN: WEB: HTTP 27/443 disconnected Sep 5 08:15:50.404 [DEBUG2] PHN: WEB: HTTP 27/443 deleted Sep 5 08:15:50.888 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:50.888 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:51.082 [INFO ] PHN: ALS_VALUE:1280 Sep 5 08:15:51.083 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:51.641 [DEBUG1] SIP: Sending Keepalive (CRLF) to Udp:212.87.45.206:5060 Sep 5 08:15:51.642 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:15:51.972 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:51.972 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:53.057 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:53.058 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:53.271 [NOTICE] PHN: TPL: Socket 33 idle/connect timeout Sep 5 08:15:53.271 [DEBUG1] TLS: 0x1b8a6d0 SSL Alert write/0:warning:close notify Sep 5 08:15:53.272 [DEBUG2] PHN: WEB: HTTP 33/443 disconnecting Sep 5 08:15:53.273 [DEBUG2] PHN: WEB: HTTP 33/443 disconnected Sep 5 08:15:53.273 [DEBUG2] PHN: WEB: HTTP 33/443 deleted Sep 5 08:15:54.141 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:54.142 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:55.092 [INFO ] PHN: ALS_VALUE:1281 Sep 5 08:15:55.093 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:55.150 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=227, has_policy=0, timestamp=0, elapsed=227 Sep 5 08:15:55.225 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:55.226 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:56.310 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:56.310 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:57.394 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:57.394 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:57.489 [ALERT ] WEBCLIENT: request https://telefon.steuerberater-bayreuth.com:443/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml stopped due to no response from server for con_id:3; resending with timeout 96000 ms Sep 5 08:15:57.490 [DEBUG2] WEBCLIENT: Send TCP none Sep 5 08:15:57.491 [DEBUG2] WEBCLIENT: Socket 36 dns_resolving Sep 5 08:15:57.522 [DEBUG1] PHN: Add Cache: telefon.steuerberater-bayreuth.com=2a05:8b81:1000:1::726e:1df0 (ttl=60, type=5) Sep 5 08:15:57.523 [DEBUG1] PHN: Add Cache: telefon.steuerberater-bayreuth.com=2a05:8b81:1000:1::726e:1df0 (ttl=60, type=5) Sep 5 08:15:57.524 [DEBUG1] PHN: Add Cache: telefon.steuerberater-bayreuth.com=2a05:8b81:1000:1::726e:1df0 (ttl=60, type=5) Sep 5 08:15:57.524 [DEBUG1] PHN: Add Cache: telefon.steuerberater-bayreuth.com=83.171.236.91 (ttl=60, type=5) Sep 5 08:15:57.524 [DEBUG1] PHN: Add Cache: telefon.steuerberater-bayreuth.com=83.171.236.91 (ttl=60, type=5) Sep 5 08:15:57.525 [DEBUG1] PHN: Add Cache: telefon.steuerberater-bayreuth.com=83.171.236.91 (ttl=60, type=5) Sep 5 08:15:57.526 [DEBUG2] PHN: TplSocket::SetNextIp: ip_list_.size()=2, ip_list_.front()=83.171.236.91 Sep 5 08:15:57.526 [DEBUG2] WEBCLIENT: Socket 36 dns_resolved Sep 5 08:15:57.527 [DEBUG2] WEBCLIENT: Send TCP dns_resolved Sep 5 08:15:57.529 [DEBUG2] WEBCLIENT: Socket 36 connecting Sep 5 08:15:57.540 [DEBUG1] TLS: no session found for key: Tls:telefon.steuerberater-bayreuth.com:83.171.236.91:443 Sep 5 08:15:57.541 [INFO ] TLS: TlsSessionOssl::SetRemoteDnsName: hostname=telefon.steuerberater-bayreuth.com, hostip=83.171.236.91, flags=0 Sep 5 08:15:57.541 [DEBUG2] TLS: 0x1bae200 handshake start Sep 5 08:15:57.542 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 before SSL initialization (0) Sep 5 08:15:57.547 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 SSLv3/TLS write client hello (0) Sep 5 08:15:57.547 [NOTICE] TLS: new session Sep 5 08:15:57.547 [DEBUG2] WEBCLIENT: Socket 36 connected Sep 5 08:15:57.562 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 SSLv3/TLS write client hello (0) Sep 5 08:15:57.571 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 SSLv3/TLS read server hello (0) Sep 5 08:15:57.573 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 TLSv1.3 read encrypted extensions (0) Sep 5 08:15:57.581 [INFO ] TLS: Result 0 at depth 2: ok Sep 5 08:15:57.581 [INFO ] TLS: Cert s: /C=US/O=Internet Security Research Group/CN=ISRG Root X1 Sep 5 08:15:57.582 [INFO ] TLS: Cert i: /C=US/O=Internet Security Research Group/CN=ISRG Root X1 Sep 5 08:15:57.598 [INFO ] TLS: Result 0 at depth 1: ok Sep 5 08:15:57.598 [INFO ] TLS: Cert s: /C=US/O=Let's Encrypt/CN=R3 Sep 5 08:15:57.598 [INFO ] TLS: Cert i: /C=US/O=Internet Security Research Group/CN=ISRG Root X1 Sep 5 08:15:57.605 [INFO ] TLS: Result 0 at depth 0: ok Sep 5 08:15:57.605 [INFO ] TLS: Cert s: /CN=steuerberater-bayreuth.com Sep 5 08:15:57.606 [INFO ] TLS: Cert i: /C=US/O=Let's Encrypt/CN=R3 Sep 5 08:15:57.607 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 SSLv3/TLS read server certificate (0) Sep 5 08:15:57.612 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 TLSv1.3 read server certificate verify (0) Sep 5 08:15:57.615 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 SSLv3/TLS read finished (0) Sep 5 08:15:57.615 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:15:57.618 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 SSLv3/TLS write finished (0) Sep 5 08:15:57.619 [DEBUG2] TLS: 0x1bae200 handshake done Sep 5 08:15:57.620 [DEBUG1] TLS: 0x1b1f3a8 session cache add 1 Sep 5 08:15:57.620 [DEBUG2] TLS: 0x1bae200 SetHandshakeFinished() Sep 5 08:15:57.634 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 SSL negotiation finished successfully (0) Sep 5 08:15:57.634 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 SSL negotiation finished successfully (0) Sep 5 08:15:57.635 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 SSLv3/TLS read server session ticket (0) Sep 5 08:15:57.636 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 SSL negotiation finished successfully (0) Sep 5 08:15:57.637 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 SSL negotiation finished successfully (0) Sep 5 08:15:57.638 [DEBUG2] TLS: 0x1bae200 SSL_connect/0 SSLv3/TLS read server session ticket (0) Sep 5 08:15:57.662 [DEBUG1] TLS: 0x1bae200 SSL Alert write/0:warning:close notify Sep 5 08:15:57.663 [DEBUG2] WEBCLIENT: Socket 36 disconnecting Sep 5 08:15:57.664 [DEBUG2] WEBCLIENT: Socket 36 disconnected Sep 5 08:15:57.665 [DEBUG2] WEBCLIENT: Socket 36 deleted Sep 5 08:15:57.665 [INFO ] PHN: OnImageLocation: Fetching FW URL: https://telefon.steuerberater-bayreuth.com:443/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml done, result 200 Sep 5 08:15:57.666 [INFO ] PHN: OnImageLocationWithoutFallback: Fetching FW URL: https://telefon.steuerberater-bayreuth.com:443/provisioning/C6L3MNQY23D2/D735-firmwareupdate.xml done, result 200 Sep 5 08:15:57.666 [NOTICE] PHN: read_xml_settings: found firmware-settings XML header Sep 5 08:15:57.667 [NOTICE] PHN: read_xml_settings: found one byte encoding: 1 Sep 5 08:15:57.668 [INFO ] PHN: ProvisioningReplacements: URL >https://downloads.snom.com:443/fw/10.1.119.10/bin/snomD735-10.1.119.10-SIP-r.bin< Sep 5 08:15:57.669 [DEBUG0] PHN: Uri Replace >{mac}< in >https://downloads.snom.com:443/fw/10.1.119.10/bin/snomD735-10.1.119.10-SIP-r.bin< Sep 5 08:15:57.670 [DEBUG0] PHN: Uri Replaced result: >https://downloads.snom.com:443/fw/10.1.119.10/bin/snomD735-10.1.119.10-SIP-r.bin< Sep 5 08:15:57.670 [DEBUG0] PHN: Uri Replace >{phone_type}< in >https://downloads.snom.com:443/fw/10.1.119.10/bin/snomD735-10.1.119.10-SIP-r.bin< Sep 5 08:15:57.671 [DEBUG0] PHN: Uri Replaced result: >https://downloads.snom.com:443/fw/10.1.119.10/bin/snomD735-10.1.119.10-SIP-r.bin< Sep 5 08:15:57.672 [DEBUG0] PHN: Uri Replace >{firmware_version}< in >https://downloads.snom.com:443/fw/10.1.119.10/bin/snomD735-10.1.119.10-SIP-r.bin< Sep 5 08:15:57.672 [DEBUG0] PHN: Uri Replaced result: >https://downloads.snom.com:443/fw/10.1.119.10/bin/snomD735-10.1.119.10-SIP-r.bin< Sep 5 08:15:57.673 [DEBUG0] PHN: ReplaceQueryVariables in >https://downloads.snom.com:443/fw/10.1.119.10/bin/snomD735-10.1.119.10-SIP-r.bin< Sep 5 08:15:57.674 [DEBUG0] PHN: ReplaceQueryVariables replaced: >https://downloads.snom.com:443/fw/10.1.119.10/bin/snomD735-10.1.119.10-SIP-r.bin< Sep 5 08:15:57.676 [INFO ] PHN: Update: FW URL [https://downloads.snom.com:443/fw/10.1.119.10/bin/snomD735-10.1.119.10-SIP-r.bin] already known, thus no update! Sep 5 08:15:57.677 [DEBUG1] TLS: 0x1b1f3a8 session cache rem 0 Sep 5 08:15:58.478 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:58.479 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:15:58.959 [DEBUG1] PHN: Removing addrinfo de.pool.ntp.org: 90.187.148.77 Sep 5 08:15:58.960 [DEBUG1] PHN: Removing addrinfo de.pool.ntp.org: 136.243.7.20 Sep 5 08:15:58.962 [DEBUG1] PHN: Removing addrinfo de.pool.ntp.org: 141.98.136.83 Sep 5 08:15:58.964 [DEBUG1] PHN: Removing addrinfo de.pool.ntp.org: 162.159.200.123 Sep 5 08:15:59.088 [DEBUG1] PHN: Removing addrinfo pbx.sipbase.de: 212.87.45.206 Sep 5 08:15:59.113 [INFO ] PHN: ALS_VALUE:1282 Sep 5 08:15:59.113 [INFO ] PHN: ALS_KEY:4 Sep 5 08:15:59.563 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:15:59.564 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:00.646 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:00.647 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:01.731 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:01.732 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:02.815 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:02.816 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:03.112 [INFO ] PHN: ALS_VALUE:1283 Sep 5 08:16:03.113 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:03.901 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:03.901 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:04.985 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:04.985 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:05.151 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=237, has_policy=0, timestamp=0, elapsed=237 Sep 5 08:16:06.068 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:06.069 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:07.126 [INFO ] PHN: ALS_VALUE:1282 Sep 5 08:16:07.127 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:07.153 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:07.153 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:08.237 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:08.237 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:08.600 [DEBUG1] PHN: Sending Keepalive to Watchdog Sep 5 08:16:08.604 [INFO ] PHN: HandleWatchdog: status: 1 -> 1, timeout: 60, dog_fd: 7, setting set: 0 value: Sep 5 08:16:08.632 [NOTICE] PHN: TPL: Socket 34 idle/connect timeout Sep 5 08:16:08.633 [DEBUG1] TLS: 0x1b9d5c0 SSL Alert write/0:warning:close notify Sep 5 08:16:08.634 [DEBUG2] PHN: WEB: HTTP 34/443 disconnecting Sep 5 08:16:08.635 [DEBUG2] PHN: WEB: HTTP 34/443 disconnected Sep 5 08:16:08.635 [DEBUG2] PHN: WEB: HTTP 34/443 deleted Sep 5 08:16:08.689 [NOTICE] PHN: TPL: Socket 35 idle/connect timeout Sep 5 08:16:08.690 [DEBUG1] TLS: 0x1bb0620 SSL Alert write/0:warning:close notify Sep 5 08:16:08.690 [DEBUG2] PHN: WEB: HTTP 35/443 disconnecting Sep 5 08:16:08.691 [DEBUG2] PHN: WEB: HTTP 35/443 disconnected Sep 5 08:16:08.692 [DEBUG2] PHN: WEB: HTTP 35/443 deleted Sep 5 08:16:09.320 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:09.321 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:10.412 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:10.413 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:11.132 [INFO ] PHN: ALS_VALUE:1284 Sep 5 08:16:11.133 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:11.497 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:11.497 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:12.581 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:12.582 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:13.666 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:13.666 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:14.749 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:14.750 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:15.142 [INFO ] PHN: ALS_VALUE:1286 Sep 5 08:16:15.143 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:15.151 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=247, has_policy=0, timestamp=0, elapsed=247 Sep 5 08:16:15.833 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:15.834 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:16.918 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:16.918 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:18.004 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:18.004 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:19.087 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:19.088 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:19.169 [INFO ] PHN: ALS_VALUE:1287 Sep 5 08:16:19.170 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:20.174 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:20.174 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:21.258 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:21.258 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:21.643 [DEBUG1] SIP: Sending Keepalive (CRLF) to Udp:212.87.45.206:5060 Sep 5 08:16:21.644 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:16:22.342 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:22.342 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:23.162 [INFO ] PHN: ALS_VALUE:1289 Sep 5 08:16:23.163 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:23.427 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:23.427 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:24.378 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50353 Sep 5 08:16:24.379 [DEBUG2] PHN: WEB: HTTP 37/443 accepted from Tls:10.137.12.131:50353 Sep 5 08:16:24.379 [DEBUG2] TLS: 0x1b5aed8 handshake start Sep 5 08:16:24.381 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 before SSL initialization (0) Sep 5 08:16:24.381 [DEBUG2] PHN: WEB: HTTP 37/443 connected Sep 5 08:16:24.382 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50354 Sep 5 08:16:24.382 [DEBUG2] PHN: WEB: HTTP 38/443 accepted from Tls:10.137.12.131:50354 Sep 5 08:16:24.383 [DEBUG2] TLS: 0x1bb7b40 handshake start Sep 5 08:16:24.384 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 before SSL initialization (0) Sep 5 08:16:24.384 [DEBUG2] PHN: WEB: HTTP 38/443 connected Sep 5 08:16:24.385 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 before SSL initialization (0) Sep 5 08:16:24.388 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:16:24.397 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:16:24.400 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:16:24.401 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:16:24.404 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:16:24.404 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:16:24.406 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 before SSL initialization (0) Sep 5 08:16:24.408 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:16:24.418 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:16:24.421 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:16:24.422 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:16:24.424 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:16:24.425 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:16:24.426 [DEBUG1] TLS: 0x1b5aed8 SSL Alert read/0:fatal:certificate unknown Sep 5 08:16:24.427 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 error in error Sep 5 08:16:24.427 [ERROR ] TLS: OSSL error (GetDecryptedInput ssl error): code 336151574, error:14094416:SSL routines:ssl3_read_bytes:sslv3 alert certificate unknown Sep 5 08:16:24.428 [ERROR ] PHN: TPL: Socket Error: 37/32/connected, Tls error, closing Sep 5 08:16:24.428 [DEBUG2] PHN: WEB: HTTP 37/443 disconnected Sep 5 08:16:24.429 [DEBUG2] PHN: WEB: HTTP 37/443 deleted Sep 5 08:16:24.432 [DEBUG1] TLS: 0x1bb7b40 SSL Alert read/0:fatal:certificate unknown Sep 5 08:16:24.432 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 error in error Sep 5 08:16:24.433 [ERROR ] TLS: OSSL error (GetDecryptedInput ssl error): code 336151574, error:14094416:SSL routines:ssl3_read_bytes:sslv3 alert certificate unknown Sep 5 08:16:24.434 [ERROR ] PHN: TPL: Socket Error: 38/42/connected, Tls error, closing Sep 5 08:16:24.435 [DEBUG2] PHN: WEB: HTTP 38/443 disconnected Sep 5 08:16:24.435 [DEBUG2] PHN: WEB: HTTP 38/443 deleted Sep 5 08:16:24.437 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50355 Sep 5 08:16:24.438 [DEBUG2] PHN: WEB: HTTP 39/443 accepted from Tls:10.137.12.131:50355 Sep 5 08:16:24.439 [DEBUG2] TLS: 0x1b5aed8 handshake start Sep 5 08:16:24.440 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 before SSL initialization (0) Sep 5 08:16:24.440 [DEBUG2] PHN: WEB: HTTP 39/443 connected Sep 5 08:16:24.441 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 before SSL initialization (0) Sep 5 08:16:24.442 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:16:24.451 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:16:24.455 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:16:24.455 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:16:24.456 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS write certificate request (0) Sep 5 08:16:24.468 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS write certificate (0) Sep 5 08:16:24.610 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 TLSv1.3 write server certificate verify (0) Sep 5 08:16:24.612 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:16:24.613 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:16:24.648 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:24.648 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:24.775 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:16:24.775 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS read client certificate (0) Sep 5 08:16:24.778 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS read finished (0) Sep 5 08:16:24.778 [DEBUG2] TLS: 0x1b5aed8 handshake done Sep 5 08:16:24.778 [DEBUG2] TLS: 0x1b5aed8 Flag SSL3_FLAGS_NO_RENEGOTIATE_CIPHERS set. Sep 5 08:16:24.779 [DEBUG2] TLS: 0x1b5aed8 SetHandshakeFinished() Sep 5 08:16:24.781 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS write session ticket (0) Sep 5 08:16:24.784 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS write session ticket (0) Sep 5 08:16:24.786 [INFO ] PHN: WEB: Request 39/1204/0: POST /log.htm HTTP/1.1 Sep 5 08:16:24.788 [INFO ] PHN: WEB: 39 Digest authentication Sep 5 08:16:25.151 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=257, has_policy=0, timestamp=0, elapsed=257 Sep 5 08:16:25.734 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:25.734 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:26.819 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:26.819 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:27.172 [INFO ] PHN: ALS_VALUE:1290 Sep 5 08:16:27.173 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:27.905 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:27.905 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:27.985 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50357 Sep 5 08:16:27.986 [DEBUG2] PHN: WEB: HTTP 40/443 accepted from Tls:10.137.12.131:50357 Sep 5 08:16:27.987 [DEBUG2] TLS: 0x1bbe6f0 handshake start Sep 5 08:16:27.988 [DEBUG2] TLS: 0x1bbe6f0 SSL_accept/0 before SSL initialization (0) Sep 5 08:16:27.988 [DEBUG2] PHN: WEB: HTTP 40/443 connected Sep 5 08:16:27.990 [INFO ] PHN: WEB: Request 39/1204/0: POST /log.htm HTTP/1.1 Sep 5 08:16:27.992 [INFO ] PHN: WEB: 39 Digest authentication Sep 5 08:16:28.120 [DEBUG0] PHN: LoopMon: LCS/4230 took 221 (0) msecs, started Sep 5 08:16:27, 3 tasks Sep 5 08:16:28.166 [DEBUG2] TLS: 0x1bbe6f0 SSL_accept/0 before SSL initialization (0) Sep 5 08:16:28.170 [DEBUG2] TLS: 0x1bbe6f0 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:16:28.179 [DEBUG2] TLS: 0x1bbe6f0 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:16:28.182 [DEBUG2] TLS: 0x1bbe6f0 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:16:28.183 [DEBUG2] TLS: 0x1bbe6f0 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:16:28.186 [DEBUG2] TLS: 0x1bbe6f0 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:16:28.186 [DEBUG2] TLS: 0x1bbe6f0 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:16:28.198 [DEBUG1] TLS: 0x1bbe6f0 SSL Alert read/0:fatal:certificate unknown Sep 5 08:16:28.198 [DEBUG2] TLS: 0x1bbe6f0 SSL_accept/0 error in error Sep 5 08:16:28.199 [ERROR ] TLS: OSSL error (GetDecryptedInput ssl error): code 336151574, error:14094416:SSL routines:ssl3_read_bytes:sslv3 alert certificate unknown Sep 5 08:16:28.200 [ERROR ] PHN: TPL: Socket Error: 40/42/connected, Tls error, closing Sep 5 08:16:28.201 [DEBUG2] PHN: WEB: HTTP 40/443 disconnected Sep 5 08:16:28.202 [DEBUG2] PHN: WEB: HTTP 40/443 deleted Sep 5 08:16:28.990 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:28.991 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:30.075 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:30.075 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:31.159 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:31.160 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:31.244 [INFO ] PHN: ALS_VALUE:1289 Sep 5 08:16:31.245 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:32.249 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:32.249 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:33.333 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:33.334 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:34.422 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:34.423 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:35.152 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=267, has_policy=0, timestamp=0, elapsed=267 Sep 5 08:16:35.192 [INFO ] PHN: ALS_VALUE:1290 Sep 5 08:16:35.193 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:35.507 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:35.507 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:36.591 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:36.591 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:37.673 [DEBUG2] PHN: LLDP: send lldp advertisment Sep 5 08:16:37.679 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:37.679 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:38.310 [NOTICE] PHN: TPL: Socket 39 idle/connect timeout Sep 5 08:16:38.311 [DEBUG1] TLS: 0x1b5aed8 SSL Alert write/0:warning:close notify Sep 5 08:16:38.311 [DEBUG2] PHN: WEB: HTTP 39/443 disconnecting Sep 5 08:16:38.312 [DEBUG2] PHN: WEB: HTTP 39/443 disconnected Sep 5 08:16:38.312 [DEBUG2] PHN: WEB: HTTP 39/443 deleted Sep 5 08:16:38.604 [DEBUG1] PHN: Sending Keepalive to Watchdog Sep 5 08:16:38.607 [INFO ] PHN: HandleWatchdog: status: 1 -> 1, timeout: 60, dog_fd: 7, setting set: 0 value: Sep 5 08:16:38.763 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:38.764 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:39.202 [INFO ] PHN: ALS_VALUE:1289 Sep 5 08:16:39.203 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:39.847 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:39.847 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:40.932 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:40.933 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:42.018 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:42.018 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:43.102 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:43.103 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:43.224 [INFO ] PHN: ALS_VALUE:1291 Sep 5 08:16:43.225 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:44.186 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:44.187 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:45.152 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=277, has_policy=0, timestamp=0, elapsed=277 Sep 5 08:16:45.271 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:45.271 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:46.355 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:46.355 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:47.222 [INFO ] PHN: ALS_VALUE:1289 Sep 5 08:16:47.223 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:47.439 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:47.440 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:48.524 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:48.525 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:49.608 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:49.609 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:50.694 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:50.694 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:51.232 [INFO ] PHN: ALS_VALUE:1291 Sep 5 08:16:51.233 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:51.644 [DEBUG1] SIP: Sending Keepalive (CRLF) to Udp:212.87.45.206:5060 Sep 5 08:16:51.645 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:16:51.778 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:51.778 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:52.863 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:52.863 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:53.951 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:53.952 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:55.037 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:55.037 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:55.157 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=287, has_policy=0, timestamp=0, elapsed=287 Sep 5 08:16:55.242 [INFO ] PHN: ALS_VALUE:1293 Sep 5 08:16:55.243 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:56.121 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:56.121 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:57.205 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:57.206 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:57.524 [DEBUG1] PHN: Removing addrinfo telefon.steuerberater-bayreuth.com: 2a05:8b81:1000:1::726e:1df0 Sep 5 08:16:57.525 [DEBUG1] PHN: Removing addrinfo telefon.steuerberater-bayreuth.com: 83.171.236.91 Sep 5 08:16:58.289 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:58.290 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:16:59.252 [INFO ] PHN: ALS_VALUE:1294 Sep 5 08:16:59.253 [INFO ] PHN: ALS_KEY:4 Sep 5 08:16:59.374 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:16:59.375 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:00.459 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:00.460 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:01.543 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:01.544 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:02.627 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:02.628 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:03.266 [INFO ] PHN: ALS_VALUE:1295 Sep 5 08:17:03.267 [INFO ] PHN: ALS_KEY:4 Sep 5 08:17:03.711 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:03.712 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:04.796 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:04.796 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:05.153 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=297, has_policy=0, timestamp=0, elapsed=297 Sep 5 08:17:05.881 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:05.881 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:06.964 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:06.965 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:07.272 [INFO ] PHN: ALS_VALUE:1298 Sep 5 08:17:07.273 [INFO ] PHN: ALS_KEY:4 Sep 5 08:17:08.048 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:08.049 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:08.607 [DEBUG1] PHN: Sending Keepalive to Watchdog Sep 5 08:17:08.611 [INFO ] PHN: HandleWatchdog: status: 1 -> 1, timeout: 60, dog_fd: 7, setting set: 0 value: Sep 5 08:17:09.133 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:09.134 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:10.218 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:10.219 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:11.282 [INFO ] PHN: ALS_VALUE:1299 Sep 5 08:17:11.283 [INFO ] PHN: ALS_KEY:4 Sep 5 08:17:11.302 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:11.303 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:12.392 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:12.392 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:13.477 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:13.477 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:14.561 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:14.562 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:15.154 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=307, has_policy=0, timestamp=0, elapsed=307 Sep 5 08:17:15.292 [INFO ] PHN: ALS_VALUE:1298 Sep 5 08:17:15.293 [INFO ] PHN: ALS_KEY:4 Sep 5 08:17:15.646 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:15.647 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:16.731 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:16.731 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:17.815 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:17.815 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:18.899 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:18.899 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:19.302 [INFO ] PHN: ALS_VALUE:1300 Sep 5 08:17:19.303 [INFO ] PHN: ALS_KEY:4 Sep 5 08:17:19.983 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:19.984 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:21.068 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:21.068 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:21.646 [DEBUG1] SIP: Sending Keepalive (CRLF) to Udp:212.87.45.206:5060 Sep 5 08:17:21.647 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:17:22.152 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:22.152 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:23.236 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:23.237 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:23.319 [INFO ] PHN: ALS_VALUE:1301 Sep 5 08:17:23.319 [INFO ] PHN: ALS_KEY:4 Sep 5 08:17:24.324 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:24.324 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:25.154 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=317, has_policy=0, timestamp=0, elapsed=317 Sep 5 08:17:25.415 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:25.415 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:26.498 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:26.499 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:27.322 [INFO ] PHN: ALS_VALUE:1300 Sep 5 08:17:27.323 [INFO ] PHN: ALS_KEY:4 Sep 5 08:17:27.583 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:27.584 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:28.668 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:28.669 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:29.753 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:29.754 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:30.837 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:30.838 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:31.332 [INFO ] PHN: ALS_VALUE:1298 Sep 5 08:17:31.333 [INFO ] PHN: ALS_KEY:4 Sep 5 08:17:31.921 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:31.922 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:33.005 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:33.005 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:34.090 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:34.090 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:35.155 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=327, has_policy=0, timestamp=0, elapsed=327 Sep 5 08:17:35.174 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:35.175 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:35.342 [INFO ] PHN: ALS_VALUE:1299 Sep 5 08:17:35.343 [INFO ] PHN: ALS_KEY:4 Sep 5 08:17:36.259 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:36.259 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:37.344 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:37.344 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:37.677 [DEBUG2] PHN: LLDP: send lldp advertisment Sep 5 08:17:38.428 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:38.428 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:38.610 [DEBUG1] PHN: Sending Keepalive to Watchdog Sep 5 08:17:38.614 [INFO ] PHN: HandleWatchdog: status: 1 -> 1, timeout: 60, dog_fd: 7, setting set: 0 value: Sep 5 08:17:39.352 [INFO ] PHN: ALS_VALUE:1298 Sep 5 08:17:39.353 [INFO ] PHN: ALS_KEY:4 Sep 5 08:17:39.512 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:39.513 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:40.597 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:40.598 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:41.682 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:41.683 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:42.768 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:42.768 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:43.362 [INFO ] PHN: ALS_VALUE:1299 Sep 5 08:17:43.363 [INFO ] PHN: ALS_KEY:4 Sep 5 08:17:43.852 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:43.852 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:44.941 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:44.942 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:45.155 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=337, has_policy=0, timestamp=0, elapsed=337 Sep 5 08:17:46.026 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:46.027 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:47.111 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:47.112 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:47.372 [INFO ] PHN: ALS_VALUE:1298 Sep 5 08:17:47.373 [INFO ] PHN: ALS_KEY:4 Sep 5 08:17:48.196 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:48.196 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:49.280 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:49.280 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:50.364 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:50.364 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:51.382 [INFO ] PHN: ALS_VALUE:1299 Sep 5 08:17:51.383 [INFO ] PHN: ALS_KEY:4 Sep 5 08:17:51.448 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:51.448 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:51.648 [DEBUG1] SIP: Sending Keepalive (CRLF) to Udp:212.87.45.206:5060 Sep 5 08:17:51.648 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:17:52.532 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:52.533 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:53.617 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:53.617 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:54.701 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:54.701 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:55.155 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=347, has_policy=0, timestamp=0, elapsed=347 Sep 5 08:17:55.392 [INFO ] PHN: ALS_VALUE:1298 Sep 5 08:17:55.393 [INFO ] PHN: ALS_KEY:4 Sep 5 08:17:55.785 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:55.786 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:56.870 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:56.870 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:57.955 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:57.956 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:59.039 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:17:59.040 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:17:59.402 [INFO ] PHN: ALS_VALUE:1300 Sep 5 08:17:59.403 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:00.125 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:00.125 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:01.210 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:01.211 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:02.294 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:02.295 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:03.379 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:03.380 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:03.469 [INFO ] PHN: ALS_VALUE:1301 Sep 5 08:18:03.470 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:04.474 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:04.475 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:05.156 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=357, has_policy=0, timestamp=0, elapsed=357 Sep 5 08:18:05.558 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:05.559 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:06.643 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:06.644 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:07.422 [INFO ] PHN: ALS_VALUE:1300 Sep 5 08:18:07.423 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:07.728 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:07.728 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:08.614 [DEBUG1] PHN: Sending Keepalive to Watchdog Sep 5 08:18:08.617 [INFO ] PHN: HandleWatchdog: status: 1 -> 1, timeout: 60, dog_fd: 7, setting set: 0 value: Sep 5 08:18:08.813 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:08.813 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:09.898 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:09.898 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:10.982 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:10.983 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:11.432 [INFO ] PHN: ALS_VALUE:1301 Sep 5 08:18:11.433 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:12.067 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:12.067 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:13.151 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:13.151 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:14.236 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:14.237 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:15.156 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=367, has_policy=0, timestamp=0, elapsed=367 Sep 5 08:18:15.322 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:15.322 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:15.448 [INFO ] PHN: ALS_VALUE:1298 Sep 5 08:18:15.451 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:16.413 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:16.414 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:17.497 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:17.498 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:18.582 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:18.582 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:19.452 [INFO ] PHN: ALS_VALUE:1295 Sep 5 08:18:19.453 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:19.666 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:19.667 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:20.751 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:20.751 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:21.649 [DEBUG1] SIP: Sending Keepalive (CRLF) to Udp:212.87.45.206:5060 Sep 5 08:18:21.650 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:18:21.835 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:21.836 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:22.920 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:22.921 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:23.463 [INFO ] PHN: ALS_VALUE:1293 Sep 5 08:18:23.463 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:24.004 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:24.005 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:25.089 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:25.089 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:25.169 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=377, has_policy=0, timestamp=0, elapsed=377 Sep 5 08:18:26.174 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:26.175 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:27.258 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:27.259 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:27.472 [INFO ] PHN: ALS_VALUE:1291 Sep 5 08:18:27.473 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:28.344 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:28.344 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:29.428 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:29.429 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:30.513 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:30.514 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:31.482 [INFO ] PHN: ALS_VALUE:1289 Sep 5 08:18:31.483 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:31.597 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:31.598 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:32.682 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:32.682 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:33.767 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:33.768 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:34.851 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:34.852 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:35.157 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=387, has_policy=0, timestamp=0, elapsed=387 Sep 5 08:18:35.498 [INFO ] PHN: ALS_VALUE:1284 Sep 5 08:18:35.498 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:35.942 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:35.942 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:37.025 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:37.026 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:37.686 [DEBUG2] PHN: LLDP: send lldp advertisment Sep 5 08:18:38.123 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:38.124 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:38.617 [DEBUG1] PHN: Sending Keepalive to Watchdog Sep 5 08:18:38.620 [INFO ] PHN: HandleWatchdog: status: 1 -> 1, timeout: 60, dog_fd: 7, setting set: 0 value: Sep 5 08:18:39.208 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:39.209 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:39.502 [INFO ] PHN: ALS_VALUE:1282 Sep 5 08:18:39.503 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:40.291 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:40.292 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:41.376 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:41.376 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:42.461 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:42.461 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:43.519 [INFO ] PHN: ALS_VALUE:1278 Sep 5 08:18:43.520 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:43.545 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:43.546 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:44.630 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:44.631 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:45.157 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=397, has_policy=0, timestamp=0, elapsed=397 Sep 5 08:18:45.715 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:45.716 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:46.799 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:46.800 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:47.522 [INFO ] PHN: ALS_VALUE:1279 Sep 5 08:18:47.523 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:47.883 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:47.884 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:48.968 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:48.968 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:50.052 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:50.053 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:51.137 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:51.138 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:51.532 [INFO ] PHN: ALS_VALUE:1276 Sep 5 08:18:51.533 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:51.651 [DEBUG1] SIP: Sending Keepalive (CRLF) to Udp:212.87.45.206:5060 Sep 5 08:18:51.651 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:18:52.221 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:52.222 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:53.305 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:53.306 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:54.390 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:54.390 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:55.158 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=407, has_policy=0, timestamp=0, elapsed=407 Sep 5 08:18:55.482 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:55.482 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:55.565 [INFO ] PHN: ALS_VALUE:1273 Sep 5 08:18:55.566 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:56.570 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:56.570 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:57.654 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:57.654 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:58.738 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:58.739 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:18:59.552 [INFO ] PHN: ALS_VALUE:1274 Sep 5 08:18:59.553 [INFO ] PHN: ALS_KEY:4 Sep 5 08:18:59.823 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:18:59.824 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:00.908 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:00.909 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:01.993 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:01.993 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:03.078 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:03.078 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:03.562 [INFO ] PHN: ALS_VALUE:1276 Sep 5 08:19:03.563 [INFO ] PHN: ALS_KEY:4 Sep 5 08:19:04.161 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:04.162 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:05.158 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=417, has_policy=0, timestamp=0, elapsed=417 Sep 5 08:19:05.246 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:05.247 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:06.330 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:06.331 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:07.421 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:07.421 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:07.572 [INFO ] PHN: ALS_VALUE:1278 Sep 5 08:19:07.573 [INFO ] PHN: ALS_KEY:4 Sep 5 08:19:08.505 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:08.505 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:08.624 [DEBUG1] PHN: Sending Keepalive to Watchdog Sep 5 08:19:08.628 [INFO ] PHN: HandleWatchdog: status: 1 -> 1, timeout: 60, dog_fd: 7, setting set: 0 value: Sep 5 08:19:09.589 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:09.589 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:10.674 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:10.675 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:11.582 [INFO ] PHN: ALS_VALUE:1284 Sep 5 08:19:11.583 [INFO ] PHN: ALS_KEY:4 Sep 5 08:19:11.758 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:11.759 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:12.842 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:12.843 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:13.927 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:13.928 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:15.012 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:15.012 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:15.132 [DEBUG1] SIP: remove receive packet: 1, all 9 Sep 5 08:19:15.159 [DEBUG2] PHN: LLDP: testNetworkPolicyIsSet, timeout=90, now=427, has_policy=0, timestamp=0, elapsed=427 Sep 5 08:19:15.179 [DEBUG1] SIP: remove receive packet: 2, all 8 Sep 5 08:19:15.592 [INFO ] PHN: ALS_VALUE:1289 Sep 5 08:19:15.593 [INFO ] PHN: ALS_KEY:4 Sep 5 08:19:16.096 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:16.096 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:16.254 [DEBUG1] SIP: remove receive packet: 3, all 7 Sep 5 08:19:16.275 [DEBUG1] SIP: remove receive packet: 5, all 6 Sep 5 08:19:16.295 [DEBUG1] SIP: remove receive packet: 7, all 5 Sep 5 08:19:16.314 [DEBUG1] SIP: remove receive packet: 9, all 4 Sep 5 08:19:16.333 [DEBUG1] SIP: remove receive packet: 11, all 3 Sep 5 08:19:16.425 [DEBUG1] SIP: remove receive packet: 13, all 2 Sep 5 08:19:16.446 [DEBUG1] SIP: remove receive packet: 15, all 1 Sep 5 08:19:17.180 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:17.180 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:18.265 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:18.265 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:19.255 [DEBUG1] SIP: remove pending packet: 1000004, all 10 Sep 5 08:19:19.276 [DEBUG1] SIP: remove pending packet: 1000005, all 9 Sep 5 08:19:19.321 [DEBUG1] SIP: remove pending packet: 1000006, all 8 Sep 5 08:19:19.321 [DEBUG1] SIP: remove pending packet: 1000007, all 7 Sep 5 08:19:19.334 [DEBUG1] SIP: remove pending packet: 1000008, all 6 Sep 5 08:19:19.349 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:19.349 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:19.466 [DEBUG1] SIP: remove pending packet: 1000009, all 5 Sep 5 08:19:19.467 [DEBUG1] SIP: remove pending packet: 1000010, all 4 Sep 5 08:19:19.602 [INFO ] PHN: ALS_VALUE:1293 Sep 5 08:19:19.603 [INFO ] PHN: ALS_KEY:4 Sep 5 08:19:20.434 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:20.434 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:21.491 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50374 Sep 5 08:19:21.492 [DEBUG2] PHN: WEB: HTTP 41/443 accepted from Tls:10.137.12.131:50374 Sep 5 08:19:21.493 [DEBUG2] TLS: 0x1b5aed8 handshake start Sep 5 08:19:21.494 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 before SSL initialization (0) Sep 5 08:19:21.494 [DEBUG2] PHN: WEB: HTTP 41/443 connected Sep 5 08:19:21.495 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50375 Sep 5 08:19:21.495 [DEBUG2] PHN: WEB: HTTP 42/443 accepted from Tls:10.137.12.131:50375 Sep 5 08:19:21.496 [DEBUG2] TLS: 0x1bba018 handshake start Sep 5 08:19:21.497 [DEBUG2] TLS: 0x1bba018 SSL_accept/0 before SSL initialization (0) Sep 5 08:19:21.497 [DEBUG2] PHN: WEB: HTTP 42/443 connected Sep 5 08:19:21.498 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 before SSL initialization (0) Sep 5 08:19:21.501 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:19:21.510 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:19:21.514 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:19:21.515 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:19:21.518 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:19:21.518 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:19:21.519 [DEBUG2] TLS: 0x1bba018 SSL_accept/0 before SSL initialization (0) Sep 5 08:19:21.521 [DEBUG2] TLS: 0x1bba018 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:19:21.532 [DEBUG2] TLS: 0x1bba018 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:19:21.535 [DEBUG2] TLS: 0x1bba018 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:19:21.535 [DEBUG2] TLS: 0x1bba018 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:19:21.536 [DEBUG2] TLS: 0x1bba018 SSL_accept/0 SSLv3/TLS write certificate request (0) Sep 5 08:19:21.548 [DEBUG2] TLS: 0x1bba018 SSL_accept/0 SSLv3/TLS write certificate (0) Sep 5 08:19:21.690 [DEBUG2] TLS: 0x1bba018 SSL_accept/0 TLSv1.3 write server certificate verify (0) Sep 5 08:19:21.693 [DEBUG2] TLS: 0x1bba018 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:19:21.694 [DEBUG2] TLS: 0x1bba018 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:19:21.700 [DEBUG2] GUI: SelectionList::Draw List x position adjusted to fit with smart labels Sep 5 08:19:21.701 [DEBUG2] GUI: SelectionList::Draw List width adjusted to fit with smart labels Sep 5 08:19:21.818 [DEBUG1] SIP: Sending Keepalive (CRLF) to Udp:212.87.45.206:5060 Sep 5 08:19:21.821 [DEBUG2] SIP: Updated Transport 0x13ad3a8 TTL 660000 Sep 5 08:19:21.822 [DEBUG2] PHN: WEB: HTTP accepting from Tls:10.137.12.131:50376 Sep 5 08:19:21.822 [DEBUG2] PHN: WEB: HTTP 43/443 accepted from Tls:10.137.12.131:50376 Sep 5 08:19:21.823 [DEBUG2] TLS: 0x1bb7b40 handshake start Sep 5 08:19:21.824 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 before SSL initialization (0) Sep 5 08:19:21.825 [DEBUG2] PHN: WEB: HTTP 43/443 connected Sep 5 08:19:21.825 [DEBUG1] TLS: 0x1b5aed8 SSL Alert read/0:fatal:certificate unknown Sep 5 08:19:21.826 [DEBUG2] TLS: 0x1b5aed8 SSL_accept/0 error in error Sep 5 08:19:21.826 [ERROR ] TLS: OSSL error (GetDecryptedInput ssl error): code 336151574, error:14094416:SSL routines:ssl3_read_bytes:sslv3 alert certificate unknown Sep 5 08:19:21.827 [ERROR ] PHN: TPL: Socket Error: 41/32/connected, Tls error, closing Sep 5 08:19:21.828 [DEBUG2] PHN: WEB: HTTP 41/443 disconnected Sep 5 08:19:21.828 [DEBUG2] PHN: WEB: HTTP 41/443 deleted Sep 5 08:19:21.829 [DEBUG1] TLS: 0x1bba018 SSL Alert read/0:fatal:certificate unknown Sep 5 08:19:21.829 [DEBUG2] TLS: 0x1bba018 SSL_accept/0 error in error Sep 5 08:19:21.830 [ERROR ] TLS: OSSL error (GetDecryptedInput ssl error): code 336151574, error:14094416:SSL routines:ssl3_read_bytes:sslv3 alert certificate unknown Sep 5 08:19:21.831 [ERROR ] PHN: TPL: Socket Error: 42/42/connected, Tls error, closing Sep 5 08:19:21.832 [DEBUG2] PHN: WEB: HTTP 42/443 disconnected Sep 5 08:19:21.832 [DEBUG2] PHN: WEB: HTTP 42/443 deleted Sep 5 08:19:21.834 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 before SSL initialization (0) Sep 5 08:19:21.836 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 SSLv3/TLS read client hello (0) Sep 5 08:19:21.845 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 SSLv3/TLS write server hello (0) Sep 5 08:19:21.847 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 SSLv3/TLS write change cipher spec (0) Sep 5 08:19:21.848 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 TLSv1.3 write encrypted extensions (0) Sep 5 08:19:21.849 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 SSLv3/TLS write certificate request (0) Sep 5 08:19:21.861 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 SSLv3/TLS write certificate (0) Sep 5 08:19:22.003 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 TLSv1.3 write server certificate verify (0) Sep 5 08:19:22.006 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 SSLv3/TLS write finished (0) Sep 5 08:19:22.006 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:19:22.118 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 TLSv1.3 early data (0) Sep 5 08:19:22.119 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 SSLv3/TLS read client certificate (0) Sep 5 08:19:22.121 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 SSLv3/TLS read finished (0) Sep 5 08:19:22.121 [DEBUG2] TLS: 0x1bb7b40 handshake done Sep 5 08:19:22.122 [DEBUG2] TLS: 0x1bb7b40 Flag SSL3_FLAGS_NO_RENEGOTIATE_CIPHERS set. Sep 5 08:19:22.122 [DEBUG2] TLS: 0x1bb7b40 SetHandshakeFinished() Sep 5 08:19:22.124 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 SSLv3/TLS write session ticket (0) Sep 5 08:19:22.127 [DEBUG2] TLS: 0x1bb7b40 SSL_accept/0 SSLv3/TLS write session ticket (0) Sep 5 08:19:22.130 [INFO ] PHN: WEB: Request 43/1204/0: POST /log.htm HTTP/1.1 Sep 5 08:19:22.132 [INFO ] PHN: WEB: 43 Digest authentication