INFO | 20240730-144242.137 | WRAPPER | 25056 | log_manager.cpp:295 | Log started, rev v2.10.20.4, Library last commit date : 2024-02-16 17:01:00 +0200 INFO | 20240730-144242.138 | WRAPPER | 25056 | log_manager.cpp:60 | System Memory status at application launch: 74% is in use. 7991MiB total memory. 2007MiB available memory. 9615MiB total page file. 1795MiB available page file. 134217727MiB total virtual memory. 134172258MiB available virtual memory. INFO | 20240730-144242.138 | WRAPPER | 25056 | log_manager.cpp:73 | CPU Vendor name: GenuineIntel INFO | 20240730-144242.138 | WRAPPER | 25056 | log_manager.cpp:78 | CPUID 01H Features -330865 INFO | 20240730-144242.148 | WRAPPER | 25056 | log_manager.cpp:79 | SSE3 support: yes INFO | 20240730-144242.148 | WRAPPER | 25056 | log_manager.cpp:80 | SSE4_1 support: yes INFO | 20240730-144242.148 | WRAPPER | 25056 | log_manager.cpp:81 | SSE4_2 support: yes INFO | 20240730-144242.148 | WRAPPER | 25056 | log_manager.cpp:82 | AVX support: yes INFO | 20240730-144242.148 | WRAPPER | 25056 | log_manager.cpp:103 | CPU Brand String: 11th INFO | 20240730-144242.148 | WRAPPER | 25056 | log_manager.cpp:298 | Audio device info INFO | 20240730-144242.148 | WRAPPER | 25056 | pa_manager.cpp:126 | PaManager: 00007FF69D276130 INFO | 20240730-144242.148 | WRAPPER | 25056 | pa_manager.cpp:139 | Reset DEBUG | 20240730-144242.159 | WRAPPER | 25056 | audio_detector_windows.cpp:52 | Start DEBUG | 20240730-144242.160 | WRAPPER | 25056 | pa_manager.cpp:417 | Default input device = 1 : Микрофон (Realtek(R) Audio) DEBUG | 20240730-144242.160 | WRAPPER | 25056 | pa_manager.cpp:420 | Default output device = 0 : Динамики (Realtek(R) Audio) DEBUG | 20240730-144242.160 | WRAPPER | 25056 | pa_manager.cpp:390 | State Closed -> Initialized DEBUG | 20240730-144242.160 | WRAPPER | 25056 | pa_manager.cpp:209 | Found 3 audio devices: DEBUG | 20240730-144242.160 | WRAPPER | 25056 | pa_manager.cpp:213 | #0, 'Динамики (Realtek(R) Audio)', 0 input + 2 output DEBUG | 20240730-144242.160 | WRAPPER | 25056 | pa_manager.cpp:213 | #1, 'Микрофон (Realtek(R) Audio)', 2 input + 0 output DEBUG | 20240730-144242.160 | WRAPPER | 25056 | pa_manager.cpp:213 | #2, 'Динамики (Realtek(R) Audio) [Loopback]', 2 input + 0 output INFO | 20240730-144242.160 | Z:APP | 25056 | DiagnosticOptions.cpp:92 | Zoiper5 5.6.4 for Windows 64bit DEBUG | 20240730-144242.160 | Z:APP | 25056 | DiagnosticOptions.cpp:101 | Diagnostic options. Set audio debug. DEBUG | 20240730-144242.160 | WRAPPER | 25056 | volume_control.cpp:269 | UpdateInput: no input endpoint DEBUG | 20240730-144242.160 | WRAPPER | 25056 | volume_control.cpp:301 | UpdateOutput: no output endpoint DEBUG | 20240730-144242.160 | WRAPPER | 25056 | volume_control.cpp:38 | VolumeControl 000001F71C259550 created DEBUG | 20240730-144242.160 | WRAPPER | 25056 | audio_builder.cpp:105 | Builder 00007FF69D276BD8 DEBUG | 20240730-144242.160 | WRAPPER | 25056 | audio_builder.cpp:1668 | Reading system volume starting DEBUG | 20240730-144242.160 | WRAPPER | 25056 | pa_endpoint.cpp:133 | IsSupported full duplex= 0 flags= 0 DEBUG | 20240730-144242.160 | WRAPPER | 25056 | pa_endpoint.cpp:134 | In : dev= 1, format= PCM16, 960 @ 48000 Hz, stereo DEBUG | 20240730-144242.160 | WRAPPER | 25056 | pa_endpoint.cpp:135 | Out : dev= 0, format= PCM16, 960 @ 48000 Hz, stereo DEBUG | 20240730-144242.166 | WRAPPER | 25056 | pa_endpoint.cpp:165 | IsSupported: Format supported DEBUG | 20240730-144242.166 | WRAPPER | 25056 | base_endpoint.cpp:15 | BaseEndpoint 000001F71C25DB70: PaEndpoint DEBUG | 20240730-144242.166 | WRAPPER | 25056 | pa_endpoint.cpp:30 | PaEndpoint 000001F71C25DB70 DEBUG | 20240730-144242.166 | WRAPPER | 25056 | audio_graph.cpp:16 | Graph 000001F71C25DEF0 DEBUG | 20240730-144242.166 | WRAPPER | 25056 | base_endpoint.cpp:132 | Register 000001F71C25DB70 with 000001F71C25E070 DEBUG | 20240730-144242.166 | WRAPPER | 25056 | audio_graph.cpp:63 | Register Stream 000001F71C25DED8 DEBUG | 20240730-144242.166 | WRAPPER | 25056 | base_endpoint.cpp:39 | Start 000001F71C25DB70: name= PaEndpoint graph= 000001F71C25E070 DEBUG | 20240730-144242.166 | WRAPPER | 25056 | audio_thread.cpp:21 | BaseAudioThread: 000001F71C267950: PaEndpoint::Sink DEBUG | 20240730-144242.166 | WRAPPER | 25056 | audio_thread.cpp:21 | BaseAudioThread: 000001F71C267C40: PaEndpoint::Source DEBUG | 20240730-144242.166 | WRAPPER | 25056 | audio_thread.cpp:132 | Transition: Stopped -> Running DEBUG | 20240730-144242.166 | WRAPPER | 25056 | audio_stats.cpp:13 | AudioStats Reset 000001F71C2679D8 DEBUG | 20240730-144242.166 | WRAPPER | 25056 | audio_thread.cpp:132 | Transition: Stopped -> Running DEBUG | 20240730-144242.166 | WRAPPER | 25056 | audio_stats.cpp:13 | AudioStats Reset 000001F71C267CC8 DEBUG | 20240730-144242.166 | WRAPPER | 25056 | pa_endpoint.cpp:46 | InternalStart 000001F71C25DB70 DEBUG | 20240730-144242.166 | WRAPPER | 25056 | pa_endpoint.cpp:255 | PaOpen 000001F71C25DB70: full duplex= 0 flags= 0 DEBUG | 20240730-144242.166 | WRAPPER | 25056 | pa_endpoint.cpp:256 | In : dev= 1, format= PCM16, 960 @ 48000 Hz, stereo DEBUG | 20240730-144242.166 | WRAPPER | 25056 | pa_endpoint.cpp:257 | Out : dev= 0, format= PCM16, 960 @ 48000 Hz, stereo DEBUG | 20240730-144242.316 | WRAPPER | 25056 | pa_endpoint.cpp:320 | PaOpen: Successfully opened OUTPUT device DEBUG | 20240730-144242.380 | WRAPPER | 25056 | pa_endpoint.cpp:340 | PaOpen: Successfully opened INPUT device DEBUG | 20240730-144242.380 | WRAPPER | 25056 | pa_endpoint.cpp:360 | PaOpen: Input latency: 0.08 sec, 3840 samples @ 48000 Hz DEBUG | 20240730-144242.380 | WRAPPER | 25056 | pa_endpoint.cpp:361 | PaOpen: Output Latency: 0.08 sec, 3840 samples @ 48000 Hz DEBUG | 20240730-144242.383 | WRAPPER | 25056 | pa_endpoint.cpp:386 | PaOpen: Current input source index= 0, name= (null) DEBUG | 20240730-144242.383 | WRAPPER | 25056 | pa_endpoint.cpp:395 | PaOpen: Auto input source index= 0, name= (null) DEBUG | 20240730-144242.383 | WRAPPER | 25056 | pa_endpoint.cpp:400 | PaOpen: Auto switching input source DEBUG | 20240730-144242.383 | WRAPPER | 25056 | pa_endpoint.cpp:489 | PaStart 000001F71C25DB70 DEBUG | 20240730-144242.385 | WRAPPER | 25056 | pa_endpoint.cpp:501 | PaStart: m_InStream started successfully DEBUG | 20240730-144242.385 | WRAPPER | 25056 | pa_endpoint.cpp:518 | PaStart: m_OutStream started successfully DEBUG | 20240730-144242.385 | WRAPPER | 25056 | audio_graph.cpp:54 | Register Thread 000001F71C267C20 DEBUG | 20240730-144242.385 | WRAPPER | 25056 | audio_graph.cpp:54 | Register Thread 000001F71C267F10 DEBUG | 20240730-144242.385 | WRAPPER | 25056 | base_endpoint.cpp:191 | Transition 000001F71C25DB70: Stopped -> Running DEBUG | 20240730-144242.385 | WRAPPER | 25056 | volume_control.cpp:57 | VolumeControl 000000A747799580 copying from 000001F71C259550 DEBUG | 20240730-144242.385 | WRAPPER | 25056 | base_endpoint.cpp:83 | Stop 000001F71C25DB70: graph= 000001F71C25E070 DEBUG | 20240730-144242.385 | WRAPPER | 25056 | pa_endpoint.cpp:71 | InternalStop 000001F71C25DB70 DEBUG | 20240730-144242.385 | WRAPPER | 25056 | pa_endpoint.cpp:437 | PaClose 000001F71C25DB70 DEBUG | 20240730-144242.406 | WRAPPER | 25056 | pa_endpoint.cpp:455 | PaClose: m_InStream closed successfully DEBUG | 20240730-144242.423 | WRAPPER | 25056 | pa_endpoint.cpp:474 | PaClose: m_OutStream closed successfully DEBUG | 20240730-144242.423 | WRAPPER | 25056 | base_endpoint.cpp:191 | Transition 000001F71C25DB70: Running -> Stopped DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_graph.cpp:72 | Unregister Thread 000001F71C267C20 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_graph.cpp:72 | Unregister Thread 000001F71C267F10 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_thread.cpp:26 | ~BaseAudioThread: 000001F71C267950: PaEndpoint::Sink DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_thread.cpp:26 | ~BaseAudioThread: 000001F71C267C40: PaEndpoint::Source DEBUG | 20240730-144242.423 | WRAPPER | 25056 | base_endpoint.cpp:150 | Unregister 000001F71C25DB70 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_graph.cpp:81 | Unregister Stream 000001F71C25DED8 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | volume_control.cpp:57 | VolumeControl 000001F71C2B5210 copying from 000000A747799580 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | volume_control.cpp:269 | UpdateInput: no input endpoint DEBUG | 20240730-144242.423 | WRAPPER | 25056 | volume_control.cpp:301 | UpdateOutput: no output endpoint DEBUG | 20240730-144242.423 | WRAPPER | 25056 | volume_control.cpp:22 | ~VolumeControl 000001F71C259550 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | volume_control.cpp:22 | ~VolumeControl 000000A747799580 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_graph.cpp:26 | ~Graph 000001F71C25DEF0 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_builder.cpp:1654 | Input Audio High Thread total runs: 0 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_builder.cpp:1655 | Input Audio High Thread overrun 25ms: 0 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_builder.cpp:1656 | Input Audio High Thread overrun 50ms: 0 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_builder.cpp:1657 | Output Audio High Thread total runs: 5 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_builder.cpp:1658 | Output Audio High Thread overrun 25ms: 0 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_builder.cpp:1659 | Output Audio High Thread overrun 50ms: 0 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | appl_event_queue.cpp:35 | Notify: event= [class scx::CAudioHighThreadStatistics] DEBUG | 20240730-144242.423 | WRAPPER | 25056 | pa_endpoint.cpp:40 | ~PaEndpoint 000001F71C25DB70 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | base_endpoint.cpp:20 | ~BaseEndpoint 000001F71C25DB70: PaEndpoint DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_builder.cpp:1672 | Reading system volume ready with result Ok DEBUG | 20240730-144242.423 | WRAPPER | 25056 | volume_control.cpp:269 | UpdateInput: no input endpoint DEBUG | 20240730-144242.423 | WRAPPER | 25056 | volume_control.cpp:301 | UpdateOutput: no output endpoint DEBUG | 20240730-144242.423 | WRAPPER | 25056 | volume_control.cpp:38 | VolumeControl 000001F71C2BE3C0 created DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_builder.cpp:105 | Builder 00007FF69D2770A0 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | audio_builder.cpp:1668 | Reading system volume starting DEBUG | 20240730-144242.423 | WRAPPER | 25056 | pa_endpoint.cpp:133 | IsSupported full duplex= 0 flags= 0 DEBUG | 20240730-144242.423 | WRAPPER | 25056 | pa_endpoint.cpp:134 | In : dev= 1, format= PCM16, 960 @ 48000 Hz, stereo DEBUG | 20240730-144242.423 | WRAPPER | 25056 | pa_endpoint.cpp:135 | Out : dev= 0, format= PCM16, 960 @ 48000 Hz, stereo DEBUG | 20240730-144242.431 | WRAPPER | 25056 | pa_endpoint.cpp:165 | IsSupported: Format supported DEBUG | 20240730-144242.431 | WRAPPER | 25056 | base_endpoint.cpp:15 | BaseEndpoint 000001F71C2B5B10: PaEndpoint DEBUG | 20240730-144242.431 | WRAPPER | 25056 | pa_endpoint.cpp:30 | PaEndpoint 000001F71C2B5B10 DEBUG | 20240730-144242.431 | WRAPPER | 25056 | audio_graph.cpp:16 | Graph 000001F71C259550 DEBUG | 20240730-144242.431 | WRAPPER | 25056 | base_endpoint.cpp:132 | Register 000001F71C2B5B10 with 000001F71C2596D0 DEBUG | 20240730-144242.431 | WRAPPER | 25056 | audio_graph.cpp:63 | Register Stream 000001F71C2B5E78 DEBUG | 20240730-144242.431 | WRAPPER | 25056 | base_endpoint.cpp:39 | Start 000001F71C2B5B10: name= PaEndpoint graph= 000001F71C2596D0 DEBUG | 20240730-144242.431 | WRAPPER | 25056 | audio_thread.cpp:21 | BaseAudioThread: 000001F71C2B5590: PaEndpoint::Sink DEBUG | 20240730-144242.431 | WRAPPER | 25056 | audio_thread.cpp:21 | BaseAudioThread: 000001F71C2C40E0: PaEndpoint::Source DEBUG | 20240730-144242.431 | WRAPPER | 25056 | audio_thread.cpp:132 | Transition: Stopped -> Running DEBUG | 20240730-144242.431 | WRAPPER | 25056 | audio_stats.cpp:13 | AudioStats Reset 000001F71C2B5618 DEBUG | 20240730-144242.431 | WRAPPER | 25056 | audio_thread.cpp:132 | Transition: Stopped -> Running DEBUG | 20240730-144242.431 | WRAPPER | 25056 | audio_stats.cpp:13 | AudioStats Reset 000001F71C2C4168 DEBUG | 20240730-144242.431 | WRAPPER | 25056 | pa_endpoint.cpp:46 | InternalStart 000001F71C2B5B10 DEBUG | 20240730-144242.432 | WRAPPER | 25056 | pa_endpoint.cpp:255 | PaOpen 000001F71C2B5B10: full duplex= 0 flags= 0 DEBUG | 20240730-144242.432 | WRAPPER | 25056 | pa_endpoint.cpp:256 | In : dev= 1, format= PCM16, 960 @ 48000 Hz, stereo DEBUG | 20240730-144242.432 | WRAPPER | 25056 | pa_endpoint.cpp:257 | Out : dev= 0, format= PCM16, 960 @ 48000 Hz, stereo DEBUG | 20240730-144242.478 | WRAPPER | 25056 | pa_endpoint.cpp:320 | PaOpen: Successfully opened OUTPUT device DEBUG | 20240730-144242.531 | WRAPPER | 25056 | pa_endpoint.cpp:340 | PaOpen: Successfully opened INPUT device DEBUG | 20240730-144242.531 | WRAPPER | 25056 | pa_endpoint.cpp:360 | PaOpen: Input latency: 0.08 sec, 3840 samples @ 48000 Hz DEBUG | 20240730-144242.531 | WRAPPER | 25056 | pa_endpoint.cpp:361 | PaOpen: Output Latency: 0.08 sec, 3840 samples @ 48000 Hz DEBUG | 20240730-144242.531 | WRAPPER | 25056 | pa_endpoint.cpp:386 | PaOpen: Current input source index= 0, name= (null) DEBUG | 20240730-144242.531 | WRAPPER | 25056 | pa_endpoint.cpp:395 | PaOpen: Auto input source index= 0, name= (null) DEBUG | 20240730-144242.531 | WRAPPER | 25056 | pa_endpoint.cpp:400 | PaOpen: Auto switching input source DEBUG | 20240730-144242.531 | WRAPPER | 25056 | pa_endpoint.cpp:489 | PaStart 000001F71C2B5B10 DEBUG | 20240730-144242.532 | WRAPPER | 25056 | pa_endpoint.cpp:501 | PaStart: m_InStream started successfully DEBUG | 20240730-144242.533 | WRAPPER | 25056 | pa_endpoint.cpp:518 | PaStart: m_OutStream started successfully DEBUG | 20240730-144242.533 | WRAPPER | 25056 | audio_graph.cpp:54 | Register Thread 000001F71C2B5860 DEBUG | 20240730-144242.533 | WRAPPER | 25056 | audio_graph.cpp:54 | Register Thread 000001F71C2C43B0 DEBUG | 20240730-144242.533 | WRAPPER | 25056 | base_endpoint.cpp:191 | Transition 000001F71C2B5B10: Stopped -> Running DEBUG | 20240730-144242.533 | WRAPPER | 25056 | volume_control.cpp:57 | VolumeControl 000000A747799580 copying from 000001F71C2BE3C0 DEBUG | 20240730-144242.533 | WRAPPER | 25056 | base_endpoint.cpp:83 | Stop 000001F71C2B5B10: graph= 000001F71C2596D0 DEBUG | 20240730-144242.533 | WRAPPER | 25056 | pa_endpoint.cpp:71 | InternalStop 000001F71C2B5B10 DEBUG | 20240730-144242.533 | WRAPPER | 25056 | pa_endpoint.cpp:437 | PaClose 000001F71C2B5B10 DEBUG | 20240730-144242.559 | WRAPPER | 25056 | pa_endpoint.cpp:455 | PaClose: m_InStream closed successfully DEBUG | 20240730-144242.572 | WRAPPER | 25056 | pa_endpoint.cpp:474 | PaClose: m_OutStream closed successfully DEBUG | 20240730-144242.572 | WRAPPER | 25056 | base_endpoint.cpp:191 | Transition 000001F71C2B5B10: Running -> Stopped DEBUG | 20240730-144242.572 | WRAPPER | 25056 | audio_graph.cpp:72 | Unregister Thread 000001F71C2B5860 DEBUG | 20240730-144242.572 | WRAPPER | 25056 | audio_graph.cpp:72 | Unregister Thread 000001F71C2C43B0 DEBUG | 20240730-144242.572 | WRAPPER | 25056 | audio_thread.cpp:26 | ~BaseAudioThread: 000001F71C2B5590: PaEndpoint::Sink DEBUG | 20240730-144242.572 | WRAPPER | 25056 | audio_thread.cpp:26 | ~BaseAudioThread: 000001F71C2C40E0: PaEndpoint::Source DEBUG | 20240730-144242.572 | WRAPPER | 25056 | base_endpoint.cpp:150 | Unregister 000001F71C2B5B10 DEBUG | 20240730-144242.572 | WRAPPER | 25056 | audio_graph.cpp:81 | Unregister Stream 000001F71C2B5E78 DEBUG | 20240730-144242.572 | WRAPPER | 25056 | volume_control.cpp:57 | VolumeControl 000001F71C2C18B0 copying from 000000A747799580 DEBUG | 20240730-144242.572 | WRAPPER | 25056 | volume_control.cpp:269 | UpdateInput: no input endpoint DEBUG | 20240730-144242.572 | WRAPPER | 25056 | volume_control.cpp:301 | UpdateOutput: no output endpoint DEBUG | 20240730-144242.572 | WRAPPER | 25056 | volume_control.cpp:22 | ~VolumeControl 000001F71C2BE3C0 DEBUG | 20240730-144242.572 | WRAPPER | 25056 | volume_control.cpp:22 | ~VolumeControl 000000A747799580 DEBUG | 20240730-144242.573 | WRAPPER | 25056 | audio_graph.cpp:26 | ~Graph 000001F71C259550 DEBUG | 20240730-144242.573 | WRAPPER | 25056 | audio_builder.cpp:1654 | Input Audio High Thread total runs: 0 DEBUG | 20240730-144242.573 | WRAPPER | 25056 | audio_builder.cpp:1655 | Input Audio High Thread overrun 25ms: 0 DEBUG | 20240730-144242.573 | WRAPPER | 25056 | audio_builder.cpp:1656 | Input Audio High Thread overrun 50ms: 0 DEBUG | 20240730-144242.573 | WRAPPER | 25056 | audio_builder.cpp:1657 | Output Audio High Thread total runs: 5 DEBUG | 20240730-144242.573 | WRAPPER | 25056 | audio_builder.cpp:1658 | Output Audio High Thread overrun 25ms: 0 DEBUG | 20240730-144242.573 | WRAPPER | 25056 | audio_builder.cpp:1659 | Output Audio High Thread overrun 50ms: 0 DEBUG | 20240730-144242.573 | WRAPPER | 25056 | appl_event_queue.cpp:35 | Notify: event= [class scx::CAudioHighThreadStatistics] DEBUG | 20240730-144242.573 | WRAPPER | 25056 | pa_endpoint.cpp:40 | ~PaEndpoint 000001F71C2B5B10 DEBUG | 20240730-144242.573 | WRAPPER | 25056 | base_endpoint.cpp:20 | ~BaseEndpoint 000001F71C2B5B10: PaEndpoint DEBUG | 20240730-144242.573 | WRAPPER | 25056 | audio_builder.cpp:1672 | Reading system volume ready with result Ok DEBUG | 20240730-144242.573 | WRAPPER | 25056 | wav_loader.cpp:186 | WavLoader 000001F71C2BE3C0 DEBUG | 20240730-144242.573 | WRAPPER | 25056 | base_streammixer.cpp:16 | BaseStreamMixer 000001F71C2C40E0 DEBUG | 20240730-144242.573 | WRAPPER | 25056 | music_server.cpp:18 | MusicServer 000001F71C2C40E0 rf= 00007FF69D1E87F8 DEBUG | 20240730-144242.573 | WRAPPER | 25056 | audio_manager.cpp:83 | Manager: 00007FF69D276B58 INFO | 20240730-144242.573 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2BCC50, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.573 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EE1 INFO | 20240730-144242.573 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2D47C0, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.573 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EE2 INFO | 20240730-144242.573 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2D6D60, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.573 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EE3 INFO | 20240730-144242.573 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2D9300, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.573 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EE4 INFO | 20240730-144242.573 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2DB8A0, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.573 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EE5 INFO | 20240730-144242.573 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2DDE40, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.573 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EE6 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2E03E0, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EE7 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2E2980, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EE8 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2E4F20, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EE9 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2E8860, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EEA INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2E7550, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EEB INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2EC190, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EEC INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2E6240, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EED INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2F0DD0, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EEE INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2EFAC0, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EEF INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71C2F8870, size= 4800, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77EF0 INFO | 20240730-144242.574 | WRAPPER | 25056 | audio_manager.cpp:1093 | StopAudioDebugDump: 00007FF69D276B58 DEBUG | 20240730-144242.598 | Z:APP | 25056 | GeneralOptions.cpp:724 | General options. Add to firewall. DEBUG | 20240730-144242.620 | Z:APP | 25056 | GeneralOptions.cpp:763 | General options. Intergate start with OS. DEBUG | 20240730-144242.621 | Z:APP | 25056 | Phone.cpp:154 | Wrapper cleanup : CPhone::ApplyOptions DEBUG | 20240730-144242.621 | Z:APP | 25056 | NetworkOptions.cpp:62 | Network options. Set media DSCP. DEBUG | 20240730-144242.621 | Z:APP | 25056 | NetworkOptions.cpp:68 | Network options. Set signalling DSCP. This should not work here! DEBUG | 20240730-144242.621 | APP | 25056 | ares_init.c:1327 | get_DNS_Windows: try get_DNS_AdaptersAddresses() DEBUG | 20240730-144242.626 | APP | 25056 | ares_init.c:2230 | fd00::7642:7fff:fe48:84de,2003:d2:ff21:fa00:7642:7fff:fe48:84de,192.168.178.1,fec0:0:0:ffff::1,fec0:0:0:ffff::2,fec0:0:0:ffff::3 INFO | 20240730-144242.627 | RESIP:DNS | 25056 | AresDns.cxx:505 | DNS initialization: using c-ares v1.17.0 INFO | 20240730-144242.627 | RESIP:DNS | 25056 | AresDns.cxx:533 | DNS initialization: found 3 name servers: fd00::7642:7fff:fe48:84de 2003:d2:ff21:fa00:7642:7fff:fe48:84de 192.168.178.1 INFO | 20240730-144242.627 | WRAPPER | 25056 | dns_manager.cpp:123 | dns::Manager INFO | 20240730-144242.627 | WRAPPER | 25056 | dns_manager.cpp:95 | SetIPVersionPreference: E_IPVP_AUTOMATIC INFO | 20240730-144242.627 | UTILS | 25056 | curl_manager.cpp:16 | CurlManager DEBUG | 20240730-144242.627 | WRAPPER | 23884 | dns_manager.cpp:42 | DnsRequest: query= google.com, tryIPv6= 1 DEBUG | 20240730-144242.627 | WRAPPER | 23884 | dns_result.cpp:409 | Result this= 000001F71C3BA9A0 INFO | 20240730-144242.627 | WRAPPER | 23884 | dns_result.cpp:450 | LookUp: Resolving AAAA for google.com DEBUG | 20240730-144242.627 | WRAPPER | 23884 | dns_result.cpp:310 | HostResultSink this= 000001F71B8AEAA0 DEBUG | 20240730-144242.627 | WRAPPER | 23884 | dns_result.cpp:310 | HostResultSink this= 000001F71B8AECD0 INFO | 20240730-144242.627 | UTILS | 25056 | curl_manager.cpp:24 | CurlManager: Default timeout: -1ms DEBUG | 20240730-144242.627 | UTILS | 25056 | curl_manager.cpp:263 | CurlTimerCallback: timeout= -1ms DEBUG | 20240730-144242.627 | UTILS | 25056 | curl_manager.cpp:268 | CurlTimerCallback: Timeout updated to 60000 DEBUG | 20240730-144242.627 | UTILS | 25056 | curl_manager.cpp:162 | ManagerState: Offline -> Online INFO | 20240730-144242.627 | UTILS | 9184 | curl_manager.cpp:230 | thread DEBUG | 20240730-144242.627 | UTILS | 9184 | curl_manager.cpp:169 | ThreadState: Inactive -> Active INFO | 20240730-144242.627 | UTILS | 25056 | curl_manager.cpp:37 | CurlManager: Done INFO | 20240730-144242.627 | WRAPPER | 25056 | api.cpp:3904 | SetSecureSuite: 3 INFO | 20240730-144242.627 | WRAPPER | 25056 | api.cpp:806 | InitCallManager <<< INFO | 20240730-144242.627 | WRAPPER | 25056 | appl_event_queue.cpp:79 | SetCallbackTable: 00007FF69D277690, pCbk= 000001F717CE3140 INFO | 20240730-144242.628 | RESIP:DUM | 25056 | UserProfile.cxx:22 | ************ UserProfile created (no base)!: UserProfile: [] DEBUG | 20240730-144242.629 | RESIP | 25056 | Security.cxx:1179 | BaseSecurity::BaseSecurity WARNING | 20240730-144242.629 | RESIP | 25056 | Security.cxx:3186 | unable to load DH parameters (required for PFS): TlsDHParamsFilename not specified WARNING | 20240730-144242.629 | RESIP | 25056 | Security.cxx:3186 | unable to load DH parameters (required for PFS): TlsDHParamsFilename not specified DEBUG | 20240730-144242.629 | RESIP | 25056 | Compression.cxx:44 | COMPRESSION SUPPORT NOT COMPILED IN DEBUG | 20240730-144242.629 | RESIP | 25056 | Compression.cxx:47 | Compression configuration object created; algorithm = 0 DEBUG | 20240730-144242.629 | RESIP:TRANSPORT | 25056 | TransportSelector.cxx:101 | No compression library available INFO | 20240730-144242.631 | RESIP:DNS | 25056 | DnsUtil.cxx:174 | local hostname does not contain a domain part Powerz-GmbH INFO | 20240730-144242.631 | UTILS | 25056 | security.cpp:331 | Loading certificates from store Root DEBUG | 20240730-144242.637 | RESIP:DNS | 23140 | AresDns.cxx:844 | New UDP socket, FD 2404 DEBUG | 20240730-144242.637 | RESIP:DNS | 23140 | AresDns.cxx:838 | Active FD 2404, readable= 1, writable= 0 DEBUG | 20240730-144242.658 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: google.com (AAAA) --> 2a00:1450:4001:813::200e INFO | 20240730-144242.658 | WRAPPER | 23140 | dns_result.cpp:585 | Resolve RR_AAAA success for google.com DEBUG | 20240730-144242.658 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: google.com(A)--> 142.250.185.110 INFO | 20240730-144242.658 | WRAPPER | 23140 | dns_result.cpp:551 | Resolve RR_A success for google.com DEBUG | 20240730-144242.658 | RESIP:DNS | 23140 | AresDns.cxx:834 | Closing FD 2404 INFO | 20240730-144242.659 | UTILS | 25056 | security.cpp:351 | Loaded 284 certificates from store Root INFO | 20240730-144242.660 | UTILS | 25056 | security.cpp:331 | Loading certificates from store CA INFO | 20240730-144242.661 | UTILS | 25056 | security.cpp:351 | Loaded 9 certificates from store CA DEBUG | 20240730-144242.661 | WRAPPER | 25056 | sip_reginfo_handler.cpp:24 | SipRegInfoHandler 000001F71CA389C0 DEBUG | 20240730-144242.661 | WRAPPER | 25056 | ood_request_helper.cpp:20 | OodRequestHelper 000001F71CA38D80 DEBUG | 20240730-144242.661 | WRAPPER | 25056 | sip_push_handler.cpp:364 | SipPushHandler 000001F71CA38D60 INFO | 20240730-144242.661 | WRAPPER | 25056 | msrp_manager.cpp:22 | MsrpManager 000001F71CA39150 DEBUG | 20240730-144242.661 | WRAPPER | 25056 | sms_manager.cpp:20 | SmsManager 000001F71CA392E0 INFO | 20240730-144242.661 | WRAPPER | 25056 | sip_user.cpp:388 | SipUser 000001F71C2D2740, id= 0000000000C77F08 name= anonymous host= INFO | 20240730-144242.661 | RESIP:DUM | 25056 | UserProfile.cxx:31 | ************ UserProfile created (with base)!: UserProfile: [] DEBUG | 20240730-144242.661 | RESIP:DUM | 25056 | UserProfile.cxx:145 | Adding credential: realm= user=anonymous DEBUG | 20240730-144242.661 | WRAPPER | 25056 | sip_user.cpp:490 | AddOutboundProxyToProfile: Proxy manager is not started yet DEBUG | 20240730-144242.662 | RESIP:TRANSPORT | 25056 | InternalTransport.cxx:121 | Creating fd=2396 V4/UDP DEBUG | 20240730-144242.662 | RESIP:TRANSPORT | 25056 | InternalTransport.cxx:133 | Binding to 0.0.0.0 INFO | 20240730-144242.662 | RESIP:TRANSPORT | 25056 | UdpTransport.cxx:73 | Creating UDP transport host= port=50857 ipv4=1 DEBUG | 20240730-144242.662 | RESIP:TRANSPORT | 25056 | UdpTransport.cxx:87 | No compression library available: Transport: [ V4 0.0.0.0:50857 UDP flowKey=2396 ] DEBUG | 20240730-144242.662 | RESIP:TRANSPORT | 25056 | WinCompat.cxx:191 | WinCompat constructor complete! DEBUG | 20240730-144242.667 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 127.0.0.1:50857 DEBUG | 20240730-144242.667 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 172.29.128.1:50857 DEBUG | 20240730-144242.667 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 127.0.0.1:50857 DEBUG | 20240730-144242.667 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 169.254.63.87:50857 DEBUG | 20240730-144242.667 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 169.254.133.248:50857 DEBUG | 20240730-144242.667 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 169.254.156.28:50857 DEBUG | 20240730-144242.667 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 169.254.64.27:50857 DEBUG | 20240730-144242.667 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 169.254.96.46:50857 DEBUG | 20240730-144242.667 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 192.168.178.33:50857 DEBUG | 20240730-144242.667 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 169.254.177.66:50857 DEBUG | 20240730-144242.667 | RESIP:TRANSPORT | 25056 | TransportSelector.cxx:223 | Adding transport: [ V4 0.0.0.0:50857 UDP transportKey=1 ] INFO | 20240730-144242.667 | RESIP:TRANSPORT | 25056 | TransportSelector.cxx:295 | TransportSelector::addTransport: added transport for tuple=[ V4 0.0.0.0:50857 UDP transportKey=1 ], key=1 DEBUG | 20240730-144242.667 | RESIP:TRANSPORT | 25056 | ConnectionBase.cxx:70 | ConnectionBase::ConnectionBase, who: [ V4 0.0.0.0:0 UNKNOWN_TRANSPORT ] 000001F71C2D1FD0 DEBUG | 20240730-144242.667 | RESIP:TRANSPORT | 25056 | ConnectionBase.cxx:83 | No compression library available: 000001F71C2D1FD0 INFO | 20240730-144242.667 | RESIP:TRANSPORT | 25056 | Connection.cxx:127 | Connection::Connection: new connection created to who: [ V4 0.0.0.0:0 UNKNOWN_TRANSPORT ], is server = 0 DEBUG | 20240730-144242.667 | RESIP:TRANSPORT | 25056 | ConnectionManager.cxx:34 | ConnectionManager::ConnectionManager() called DEBUG | 20240730-144242.667 | RESIP:TRANSPORT | 25056 | InternalTransport.cxx:121 | Creating fd=2424 V4/TCP DEBUG | 20240730-144242.667 | RESIP:TRANSPORT | 25056 | InternalTransport.cxx:133 | Binding to 0.0.0.0 INFO | 20240730-144242.667 | RESIP:TRANSPORT | 25056 | TcpTransport.cxx:39 | Creating TCP transport host= port=50857 ipv4=1 INFO | 20240730-144242.669 | WRAPPER | 23884 | network_helper.cpp:694 | FastestInterfaceIPVersion: result= V4 DEBUG | 20240730-144242.672 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 127.0.0.1:50857 DEBUG | 20240730-144242.672 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 172.29.128.1:50857 DEBUG | 20240730-144242.672 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 127.0.0.1:50857 DEBUG | 20240730-144242.672 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 169.254.63.87:50857 DEBUG | 20240730-144242.672 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 169.254.133.248:50857 DEBUG | 20240730-144242.672 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 169.254.156.28:50857 DEBUG | 20240730-144242.672 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 169.254.64.27:50857 DEBUG | 20240730-144242.672 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 169.254.96.46:50857 DEBUG | 20240730-144242.672 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 192.168.178.33:50857 DEBUG | 20240730-144242.672 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 169.254.177.66:50857 DEBUG | 20240730-144242.672 | RESIP:TRANSPORT | 25056 | TransportSelector.cxx:223 | Adding transport: [ V4 0.0.0.0:50857 TCP transportKey=2 ] INFO | 20240730-144242.672 | RESIP:TRANSPORT | 25056 | TransportSelector.cxx:295 | TransportSelector::addTransport: added transport for tuple=[ V4 0.0.0.0:50857 TCP transportKey=2 ], key=2 DEBUG | 20240730-144242.672 | WRAPPER | 25056 | msrp_manager.cpp:52 | Init 000001F71CA39150 DEBUG | 20240730-144242.672 | WRAPPER | 25056 | msrp_manager.cpp:893 | Transition 000001F71CA39150idle -> running DEBUG | 20240730-144242.672 | WRAPPER | 25056 | audio_graph.cpp:16 | Graph 000001F71CA43A60 DEBUG | 20240730-144242.672 | WRAPPER | 25056 | conference_manager.cpp:46 | ConferenceManager 000001F71CA5F680 INFO | 20240730-144242.672 | WRAPPER | 25056 | api.cpp:857 | InitCallManager: DONE INFO | 20240730-144242.672 | WRAPPER | 25056 | iax2_user.cpp:39 | Iax2User 000001F71C3AC430, id=0000000000C77F09, user=anonymous, host=localhost INFO | 20240730-144242.673 | WRAPPER | 25056 | iax2_manager.cpp:110 | Iax2Manager::Iax2Manager DEBUG | 20240730-144242.673 | WRAPPER | 25056 | iax2_manager.cpp:587 | Iax2Manager::CreateReader: reader initialized on 0.0.0.0:50859 DEBUG | 20240730-144242.673 | WRAPPER | 25056 | iax2_client.cpp:89 | Iax2Client::Iax2Client mode 3 DEBUG | 20240730-144242.673 | WRAPPER | 25056 | iax2_client.cpp:197 | Iax2Client::DoDst0 DEBUG | 20240730-144242.673 | WRAPPER | 21828 | iax2_manager.cpp:448 | Iax2Manager::thread: running reader DEBUG | 20240730-144242.673 | WRAPPER | 25504 | iax2_client.cpp:850 | Iax2Client::thread: running INFO | 20240730-144242.673 | WRAPPER | 25056 | sip_call_manager.cpp:7102 | InitIPv6: adding UDPv6 transport DEBUG | 20240730-144242.673 | RESIP:TRANSPORT | 25056 | InternalTransport.cxx:121 | Creating fd=2076 V6/UDP DEBUG | 20240730-144242.673 | RESIP:TRANSPORT | 25056 | InternalTransport.cxx:133 | Binding to :: INFO | 20240730-144242.673 | RESIP:TRANSPORT | 25056 | UdpTransport.cxx:73 | Creating UDP transport host= port=50857 ipv4=0 DEBUG | 20240730-144242.673 | RESIP:TRANSPORT | 25056 | UdpTransport.cxx:87 | No compression library available: Transport: [ V6 :: port=50857 UDP flowKey=2076 ] DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::d8fd:d7c5:a750:619:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: ::1:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::d12f:8ddb:c148:48e7:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::5f2c:fff1:14cf:3bdb:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::7668:3e9f:33d0:c229:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::9887:8690:2795:df81:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::9ddb:7fd6:29be:b093:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::13ff:d219:b35f:9722:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fd00::e774:3e4c:52e3:681e:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fd00::c16c:a00f:964a:fd54:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 2003:d2:ff21:fa00:c16c:a00f:964a:fd54:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 2003:d2:ff21:fa00:589d:2c3f:83d8:42d9:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 2003:d2:ff03:1e00:c16c:a00f:964a:fd54:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 2003:d2:ff03:1d00:c16c:a00f:964a:fd54:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 2003:d2:ff03:1d00:99d2:c456:236:c519:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 2003:d2:ff03:1e00:e3fe:1e8f:72b1:f44f:50857 DEBUG | 20240730-144242.678 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::e1b9:e43c:316c:3273:50857 INFO | 20240730-144242.678 | WRAPPER | 25056 | sip_call_manager.cpp:7127 | InitIPv6: adding TCPv6 transport DEBUG | 20240730-144242.678 | RESIP:TRANSPORT | 25056 | ConnectionBase.cxx:70 | ConnectionBase::ConnectionBase, who: [ V4 0.0.0.0:0 UNKNOWN_TRANSPORT ] 000001F71CC25370 DEBUG | 20240730-144242.678 | RESIP:TRANSPORT | 25056 | ConnectionBase.cxx:83 | No compression library available: 000001F71CC25370 INFO | 20240730-144242.678 | RESIP:TRANSPORT | 25056 | Connection.cxx:127 | Connection::Connection: new connection created to who: [ V4 0.0.0.0:0 UNKNOWN_TRANSPORT ], is server = 0 DEBUG | 20240730-144242.678 | RESIP:TRANSPORT | 25056 | ConnectionManager.cxx:34 | ConnectionManager::ConnectionManager() called DEBUG | 20240730-144242.678 | RESIP:TRANSPORT | 25056 | InternalTransport.cxx:121 | Creating fd=2504 V6/TCP DEBUG | 20240730-144242.678 | RESIP:TRANSPORT | 25056 | InternalTransport.cxx:133 | Binding to :: INFO | 20240730-144242.678 | RESIP:TRANSPORT | 25056 | TcpTransport.cxx:39 | Creating TCP transport host= port=50857 ipv4=0 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::d8fd:d7c5:a750:619:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: ::1:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::d12f:8ddb:c148:48e7:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::5f2c:fff1:14cf:3bdb:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::7668:3e9f:33d0:c229:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::9887:8690:2795:df81:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::9ddb:7fd6:29be:b093:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::13ff:d219:b35f:9722:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fd00::e774:3e4c:52e3:681e:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fd00::c16c:a00f:964a:fd54:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 2003:d2:ff21:fa00:c16c:a00f:964a:fd54:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 2003:d2:ff21:fa00:589d:2c3f:83d8:42d9:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 2003:d2:ff03:1e00:c16c:a00f:964a:fd54:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 2003:d2:ff03:1d00:c16c:a00f:964a:fd54:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 2003:d2:ff03:1d00:99d2:c456:236:c519:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: 2003:d2:ff03:1e00:e3fe:1e8f:72b1:f44f:50857 DEBUG | 20240730-144242.683 | RESIP | 25056 | SipStack.cxx:701 | Adding domain alias: fe80::e1b9:e43c:316c:3273:50857 INFO | 20240730-144242.683 | WRAPPER | 25056 | nat64_detector.cpp:67 | NAT64Detector: 00007FF69D277790 DEBUG | 20240730-144242.683 | WRAPPER | 25056 | network_helper.cpp:178 | determineSourceAddress [ V6 :: port=0 ] DEBUG | 20240730-144242.683 | WRAPPER | 25056 | network_helper.cpp:103 | overriding zero port DEBUG | 20240730-144242.683 | WRAPPER | 25056 | network_helper.cpp:109 | overriding ANY ADDR with google dns DEBUG | 20240730-144242.683 | WRAPPER | 25056 | network_helper.cpp:116 | determineSourceAddressUnsafe [ V6 2001:4860:4860::8888 port=8000 ] DEBUG | 20240730-144242.687 | WRAPPER | 25056 | network_helper.cpp:446 | haveInterface: IpVersion 1= 1 DEBUG | 20240730-144242.687 | WRAPPER | 25056 | dns_manager.cpp:42 | DnsRequest: query= n64d1.zoiper.com, tryIPv6= 1 DEBUG | 20240730-144242.687 | WRAPPER | 25056 | dns_result.cpp:409 | Result this= 000001F71CBC4010 INFO | 20240730-144242.687 | WRAPPER | 25056 | dns_result.cpp:450 | LookUp: Resolving AAAA for n64d1.zoiper.com DEBUG | 20240730-144242.687 | WRAPPER | 25056 | dns_result.cpp:310 | HostResultSink this= 000001F71CB61D60 DEBUG | 20240730-144242.687 | WRAPPER | 25056 | dns_result.cpp:310 | HostResultSink this= 000001F71CB61720 DEBUG | 20240730-144242.687 | WRAPPER | 25056 | dns_manager.cpp:42 | DnsRequest: query= n64d2.zoiper.com, tryIPv6= 1 DEBUG | 20240730-144242.687 | WRAPPER | 25056 | dns_result.cpp:409 | Result this= 000001F71CBC7A80 INFO | 20240730-144242.687 | WRAPPER | 25056 | dns_result.cpp:450 | LookUp: Resolving AAAA for n64d2.zoiper.com DEBUG | 20240730-144242.687 | WRAPPER | 25056 | dns_result.cpp:310 | HostResultSink this= 000001F71CB614A0 DEBUG | 20240730-144242.687 | WRAPPER | 25056 | dns_result.cpp:310 | HostResultSink this= 000001F71CB61B80 DEBUG | 20240730-144242.687 | WRAPPER | 25056 | nat64_detector.cpp:105 | nat64Reset: started DNS query for n64d1.zoiper.com and n64d2.zoiper.com DEBUG | 20240730-144242.697 | RESIP:DNS | 23140 | AresDns.cxx:844 | New UDP socket, FD 2512 DEBUG | 20240730-144242.697 | RESIP:DNS | 23140 | AresDns.cxx:838 | Active FD 2512, readable= 1, writable= 0 DEBUG | 20240730-144242.699 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: n64d1.zoiper.com lookup failed: DNS server returned answer with no data DEBUG | 20240730-144242.700 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: n64d1.zoiper.com(A)--> 42.43.44.45 INFO | 20240730-144242.700 | WRAPPER | 23140 | dns_result.cpp:551 | Resolve RR_A success for n64d1.zoiper.com DEBUG | 20240730-144242.700 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: n64d2.zoiper.com lookup failed: DNS server returned answer with no data DEBUG | 20240730-144242.701 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: n64d2.zoiper.com(A)--> 213.212.211.210 INFO | 20240730-144242.701 | WRAPPER | 23140 | dns_result.cpp:551 | Resolve RR_A success for n64d2.zoiper.com DEBUG | 20240730-144242.701 | RESIP:DNS | 23140 | AresDns.cxx:834 | Closing FD 2512 DEBUG | 20240730-144242.711 | WRAPPER | 23884 | nat64_detector.cpp:208 | onDnsResult: query= n64d1.zoiper.com DEBUG | 20240730-144242.711 | WRAPPER | 23884 | nat64_detector.cpp:213 | onDnsResult: not an IPv6 DEBUG | 20240730-144242.711 | WRAPPER | 23884 | dns_result.cpp:428 | ~Result this= 000001F71CBC4010 DEBUG | 20240730-144242.711 | WRAPPER | 23884 | dns_result.cpp:315 | ~HostResultSink this= 000001F71CB61D60 DEBUG | 20240730-144242.711 | WRAPPER | 23884 | dns_result.cpp:315 | ~HostResultSink this= 000001F71CB61720 DEBUG | 20240730-144242.711 | WRAPPER | 23884 | nat64_detector.cpp:208 | onDnsResult: query= n64d2.zoiper.com DEBUG | 20240730-144242.711 | WRAPPER | 23884 | nat64_detector.cpp:213 | onDnsResult: not an IPv6 DEBUG | 20240730-144242.711 | WRAPPER | 23884 | dns_result.cpp:428 | ~Result this= 000001F71CBC7A80 DEBUG | 20240730-144242.711 | WRAPPER | 23884 | dns_result.cpp:315 | ~HostResultSink this= 000001F71CB614A0 DEBUG | 20240730-144242.711 | WRAPPER | 23884 | dns_result.cpp:315 | ~HostResultSink this= 000001F71CB61B80 DEBUG | 20240730-144242.772 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:223 | Adding transport: [ V6 :: port=50857 UDP transportKey=3 ] INFO | 20240730-144242.772 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:295 | TransportSelector::addTransport: added transport for tuple=[ V6 :: port=50857 UDP transportKey=3 ], key=3 DEBUG | 20240730-144242.772 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:223 | Adding transport: [ V6 :: port=50857 TCP transportKey=4 ] INFO | 20240730-144242.772 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:295 | TransportSelector::addTransport: added transport for tuple=[ V6 :: port=50857 TCP transportKey=4 ], key=4 ERR | 20240730-144242.787 | Z:APP | 25056 | HistoryDeleteFilter.cpp:49 | History deletion filter (Z5c64f74cdb34ece89fd86e38) failed to have criterion DEBUG | 20240730-144242.787 | Z:APP | 25056 | HistoryDeleteFilter.cpp:75 | History deletion filter (Z5c64f74cdb34ece89fd86e38) added: DEBUG | 20240730-144242.787 | Z:APP | 25056 | HistoryDeleteFilter.cpp:91 | History deletion filter (Z5c64f74cdb34ece89fd86e38) had time interval added (1400-01-01T00:00:00 - 2024-07-23T14:42:42.787756). DEBUG | 20240730-144242.788 | Z:APP | 25056 | HistoryDeleteFilter.cpp:108 | History deletion filter (Z5c64f74cdb34ece89fd86e38) deleted stuff. DEBUG | 20240730-144242.788 | Z:APP | 25056 | HistoryDeleteFilter.cpp:111 | History filter refresh request because of a history deletion grouped by (3). DEBUG | 20240730-144242.788 | Z:APP | 25056 | HistoryDeleteFilter.cpp:122 | History delete entries elapsed time = 0ms ERR | 20240730-144242.788 | Z:APP | 25056 | XServiceContext.cpp:62 | Cannot cancel deferred group call DEBUG | 20240730-144242.788 | Z:APP | 25056 | HistoryService.cpp:500 | History count entries elapsed time = 0ms INFO | 20240730-144242.788 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71B7F8B40, size= 19200, sample= 2, freq= 8000, repeat= 1, pause= 5000 INFO | 20240730-144242.788 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77F1A INFO | 20240730-144242.788 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71B815E90, size= 16000, sample= 2, freq= 8000, repeat= 1, pause= 3000 INFO | 20240730-144242.788 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77F1B INFO | 20240730-144242.788 | WRAPPER | 25056 | audio_manager.cpp:341 | AddSound: 00007FF69D276B58, data= 000001F71B7FD650, size= 16000, sample= 2, freq= 8000, repeat= 0, pause= 0 INFO | 20240730-144242.788 | WRAPPER | 25056 | audio_manager.cpp:350 | SoundHandler= 0000000000C77F1C DEBUG | 20240730-144242.788 | Z:APP | 25056 | RTPOptions.cpp:88 | RTP options. Set use random port. INFO | 20240730-144242.788 | WRAPPER | 25056 | rtp_port_manager.cpp:19 | ChangePortBase: portBase= 0; portsCount= 128 DEBUG | 20240730-144242.788 | Z:APP | 25056 | RTPOptions.cpp:103 | RTP options. Set session name. DEBUG | 20240730-144242.788 | Z:APP | 25056 | RTPOptions.cpp:110 | RTP options. Set user name. DEBUG | 20240730-144242.788 | Z:APP | 25056 | RTPOptions.cpp:117 | RTP options. Set URL. DEBUG | 20240730-144242.788 | Z:APP | 25056 | RTPOptions.cpp:124 | RTP options. Set email. DEBUG | 20240730-144242.788 | Z:APP | 25056 | STUNOptions.cpp:97 | Creating the default STUN server DEBUG | 20240730-144242.788 | Z:APP | 25056 | STUNOptions.cpp:103 | Creating STUN server : stun.t-online.de3478 DEBUG | 20240730-144242.788 | WRAPPER | 25056 | stun_server.cpp:86 | SetStunRefreshPeriod: New refreshPeriod= 30000 DEBUG | 20240730-144242.788 | WRAPPER | 25056 | stun_server.cpp:582 | Reset INFO | 20240730-144242.788 | WRAPPER | 25056 | stun_server.cpp:798 | SetNetworkType: old type= 255, new type= 255 DEBUG | 20240730-144242.788 | WRAPPER | 25056 | appl_event_queue.cpp:35 | Notify: event= [class scx::CStunNetworkDiscovered] DEBUG | 20240730-144242.788 | WRAPPER | 25056 | stun_server.cpp:808 | SetStunState: old state= NotActive, new state= NotActive DEBUG | 20240730-144242.788 | WRAPPER | 25056 | stun_server.cpp:817 | SetNetDiscoveryState: old state= NotActive, new state= NotActive DEBUG | 20240730-144242.788 | WRAPPER | 25056 | stun_server.cpp:808 | SetStunState: old state= NotActive, new state= ServerResolving DEBUG | 20240730-144242.788 | WRAPPER | 25056 | network_helper.cpp:178 | determineSourceAddress [ V6 :: port=0 ] DEBUG | 20240730-144242.788 | WRAPPER | 25056 | network_helper.cpp:103 | overriding zero port DEBUG | 20240730-144242.788 | WRAPPER | 25056 | network_helper.cpp:109 | overriding ANY ADDR with google dns DEBUG | 20240730-144242.788 | WRAPPER | 25056 | network_helper.cpp:116 | determineSourceAddressUnsafe [ V6 2001:4860:4860::8888 port=8000 ] DEBUG | 20240730-144242.793 | WRAPPER | 25056 | network_helper.cpp:446 | haveInterface: IpVersion 1= 1 DEBUG | 20240730-144242.793 | WRAPPER | 25056 | dns_manager.cpp:42 | DnsRequest: query= stun.t-online.de, tryIPv6= 1 DEBUG | 20240730-144242.793 | WRAPPER | 25056 | dns_result.cpp:409 | Result this= 000001F71CBC7420 INFO | 20240730-144242.793 | WRAPPER | 25056 | dns_result.cpp:450 | LookUp: Resolving AAAA for stun.t-online.de DEBUG | 20240730-144242.793 | WRAPPER | 25056 | dns_result.cpp:310 | HostResultSink this= 000001F71CB61220 DEBUG | 20240730-144242.793 | WRAPPER | 25056 | dns_result.cpp:310 | HostResultSink this= 000001F71CB61E00 DEBUG | 20240730-144242.793 | WRAPPER | 25056 | codec_manager.cpp:82 | CodecManager::CreateDefaultProfile: created for codecId: 35 DEBUG | 20240730-144242.793 | Z:APP | 25056 | Codec.cpp:213 | Added codec = 35 DEBUG | 20240730-144242.793 | WRAPPER | 25056 | codec_manager.cpp:82 | CodecManager::CreateDefaultProfile: created for codecId: 7 DEBUG | 20240730-144242.793 | Z:APP | 25056 | Codec.cpp:213 | Added codec = 7 DEBUG | 20240730-144242.793 | WRAPPER | 25056 | codec_manager.cpp:82 | CodecManager::CreateDefaultProfile: created for codecId: 34 DEBUG | 20240730-144242.793 | Z:APP | 25056 | Codec.cpp:213 | Added codec = 34 DEBUG | 20240730-144242.793 | WRAPPER | 25056 | codec_manager.cpp:82 | CodecManager::CreateDefaultProfile: created for codecId: 0 DEBUG | 20240730-144242.793 | Z:APP | 25056 | Codec.cpp:213 | Added codec = 0 DEBUG | 20240730-144242.793 | WRAPPER | 25056 | codec_manager.cpp:82 | CodecManager::CreateDefaultProfile: created for codecId: 6 DEBUG | 20240730-144242.793 | Z:APP | 25056 | Codec.cpp:213 | Added codec = 6 DEBUG | 20240730-144242.793 | WRAPPER | 25056 | codec_manager.cpp:82 | CodecManager::CreateDefaultProfile: created for codecId: 1 DEBUG | 20240730-144242.793 | Z:APP | 25056 | Codec.cpp:213 | Added codec = 1 DEBUG | 20240730-144242.793 | WRAPPER | 25056 | codec_manager.cpp:82 | CodecManager::CreateDefaultProfile: created for codecId: 33 DEBUG | 20240730-144242.793 | Z:APP | 25056 | Codec.cpp:360 | Codec options applied. UserControl = 0 INFO | 20240730-144242.793 | WRAPPER | 25056 | audio_manager.cpp:1157 | SetHostApi: 5 DEBUG | 20240730-144242.793 | WRAPPER | 25056 | pa_manager.cpp:513 | Set host api preference to 13 INFO | 20240730-144242.793 | WRAPPER | 25056 | audio_manager.cpp:123 | Restart 00007FF69D276B58 INFO | 20240730-144242.793 | WRAPPER | 25056 | pa_manager.cpp:139 | Reset DEBUG | 20240730-144242.793 | WRAPPER | 25056 | pa_manager.cpp:430 | InternalReset DEBUG | 20240730-144242.793 | WRAPPER | 25056 | pa_manager.cpp:444 | Old input device 'Микрофон (Realtek(R) Audio)' DEBUG | 20240730-144242.793 | WRAPPER | 25056 | pa_manager.cpp:445 | Old output device 'Динамики (Realtek(R) Audio)' DEBUG | 20240730-144242.793 | WRAPPER | 25056 | pa_manager.cpp:446 | Old ring device 'Динамики (Realtek(R) Audio)' DEBUG | 20240730-144242.793 | WRAPPER | 25056 | audio_detector_windows.cpp:78 | Stop DEBUG | 20240730-144242.793 | WRAPPER | 25056 | pa_manager.cpp:390 | State Initialized -> Closed DEBUG | 20240730-144242.798 | WRAPPER | 25056 | audio_detector_windows.cpp:52 | Start DEBUG | 20240730-144242.799 | WRAPPER | 25056 | pa_manager.cpp:417 | Default input device = 1 : Микрофон (Realtek(R) Audio) DEBUG | 20240730-144242.799 | WRAPPER | 25056 | pa_manager.cpp:420 | Default output device = 0 : Динамики (Realtek(R) Audio) DEBUG | 20240730-144242.799 | WRAPPER | 25056 | pa_manager.cpp:390 | State Closed -> Initialized DEBUG | 20240730-144242.799 | WRAPPER | 25056 | pa_manager.cpp:472 | Available 3 devices: DEBUG | 20240730-144242.799 | WRAPPER | 25056 | pa_manager.cpp:476 | #0, 'Динамики (Realtek(R) Audio)', 0 input + 2 output DEBUG | 20240730-144242.799 | WRAPPER | 25056 | pa_manager.cpp:476 | #1, 'Микрофон (Realtek(R) Audio)', 2 input + 0 output DEBUG | 20240730-144242.799 | WRAPPER | 25056 | pa_manager.cpp:476 | #2, 'Динамики (Realtek(R) Audio) [Loopback]', 2 input + 0 output DEBUG | 20240730-144242.799 | WRAPPER | 25056 | audio_builder.cpp:573 | Restart DEBUG | 20240730-144242.799 | WRAPPER | 25056 | audio_builder.cpp:956 | InternalRestart DEBUG | 20240730-144242.799 | WRAPPER | 25056 | audio_builder.cpp:863 | InternalReset 00007FF69D276BD8 DEBUG | 20240730-144242.799 | WRAPPER | 25056 | volume_control.cpp:57 | VolumeControl 000001F71CA52A60 copying from 000001F71C2B5210 DEBUG | 20240730-144242.799 | WRAPPER | 25056 | volume_control.cpp:269 | UpdateInput: no input endpoint DEBUG | 20240730-144242.799 | WRAPPER | 25056 | volume_control.cpp:301 | UpdateOutput: no output endpoint DEBUG | 20240730-144242.799 | WRAPPER | 25056 | volume_control.cpp:22 | ~VolumeControl 000001F71C2B5210 DEBUG | 20240730-144242.799 | WRAPPER | 25056 | audio_builder.cpp:856 | Transition: Idle -> Idle DEBUG | 20240730-144242.799 | WRAPPER | 25056 | audio_builder.cpp:962 | No streams to add DEBUG | 20240730-144242.799 | Z:APP | 25056 | AudioOptions.cpp:567 | Audio options. Set auto mic selection. INFO | 20240730-144242.799 | WRAPPER | 25056 | audio_manager.cpp:711 | SetAutoMicSelection: 00007FF69D276B58, enable= 0 DEBUG | 20240730-144242.799 | WRAPPER | 25056 | audio_builder.cpp:211 | SetExtraFlags, old= 0, new= 0 DEBUG | 20240730-144242.799 | Z:APP | 25056 | AudioOptions.cpp:573 | Audio options. Set auto gain control. INFO | 20240730-144242.799 | WRAPPER | 25056 | audio_manager.cpp:236 | SetAGC: 00007FF69D276B58, mode= 1, gain= 20 DEBUG | 20240730-144242.799 | WRAPPER | 25056 | audio_builder.cpp:300 | SetAGCMode 0 -> 1 DEBUG | 20240730-144242.799 | WRAPPER | 25056 | audio_builder.cpp:301 | SetAGCGain 0 -> 20 DEBUG | 20240730-144242.799 | WRAPPER | 25056 | volume_control.cpp:269 | UpdateInput: no input endpoint DEBUG | 20240730-144242.799 | WRAPPER | 25056 | audio_manager.cpp:730 | GetInputVolume: 00007FF69D276B58, vol = 0.822284 DEBUG | 20240730-144242.799 | WRAPPER | 25056 | volume_control.cpp:301 | UpdateOutput: no output endpoint DEBUG | 20240730-144242.799 | WRAPPER | 25056 | audio_manager.cpp:749 | GetOutputVolume: 00007FF69D276B58, vol= 1 DEBUG | 20240730-144242.799 | Z:APP | 25056 | AudioOptions.cpp:588 | Audio options. Set noise suppression. INFO | 20240730-144242.799 | WRAPPER | 25056 | audio_manager.cpp:247 | SetNS: 00007FF69D276B58, use= 1 DEBUG | 20240730-144242.799 | WRAPPER | 25056 | audio_builder.cpp:318 | SetNS 0 -> 1 DEBUG | 20240730-144242.799 | Z:APP | 25056 | AudioOptions.cpp:594 | Audio options. Set high pass filter. INFO | 20240730-144242.799 | WRAPPER | 25056 | audio_manager.cpp:258 | SetHighPass: 00007FF69D276B58, use= 0 DEBUG | 20240730-144242.799 | WRAPPER | 25056 | audio_builder.cpp:334 | SetHighPass 0 -> 0 DEBUG | 20240730-144242.799 | Z:APP | 25056 | AudioOptions.cpp:600 | Audio options. Set pre amplifier. INFO | 20240730-144242.799 | WRAPPER | 25056 | audio_manager.cpp:269 | SetPreAmplifier: 00007FF69D276B58, use= 0, gain= 1 DEBUG | 20240730-144242.800 | WRAPPER | 25056 | audio_builder.cpp:350 | SetUsePreAmplifier 0 -> 0 DEBUG | 20240730-144242.800 | WRAPPER | 25056 | audio_builder.cpp:351 | SetPreAmplifierGain 1 -> 1 DEBUG | 20240730-144242.800 | Z:APP | 25056 | AudioOptions.cpp:80 | Selected input audio device: DEBUG | 20240730-144242.800 | Z:APP | 25056 | AudioOptions.cpp:80 | Selected output audio device: DEBUG | 20240730-144242.800 | Z:APP | 25056 | AudioOptions.cpp:80 | Selected ringing audio device: DEBUG | 20240730-144242.800 | Z:APP | 25056 | AudioOptions.cpp:80 | Selected input audio device: DEBUG | 20240730-144242.800 | Z:APP | 25056 | AudioOptions.cpp:80 | Selected output audio device: DEBUG | 20240730-144242.800 | Z:APP | 25056 | AudioOptions.cpp:621 | Audio options. Set mic boost. DEBUG | 20240730-144242.800 | Z:APP | 25056 | AudioOptions.cpp:627 | Audio options. Set echo cancellation. INFO | 20240730-144242.800 | WRAPPER | 25056 | audio_manager.cpp:225 | SetAEC: 00007FF69D276B58, use= 1 DEBUG | 20240730-144242.800 | WRAPPER | 25056 | audio_builder.cpp:284 | SetAEC 0 -> 1 DEBUG | 20240730-144242.800 | Z:APP | 25056 | AudioOptions.cpp:652 | Audio options. Set Disable DTMF sounds. DEBUG | 20240730-144242.800 | Z:APP | 25056 | Account.cpp:1265 | Account (+4986322880835001@tel.t-online.de) creating account. ERR | 20240730-144242.800 | Z:APP | 25056 | ContactSubscriptions.cpp:98 | Account (+4986322880835001@tel.t-online.de) - unsubscribing all phones. DEBUG | 20240730-144242.800 | Z:APP | 25056 | Account.cpp:1287 | Creating SIP account. Account = +4986322880835001@tel.t-online.de, +4986322880835001@tel.t-online.de INFO | 20240730-144242.800 | WRAPPER | 25056 | sip_call_manager.cpp:1166 | AddUser: name=+4986322880835001, proxy= , realm= tel.t-online.de, callerid= , callernum= DEBUG | 20240730-144242.800 | WRAPPER | 25056 | sip_call_manager.cpp:1193 | AddUser: Aor= INFO | 20240730-144242.800 | WRAPPER | 25056 | sip_user.cpp:388 | SipUser 000001F71C422E50, id= 0000000000C77F24 name= +4986322880835001 host= tel.t-online.de DEBUG | 20240730-144242.800 | WRAPPER | 25056 | network_helper.cpp:178 | determineSourceAddress [ V6 :: port=0 ] DEBUG | 20240730-144242.800 | WRAPPER | 25056 | network_helper.cpp:103 | overriding zero port DEBUG | 20240730-144242.800 | WRAPPER | 25056 | network_helper.cpp:109 | overriding ANY ADDR with google dns DEBUG | 20240730-144242.800 | WRAPPER | 25056 | network_helper.cpp:116 | determineSourceAddressUnsafe [ V6 2001:4860:4860::8888 port=8000 ] DEBUG | 20240730-144242.803 | RESIP:DNS | 23140 | AresDns.cxx:844 | New UDP socket, FD 2100 DEBUG | 20240730-144242.803 | RESIP:DNS | 23140 | AresDns.cxx:838 | Active FD 2100, readable= 1, writable= 0 DEBUG | 20240730-144242.805 | WRAPPER | 25056 | network_helper.cpp:446 | haveInterface: IpVersion 1= 1 DEBUG | 20240730-144242.805 | WRAPPER | 25056 | dns_manager.cpp:51 | DnsSrvRequest: query= tel.t-online.de DEBUG | 20240730-144242.805 | WRAPPER | 25056 | dns_result.cpp:409 | Result this= 000001F71CBC5880 INFO | 20240730-144242.805 | WRAPPER | 25056 | dns_result.cpp:450 | LookUp: Resolving SRV for tel.t-online.de DEBUG | 20240730-144242.805 | WRAPPER | 25056 | dns_result.cpp:113 | SrvResultSink this= 000001F71CA5E280 INFO | 20240730-144242.805 | RESIP:DUM | 25056 | UserProfile.cxx:31 | ************ UserProfile created (with base)!: UserProfile: [] DEBUG | 20240730-144242.805 | RESIP:DUM | 25056 | UserProfile.cxx:145 | Adding credential: realm=tel.t-online.de user=+4986322880835001 DEBUG | 20240730-144242.805 | WRAPPER | 25056 | sip_user.cpp:480 | AddOutboundProxyToProfile: Unsetting use of proxy DEBUG | 20240730-144242.805 | WRAPPER | 25056 | sip_user.cpp:480 | AddOutboundProxyToProfile: Unsetting use of proxy DEBUG | 20240730-144242.805 | WRAPPER | 25056 | sip_call_manager.cpp:1209 | AddUser +4986322880835001 -> 0000000000C77F24 INFO | 20240730-144242.805 | WRAPPER | 25056 | api.cpp:954 | AddUser id= 0000000000C77F24 INFO | 20240730-144242.806 | WRAPPER | 25056 | sip_call_manager.cpp:5804 | Configuring user id 0000000000C77F24 with srvConf= 0 aor= +4986322880835001@tel.t-online.de DEBUG | 20240730-144242.806 | WRAPPER | 25056 | sip_call_manager.cpp:5809 | Disabling TLS server behavior for user id 0000000000C77F24 DEBUG | 20240730-144242.806 | WRAPPER | 25056 | sip_user.cpp:480 | AddOutboundProxyToProfile: Unsetting use of proxy DEBUG | 20240730-144242.806 | Z:APP | 25056 | Account.cpp:1293 | Creating SIP account. Result: 0 DEBUG | 20240730-144242.806 | Z:APP | 25056 | Account.cpp:1347 | Account = +4986322880835001@tel.t-online.de. Set TransportType: 0 DEBUG | 20240730-144242.806 | Z:APP | 25056 | Account.cpp:1367 | Account = +4986322880835001@tel.t-online.de. Set signalling and KPML DEBUG | 20240730-144242.806 | Z:APP | 25056 | Account.cpp:1411 | Account = +4986322880835001@tel.t-online.de. Set authentication username. DEBUG | 20240730-144242.806 | RESIP:DUM | 25056 | UserProfile.cxx:145 | Adding credential: realm=tel.t-online.de user=02342402349232@tel.t-online.de DEBUG | 20240730-144242.806 | WRAPPER | 25056 | sip_user.cpp:480 | AddOutboundProxyToProfile: Unsetting use of proxy DEBUG | 20240730-144242.806 | Z:APP | 25056 | Account.cpp:1436 | Account = +4986322880835001@tel.t-online.de. Set RPORT. DEBUG | 20240730-144242.806 | WRAPPER | 25056 | sip_user.cpp:480 | AddOutboundProxyToProfile: Unsetting use of proxy DEBUG | 20240730-144242.806 | WRAPPER | 25056 | codec_manager.cpp:82 | CodecManager::CreateDefaultProfile: created for codecId: 35 DEBUG | 20240730-144242.806 | Z:APP | 25056 | Codec.cpp:223 | Added codec = 35 UserControl = 2160850819344SetCodecParameters: 4294967294 DEBUG | 20240730-144242.806 | WRAPPER | 25056 | codec_manager.cpp:82 | CodecManager::CreateDefaultProfile: created for codecId: 7 DEBUG | 20240730-144242.806 | Z:APP | 25056 | Codec.cpp:223 | Added codec = 7 UserControl = 2160850819344SetCodecParameters: 4294967294 DEBUG | 20240730-144242.806 | WRAPPER | 25056 | codec_manager.cpp:82 | CodecManager::CreateDefaultProfile: created for codecId: 34 DEBUG | 20240730-144242.806 | Z:APP | 25056 | Codec.cpp:223 | Added codec = 34 UserControl = 2160850819344SetCodecParameters: 0 DEBUG | 20240730-144242.806 | WRAPPER | 25056 | codec_manager.cpp:82 | CodecManager::CreateDefaultProfile: created for codecId: 0 DEBUG | 20240730-144242.806 | Z:APP | 25056 | Codec.cpp:223 | Added codec = 0 UserControl = 2160850819344SetCodecParameters: 4294967294 DEBUG | 20240730-144242.806 | WRAPPER | 25056 | codec_manager.cpp:82 | CodecManager::CreateDefaultProfile: created for codecId: 6 DEBUG | 20240730-144242.806 | Z:APP | 25056 | Codec.cpp:223 | Added codec = 6 UserControl = 2160850819344SetCodecParameters: 4294967294 DEBUG | 20240730-144242.806 | WRAPPER | 25056 | codec_manager.cpp:82 | CodecManager::CreateDefaultProfile: created for codecId: 1 DEBUG | 20240730-144242.806 | Z:APP | 25056 | Codec.cpp:223 | Added codec = 1 UserControl = 2160850819344SetCodecParameters: 4294967294 DEBUG | 20240730-144242.806 | WRAPPER | 25056 | codec_manager.cpp:82 | CodecManager::CreateDefaultProfile: created for codecId: 33 DEBUG | 20240730-144242.806 | Z:APP | 25056 | Codec.cpp:360 | Codec options applied. UserControl = 2160850819344 DEBUG | 20240730-144242.806 | Z:APP | 25056 | STUNOptions.cpp:103 | Creating STUN server : stun.t-online.de3478 DEBUG | 20240730-144242.806 | WRAPPER | 25056 | stun_server.cpp:86 | SetStunRefreshPeriod: New refreshPeriod= 30000 DEBUG | 20240730-144242.806 | WRAPPER | 25056 | stun_server.cpp:582 | Reset INFO | 20240730-144242.806 | WRAPPER | 25056 | stun_server.cpp:798 | SetNetworkType: old type= 255, new type= 255 DEBUG | 20240730-144242.806 | WRAPPER | 25056 | appl_event_queue.cpp:35 | Notify: event= [class scx::CStunNetworkDiscovered] DEBUG | 20240730-144242.806 | WRAPPER | 25056 | stun_server.cpp:808 | SetStunState: old state= NotActive, new state= NotActive DEBUG | 20240730-144242.806 | WRAPPER | 25056 | stun_server.cpp:817 | SetNetDiscoveryState: old state= NotActive, new state= NotActive DEBUG | 20240730-144242.806 | WRAPPER | 25056 | stun_server.cpp:808 | SetStunState: old state= NotActive, new state= ServerResolving DEBUG | 20240730-144242.806 | WRAPPER | 25056 | network_helper.cpp:178 | determineSourceAddress [ V6 :: port=0 ] DEBUG | 20240730-144242.806 | WRAPPER | 25056 | network_helper.cpp:103 | overriding zero port DEBUG | 20240730-144242.806 | WRAPPER | 25056 | network_helper.cpp:109 | overriding ANY ADDR with google dns DEBUG | 20240730-144242.806 | WRAPPER | 25056 | network_helper.cpp:116 | determineSourceAddressUnsafe [ V6 2001:4860:4860::8888 port=8000 ] DEBUG | 20240730-144242.811 | WRAPPER | 25056 | network_helper.cpp:446 | haveInterface: IpVersion 1= 1 DEBUG | 20240730-144242.811 | WRAPPER | 25056 | dns_manager.cpp:42 | DnsRequest: query= stun.t-online.de, tryIPv6= 1 DEBUG | 20240730-144242.811 | WRAPPER | 25056 | dns_result.cpp:409 | Result this= 000001F71CBC70F0 INFO | 20240730-144242.811 | WRAPPER | 25056 | dns_result.cpp:450 | LookUp: Resolving AAAA for stun.t-online.de DEBUG | 20240730-144242.811 | WRAPPER | 25056 | dns_result.cpp:310 | HostResultSink this= 000001F71CB60BE0 DEBUG | 20240730-144242.811 | WRAPPER | 25056 | dns_result.cpp:310 | HostResultSink this= 000001F71CB61900 INFO | 20240730-144242.811 | WRAPPER | 25056 | stun_server.cpp:129 | Disable: old= 0, new= 0 DEBUG | 20240730-144242.811 | WRAPPER | 25056 | stun_server.cpp:145 | SetUseStunOnPrivateIp: old= 0, new= 0 DEBUG | 20240730-144242.811 | WRAPPER | 25056 | sip_call_manager.cpp:6923 | ReplaceUserRegistrationInLock: id= 0000000000C77F24, immediate= 0 WARNING | 20240730-144242.811 | WRAPPER | 25056 | sip_call_manager.cpp:7028 | Ignoring in state 0 DEBUG | 20240730-144242.811 | Z:APP | 25056 | Account.cpp:1001 | Account waiting for custom STUN discovery. Account = +4986322880835001@tel.t-online.de INFO | 20240730-144242.811 | WRAPPER | 25056 | api.cpp:974 | RegisterUser: id= 0000000000C77F24 INFO | 20240730-144242.811 | WRAPPER | 25056 | sip_call_manager.cpp:1265 | RegisterUser 0000000000C77F24 DEBUG | 20240730-144242.811 | WRAPPER | 25056 | sip_call_manager.cpp:1299 | InternalRegisterUser: registering 0000000000C77F24 , userDriven= 1 DEBUG | 20240730-144242.811 | WRAPPER | 25056 | sip_user.cpp:64 | OutboundProxyManager::onRegistrationStart: Not measuring latency DEBUG | 20240730-144242.811 | WRAPPER | 25056 | sip_user.cpp:653 | Register: Waiting for stun discovery to complete DEBUG | 20240730-144242.811 | Z:APP | 25056 | Account.cpp:1124 | Account (+4986322880835001@tel.t-online.de) register request : SIP:+4986322880835001@tel.t-online.de DEBUG | 20240730-144242.811 | Z:APP | 25056 | Video.cpp:196 | Video : Created. DEBUG | 20240730-144242.811 | Z:APP | 25056 | Video.cpp:233 | Video : Refreshing camera devices. DEBUG | 20240730-144242.815 | RESIP:DNS | 23140 | DnsStub.cxx:696 | stun.t-online.de mapped to stun-a01.isp.t-ipnet.de and returned result DEBUG | 20240730-144242.815 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: stun-a01.isp.t-ipnet.de(A)--> 217.0.11.241, stun-a01.isp.t-ipnet.de(A)--> 217.0.136.17, stun-a01.isp.t-ipnet.de(A)--> 217.0.12.17, stun-a01.isp.t-ipnet.de(A)--> 217.0.136.1, stun-a01.isp.t-ipnet.de(A)--> 217.0.12.1, stun-a01.isp.t-ipnet.de(A)--> 217.0.11.225 INFO | 20240730-144242.815 | WRAPPER | 23140 | dns_result.cpp:551 | Resolve RR_A success for stun.t-online.de DEBUG | 20240730-144242.816 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: stun.t-online.de lookup failed: DNS server returned answer with no data DEBUG | 20240730-144242.816 | RESIP:DNS | 23140 | AresDns.cxx:834 | Closing FD 2100 DEBUG | 20240730-144242.816 | RESIP:DNS | 23140 | AresDns.cxx:844 | New UDP socket, FD 2100 DEBUG | 20240730-144242.816 | RESIP:DNS | 23140 | AresDns.cxx:838 | Active FD 2100, readable= 1, writable= 0 DEBUG | 20240730-144242.817 | RESIP:DNS | 23140 | DnsStub.cxx:67 | SRV Result: _sip._udp.tel.t-online.de (SRV) --> p=10 w=0 mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=20 w=0 hno002-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=30 w=0 nes008-f01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144242.817 | RESIP:DNS | 23140 | AresDns.cxx:834 | Closing FD 2100 DEBUG | 20240730-144242.822 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: stun.t-online.de lookup failed: DNS server returned answer with no data DEBUG | 20240730-144242.822 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: stun-a01.isp.t-ipnet.de(A)--> 217.0.11.241, stun-a01.isp.t-ipnet.de(A)--> 217.0.136.17, stun-a01.isp.t-ipnet.de(A)--> 217.0.12.17, stun-a01.isp.t-ipnet.de(A)--> 217.0.136.1, stun-a01.isp.t-ipnet.de(A)--> 217.0.12.1, stun-a01.isp.t-ipnet.de(A)--> 217.0.11.225 INFO | 20240730-144242.822 | WRAPPER | 23140 | dns_result.cpp:551 | Resolve RR_A success for stun.t-online.de DEBUG | 20240730-144242.826 | WRAPPER | 23884 | dns_result.cpp:428 | ~Result this= 000001F71CBC7420 DEBUG | 20240730-144242.826 | WRAPPER | 23884 | dns_result.cpp:315 | ~HostResultSink this= 000001F71CB61220 DEBUG | 20240730-144242.826 | WRAPPER | 23884 | dns_result.cpp:315 | ~HostResultSink this= 000001F71CB61E00 DEBUG | 20240730-144242.826 | WRAPPER | 23884 | stun_server.cpp:913 | InternalStartUsingStun: currentTime= 415727580316000 DEBUG | 20240730-144242.826 | WRAPPER | 23884 | stun_server.cpp:817 | SetNetDiscoveryState: old state= NotActive, new state= Phase1 DEBUG | 20240730-144242.826 | WRAPPER | 23884 | stun_server.cpp:674 | SendStunTest: Sending to tStunDest= [ V4 217.0.11.241:3478 UDP targetDomain=stun.t-online.de ], IsIPv6= 0, StunState= ServerResolving, NetDiscoveryState= Phase1, UdpV6Transport= 000001F71CA6D170, UdpTransport= 000001F71CB025B0 DEBUG | 20240730-144242.826 | WRAPPER | 23884 | stun_server.cpp:808 | SetStunState: old state= ServerResolving, new state= AddressResolving DEBUG | 20240730-144242.828 | RESIP:DNS | 23140 | AresDns.cxx:844 | New UDP socket, FD 3024 DEBUG | 20240730-144242.829 | RESIP:DNS | 23140 | AresDns.cxx:838 | Active FD 3024, readable= 1, writable= 0 DEBUG | 20240730-144242.830 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de lookup failed: DNS server returned answer with no data DEBUG | 20240730-144242.830 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de(A)--> 217.0.148.69 DEBUG | 20240730-144242.831 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: nes008-f01-mav-pc-rt-001.edns.t-ipnet.de lookup failed: DNS server returned answer with no data DEBUG | 20240730-144242.832 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: nes008-f01-mav-pc-rt-001.edns.t-ipnet.de(A)--> 217.0.147.5 DEBUG | 20240730-144242.832 | WRAPPER | 23884 | dns_result.cpp:428 | ~Result this= 000001F71CBC70F0 DEBUG | 20240730-144242.832 | WRAPPER | 23884 | dns_result.cpp:315 | ~HostResultSink this= 000001F71CB60BE0 DEBUG | 20240730-144242.832 | WRAPPER | 23884 | dns_result.cpp:315 | ~HostResultSink this= 000001F71CB61900 DEBUG | 20240730-144242.832 | WRAPPER | 23884 | stun_server.cpp:913 | InternalStartUsingStun: currentTime= 415727586477600 DEBUG | 20240730-144242.832 | WRAPPER | 23884 | stun_server.cpp:817 | SetNetDiscoveryState: old state= NotActive, new state= Phase1 DEBUG | 20240730-144242.832 | WRAPPER | 23884 | stun_server.cpp:674 | SendStunTest: Sending to tStunDest= [ V4 217.0.11.241:3478 UDP targetDomain=stun.t-online.de ], IsIPv6= 0, StunState= ServerResolving, NetDiscoveryState= Phase1, UdpV6Transport= 000001F71CA6D170, UdpTransport= 000001F71CB025B0 DEBUG | 20240730-144242.832 | WRAPPER | 23884 | stun_server.cpp:808 | SetStunState: old state= ServerResolving, new state= AddressResolving DEBUG | 20240730-144242.832 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: hno002-l01-mav-pc-rt-001.edns.t-ipnet.de lookup failed: DNS server returned answer with no data DEBUG | 20240730-144242.834 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: hno002-l01-mav-pc-rt-001.edns.t-ipnet.de(A)--> 217.0.147.197 INFO | 20240730-144242.834 | WRAPPER | 23140 | dns_result.cpp:551 | Resolve RR_A success for tel.t-online.de DEBUG | 20240730-144242.834 | RESIP:DNS | 23140 | AresDns.cxx:834 | Closing FD 3024 DEBUG | 20240730-144242.844 | WRAPPER | 23884 | sip_user.cpp:1510 | onDnsResult: userId= 0000000000C77F24, server= tel.t-online.de resolved= 217.0.148.69 INFO | 20240730-144242.844 | WRAPPER | 23884 | user.cpp:374 | SetResolvedServer: User 0000000000C77F24; oldResolvedServer= 0.0.0.0; newResolvedServer= 217.0.148.69 DEBUG | 20240730-144242.844 | WRAPPER | 23884 | network_helper.cpp:178 | determineSourceAddress [ V4 217.0.148.69:5060 ] DEBUG | 20240730-144242.844 | WRAPPER | 23884 | network_helper.cpp:116 | determineSourceAddressUnsafe [ V4 217.0.148.69:5060 ] INFO | 20240730-144242.848 | WRAPPER | 23884 | user.cpp:392 | SetLocalAddress: User 0000000000C77F24; oldLocalAddress= 0.0.0.0; newLocalAddress= 192.168.178.33 INFO | 20240730-144242.848 | WRAPPER | 23884 | user.cpp:275 | SetIPv6: 0 INFO | 20240730-144242.848 | WRAPPER | 23884 | stun_server.cpp:129 | Disable: old= 0, new= 0 DEBUG | 20240730-144242.848 | WRAPPER | 23884 | dns_result.cpp:428 | ~Result this= 000001F71CBC5880 DEBUG | 20240730-144242.848 | WRAPPER | 23884 | dns_result.cpp:118 | ~SrvResultSink this= 000001F71CA5E280 INFO | 20240730-144242.873 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.11.241; port: 3478 INFO | 20240730-144242.873 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144242.873 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 88 bytes, sent 88 instead INFO | 20240730-144242.873 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.11.241; port: 3478 INFO | 20240730-144242.873 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144242.873 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 88 bytes, sent 88 instead INFO | 20240730-144242.873 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.11.241; port: 3478 INFO | 20240730-144242.873 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144242.873 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 88 bytes, sent 88 instead INFO | 20240730-144242.873 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.11.241; port: 3478 INFO | 20240730-144242.873 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144242.873 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 88 bytes, sent 88 instead DEBUG | 20240730-144242.889 | WRAPPER | 26276 | stun_server.cpp:817 | SetNetDiscoveryState: old state= Phase1, new state= Phase2 DEBUG | 20240730-144242.890 | WRAPPER | 26276 | stun_server.cpp:674 | SendStunTest: Sending to tStunDest= [ V4 217.0.11.242:3478 UDP ], IsIPv6= 0, StunState= AddressResolving, NetDiscoveryState= Phase2, UdpV6Transport= 000001F71CA6D170, UdpTransport= 000001F71CB025B0 DEBUG | 20240730-144242.890 | WRAPPER | 26276 | stun_server.cpp:674 | SendStunTest: Sending to tStunDest= [ V4 217.0.11.242:3479 UDP ], IsIPv6= 0, StunState= AddressResolving, NetDiscoveryState= Phase2, UdpV6Transport= 000001F71CA6D170, UdpTransport= 000001F71CB025B0 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.11.242; port: 3478 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 88 bytes, sent 88 instead DEBUG | 20240730-144242.890 | WRAPPER | 26276 | stun_server.cpp:817 | SetNetDiscoveryState: old state= Phase1, new state= Phase2 DEBUG | 20240730-144242.890 | WRAPPER | 26276 | stun_server.cpp:674 | SendStunTest: Sending to tStunDest= [ V4 217.0.11.242:3478 UDP ], IsIPv6= 0, StunState= AddressResolving, NetDiscoveryState= Phase2, UdpV6Transport= 000001F71CA6D170, UdpTransport= 000001F71CB025B0 DEBUG | 20240730-144242.890 | WRAPPER | 26276 | stun_server.cpp:674 | SendStunTest: Sending to tStunDest= [ V4 217.0.11.242:3479 UDP ], IsIPv6= 0, StunState= AddressResolving, NetDiscoveryState= Phase2, UdpV6Transport= 000001F71CA6D170, UdpTransport= 000001F71CB025B0 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.11.242; port: 3478 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 88 bytes, sent 88 instead INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.11.242; port: 3479 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 88 bytes, sent 88 instead INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.11.242; port: 3479 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 88 bytes, sent 88 instead INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.11.242; port: 3478 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 88 bytes, sent 88 instead INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.11.242; port: 3478 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 88 bytes, sent 88 instead INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.11.242; port: 3479 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144242.890 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 88 bytes, sent 88 instead INFO | 20240730-144242.891 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.11.242; port: 3479 INFO | 20240730-144242.891 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144242.891 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 88 bytes, sent 88 instead DEBUG | 20240730-144242.907 | WRAPPER | 26276 | stun_server.cpp:779 | SetMappedAddress: [ V4 93.216.249.22:50857 UDP ] INFO | 20240730-144242.907 | WRAPPER | 26276 | stun_server.cpp:798 | SetNetworkType: old type= 255, new type= 7 DEBUG | 20240730-144242.907 | WRAPPER | 26276 | appl_event_queue.cpp:35 | Notify: event= [class scx::CStunNetworkDiscovered] DEBUG | 20240730-144242.907 | WRAPPER | 26276 | stun_server.cpp:808 | SetStunState: old state= AddressResolving, new state= AddressAcquired INFO | 20240730-144242.907 | WRAPPER | 26276 | stun_server.cpp:811 | STUN discovery done! Got NAT type= E_NETWORK_NOT_SYMMETRIC_NAT DEBUG | 20240730-144242.907 | WRAPPER | 26276 | stun_server.cpp:817 | SetNetDiscoveryState: old state= Phase2, new state= Done DEBUG | 20240730-144242.910 | WRAPPER | 26276 | stun_server.cpp:779 | SetMappedAddress: [ V4 93.216.249.22:50857 UDP ] INFO | 20240730-144242.910 | WRAPPER | 26276 | stun_server.cpp:798 | SetNetworkType: old type= 255, new type= 7 DEBUG | 20240730-144242.910 | WRAPPER | 26276 | appl_event_queue.cpp:35 | Notify: event= [class scx::CStunNetworkDiscovered] DEBUG | 20240730-144242.910 | WRAPPER | 26276 | stun_server.cpp:808 | SetStunState: old state= AddressResolving, new state= AddressAcquired INFO | 20240730-144242.910 | WRAPPER | 26276 | stun_server.cpp:811 | STUN discovery done! Got NAT type= E_NETWORK_NOT_SYMMETRIC_NAT DEBUG | 20240730-144242.910 | WRAPPER | 26276 | stun_server.cpp:817 | SetNetDiscoveryState: old state= Phase2, new state= Done DEBUG | 20240730-144242.911 | WRAPPER | 23884 | sip_user.cpp:480 | AddOutboundProxyToProfile: Unsetting use of proxy DEBUG | 20240730-144242.911 | WRAPPER | 23884 | app_dialogs.cpp:54 | AppDialogSet 000001F71CAA99D0 DEBUG | 20240730-144242.911 | WRAPPER | 23884 | app_dialogs.cpp:60 | User id= 0000000000C77F24 DEBUG | 20240730-144242.911 | RESIP:DUM | 23884 | BaseCreator.cxx:156 | BaseCreator::makeInitialRequest: REGISTER sip:+4986322880835001@tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/ ;branch=z9hG4bK-524287-1---655cbb18b78ebf9d;rport Max-Forwards: 70 Contact: To: From: ;tag=a208f206 Call-ID: iWqP-Jbw-ZvTOKLDeWVFJQ.. CSeq: 1 REGISTER Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 DEBUG | 20240730-144242.911 | RESIP:DUM | 23884 | RegistrationCreator.cxx:27 | RegistrationCreator::RegistrationCreator: 000001F71CA53530 DEBUG | 20240730-144242.911 | RESIP:DUM | 23884 | DialogSet.cxx:54 | ************* Created DialogSet(UAC) -- iWqP-Jbw-ZvTOKLDeWVFJQ..-a208f206************* DEBUG | 20240730-144242.911 | WRAPPER | 23884 | appl_event_queue.cpp:35 | Notify: event= [class scx::CRegistrationStarting] DEBUG | 20240730-144242.911 | RESIP:DUM | 23884 | DialogUsageManager.cxx:1011 | SEND: REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP ;branch=z9hG4bK-524287-1---a0e043b8b670e22d;rport Max-Forwards: 70 Contact: To: From: ;tag=a208f206 Call-ID: iWqP-Jbw-ZvTOKLDeWVFJQ.. CSeq: 1 REGISTER Expires: 60 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 DEBUG | 20240730-144242.911 | RESIP:DUM | 23884 | DialogId.cxx:50 | DialogId::DialogId: iWqP-Jbw-ZvTOKLDeWVFJQ..-a208f206- DEBUG | 20240730-144242.911 | RESIP:DUM | 23884 | DialogUsageManager.cxx:1172 | Send: SipReq: REGISTER tel.t-online.de tid=a0e043b8b670e22d cseq=1 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 1 from(tu) DEBUG | 20240730-144242.911 | RESIP | 23884 | SipStack.cxx:862 | SEND: SipReq: REGISTER tel.t-online.de tid=a0e043b8b670e22d cseq=1 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 1 from(tu) DEBUG | 20240730-144242.911 | WRAPPER | 23884 | sip_user.cpp:1495 | SetState: userId = 0000000000C77F24 - USER_UNREGISTERED -> USER_REGISTERING DEBUG | 20240730-144243.011 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer F tid=a0e043b8b670e22d ms=2000 DEBUG | 20240730-144243.011 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:606 | Looking up dns entries for sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144243.011 | RESIP:DNS | 26276 | DnsResult.cxx:262 | DnsResult::lookup sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144243.011 | RESIP:DNS | 23140 | DnsStub.cxx:67 | SRV Result: _sip._udp.tel.t-online.de (SRV) --> p=10 w=0 mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=20 w=0 hno002-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=30 w=0 nes008-f01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144243.011 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de(A)--> 217.0.148.69 DEBUG | 20240730-144243.011 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de lookup failed: DNS server returned answer with no data DEBUG | 20240730-144243.111 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer E1 tid=a0e043b8b670e22d ms=500 DEBUG | 20240730-144243.111 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:728 | TransportSelector::findTransportByVia: source: [ V4 0.0.0.0:0 UDP ] DEBUG | 20240730-144243.111 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1615 | findTransportBySource([ V4 0.0.0.0:0 UDP ]) DEBUG | 20240730-144243.111 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1633 | should port be ignored: 1 DEBUG | 20240730-144243.111 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1696 | findTransport (any port, any interface) => Transport: [ V4 0.0.0.0:50857 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144243.111 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1054 | Found transport: [ V4 0.0.0.0:50857 UDP ] DEBUG | 20240730-144243.119 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:985 | Looked up source for destination: [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de ] -> [ V4 192.168.178.33:0 UDP targetDomain=tel.t-online.de ] sent-by= sent-port=0 DEBUG | 20240730-144243.120 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1405 | Transmitting to [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de transportKey=1 ] tlsDomain= via [ V4 192.168.178.33:50857 UDP targetDomain=tel.t-online.de ] REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP 192.168.178.33:50857;branch=z9hG4bK-524287-1---a0e043b8b670e22d;rport Max-Forwards: 70 Contact: To: From: ;tag=a208f206 Call-ID: iWqP-Jbw-ZvTOKLDeWVFJQ.. CSeq: 1 REGISTER Expires: 60 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 sigcomp id= INFO | 20240730-144243.120 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.148.69; port: 5060 INFO | 20240730-144243.120 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144243.120 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 745 bytes, sent 745 instead DEBUG | 20240730-144243.165 | RESIP:TRANSPORT | 26276 | Transport.cxx:397 | incoming from: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144243.165 | RESIP:TRANSACTION | 26276 | TuSelector.cxx:73 | Send to TU: DialogUsageManager size=0 SIP/2.0 423 Interval Too Brief Via: SIP/2.0/UDP 192.168.178.33:50857;received=93.216.249.22;branch=z9hG4bK-524287-1---a0e043b8b670e22d;rport=50857 To: ;tag=029C57715001-2075-b0053700-89c5995-66a8dfc3-a9c81 From: ;tag=a208f206 Call-ID: iWqP-Jbw-ZvTOKLDeWVFJQ.. CSeq: 1 REGISTER Min-Expires: 480 Content-Length: 0 DEBUG | 20240730-144243.165 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer K tid=a0e043b8b670e22d ms=5000 DEBUG | 20240730-144243.165 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting _sip._udp.tel.t-online.de(33): mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144243.165 | RESIP:DNS | 23140 | RRVip.cxx:194 | Creating a new SRV transform formue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144243.165 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting tel.t-online.de(1): 217.0.148.69 DEBUG | 20240730-144243.165 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1627 | Got: SipResp: 423 tid=a0e043b8b670e22d cseq=1 REGISTER / 1 from(wire) DEBUG | 20240730-144243.165 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1641 | DialogUsageManager::process: found SipMessage DEBUG | 20240730-144243.165 | RESIP:DUM | 26276 | DialogUsageManager.cxx:2177 | DialogUsageManager::processResponse: SipResp: 423 tid=a0e043b8b670e22d cseq=1 REGISTER / 1 from(wire) DEBUG | 20240730-144243.165 | RESIP:DUM | 26276 | DialogId.cxx:50 | DialogId::DialogId: iWqP-Jbw-ZvTOKLDeWVFJQ..-a208f206-029C57715001-2075-b0053700-89c5995-66a8dfc3-a9c81 DEBUG | 20240730-144243.165 | RESIP:DUM | 26276 | KeepAliveManager.cxx:26 | First keep alive for id=0: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ], interval=30s, supportsOutbound=false DEBUG | 20240730-144243.165 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:124 | Adding application timer: KeepAliveTimeout[ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ](0) ms=30000 DEBUG | 20240730-144243.165 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1011 | SEND: REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP ;branch=z9hG4bK-524287-1---2e5b32422563344a;rport Max-Forwards: 70 Contact: To: From: ;tag=a208f206 Call-ID: iWqP-Jbw-ZvTOKLDeWVFJQ.. CSeq: 2 REGISTER Expires: 480 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 DEBUG | 20240730-144243.165 | RESIP:DUM | 26276 | DialogId.cxx:50 | DialogId::DialogId: iWqP-Jbw-ZvTOKLDeWVFJQ..-a208f206- DEBUG | 20240730-144243.165 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1172 | Send: SipReq: REGISTER tel.t-online.de tid=2e5b32422563344a cseq=2 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 2 from(tu) DEBUG | 20240730-144243.165 | RESIP | 26276 | SipStack.cxx:862 | SEND: SipReq: REGISTER tel.t-online.de tid=2e5b32422563344a cseq=2 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 2 from(tu) DEBUG | 20240730-144243.165 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer F tid=2e5b32422563344a ms=2000 DEBUG | 20240730-144243.165 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:606 | Looking up dns entries for sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144243.165 | RESIP:DNS | 26276 | DnsResult.cxx:262 | DnsResult::lookup sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144243.165 | RESIP:DNS | 23140 | DnsStub.cxx:67 | SRV Result: _sip._udp.tel.t-online.de (SRV) --> p=10 w=0 mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=20 w=0 hno002-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=30 w=0 nes008-f01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144243.165 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de(A)--> 217.0.148.69 DEBUG | 20240730-144243.165 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de lookup failed: DNS server returned answer with no data DEBUG | 20240730-144243.253 | Z:APP | 25056 | Video.cpp:248 | Video : Device - 0 - Integrated Camera DEBUG | 20240730-144243.254 | Z:APP | 25056 | VideoServer.cpp:412 | Video server : Created. DEBUG | 20240730-144243.254 | Z:APP | 25056 | VideoServer.cpp:439 | Video server : Bound to port - 62127 DEBUG | 20240730-144243.254 | Z:APP | 25056 | WorkerThread.cpp:27 | Starting thread with description "Video server" DEBUG | 20240730-144243.254 | Z:APP | 25056 | WorkerThread.cpp:31 | Starting thread with description "Video server" suceeded. 2160841812232 -> 5156542034907288322 DEBUG | 20240730-144243.254 | Z:APP | 25056 | VideoOptions.cpp:149 | Video options. Set video options. DEBUG | 20240730-144243.254 | Z:APP | 25056 | ChatOptions.cpp:105 | Audio options. Set new message sound file. INFO | 20240730-144243.254 | WRAPPER | 25056 | audio_manager.cpp:373 | AddSoundFromWav: 00007FF69D276B58, file= NewMessage.wav, repeat= 0, pauseMs= 0, async= 1 DEBUG | 20240730-144243.254 | WRAPPER | 25056 | wav_loader.cpp:222 | Load (async) 000001F71C2BE3C0, name= NewMessage.wav, repeat= 0, pauseMs= 0, handler= 000001F71C3BE2D0 DEBUG | 20240730-144243.254 | Z:APP | 22912 | WorkerThread.cpp:70 | Thread with description "Video server" running DEBUG | 20240730-144243.254 | Z:APP | 22912 | VideoServer.cpp:536 | Video server thread started. DEBUG | 20240730-144243.254 | WRAPPER | 25056 | wav_file.cpp:36 | WavFile: NewMessage.wav, valid = 1 DEBUG | 20240730-144243.254 | WRAPPER | 25056 | wav_loader.cpp:19 | Job 000001F71CBA6620 file= NewMessage.wav handler= 000001F71C3BE2D0 DEBUG | 20240730-144243.254 | WRAPPER | 25056 | wav_file.cpp:50 | LoadHeaders DEBUG | 20240730-144243.254 | WRAPPER | 25056 | wav_file.cpp:67 | Chunk: RIFF DEBUG | 20240730-144243.254 | WRAPPER | 25056 | wav_file.cpp:185 | RIFF: Type WAVE DEBUG | 20240730-144243.254 | WRAPPER | 25056 | wav_loader.cpp:54 | Creating SoundBuffer with format: PCM16, 9792 @ 8000 Hz, mono DEBUG | 20240730-144243.254 | WRAPPER | 25056 | wav_loader.cpp:231 | Job prepated: 000001F71CBA6620, sound Id= 0000000000C77F3F, format= PCM16, 9792 @ 8000 Hz, mono DEBUG | 20240730-144243.254 | WRAPPER | 25056 | wav_loader.cpp:237 | Starting thread 000001F71C2BE3C0 INFO | 20240730-144243.254 | WRAPPER | 25056 | audio_manager.cpp:411 | SoundHandler= 0000000000C77F3F DEBUG | 20240730-144243.254 | Z:APP | 25056 | HistoryService.cpp:600 | History started resetting common details for service (Zoiper5 Contact Service). DEBUG | 20240730-144243.254 | Z:APP | 25056 | HistoryService.cpp:612 | History finished resetting common details for service (Zoiper5 Contact Service). DEBUG | 20240730-144243.255 | WRAPPER | 23300 | wav_loader.cpp:254 | WavLoader::thread started 000001F71C2BE3C0 DEBUG | 20240730-144243.255 | WRAPPER | 23300 | wav_loader.cpp:268 | Processing 000001F71C2BE3C0 job 0000000000C77F3F, 000001F71CBA6620 DEBUG | 20240730-144243.255 | WRAPPER | 23300 | wav_loader.cpp:271 | Job 0000000000C77F3F completed successfully DEBUG | 20240730-144243.255 | WRAPPER | 23300 | appl_event_queue.cpp:35 | Notify: event= [class scx::CSoundLoadCompleted] DEBUG | 20240730-144243.255 | WRAPPER | 23300 | wav_loader.cpp:63 | ~Job 000001F71CBA6620 DEBUG | 20240730-144243.255 | WRAPPER | 23300 | wav_file.cpp:44 | ~WavFile DEBUG | 20240730-144243.255 | Z:APP | 25056 | ContactService.cpp:583 | Contact service (Zoiper5 Contact Service) created. DEBUG | 20240730-144243.255 | Z:APP | 25056 | ContactService.cpp:263 | Contact service (Zoiper5 Contact Service) status changed (2) DEBUG | 20240730-144243.255 | Z:APP | 25056 | ContactService.cpp:558 | History filter refresh request because of a contact service settings change grouped by (2). DEBUG | 20240730-144243.255 | Z:APP | 25056 | ContactService.cpp:450 | Contact service (Zoiper5 Contact Service) registered ERR | 20240730-144243.256 | UTILS | 25056 | os_win.cpp:851 | Failed ReadPhysicalDriveInNTWithAdminRights ERR | 20240730-144243.256 | UTILS | 25056 | os_win.cpp:861 | Failed ReadIdeDriveAsScsiDriveInNT DEBUG | 20240730-144243.256 | Z:APP | 25056 | WorkerThread.cpp:27 | Starting thread with description "Check for updates thread" DEBUG | 20240730-144243.256 | Z:APP | 25056 | WorkerThread.cpp:31 | Starting thread with description "Check for updates thread" suceeded. 2160842357904 -> 2153324467979300214 DEBUG | 20240730-144243.256 | Z:APP | 22908 | WorkerThread.cpp:70 | Thread with description "Check for updates thread" running DEBUG | 20240730-144243.256 | Z:APP | 22908 | UpDown.cpp:299 | GET https://cert.zoiper.com/versions/check_for_updates?build=Zoiper5%205.6.4%20for%20Windows%2064bit&id=14CC3F5EE7B58DDA1674DE353F52E59BD88D751E&activated=no&os=Windows ERR | 20240730-144243.256 | Z:APP | 22908 | UpDown.cpp:67 | Failed to get proxy configuration. DEBUG | 20240730-144243.266 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer E1 tid=2e5b32422563344a ms=500 DEBUG | 20240730-144243.266 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:728 | TransportSelector::findTransportByVia: source: [ V4 0.0.0.0:0 UDP ] DEBUG | 20240730-144243.266 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1615 | findTransportBySource([ V4 0.0.0.0:0 UDP ]) DEBUG | 20240730-144243.266 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1633 | should port be ignored: 1 DEBUG | 20240730-144243.266 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1696 | findTransport (any port, any interface) => Transport: [ V4 0.0.0.0:50857 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144243.266 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1054 | Found transport: [ V4 0.0.0.0:50857 UDP ] DEBUG | 20240730-144243.273 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:985 | Looked up source for destination: [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de ] -> [ V4 192.168.178.33:0 UDP targetDomain=tel.t-online.de ] sent-by= sent-port=0 DEBUG | 20240730-144243.273 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1405 | Transmitting to [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de transportKey=1 ] tlsDomain= via [ V4 192.168.178.33:50857 UDP targetDomain=tel.t-online.de ] REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP 192.168.178.33:50857;branch=z9hG4bK-524287-1---2e5b32422563344a;rport Max-Forwards: 70 Contact: To: From: ;tag=a208f206 Call-ID: iWqP-Jbw-ZvTOKLDeWVFJQ.. CSeq: 2 REGISTER Expires: 480 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 sigcomp id= INFO | 20240730-144243.273 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.148.69; port: 5060 INFO | 20240730-144243.274 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144243.274 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 746 bytes, sent 746 instead DEBUG | 20240730-144243.312 | Z:APP | 25056 | HistoryFilter.cpp:230 | History filter (Z825c16a1b741bb995797f0a5) started (limit = 20; groupMode = 2). DEBUG | 20240730-144243.313 | Z:APP | 25056 | HistoryFilter.cpp:230 | History filter (Ze8d51caad2b0d70fbc6de23) started (limit = 20; groupMode = 2). DEBUG | 20240730-144243.313 | Z:APP | 25056 | HistoryFilter.cpp:230 | History filter (Z6d4379137c1d70a296ebd68) started (limit = 20; groupMode = 2). INFO | 20240730-144243.336 | Z:APP | 25056 | STUN.cpp:47 | Network discovered for STUN = stun.t-online.de; STUN server in not working properly (result = 255) INFO | 20240730-144243.336 | Z:APP | 25056 | STUN.cpp:47 | Network discovered for STUN = stun.t-online.de; STUN server in not working properly (result = 255) INFO | 20240730-144243.336 | Z:APP | 25056 | STUN.cpp:47 | Network discovered for STUN = stun.t-online.de; UNKNOWN (result = 7) INFO | 20240730-144243.336 | Z:APP | 25056 | STUN.cpp:47 | Network discovered for STUN = stun.t-online.de; UNKNOWN (result = 7) DEBUG | 20240730-144243.364 | Z:APP | 25056 | HistoryService.cpp:414 | History add account elapsed time = 13ms DEBUG | 20240730-144243.369 | RESIP:TRANSPORT | 26276 | Transport.cxx:397 | incoming from: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144243.369 | RESIP:TRANSACTION | 26276 | TuSelector.cxx:73 | Send to TU: DialogUsageManager size=0 SIP/2.0 600 Busy Everywhere Via: SIP/2.0/UDP 192.168.178.33:50857;received=93.216.249.22;branch=z9hG4bK-524287-1---2e5b32422563344a;rport=50857 To: ;tag=mavodi-0-51-33d-2-ffffff-bcd-ffffffffffffffff-0-0-_024282337F33-465b-fd3b5700-3e2752-66a8dfc3-d8404 From: ;tag=a208f206 Call-ID: iWqP-Jbw-ZvTOKLDeWVFJQ.. CSeq: 2 REGISTER Reason: SIP;cause=600;text="CC_DIAM_NO_MANDATORY_CAPABILITY_MATCHED_SCSCF" Content-Length: 0 DEBUG | 20240730-144243.370 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer K tid=2e5b32422563344a ms=5000 DEBUG | 20240730-144243.370 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1627 | Got: SipResp: 600 tid=2e5b32422563344a cseq=2 REGISTER / 2 from(wire) DEBUG | 20240730-144243.370 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1641 | DialogUsageManager::process: found SipMessage DEBUG | 20240730-144243.370 | RESIP:DUM | 26276 | DialogUsageManager.cxx:2177 | DialogUsageManager::processResponse: SipResp: 600 tid=2e5b32422563344a cseq=2 REGISTER / 2 from(wire) DEBUG | 20240730-144243.370 | RESIP:DUM | 26276 | DialogId.cxx:50 | DialogId::DialogId: iWqP-Jbw-ZvTOKLDeWVFJQ..-a208f206-mavodi-0-51-33d-2-ffffff-bcd-ffffffffffffffff-0-0-_024282337F33-465b-fd3b5700-3e2752-66a8dfc3-d8404 INFO | 20240730-144243.370 | WRAPPER | 26276 | sip_call_manager.cpp:3645 | onFailure: user id= 0000000000C77F24 response= SipResp: 600 tid=2e5b32422563344a cseq=2 REGISTER / 2 from(wire) INFO | 20240730-144243.370 | WRAPPER | 26276 | sip_call_manager.cpp:6198 | TerminateUserConnection: Invalid transport= 3 for userId= 0000000000C77F24 INFO | 20240730-144243.370 | WRAPPER | 26276 | sip_call_manager.cpp:3699 | Notifying onUserRegistrationFailure( 0000000000C77F24, 1 ) DEBUG | 20240730-144243.370 | WRAPPER | 26276 | appl_event_queue.cpp:35 | Notify: event= [class scx::CUserRegistrationFailure] DEBUG | 20240730-144243.370 | WRAPPER | 26276 | sip_user.cpp:1495 | SetState: userId = 0000000000C77F24 - USER_REGISTERING -> USER_LOCALRETRY INFO | 20240730-144243.370 | WRAPPER | 26276 | sip_call_manager.cpp:3713 | onFailure: will retry automatically after 2 seconds DEBUG | 20240730-144243.370 | WRAPPER | 26276 | appl_event_queue.cpp:35 | Notify: event= [class scx::CRegistrationRetrying] DEBUG | 20240730-144243.370 | RESIP:DUM | 26276 | ClientRegistration.cxx:74 | ClientRegistration::~ClientRegistration DEBUG | 20240730-144243.370 | RESIP:DUM | 26276 | KeepAliveManager.cxx:78 | Last association removed for keep alive id=0: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144243.370 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting _sip._udp.tel.t-online.de(33): mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144243.370 | RESIP:DNS | 23140 | RRVip.cxx:128 | updating an existing vip: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 with mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144243.370 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting tel.t-online.de(1): 217.0.148.69 DEBUG | 20240730-144243.370 | RESIP:DUM | 26276 | DialogSet.cxx:124 | ********** DialogSet::~DialogSet: iWqP-Jbw-ZvTOKLDeWVFJQ..-a208f206************* DEBUG | 20240730-144243.370 | RESIP:DNS | 23140 | RRVip.cxx:128 | updating an existing vip: 217.0.148.69 with 217.0.148.69 DEBUG | 20240730-144243.370 | WRAPPER | 26276 | app_dialogs.cpp:67 | ~AppDialogSet 000001F71CAA99D0 user= 0000000000C77F24 call= FFFFFFFFFFFFFFFF DEBUG | 20240730-144243.377 | Z:APP | 25056 | HistoryService.cpp:157 | History add/update elapsed time = 13ms DEBUG | 20240730-144243.391 | Z:APP | 25056 | HistoryService.cpp:414 | History add account elapsed time = 13ms DEBUG | 20240730-144243.400 | Z:APP | 25056 | HistoryService.cpp:414 | History add account elapsed time = 8ms DEBUG | 20240730-144243.401 | Z:APP | 25056 | Sound.cpp:246 | OnSoundLoadCompleted: status = 0, causeCode = 39 ERR | 20240730-144243.401 | Z:APP | 25056 | User.cpp:110 | Account (+4986322880835001@tel.t-online.de) - register failed (Busy Everywhere) : SIP:+4986322880835001 DEBUG | 20240730-144243.421 | Z:APP | 25056 | HistoryService.cpp:414 | History add account elapsed time = 6ms DEBUG | 20240730-144243.427 | Z:APP | 25056 | HistoryService.cpp:157 | History add/update elapsed time = 6ms DEBUG | 20240730-144243.428 | Z:APP | 25056 | Account.cpp:2579 | Account = +4986322880835001@tel.t-online.de history new count updated from -1 to 1 DEBUG | 20240730-144243.429 | Z:APP | 25056 | HistoryCountFilter.cpp:48 | Count filter (2160842358800) (+4986322880835001@tel.t-online.de) search started. DEBUG | 20240730-144243.429 | Z:APP | 25056 | Phone.Account.cpp:173 | History filter refresh request because of an account succesful registeration grouped by (3). ERR | 20240730-144243.429 | Z:APP | 25056 | User.cpp:86 | Account (+4986322880835001@tel.t-online.de) - retry registration in 2seconds : SIP:+4986322880835001 DEBUG | 20240730-144243.429 | Z:APP | 25056 | HistoryService.cpp:99 | History refreshing filters grouped by (2). DEBUG | 20240730-144243.429 | Z:APP | 25056 | HistoryService.cpp:99 | History refreshing filters grouped by (3). DEBUG | 20240730-144243.429 | Z:APP | 25056 | ContactService.cpp:263 | Contact service (Zoiper5 Contact Service) status changed (3) DEBUG | 20240730-144243.430 | Z:APP | 25056 | HistoryFilter.cpp:365 | History filter (Z825c16a1b741bb995797f0a5) finished (limit = 20; groupMode = 2; count = 0 DEBUG | 20240730-144243.430 | Z:APP | 25056 | HistoryFilter.cpp:368 | History filter (Z825c16a1b741bb995797f0a5) elapsed time = 118ms DEBUG | 20240730-144243.431 | Z:APP | 25056 | HistoryFilter.cpp:365 | History filter (Ze8d51caad2b0d70fbc6de23) finished (limit = 20; groupMode = 2; count = 0 DEBUG | 20240730-144243.431 | Z:APP | 25056 | HistoryFilter.cpp:368 | History filter (Ze8d51caad2b0d70fbc6de23) elapsed time = 118ms DEBUG | 20240730-144243.431 | Z:APP | 25056 | HistoryFilter.cpp:365 | History filter (Z6d4379137c1d70a296ebd68) finished (limit = 20; groupMode = 2; count = 0 DEBUG | 20240730-144243.431 | Z:APP | 25056 | HistoryFilter.cpp:368 | History filter (Z6d4379137c1d70a296ebd68) elapsed time = 118ms DEBUG | 20240730-144243.431 | Z:APP | 25056 | Account.cpp:2579 | Account = +4986322880835001@tel.t-online.de history new count updated from 1 to 44 DEBUG | 20240730-144243.432 | Z:APP | 25056 | HistoryCountFilter.cpp:126 | Count filter (2160842358800) (+4986322880835001@tel.t-online.de) search finished. DEBUG | 20240730-144243.432 | Z:APP | 25056 | HistoryCountFilter.cpp:129 | Count filter (2160842358800) elapsed time = 3ms ERR | 20240730-144243.432 | Z:APP | 25056 | XServiceContext.cpp:62 | Cannot cancel deferred group call DEBUG | 20240730-144243.444 | Z:APP | 25056 | ContainerWindow_Windows.cpp:97 | Size : Setting max size x = -1; y = -1 DEBUG | 20240730-144243.456 | Z:APP | 25056 | ContainerWindow_Windows.cpp:98 | Size : Requested max size x = -1; y = -1 DEBUG | 20240730-144243.456 | Z:APP | 25056 | ContainerWindow_Windows.cpp:81 | Size : Setting min size x = 300; y = 690 DEBUG | 20240730-144243.456 | Z:APP | 25056 | ContainerWindow_Windows.cpp:82 | Size : Requested min size x = 240; y = 552 DEBUG | 20240730-144243.456 | Z:APP | 25056 | ContainerWindow_Windows.cpp:72 | Size : Setting client size x = 300; y = 690 DEBUG | 20240730-144243.456 | Z:APP | 25056 | ContainerWindow_Windows.cpp:73 | Size : Reqested size x = 240; y = 552 DEBUG | 20240730-144243.614 | XSVC | 26588 | Local.cpp:288 | Query begin DEBUG | 20240730-144243.614 | XSVC | 26588 | Local.cpp:302 | Query complete ERR | 20240730-144243.614 | Z:APP | 25056 | XServiceContext.cpp:62 | Cannot cancel deferred group call DEBUG | 20240730-144243.614 | Z:APP | 25056 | Contacts.cpp:511 | CONTACTS : Filter completed; Service name = Zoiper5 Contact Service; Total contact count = 0 DEBUG | 20240730-144246.515 | Z:APP | 25056 | ContainerWindow_Windows.cpp:81 | Size : Setting min size x = 1050; y = 690 DEBUG | 20240730-144246.529 | Z:APP | 25056 | ContainerWindow_Windows.cpp:82 | Size : Requested min size x = 840; y = 552 DEBUG | 20240730-144246.529 | Z:APP | 25056 | ContainerWindow_Windows.cpp:72 | Size : Setting client size x = 1050; y = 690 DEBUG | 20240730-144246.529 | Z:APP | 25056 | ContainerWindow_Windows.cpp:73 | Size : Reqested size x = 840; y = 552 DEBUG | 20240730-144247.384 | WRAPPER | 23884 | sip_call_manager.cpp:3721 | Retrying registration for user 0000000000C77F24 DEBUG | 20240730-144247.384 | WRAPPER | 23884 | sip_call_manager.cpp:1299 | InternalRegisterUser: registering 0000000000C77F24 , userDriven= 0 DEBUG | 20240730-144247.384 | WRAPPER | 23884 | sip_user.cpp:480 | AddOutboundProxyToProfile: Unsetting use of proxy DEBUG | 20240730-144247.384 | WRAPPER | 23884 | app_dialogs.cpp:54 | AppDialogSet 000001F71C252BA0 DEBUG | 20240730-144247.384 | WRAPPER | 23884 | app_dialogs.cpp:60 | User id= 0000000000C77F24 DEBUG | 20240730-144247.384 | RESIP:DUM | 23884 | BaseCreator.cxx:156 | BaseCreator::makeInitialRequest: REGISTER sip:+4986322880835001@tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/ ;branch=z9hG4bK-524287-1---72ff70e4a23ee739;rport Max-Forwards: 70 Contact: To: From: ;tag=ad471d29 Call-ID: nQNN2BudI2jLpCiyKNzdZw.. CSeq: 1 REGISTER Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 DEBUG | 20240730-144247.384 | RESIP:DUM | 23884 | RegistrationCreator.cxx:27 | RegistrationCreator::RegistrationCreator: 000001F71C3C5630 DEBUG | 20240730-144247.384 | RESIP:DUM | 23884 | DialogSet.cxx:54 | ************* Created DialogSet(UAC) -- nQNN2BudI2jLpCiyKNzdZw..-ad471d29************* DEBUG | 20240730-144247.384 | WRAPPER | 23884 | appl_event_queue.cpp:35 | Notify: event= [class scx::CRegistrationStarting] DEBUG | 20240730-144247.384 | RESIP:DUM | 23884 | DialogUsageManager.cxx:1011 | SEND: REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP ;branch=z9hG4bK-524287-1---be4e1d3d69b6d98c;rport Max-Forwards: 70 Contact: To: From: ;tag=ad471d29 Call-ID: nQNN2BudI2jLpCiyKNzdZw.. CSeq: 1 REGISTER Expires: 60 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 DEBUG | 20240730-144247.384 | RESIP:DUM | 23884 | DialogId.cxx:50 | DialogId::DialogId: nQNN2BudI2jLpCiyKNzdZw..-ad471d29- DEBUG | 20240730-144247.384 | RESIP:DUM | 23884 | DialogUsageManager.cxx:1172 | Send: SipReq: REGISTER tel.t-online.de tid=be4e1d3d69b6d98c cseq=1 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 1 from(tu) DEBUG | 20240730-144247.384 | RESIP | 23884 | SipStack.cxx:862 | SEND: SipReq: REGISTER tel.t-online.de tid=be4e1d3d69b6d98c cseq=1 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 1 from(tu) DEBUG | 20240730-144247.384 | WRAPPER | 23884 | sip_user.cpp:1495 | SetState: userId = 0000000000C77F24 - USER_LOCALRETRY -> USER_REGISTERING DEBUG | 20240730-144247.414 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer F tid=be4e1d3d69b6d98c ms=4000 DEBUG | 20240730-144247.414 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:606 | Looking up dns entries for sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144247.414 | RESIP:DNS | 26276 | DnsResult.cxx:262 | DnsResult::lookup sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144247.414 | RESIP:DNS | 23140 | DnsStub.cxx:67 | SRV Result: _sip._udp.tel.t-online.de (SRV) --> p=10 w=0 mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=20 w=0 hno002-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=30 w=0 nes008-f01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144247.414 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de(A)--> 217.0.148.69 DEBUG | 20240730-144247.414 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de lookup failed: DNS server returned answer with no data DEBUG | 20240730-144247.522 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer E1 tid=be4e1d3d69b6d98c ms=500 DEBUG | 20240730-144247.522 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:728 | TransportSelector::findTransportByVia: source: [ V4 0.0.0.0:0 UDP ] DEBUG | 20240730-144247.522 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1615 | findTransportBySource([ V4 0.0.0.0:0 UDP ]) DEBUG | 20240730-144247.522 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1633 | should port be ignored: 1 DEBUG | 20240730-144247.522 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1696 | findTransport (any port, any interface) => Transport: [ V4 0.0.0.0:50857 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144247.522 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1054 | Found transport: [ V4 0.0.0.0:50857 UDP ] DEBUG | 20240730-144247.527 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:985 | Looked up source for destination: [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de ] -> [ V4 192.168.178.33:0 UDP targetDomain=tel.t-online.de ] sent-by= sent-port=0 DEBUG | 20240730-144247.527 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1405 | Transmitting to [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de transportKey=1 ] tlsDomain= via [ V4 192.168.178.33:50857 UDP targetDomain=tel.t-online.de ] REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP 192.168.178.33:50857;branch=z9hG4bK-524287-1---be4e1d3d69b6d98c;rport Max-Forwards: 70 Contact: To: From: ;tag=ad471d29 Call-ID: nQNN2BudI2jLpCiyKNzdZw.. CSeq: 1 REGISTER Expires: 60 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 sigcomp id= INFO | 20240730-144247.527 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.148.69; port: 5060 INFO | 20240730-144247.527 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144247.527 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 745 bytes, sent 745 instead DEBUG | 20240730-144247.591 | RESIP:TRANSPORT | 26276 | Transport.cxx:397 | incoming from: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144247.591 | RESIP:TRANSACTION | 26276 | TuSelector.cxx:73 | Send to TU: DialogUsageManager size=0 SIP/2.0 423 Interval Too Brief Via: SIP/2.0/UDP 192.168.178.33:50857;received=93.216.249.22;branch=z9hG4bK-524287-1---be4e1d3d69b6d98c;rport=50857 To: ;tag=029C57715001-2075-b0053700-89c59ed-66a8dfc8-1dadd From: ;tag=ad471d29 Call-ID: nQNN2BudI2jLpCiyKNzdZw.. CSeq: 1 REGISTER Min-Expires: 480 Content-Length: 0 DEBUG | 20240730-144247.591 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting _sip._udp.tel.t-online.de(33): mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144247.591 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer K tid=be4e1d3d69b6d98c ms=5000 DEBUG | 20240730-144247.591 | RESIP:DNS | 23140 | RRVip.cxx:128 | updating an existing vip: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 with mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144247.591 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting tel.t-online.de(1): 217.0.148.69 DEBUG | 20240730-144247.591 | RESIP:DNS | 23140 | RRVip.cxx:128 | updating an existing vip: 217.0.148.69 with 217.0.148.69 DEBUG | 20240730-144247.591 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1627 | Got: SipResp: 423 tid=be4e1d3d69b6d98c cseq=1 REGISTER / 1 from(wire) DEBUG | 20240730-144247.591 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1641 | DialogUsageManager::process: found SipMessage DEBUG | 20240730-144247.591 | RESIP:DUM | 26276 | DialogUsageManager.cxx:2177 | DialogUsageManager::processResponse: SipResp: 423 tid=be4e1d3d69b6d98c cseq=1 REGISTER / 1 from(wire) DEBUG | 20240730-144247.591 | RESIP:DUM | 26276 | DialogId.cxx:50 | DialogId::DialogId: nQNN2BudI2jLpCiyKNzdZw..-ad471d29-029C57715001-2075-b0053700-89c59ed-66a8dfc8-1dadd DEBUG | 20240730-144247.591 | RESIP:DUM | 26276 | KeepAliveManager.cxx:26 | First keep alive for id=1: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ], interval=30s, supportsOutbound=false DEBUG | 20240730-144247.591 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:124 | Adding application timer: KeepAliveTimeout[ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ](1) ms=30000 DEBUG | 20240730-144247.591 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1011 | SEND: REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP ;branch=z9hG4bK-524287-1---46543d9017f2d3c2;rport Max-Forwards: 70 Contact: To: From: ;tag=ad471d29 Call-ID: nQNN2BudI2jLpCiyKNzdZw.. CSeq: 2 REGISTER Expires: 480 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 DEBUG | 20240730-144247.591 | RESIP:DUM | 26276 | DialogId.cxx:50 | DialogId::DialogId: nQNN2BudI2jLpCiyKNzdZw..-ad471d29- DEBUG | 20240730-144247.591 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1172 | Send: SipReq: REGISTER tel.t-online.de tid=46543d9017f2d3c2 cseq=2 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 2 from(tu) DEBUG | 20240730-144247.591 | RESIP | 26276 | SipStack.cxx:862 | SEND: SipReq: REGISTER tel.t-online.de tid=46543d9017f2d3c2 cseq=2 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 2 from(tu) DEBUG | 20240730-144247.591 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer F tid=46543d9017f2d3c2 ms=4000 DEBUG | 20240730-144247.591 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:606 | Looking up dns entries for sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144247.592 | RESIP:DNS | 26276 | DnsResult.cxx:262 | DnsResult::lookup sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144247.592 | RESIP:DNS | 23140 | DnsStub.cxx:67 | SRV Result: _sip._udp.tel.t-online.de (SRV) --> p=10 w=0 mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=20 w=0 hno002-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=30 w=0 nes008-f01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144247.592 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de(A)--> 217.0.148.69 DEBUG | 20240730-144247.592 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de lookup failed: DNS server returned answer with no data DEBUG | 20240730-144247.692 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer E1 tid=46543d9017f2d3c2 ms=500 DEBUG | 20240730-144247.692 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:728 | TransportSelector::findTransportByVia: source: [ V4 0.0.0.0:0 UDP ] DEBUG | 20240730-144247.692 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1615 | findTransportBySource([ V4 0.0.0.0:0 UDP ]) DEBUG | 20240730-144247.692 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1633 | should port be ignored: 1 DEBUG | 20240730-144247.692 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1696 | findTransport (any port, any interface) => Transport: [ V4 0.0.0.0:50857 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144247.692 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1054 | Found transport: [ V4 0.0.0.0:50857 UDP ] DEBUG | 20240730-144247.696 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:985 | Looked up source for destination: [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de ] -> [ V4 192.168.178.33:0 UDP targetDomain=tel.t-online.de ] sent-by= sent-port=0 DEBUG | 20240730-144247.696 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1405 | Transmitting to [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de transportKey=1 ] tlsDomain= via [ V4 192.168.178.33:50857 UDP targetDomain=tel.t-online.de ] REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP 192.168.178.33:50857;branch=z9hG4bK-524287-1---46543d9017f2d3c2;rport Max-Forwards: 70 Contact: To: From: ;tag=ad471d29 Call-ID: nQNN2BudI2jLpCiyKNzdZw.. CSeq: 2 REGISTER Expires: 480 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 sigcomp id= INFO | 20240730-144247.696 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.148.69; port: 5060 INFO | 20240730-144247.697 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144247.697 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 746 bytes, sent 746 instead DEBUG | 20240730-144247.772 | RESIP:TRANSPORT | 26276 | Transport.cxx:397 | incoming from: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144247.772 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting _sip._udp.tel.t-online.de(33): mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144247.772 | RESIP:TRANSACTION | 26276 | TuSelector.cxx:73 | Send to TU: DialogUsageManager size=0 SIP/2.0 600 Busy Everywhere Via: SIP/2.0/UDP 192.168.178.33:50857;received=93.216.249.22;branch=z9hG4bK-524287-1---46543d9017f2d3c2;rport=50857 To: ;tag=mavodi-0-51-b90-2-ffffff-ba0-ffffffffffffffff-0-0-_0277A8FC97D3-48ea-d62da700-4261c7-66a8dfc8-4937c From: ;tag=ad471d29 Call-ID: nQNN2BudI2jLpCiyKNzdZw.. CSeq: 2 REGISTER Reason: SIP;cause=600;text="CC_DIAM_NO_MANDATORY_CAPABILITY_MATCHED_SCSCF" Content-Length: 0 DEBUG | 20240730-144247.772 | RESIP:DNS | 23140 | RRVip.cxx:128 | updating an existing vip: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 with mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144247.772 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer K tid=46543d9017f2d3c2 ms=5000 DEBUG | 20240730-144247.772 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting tel.t-online.de(1): 217.0.148.69 DEBUG | 20240730-144247.772 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1627 | Got: SipResp: 600 tid=46543d9017f2d3c2 cseq=2 REGISTER / 2 from(wire) DEBUG | 20240730-144247.772 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1641 | DialogUsageManager::process: found SipMessage DEBUG | 20240730-144247.772 | RESIP:DNS | 23140 | RRVip.cxx:128 | updating an existing vip: 217.0.148.69 with 217.0.148.69 DEBUG | 20240730-144247.772 | RESIP:DUM | 26276 | DialogUsageManager.cxx:2177 | DialogUsageManager::processResponse: SipResp: 600 tid=46543d9017f2d3c2 cseq=2 REGISTER / 2 from(wire) DEBUG | 20240730-144247.772 | RESIP:DUM | 26276 | DialogId.cxx:50 | DialogId::DialogId: nQNN2BudI2jLpCiyKNzdZw..-ad471d29-mavodi-0-51-b90-2-ffffff-ba0-ffffffffffffffff-0-0-_0277A8FC97D3-48ea-d62da700-4261c7-66a8dfc8-4937c INFO | 20240730-144247.772 | WRAPPER | 26276 | sip_call_manager.cpp:3645 | onFailure: user id= 0000000000C77F24 response= SipResp: 600 tid=46543d9017f2d3c2 cseq=2 REGISTER / 2 from(wire) INFO | 20240730-144247.772 | WRAPPER | 26276 | sip_call_manager.cpp:6198 | TerminateUserConnection: Invalid transport= 3 for userId= 0000000000C77F24 INFO | 20240730-144247.772 | WRAPPER | 26276 | sip_call_manager.cpp:3699 | Notifying onUserRegistrationFailure( 0000000000C77F24, 1 ) DEBUG | 20240730-144247.772 | WRAPPER | 26276 | appl_event_queue.cpp:35 | Notify: event= [class scx::CUserRegistrationFailure] DEBUG | 20240730-144247.772 | WRAPPER | 26276 | sip_user.cpp:1495 | SetState: userId = 0000000000C77F24 - USER_REGISTERING -> USER_LOCALRETRY INFO | 20240730-144247.772 | WRAPPER | 26276 | sip_call_manager.cpp:3713 | onFailure: will retry automatically after 4 seconds DEBUG | 20240730-144247.772 | WRAPPER | 26276 | appl_event_queue.cpp:35 | Notify: event= [class scx::CRegistrationRetrying] DEBUG | 20240730-144247.772 | RESIP:DUM | 26276 | ClientRegistration.cxx:74 | ClientRegistration::~ClientRegistration DEBUG | 20240730-144247.773 | RESIP:DUM | 26276 | KeepAliveManager.cxx:78 | Last association removed for keep alive id=1: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ] ERR | 20240730-144247.773 | Z:APP | 25056 | User.cpp:110 | Account (+4986322880835001@tel.t-online.de) - register failed (Busy Everywhere) : SIP:+4986322880835001 DEBUG | 20240730-144247.773 | RESIP:DUM | 26276 | DialogSet.cxx:124 | ********** DialogSet::~DialogSet: nQNN2BudI2jLpCiyKNzdZw..-ad471d29************* DEBUG | 20240730-144247.773 | WRAPPER | 26276 | app_dialogs.cpp:67 | ~AppDialogSet 000001F71C252BA0 user= 0000000000C77F24 call= FFFFFFFFFFFFFFFF DEBUG | 20240730-144247.803 | Z:APP | 25056 | HistoryService.cpp:414 | History add account elapsed time = 8ms DEBUG | 20240730-144247.812 | Z:APP | 25056 | HistoryService.cpp:157 | History add/update elapsed time = 9ms DEBUG | 20240730-144247.812 | Z:APP | 25056 | Account.cpp:2579 | Account = +4986322880835001@tel.t-online.de history new count updated from 44 to 45 DEBUG | 20240730-144247.813 | Z:APP | 25056 | Phone.Account.cpp:173 | History filter refresh request because of an account succesful registeration grouped by (3). ERR | 20240730-144247.813 | Z:APP | 25056 | User.cpp:86 | Account (+4986322880835001@tel.t-online.de) - retry registration in 4seconds : SIP:+4986322880835001 DEBUG | 20240730-144247.813 | Z:APP | 25056 | HistoryService.cpp:99 | History refreshing filters grouped by (3). DEBUG | 20240730-144249.944 | Z:APP | 25056 | HistoryFilter.cpp:230 | History filter (Z7ebc95781799394f37fcd0a7) started (limit = 1; groupMode = 1). DEBUG | 20240730-144249.960 | Z:APP | 25056 | HistoryFilter.cpp:365 | History filter (Z7ebc95781799394f37fcd0a7) finished (limit = 1; groupMode = 1; count = 1 DEBUG | 20240730-144249.960 | Z:APP | 25056 | HistoryFilter.cpp:368 | History filter (Z7ebc95781799394f37fcd0a7) elapsed time = 16ms DEBUG | 20240730-144251.626 | Z:APP | 25056 | Account.cpp:1006 | Account custom STUN discovery finished. Account = +4986322880835001@tel.t-online.de INFO | 20240730-144251.626 | WRAPPER | 25056 | api.cpp:974 | RegisterUser: id= 0000000000C77F24 INFO | 20240730-144251.626 | WRAPPER | 25056 | sip_call_manager.cpp:1265 | RegisterUser 0000000000C77F24 DEBUG | 20240730-144251.626 | WRAPPER | 25056 | sip_call_manager.cpp:1299 | InternalRegisterUser: registering 0000000000C77F24 , userDriven= 1 DEBUG | 20240730-144251.626 | WRAPPER | 25056 | sip_user.cpp:64 | OutboundProxyManager::onRegistrationStart: Not measuring latency DEBUG | 20240730-144251.626 | WRAPPER | 25056 | sip_user.cpp:480 | AddOutboundProxyToProfile: Unsetting use of proxy DEBUG | 20240730-144251.626 | WRAPPER | 25056 | app_dialogs.cpp:54 | AppDialogSet 000001F71C2519A0 DEBUG | 20240730-144251.626 | WRAPPER | 25056 | app_dialogs.cpp:60 | User id= 0000000000C77F24 DEBUG | 20240730-144251.626 | RESIP:DUM | 25056 | BaseCreator.cxx:156 | BaseCreator::makeInitialRequest: REGISTER sip:+4986322880835001@tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/ ;branch=z9hG4bK-524287-1---d5ce1492b608f999;rport Max-Forwards: 70 Contact: To: From: ;tag=8339d351 Call-ID: lfZjTOaxJ0KMDeRW7YcR9g.. CSeq: 1 REGISTER Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 DEBUG | 20240730-144251.626 | RESIP:DUM | 25056 | RegistrationCreator.cxx:27 | RegistrationCreator::RegistrationCreator: 000001F71C3C5630 DEBUG | 20240730-144251.626 | RESIP:DUM | 25056 | DialogSet.cxx:54 | ************* Created DialogSet(UAC) -- lfZjTOaxJ0KMDeRW7YcR9g..-8339d351************* DEBUG | 20240730-144251.626 | WRAPPER | 25056 | appl_event_queue.cpp:35 | Notify: event= [class scx::CRegistrationStarting] DEBUG | 20240730-144251.626 | RESIP:DUM | 25056 | DialogUsageManager.cxx:1011 | SEND: REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP ;branch=z9hG4bK-524287-1---e69929388fa1e50c;rport Max-Forwards: 70 Contact: To: From: ;tag=8339d351 Call-ID: lfZjTOaxJ0KMDeRW7YcR9g.. CSeq: 1 REGISTER Expires: 60 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 DEBUG | 20240730-144251.626 | RESIP:DUM | 25056 | DialogId.cxx:50 | DialogId::DialogId: lfZjTOaxJ0KMDeRW7YcR9g..-8339d351- DEBUG | 20240730-144251.626 | RESIP:DUM | 25056 | DialogUsageManager.cxx:1172 | Send: SipReq: REGISTER tel.t-online.de tid=e69929388fa1e50c cseq=1 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 1 from(tu) DEBUG | 20240730-144251.626 | RESIP | 25056 | SipStack.cxx:862 | SEND: SipReq: REGISTER tel.t-online.de tid=e69929388fa1e50c cseq=1 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 1 from(tu) DEBUG | 20240730-144251.627 | WRAPPER | 25056 | sip_user.cpp:1495 | SetState: userId = 0000000000C77F24 - USER_LOCALRETRY -> USER_REGISTERING DEBUG | 20240730-144251.627 | Z:APP | 25056 | Account.cpp:1124 | Account (+4986322880835001@tel.t-online.de) register request : SIP:+4986322880835001@tel.t-online.de DEBUG | 20240730-144251.653 | Z:APP | 25056 | HistoryService.cpp:414 | History add account elapsed time = 8ms DEBUG | 20240730-144251.660 | Z:APP | 25056 | HistoryService.cpp:157 | History add/update elapsed time = 6ms DEBUG | 20240730-144251.668 | Z:APP | 25056 | HistoryService.cpp:414 | History add account elapsed time = 7ms DEBUG | 20240730-144251.677 | Z:APP | 25056 | HistoryService.cpp:414 | History add account elapsed time = 9ms DEBUG | 20240730-144251.691 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer F tid=e69929388fa1e50c ms=8000 DEBUG | 20240730-144251.691 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:606 | Looking up dns entries for sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144251.691 | RESIP:DNS | 26276 | DnsResult.cxx:262 | DnsResult::lookup sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144251.691 | RESIP:DNS | 23140 | DnsStub.cxx:67 | SRV Result: _sip._udp.tel.t-online.de (SRV) --> p=10 w=0 mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=20 w=0 hno002-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=30 w=0 nes008-f01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144251.691 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de(A)--> 217.0.148.69 DEBUG | 20240730-144251.691 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de lookup failed: DNS server returned answer with no data DEBUG | 20240730-144251.795 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer E1 tid=e69929388fa1e50c ms=500 DEBUG | 20240730-144251.795 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:728 | TransportSelector::findTransportByVia: source: [ V4 0.0.0.0:0 UDP ] DEBUG | 20240730-144251.795 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1615 | findTransportBySource([ V4 0.0.0.0:0 UDP ]) DEBUG | 20240730-144251.795 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1633 | should port be ignored: 1 DEBUG | 20240730-144251.795 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1696 | findTransport (any port, any interface) => Transport: [ V4 0.0.0.0:50857 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144251.795 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1054 | Found transport: [ V4 0.0.0.0:50857 UDP ] DEBUG | 20240730-144251.801 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:985 | Looked up source for destination: [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de ] -> [ V4 192.168.178.33:0 UDP targetDomain=tel.t-online.de ] sent-by= sent-port=0 DEBUG | 20240730-144251.801 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1405 | Transmitting to [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de transportKey=1 ] tlsDomain= via [ V4 192.168.178.33:50857 UDP targetDomain=tel.t-online.de ] REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP 192.168.178.33:50857;branch=z9hG4bK-524287-1---e69929388fa1e50c;rport Max-Forwards: 70 Contact: To: From: ;tag=8339d351 Call-ID: lfZjTOaxJ0KMDeRW7YcR9g.. CSeq: 1 REGISTER Expires: 60 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 sigcomp id= INFO | 20240730-144251.801 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.148.69; port: 5060 INFO | 20240730-144251.801 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144251.801 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 745 bytes, sent 745 instead DEBUG | 20240730-144251.865 | RESIP:TRANSPORT | 26276 | Transport.cxx:397 | incoming from: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144251.866 | RESIP:TRANSACTION | 26276 | TuSelector.cxx:73 | Send to TU: DialogUsageManager size=0 SIP/2.0 423 Interval Too Brief Via: SIP/2.0/UDP 192.168.178.33:50857;received=93.216.249.22;branch=z9hG4bK-524287-1---e69929388fa1e50c;rport=50857 To: ;tag=029C57715001-2075-b0053700-89c5a2b-66a8dfcc-60ea1 From: ;tag=8339d351 Call-ID: lfZjTOaxJ0KMDeRW7YcR9g.. CSeq: 1 REGISTER Min-Expires: 480 Content-Length: 0 DEBUG | 20240730-144251.866 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer K tid=e69929388fa1e50c ms=5000 DEBUG | 20240730-144251.866 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1627 | Got: SipResp: 423 tid=e69929388fa1e50c cseq=1 REGISTER / 1 from(wire) DEBUG | 20240730-144251.866 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1641 | DialogUsageManager::process: found SipMessage DEBUG | 20240730-144251.866 | RESIP:DUM | 26276 | DialogUsageManager.cxx:2177 | DialogUsageManager::processResponse: SipResp: 423 tid=e69929388fa1e50c cseq=1 REGISTER / 1 from(wire) DEBUG | 20240730-144251.866 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting _sip._udp.tel.t-online.de(33): mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144251.866 | RESIP:DNS | 23140 | RRVip.cxx:128 | updating an existing vip: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 with mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144251.866 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting tel.t-online.de(1): 217.0.148.69 DEBUG | 20240730-144251.866 | RESIP:DNS | 23140 | RRVip.cxx:128 | updating an existing vip: 217.0.148.69 with 217.0.148.69 DEBUG | 20240730-144251.866 | RESIP:DUM | 26276 | DialogId.cxx:50 | DialogId::DialogId: lfZjTOaxJ0KMDeRW7YcR9g..-8339d351-029C57715001-2075-b0053700-89c5a2b-66a8dfcc-60ea1 DEBUG | 20240730-144251.866 | RESIP:DUM | 26276 | KeepAliveManager.cxx:26 | First keep alive for id=2: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ], interval=30s, supportsOutbound=false DEBUG | 20240730-144251.866 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:124 | Adding application timer: KeepAliveTimeout[ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ](2) ms=30000 DEBUG | 20240730-144251.866 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1011 | SEND: REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP ;branch=z9hG4bK-524287-1---fd98ea651c546ee9;rport Max-Forwards: 70 Contact: To: From: ;tag=8339d351 Call-ID: lfZjTOaxJ0KMDeRW7YcR9g.. CSeq: 2 REGISTER Expires: 480 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 DEBUG | 20240730-144251.866 | RESIP:DUM | 26276 | DialogId.cxx:50 | DialogId::DialogId: lfZjTOaxJ0KMDeRW7YcR9g..-8339d351- DEBUG | 20240730-144251.866 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1172 | Send: SipReq: REGISTER tel.t-online.de tid=fd98ea651c546ee9 cseq=2 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 2 from(tu) DEBUG | 20240730-144251.866 | RESIP | 26276 | SipStack.cxx:862 | SEND: SipReq: REGISTER tel.t-online.de tid=fd98ea651c546ee9 cseq=2 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 2 from(tu) DEBUG | 20240730-144251.866 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer F tid=fd98ea651c546ee9 ms=8000 DEBUG | 20240730-144251.866 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:606 | Looking up dns entries for sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144251.866 | RESIP:DNS | 26276 | DnsResult.cxx:262 | DnsResult::lookup sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144251.866 | RESIP:DNS | 23140 | DnsStub.cxx:67 | SRV Result: _sip._udp.tel.t-online.de (SRV) --> p=10 w=0 mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=20 w=0 hno002-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=30 w=0 nes008-f01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144251.866 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de(A)--> 217.0.148.69 DEBUG | 20240730-144251.866 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de lookup failed: DNS server returned answer with no data DEBUG | 20240730-144251.980 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer E1 tid=fd98ea651c546ee9 ms=500 DEBUG | 20240730-144251.980 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:728 | TransportSelector::findTransportByVia: source: [ V4 0.0.0.0:0 UDP ] DEBUG | 20240730-144251.980 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1615 | findTransportBySource([ V4 0.0.0.0:0 UDP ]) DEBUG | 20240730-144251.980 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1633 | should port be ignored: 1 DEBUG | 20240730-144251.980 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1696 | findTransport (any port, any interface) => Transport: [ V4 0.0.0.0:50857 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144251.980 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1054 | Found transport: [ V4 0.0.0.0:50857 UDP ] DEBUG | 20240730-144251.985 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:985 | Looked up source for destination: [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de ] -> [ V4 192.168.178.33:0 UDP targetDomain=tel.t-online.de ] sent-by= sent-port=0 DEBUG | 20240730-144251.985 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1405 | Transmitting to [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de transportKey=1 ] tlsDomain= via [ V4 192.168.178.33:50857 UDP targetDomain=tel.t-online.de ] REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP 192.168.178.33:50857;branch=z9hG4bK-524287-1---fd98ea651c546ee9;rport Max-Forwards: 70 Contact: To: From: ;tag=8339d351 Call-ID: lfZjTOaxJ0KMDeRW7YcR9g.. CSeq: 2 REGISTER Expires: 480 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 sigcomp id= INFO | 20240730-144251.985 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.148.69; port: 5060 INFO | 20240730-144251.985 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144251.985 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 746 bytes, sent 746 instead DEBUG | 20240730-144252.048 | RESIP:TRANSPORT | 26276 | Transport.cxx:397 | incoming from: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144252.048 | RESIP:TRANSACTION | 26276 | TuSelector.cxx:73 | Send to TU: DialogUsageManager size=0 SIP/2.0 600 Busy Everywhere Via: SIP/2.0/UDP 192.168.178.33:50857;received=93.216.249.22;branch=z9hG4bK-524287-1---fd98ea651c546ee9;rport=50857 To: ;tag=mavodi-0-51-72-2-ffffff-ba3-ffffffffffffffff-0-0-_02F3731D73D3-48d5-d76e6700-4258e6-66a8dfcc-8cb50 From: ;tag=8339d351 Call-ID: lfZjTOaxJ0KMDeRW7YcR9g.. CSeq: 2 REGISTER Reason: SIP;cause=600;text="CC_DIAM_NO_MANDATORY_CAPABILITY_MATCHED_SCSCF" Content-Length: 0 DEBUG | 20240730-144252.048 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer K tid=fd98ea651c546ee9 ms=5000 DEBUG | 20240730-144252.048 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1627 | Got: SipResp: 600 tid=fd98ea651c546ee9 cseq=2 REGISTER / 2 from(wire) DEBUG | 20240730-144252.048 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1641 | DialogUsageManager::process: found SipMessage DEBUG | 20240730-144252.048 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting _sip._udp.tel.t-online.de(33): mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144252.048 | RESIP:DNS | 23140 | RRVip.cxx:128 | updating an existing vip: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 with mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144252.048 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting tel.t-online.de(1): 217.0.148.69 DEBUG | 20240730-144252.048 | RESIP:DNS | 23140 | RRVip.cxx:128 | updating an existing vip: 217.0.148.69 with 217.0.148.69 DEBUG | 20240730-144252.048 | RESIP:DUM | 26276 | DialogUsageManager.cxx:2177 | DialogUsageManager::processResponse: SipResp: 600 tid=fd98ea651c546ee9 cseq=2 REGISTER / 2 from(wire) DEBUG | 20240730-144252.048 | RESIP:DUM | 26276 | DialogId.cxx:50 | DialogId::DialogId: lfZjTOaxJ0KMDeRW7YcR9g..-8339d351-mavodi-0-51-72-2-ffffff-ba3-ffffffffffffffff-0-0-_02F3731D73D3-48d5-d76e6700-4258e6-66a8dfcc-8cb50 INFO | 20240730-144252.048 | WRAPPER | 26276 | sip_call_manager.cpp:3645 | onFailure: user id= 0000000000C77F24 response= SipResp: 600 tid=fd98ea651c546ee9 cseq=2 REGISTER / 2 from(wire) INFO | 20240730-144252.048 | WRAPPER | 26276 | sip_call_manager.cpp:6198 | TerminateUserConnection: Invalid transport= 3 for userId= 0000000000C77F24 INFO | 20240730-144252.048 | WRAPPER | 26276 | sip_call_manager.cpp:3699 | Notifying onUserRegistrationFailure( 0000000000C77F24, 1 ) DEBUG | 20240730-144252.048 | WRAPPER | 26276 | appl_event_queue.cpp:35 | Notify: event= [class scx::CUserRegistrationFailure] DEBUG | 20240730-144252.048 | WRAPPER | 26276 | sip_user.cpp:1495 | SetState: userId = 0000000000C77F24 - USER_REGISTERING -> USER_LOCALRETRY INFO | 20240730-144252.048 | WRAPPER | 26276 | sip_call_manager.cpp:3713 | onFailure: will retry automatically after 8 seconds DEBUG | 20240730-144252.048 | WRAPPER | 26276 | appl_event_queue.cpp:35 | Notify: event= [class scx::CRegistrationRetrying] DEBUG | 20240730-144252.048 | RESIP:DUM | 26276 | ClientRegistration.cxx:74 | ClientRegistration::~ClientRegistration DEBUG | 20240730-144252.048 | RESIP:DUM | 26276 | KeepAliveManager.cxx:78 | Last association removed for keep alive id=2: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144252.048 | RESIP:DUM | 26276 | DialogSet.cxx:124 | ********** DialogSet::~DialogSet: lfZjTOaxJ0KMDeRW7YcR9g..-8339d351************* DEBUG | 20240730-144252.048 | WRAPPER | 26276 | app_dialogs.cpp:67 | ~AppDialogSet 000001F71C2519A0 user= 0000000000C77F24 call= FFFFFFFFFFFFFFFF ERR | 20240730-144252.048 | Z:APP | 25056 | User.cpp:110 | Account (+4986322880835001@tel.t-online.de) - register failed (Busy Everywhere) : SIP:+4986322880835001 DEBUG | 20240730-144252.077 | Z:APP | 25056 | HistoryService.cpp:414 | History add account elapsed time = 8ms DEBUG | 20240730-144252.084 | Z:APP | 25056 | HistoryService.cpp:157 | History add/update elapsed time = 6ms DEBUG | 20240730-144252.084 | Z:APP | 25056 | Account.cpp:2579 | Account = +4986322880835001@tel.t-online.de history new count updated from 45 to 46 DEBUG | 20240730-144252.086 | Z:APP | 25056 | HistoryFilter.cpp:230 | History filter (Z7ebc95781799394f37fcd0a7) started (limit = 1; groupMode = 1). DEBUG | 20240730-144252.086 | Z:APP | 25056 | Phone.Account.cpp:173 | History filter refresh request because of an account succesful registeration grouped by (3). ERR | 20240730-144252.087 | Z:APP | 25056 | User.cpp:86 | Account (+4986322880835001@tel.t-online.de) - retry registration in 8seconds : SIP:+4986322880835001 DEBUG | 20240730-144252.087 | Z:APP | 25056 | HistoryService.cpp:99 | History refreshing filters grouped by (3). DEBUG | 20240730-144252.087 | Z:APP | 25056 | HistoryFilter.cpp:365 | History filter (Z7ebc95781799394f37fcd0a7) finished (limit = 1; groupMode = 1; count = 1 DEBUG | 20240730-144252.087 | Z:APP | 25056 | HistoryFilter.cpp:368 | History filter (Z7ebc95781799394f37fcd0a7) elapsed time = 0ms DEBUG | 20240730-144255.773 | WRAPPER | 23884 | sip_call_manager.cpp:3721 | Retrying registration for user 0000000000C77F24 DEBUG | 20240730-144255.773 | WRAPPER | 23884 | sip_call_manager.cpp:1299 | InternalRegisterUser: registering 0000000000C77F24 , userDriven= 0 DEBUG | 20240730-144255.773 | WRAPPER | 23884 | sip_user.cpp:480 | AddOutboundProxyToProfile: Unsetting use of proxy DEBUG | 20240730-144255.773 | WRAPPER | 23884 | app_dialogs.cpp:54 | AppDialogSet 000001F71C2538C0 DEBUG | 20240730-144255.773 | WRAPPER | 23884 | app_dialogs.cpp:60 | User id= 0000000000C77F24 DEBUG | 20240730-144255.773 | RESIP:DUM | 23884 | BaseCreator.cxx:156 | BaseCreator::makeInitialRequest: REGISTER sip:+4986322880835001@tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/ ;branch=z9hG4bK-524287-1---a0eec37037535d7a;rport Max-Forwards: 70 Contact: To: From: ;tag=773c616c Call-ID: QPxhPmis6-jzUz7pZAzCPw.. CSeq: 1 REGISTER Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 DEBUG | 20240730-144255.773 | RESIP:DUM | 23884 | RegistrationCreator.cxx:27 | RegistrationCreator::RegistrationCreator: 000001F71CA53530 DEBUG | 20240730-144255.773 | RESIP:DUM | 23884 | DialogSet.cxx:54 | ************* Created DialogSet(UAC) -- QPxhPmis6-jzUz7pZAzCPw..-773c616c************* DEBUG | 20240730-144255.773 | WRAPPER | 23884 | appl_event_queue.cpp:35 | Notify: event= [class scx::CRegistrationStarting] DEBUG | 20240730-144255.773 | RESIP:DUM | 23884 | DialogUsageManager.cxx:1011 | SEND: REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP ;branch=z9hG4bK-524287-1---06a77081654aa8ad;rport Max-Forwards: 70 Contact: To: From: ;tag=773c616c Call-ID: QPxhPmis6-jzUz7pZAzCPw.. CSeq: 1 REGISTER Expires: 60 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 DEBUG | 20240730-144255.773 | RESIP:DUM | 23884 | DialogId.cxx:50 | DialogId::DialogId: QPxhPmis6-jzUz7pZAzCPw..-773c616c- DEBUG | 20240730-144255.773 | RESIP:DUM | 23884 | DialogUsageManager.cxx:1172 | Send: SipReq: REGISTER tel.t-online.de tid=06a77081654aa8ad cseq=1 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 1 from(tu) DEBUG | 20240730-144255.773 | RESIP | 23884 | SipStack.cxx:862 | SEND: SipReq: REGISTER tel.t-online.de tid=06a77081654aa8ad cseq=1 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 1 from(tu) DEBUG | 20240730-144255.773 | WRAPPER | 23884 | sip_user.cpp:1495 | SetState: userId = 0000000000C77F24 - USER_LOCALRETRY -> USER_REGISTERING DEBUG | 20240730-144255.775 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer F tid=06a77081654aa8ad ms=16000 DEBUG | 20240730-144255.775 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:606 | Looking up dns entries for sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144255.775 | RESIP:DNS | 26276 | DnsResult.cxx:262 | DnsResult::lookup sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144255.775 | RESIP:DNS | 23140 | DnsStub.cxx:67 | SRV Result: _sip._udp.tel.t-online.de (SRV) --> p=10 w=0 mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=20 w=0 hno002-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=30 w=0 nes008-f01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144255.775 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de(A)--> 217.0.148.69 DEBUG | 20240730-144255.775 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de lookup failed: DNS server returned answer with no data DEBUG | 20240730-144255.876 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer E1 tid=06a77081654aa8ad ms=500 DEBUG | 20240730-144255.876 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:728 | TransportSelector::findTransportByVia: source: [ V4 0.0.0.0:0 UDP ] DEBUG | 20240730-144255.876 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1615 | findTransportBySource([ V4 0.0.0.0:0 UDP ]) DEBUG | 20240730-144255.876 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1633 | should port be ignored: 1 DEBUG | 20240730-144255.876 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1696 | findTransport (any port, any interface) => Transport: [ V4 0.0.0.0:50857 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144255.876 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1054 | Found transport: [ V4 0.0.0.0:50857 UDP ] DEBUG | 20240730-144255.881 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:985 | Looked up source for destination: [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de ] -> [ V4 192.168.178.33:0 UDP targetDomain=tel.t-online.de ] sent-by= sent-port=0 DEBUG | 20240730-144255.881 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1405 | Transmitting to [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de transportKey=1 ] tlsDomain= via [ V4 192.168.178.33:50857 UDP targetDomain=tel.t-online.de ] REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP 192.168.178.33:50857;branch=z9hG4bK-524287-1---06a77081654aa8ad;rport Max-Forwards: 70 Contact: To: From: ;tag=773c616c Call-ID: QPxhPmis6-jzUz7pZAzCPw.. CSeq: 1 REGISTER Expires: 60 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 sigcomp id= INFO | 20240730-144255.881 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.148.69; port: 5060 INFO | 20240730-144255.881 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144255.881 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 745 bytes, sent 745 instead DEBUG | 20240730-144255.938 | RESIP:TRANSPORT | 26276 | Transport.cxx:397 | incoming from: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144255.938 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting _sip._udp.tel.t-online.de(33): mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144255.938 | RESIP:TRANSACTION | 26276 | TuSelector.cxx:73 | Send to TU: DialogUsageManager size=0 SIP/2.0 423 Interval Too Brief Via: SIP/2.0/UDP 192.168.178.33:50857;received=93.216.249.22;branch=z9hG4bK-524287-1---06a77081654aa8ad;rport=50857 To: ;tag=029C57715001-2075-b0053700-89c5a72-66a8dfd0-72863 From: ;tag=773c616c Call-ID: QPxhPmis6-jzUz7pZAzCPw.. CSeq: 1 REGISTER Min-Expires: 480 Content-Length: 0 DEBUG | 20240730-144255.938 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer K tid=06a77081654aa8ad ms=5000 DEBUG | 20240730-144255.938 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1627 | Got: SipResp: 423 tid=06a77081654aa8ad cseq=1 REGISTER / 1 from(wire) DEBUG | 20240730-144255.938 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1641 | DialogUsageManager::process: found SipMessage DEBUG | 20240730-144255.938 | RESIP:DNS | 23140 | RRVip.cxx:128 | updating an existing vip: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 with mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144255.938 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting tel.t-online.de(1): 217.0.148.69 DEBUG | 20240730-144255.938 | RESIP:DNS | 23140 | RRVip.cxx:128 | updating an existing vip: 217.0.148.69 with 217.0.148.69 DEBUG | 20240730-144255.938 | RESIP:DUM | 26276 | DialogUsageManager.cxx:2177 | DialogUsageManager::processResponse: SipResp: 423 tid=06a77081654aa8ad cseq=1 REGISTER / 1 from(wire) DEBUG | 20240730-144255.938 | RESIP:DUM | 26276 | DialogId.cxx:50 | DialogId::DialogId: QPxhPmis6-jzUz7pZAzCPw..-773c616c-029C57715001-2075-b0053700-89c5a72-66a8dfd0-72863 DEBUG | 20240730-144255.938 | RESIP:DUM | 26276 | KeepAliveManager.cxx:26 | First keep alive for id=3: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ], interval=30s, supportsOutbound=false DEBUG | 20240730-144255.938 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:124 | Adding application timer: KeepAliveTimeout[ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ](3) ms=30000 DEBUG | 20240730-144255.938 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1011 | SEND: REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP ;branch=z9hG4bK-524287-1---4792057de657ca28;rport Max-Forwards: 70 Contact: To: From: ;tag=773c616c Call-ID: QPxhPmis6-jzUz7pZAzCPw.. CSeq: 2 REGISTER Expires: 480 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 DEBUG | 20240730-144255.939 | RESIP:DUM | 26276 | DialogId.cxx:50 | DialogId::DialogId: QPxhPmis6-jzUz7pZAzCPw..-773c616c- DEBUG | 20240730-144255.939 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1172 | Send: SipReq: REGISTER tel.t-online.de tid=4792057de657ca28 cseq=2 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 2 from(tu) DEBUG | 20240730-144255.939 | RESIP | 26276 | SipStack.cxx:862 | SEND: SipReq: REGISTER tel.t-online.de tid=4792057de657ca28 cseq=2 REGISTER contact=+4986322880835001@93.216.249.22:50857 / 2 from(tu) DEBUG | 20240730-144255.939 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer F tid=4792057de657ca28 ms=16000 DEBUG | 20240730-144255.939 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:606 | Looking up dns entries for sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144255.939 | RESIP:DNS | 26276 | DnsResult.cxx:262 | DnsResult::lookup sip:tel.t-online.de;transport=UDP DEBUG | 20240730-144255.939 | RESIP:DNS | 23140 | DnsStub.cxx:67 | SRV Result: _sip._udp.tel.t-online.de (SRV) --> p=10 w=0 mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=20 w=0 hno002-l01-mav-pc-rt-001.edns.t-ipnet.de:5060, _sip._udp.tel.t-online.de (SRV) --> p=30 w=0 nes008-f01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144255.939 | RESIP:DNS | 23140 | DnsStub.cxx:49 | Host(A) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de(A)--> 217.0.148.69 DEBUG | 20240730-144255.939 | RESIP:DNS | 23140 | DnsStub.cxx:56 | Host(AAAA) Result: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de lookup failed: DNS server returned answer with no data DEBUG | 20240730-144256.040 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer E1 tid=4792057de657ca28 ms=500 DEBUG | 20240730-144256.040 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:728 | TransportSelector::findTransportByVia: source: [ V4 0.0.0.0:0 UDP ] DEBUG | 20240730-144256.040 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1615 | findTransportBySource([ V4 0.0.0.0:0 UDP ]) DEBUG | 20240730-144256.040 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1633 | should port be ignored: 1 DEBUG | 20240730-144256.040 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1696 | findTransport (any port, any interface) => Transport: [ V4 0.0.0.0:50857 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144256.040 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1054 | Found transport: [ V4 0.0.0.0:50857 UDP ] DEBUG | 20240730-144256.044 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:985 | Looked up source for destination: [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de ] -> [ V4 192.168.178.33:0 UDP targetDomain=tel.t-online.de ] sent-by= sent-port=0 DEBUG | 20240730-144256.044 | RESIP:TRANSPORT | 26276 | TransportSelector.cxx:1405 | Transmitting to [ V4 217.0.148.69:5060 UDP targetDomain=tel.t-online.de transportKey=1 ] tlsDomain= via [ V4 192.168.178.33:50857 UDP targetDomain=tel.t-online.de ] REGISTER sip:tel.t-online.de;transport=UDP SIP/2.0 Via: SIP/2.0/UDP 192.168.178.33:50857;branch=z9hG4bK-524287-1---4792057de657ca28;rport Max-Forwards: 70 Contact: To: From: ;tag=773c616c Call-ID: QPxhPmis6-jzUz7pZAzCPw.. CSeq: 2 REGISTER Expires: 480 Allow: INVITE, ACK, CANCEL, BYE, NOTIFY, REFER, MESSAGE, OPTIONS, INFO, SUBSCRIBE Supported: replaces, norefersub, extended-refer, timer, sec-agree, outbound, path, X-cisco-serviceuri User-Agent: Z 5.6.4 v2.10.20.4 Allow-Events: presence, kpml, talk, as-feature-event Content-Length: 0 sigcomp id= INFO | 20240730-144256.044 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:309 | Seaching address: 217.0.148.69; port: 5060 INFO | 20240730-144256.044 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:319 | processTxOne: getaddrinfo returned: 0 INFO | 20240730-144256.044 | RESIP:TRANSPORT | 26276 | UdpTransport.cxx:332 | processTxOne: Send 746 bytes, sent 746 instead DEBUG | 20240730-144256.110 | RESIP:TRANSPORT | 26276 | Transport.cxx:397 | incoming from: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ] DEBUG | 20240730-144256.111 | RESIP:TRANSACTION | 26276 | TuSelector.cxx:73 | Send to TU: DialogUsageManager size=0 SIP/2.0 600 Busy Everywhere Via: SIP/2.0/UDP 192.168.178.33:50857;received=93.216.249.22;branch=z9hG4bK-524287-1---4792057de657ca28;rport=50857 To: ;tag=mavodi-0-51-57d-1-ffffff-bac-ffffffffffffffff-0-0-_02CAE6C64783-4827-66d16700-41f9e0-66a8dfd0-9bb24 From: ;tag=773c616c Call-ID: QPxhPmis6-jzUz7pZAzCPw.. CSeq: 2 REGISTER Reason: SIP;cause=600;text="CC_DIAM_NO_MANDATORY_CAPABILITY_MATCHED_SCSCF" Content-Length: 0 DEBUG | 20240730-144256.111 | RESIP:TRANSACTION | 26276 | TimerQueue.cxx:50 | Adding timer: Timer K tid=4792057de657ca28 ms=5000 DEBUG | 20240730-144256.111 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1627 | Got: SipResp: 600 tid=4792057de657ca28 cseq=2 REGISTER / 2 from(wire) DEBUG | 20240730-144256.111 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting _sip._udp.tel.t-online.de(33): mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144256.111 | RESIP:DUM | 26276 | DialogUsageManager.cxx:1641 | DialogUsageManager::process: found SipMessage DEBUG | 20240730-144256.111 | RESIP:DNS | 23140 | RRVip.cxx:128 | updating an existing vip: mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 with mue000-l01-mav-pc-rt-001.edns.t-ipnet.de:5060 DEBUG | 20240730-144256.111 | RESIP:DUM | 26276 | DialogUsageManager.cxx:2177 | DialogUsageManager::processResponse: SipResp: 600 tid=4792057de657ca28 cseq=2 REGISTER / 2 from(wire) DEBUG | 20240730-144256.111 | RESIP:DNS | 23140 | DnsResult.cxx:254 | Whitelisting tel.t-online.de(1): 217.0.148.69 DEBUG | 20240730-144256.111 | RESIP:DUM | 26276 | DialogId.cxx:50 | DialogId::DialogId: QPxhPmis6-jzUz7pZAzCPw..-773c616c-mavodi-0-51-57d-1-ffffff-bac-ffffffffffffffff-0-0-_02CAE6C64783-4827-66d16700-41f9e0-66a8dfd0-9bb24 DEBUG | 20240730-144256.111 | RESIP:DNS | 23140 | RRVip.cxx:128 | updating an existing vip: 217.0.148.69 with 217.0.148.69 INFO | 20240730-144256.111 | WRAPPER | 26276 | sip_call_manager.cpp:3645 | onFailure: user id= 0000000000C77F24 response= SipResp: 600 tid=4792057de657ca28 cseq=2 REGISTER / 2 from(wire) INFO | 20240730-144256.111 | WRAPPER | 26276 | sip_call_manager.cpp:3699 | Notifying onUserRegistrationFailure( 0000000000C77F24, 1 ) DEBUG | 20240730-144256.111 | WRAPPER | 26276 | appl_event_queue.cpp:35 | Notify: event= [class scx::CUserRegistrationFailure] DEBUG | 20240730-144256.111 | WRAPPER | 26276 | sip_user.cpp:1495 | SetState: userId = 0000000000C77F24 - USER_REGISTERING -> USER_LOCALRETRY INFO | 20240730-144256.111 | WRAPPER | 26276 | sip_call_manager.cpp:3713 | onFailure: will retry automatically after 16 seconds DEBUG | 20240730-144256.111 | WRAPPER | 26276 | appl_event_queue.cpp:35 | Notify: event= [class scx::CRegistrationRetrying] DEBUG | 20240730-144256.111 | RESIP:DUM | 26276 | ClientRegistration.cxx:74 | ClientRegistration::~ClientRegistration DEBUG | 20240730-144256.111 | RESIP:DUM | 26276 | KeepAliveManager.cxx:78 | Last association removed for keep alive id=3: [ V4 217.0.148.69:5060 UDP flowKey=2396 transportKey=1 ] ERR | 20240730-144256.111 | Z:APP | 25056 | User.cpp:110 | Account (+4986322880835001@tel.t-online.de) - register failed (Busy Everywhere) : SIP:+4986322880835001 DEBUG | 20240730-144256.111 | RESIP:DUM | 26276 | DialogSet.cxx:124 | ********** DialogSet::~DialogSet: QPxhPmis6-jzUz7pZAzCPw..-773c616c************* DEBUG | 20240730-144256.111 | WRAPPER | 26276 | app_dialogs.cpp:67 | ~AppDialogSet 000001F71C2538C0 user= 0000000000C77F24 call= FFFFFFFFFFFFFFFF DEBUG | 20240730-144256.138 | Z:APP | 25056 | HistoryService.cpp:414 | History add account elapsed time = 8ms DEBUG | 20240730-144256.145 | Z:APP | 25056 | HistoryService.cpp:157 | History add/update elapsed time = 7ms DEBUG | 20240730-144256.145 | Z:APP | 25056 | Account.cpp:2579 | Account = +4986322880835001@tel.t-online.de history new count updated from 46 to 47 DEBUG | 20240730-144256.147 | Z:APP | 25056 | HistoryFilter.cpp:230 | History filter (Z7ebc95781799394f37fcd0a7) started (limit = 1; groupMode = 1). DEBUG | 20240730-144256.147 | Z:APP | 25056 | Phone.Account.cpp:173 | History filter refresh request because of an account succesful registeration grouped by (3). ERR | 20240730-144256.147 | Z:APP | 25056 | User.cpp:86 | Account (+4986322880835001@tel.t-online.de) - retry registration in 16seconds : SIP:+4986322880835001 DEBUG | 20240730-144256.147 | Z:APP | 25056 | HistoryService.cpp:99 | History refreshing filters grouped by (3). DEBUG | 20240730-144256.147 | Z:APP | 25056 | HistoryFilter.cpp:365 | History filter (Z7ebc95781799394f37fcd0a7) finished (limit = 1; groupMode = 1; count = 1 DEBUG | 20240730-144256.147 | Z:APP | 25056 | HistoryFilter.cpp:368 | History filter (Z7ebc95781799394f37fcd0a7) elapsed time = 0ms