locked
sip 2.0 493 unsupported request syntax error in OCS 2007 logging tools RRS feed

  • Question

  • I have came cross some problem to create session with OCS 2007, 
    In the front end services properties, I've added routing as Matching URI = SIP:*@*, next Hop = xxx.xxx.com, Port=5061 and Transport = TLS.  I've added the xxx.xxx.com onto Host Authorization tab as well.

    When an OC client selects two contacts, right click and chooses Start a Conference Call from the menu, I  got a Diagnostics error  saying Parsing Error in my conference server

    Does anyone have any ideas how to fix it.

    below is s4 trace.


    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000001 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem TcpTransport.OnReceived 0x3A6D463, arg=<OverlappedAsyncResult_15BED58>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000002 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(133))( 00EF18DE )Starting Dispatcher on current worker thread
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000003 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(169))( 00EF18DE )Started
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000004 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem TcpTransport.OnReceived 0x3A6D463, arg=<OverlappedAsyncResult_15BED58>
    TL_INFO(TF_PROTOCOL) [0]0C88.09B8::08/02/2007-15:09:23.848.00000005 (S4,TcpTransport.TraceNetworkPacket:0.idx(559))( 0375709A )Packet size=2280

    >>> Incoming TCP packet BEGIN

    \0x17\0x03\0x01\0x08\0xe3m\0xe0h\0xa7sP\0xcdk\0xaaP8H\0xd4)l\0xc5Y\0xe3\0xab\0x9f\0x07c\0xc5\0xca\0xc2[\0xea_$b}\0x0f\0x18>\0xd9\0xad\0xa4a\0xaf\0xb0\0xc5\0x8ek+R\0x11\0xac\0xb5n=\0xb4-l\0xa8\0xd7\0xd1\0x18\0xed\0xce\0x1bY\0x8e\0x8d\0x06\0xe9F\0xf7\0xa3>r\0xa2\0xfc^\0xb5\0x92\0xbb\0xdcXO\0xd8\0x84\0x8f\0x9a\0x08b\0xffP\0x98c\0xbd>\0xb0\0xb8lvxzA\0x1ca4\0x1d\0xd35\0xf8"YixC+u\0x15*j\0xcd\0xbf\0xa0\0x98\0x08\0xacC\0x93\0xef\0x89L\0x9e\0x13}\0xc4\0xbb\0xe9J\0xd6\0xe3o\0x07\0xdf\n

    \0xd6cu<\0xf2\0x9a\0xffV\0xc0\0x95]\0xf8\0x1f\0xe1\0x06S\0xbc\0x0e+x\0xe5\0xca\0x07)"\0xf1j\0xcc[\0xbdOr\0x83$@6\0x0fAd\0x93\0xd9\r\0xe0\0xed\0x14:<\ \0x9ekg\0x8c\0xc5\0x0e\0xc8\0xb8_\0xa9\0xe8\0xcf\0xee\0xcco\0x81\0xc0\0xcdf;\0xa1\0xbd\0xc5\0xaeZp\0xa1V\0xcf\0xb2c\t\0x81X\0xf3\0x18\0xba\8\0xbc\0x1c\0xab_\0xf3\r\0x99iN\0xd5?x97IF|\0x8a\0xaa\0x9d\0x18\0xdc(\0xaa|zO\0xa8Y\0xd7E \0xda\0x07\0xec\0x88\0xf9\0xc3\0x88Qs\0x89g\0xae\0xd0K\0x88\0xad\0xc4<#\0x8c?\0xb4\0x02\0x1a~\0xcfi\0x1fM\0x06\0xb8\0xa3\0xc1\0xcfAwlt\0xc74\0xa9\0xb6\0xa99\0xe6\0xffuZ\0xf9\0xaf\0xa1u\0x96\0xde\0x8bW\0xe0\0x82\0xeb\0xe3\0xd0\0x02{+\0xd2\0xc7)\0x84`\0xd7\0x97\0x1d%\0xb5\0x81\0xc5\0xc6\0xd8\0xea\0xebJ\0xca\0xbc*x\0xa4\0x00\0xd0\0xce\0xe7\0xd7\0xbc|\0x89\0x14n\0xbac\0xa4\0x96ia\0xe8\0x99i\0x0eQ\0xac\0xb3\0x0c2w\0x15\0xfe\0xd79\0x96\0xeb\0xd4... the rest is skipped (non-printable data)

    <<< Incoming TCP packet END
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000006 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem TlsTransport.OnReceived 0x57438E, arg=<TransportsDataBuffer_2282745>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000007 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem TcpTransport.OnReceived 0x3A6D463, arg=<OverlappedAsyncResult_15BED58>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000008 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem TlsTransport.OnReceived 0x57438E, arg=<TransportsDataBuffer_2282745>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000009 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem CompressionTransport.OnReceived 0x31F8BD, arg=<TransportsDataBuffer_B02836>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.0000000a (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem TlsTransport.OnReceived 0x57438E, arg=<TransportsDataBuffer_2282745>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.0000000b (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem CompressionTransport.OnReceived 0x31F8BD, arg=<TransportsDataBuffer_B02836>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.0000000c (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem SipTlsConnection.OnReceived 0xBA35F0, arg=<TransportsDataBuffer_B02836>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.0000000d (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem CompressionTransport.OnReceived 0x31F8BD, arg=<TransportsDataBuffer_B02836>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.0000000e (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem SipTlsConnection.OnReceived 0xBA35F0, arg=<TransportsDataBuffer_B02836>
    TL_INFO(TF_PROTOCOL) [0]0C88.09B8::08/02/2007-15:09:23.848.0000000f (S4,SipMessage.DataLoggingHelper:26.idx(550))

    <<<<<<<<<<<<Incoming RawDataBuffer 135.124.126.115:5061<-135.124.126.96:3446

    ACK sip:MSAdapter.devlcs.du:5063;transport=tls SIP/2.0

    Via: SIP/2.0/TLS 135.124.126.96:3446;branch=z9hG4bKEBD21BBC.7E5517C9;branched=FALSE

    Max-Forwards: 70

    CSeq: 1 ACK

    CALL-ID: db995d6e06f747618470eb045af28959

    To: <sipBig Smileevtest05@devlcs.du;gruu;opaque=app:conf:audio-video:id:C2121C2F33C38245AEFF0033970B3277>;tag=76b3b9c599

    From: "devtest05"<sipBig Smileevtest05@devlcs.du>;tag=a282655f24;epid=48568094a6

    Content-Length: 0



    7>
    TL_INFO(TF_PROTOCOL) [0]0C88.09B8::08/02/2007-15:09:23.848.00000010 (S4,SipMessage.DataLoggingHelper:26.idx(550))

    <<<<<<<<<<<<Incoming SipMessage c=[<SipTlsConnection_355EF5C>], 135.124.126.115:5061<-135.124.126.96:3446

    INVITE sip:MSAdapter.devlcs.du:5063;transport=tls SIP/2.0

    FROM: "devtest05"<sipBig Smileevtest05@devlcs.du>;tag=7c17d28779;epid=48568094a6

    TO: <sipBig Smileevtest05@devlcs.du;gruu;opaque=app:conf:audio-video:id:A7AFFEFC81D71F4495D1B08F99586CED>

    CSEQ: 1 INVITE

    CALL-ID: ca849a8b2d524f0a882d88635b044803

    MAX-FORWARDS: 69

    VIA: SIP/2.0/TLS 135.124.126.96:3446;branch=z9hG4bK82C30DB9.A5C40080;branched=FALSE

    VIA: SIP/2.0/TLS 135.124.126.46:1991;ms-received-port=1991;ms-received-cid=400

    RECORD-ROUTE: <sip:LCS2.devlcs.du:5061;transport=tls;ms-role-rs-to;ms-role-rs-from;ms-opaque=aaib2RUvEaijlMZDaBDLTsPQAA;lr>;tag=60BAD521FA945F6F48D81885A243887A

    CONTACT: <sipBig Smileevtest05@devlcs.du;opaque=user:epid:59mU92h4c1ijc-XKjowWIgAA;gruu>

    CONTENT-LENGTH: 1080

    SUPPORTED: timer

    SUPPORTED: ms-sender

    SUPPORTED: ms-conf-invite

    USER-AGENT: UCCP/2.0.6090.0 OC/2.0.6090.0 (Microsoft Office Communicator)

    CONTENT-TYPE: application/sdp

    CALL-INFO: <sipBig Smileevtest05@devlcs.du;gruu;opaque=app:conf:focus:id:A7AFFEFC81D71F4495D1B08F99586CED>;purpose=ms-conf-uri

    ms-user-data: ms-publiccloud=true;ms-federation=true

    Ms-Conversation-Id: AcfVFyctzMWhM4EVQ9S3yoaeuuzlKg==

    ms-keep-alive: UAC;hop-hop=yes



    v=0

    o=- 0 0 IN IP4 135.124.126.46

    s=session

    c=IN IP4 135.124.126.46

    b=CT:99980

    t=0 0

    m=audio 51072 RTP/AVP 114 111 112 115 116 4 8 0 97 101

    k=base64:85ba7Z94ChWAbTMbQiaBiRKD0IAit4dA67GUjL9BdQ8tnfcBt7RrUjZtxF4C

    a=candidate:24cqX+MG+BO03CorredztSqVQtteQ3zCHvjqm09z9h8 1 nETzv8ClxovQ0znHpVJMqg UDP 0.900 135.124.126.46 51072

    a=candidate:24cqX+MG+BO03CorredztSqVQtteQ3zCHvjqm09z9h8 2 nETzv8ClxovQ0znHpVJMqg UDP 0.900 135.124.126.46 13056

    a=cryptoscale:1 client AES_CM_128_HMAC_SHA1_80 inline:JXUHJ6fdksH8oWoi1fmaBMet+AG9BPkGgjDg9qIa|2^31|1:1

    a=crypto:2 AES_CM_128_HMAC_SHA1_80 inlineTongue Tied9GVZYdczc0g2rgkoabOdILH8jljh519evSgmP9X|2^31|1:1

    a=maxptime:200

    a=rtcp:13056

    a=rtpmap:114 x-msrta/16000

    a=fmtp:114 bitrate=12000

    a=rtpmap:111 SIREN/16000

    a=fmtp:111 bitrate=16000

    a=rtpmap:112 G7221/16000

    a=fmtp:112 bitrate=24000

    a=rtpmap:115 x-msrta/8000

    a=fmtp:115 bitrate=12000

    a=rtpmap:116 AAL2-G726-32/8000

    a=rtpmap:4 G723/8000

    a=rtpmap:8 PCMA/8000

    a=rtpmap:0 PCMU/8000

    a=rtpmap:97 RED/8000

    a=rtpmap:101 telephone-event/8000

    a=fmtp:101 0-16

    a=encryptionSurpriseptional

    ------------EndOfIncoming SipMessage


    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000011 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 02B4F0D0 )Queueing Workitem Microsoft.Rtc.Internal.Sip.SipConnection+MessageProcessingWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000012 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(138))( 02B4F0D0 )Starting Dispatcher on new thread pool thread
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000013 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 02015BD6 )Queueing Workitem Microsoft.Rtc.Internal.Sip.DispatchEventWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000014 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(138))( 02015BD6 )Starting Dispatcher on new thread pool thread
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000015 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem CompressionTransport.Receive 0x347B22B
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000016 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem SipTlsConnection.OnReceived 0xBA35F0, arg=<TransportsDataBuffer_B02836>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000017 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem CompressionTransport.Receive 0x347B22B
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000018 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem TlsTransport.Receive 0x1343D27
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.00000019 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem CompressionTransport.Receive 0x347B22B
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.0000001a (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem TlsTransport.Receive 0x1343D27
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.0000001b (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem TcpTransport.Receive 0x2438724
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.0000001c (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem TlsTransport.Receive 0x1343D27
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.0000001d (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem TcpTransport.Receive 0x2438724
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.0000001e (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem TcpTransport.Receive 0x2438724
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:23.848.0000001f (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(306))( 00EF18DE )Finished
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:23.848.00000020 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(169))( 02B4F0D0 )Started
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:23.848.00000021 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 02B4F0D0 )Executing Workitem Microsoft.Rtc.Internal.Sip.SipConnection+MessageProcessingWorkitem
    TL_INFO(TF_PROTOCOL) [0]0C88.0FC8::08/02/2007-15:09:23.848.00000022 (S4,SipMessage.DataLoggingHelper:26.idx(500))

    >>>>>>>>>>>>Outgoing SipMessage c=[<SipTlsConnection_355EF5C>], 135.124.126.115:5061->135.124.126.96:3446

    SIP/2.0 100 Trying

    FROM: "devtest05"<sipBig Smileevtest05@devlcs.du>;tag=7c17d28779;epid=48568094a6

    TO: <sipBig Smileevtest05@devlcs.du;gruu;opaque=app:conf:audio-video:id:A7AFFEFC81D71F4495D1B08F99586CED>

    CSEQ: 1 INVITE

    CALL-ID: ca849a8b2d524f0a882d88635b044803

    MAX-FORWARDS: 70

    VIA: SIP/2.0/TLS 135.124.126.96:3446;branch=z9hG4bK82C30DB9.A5C40080;branched=FALSE,SIP/2.0/TLS 135.124.126.46:1991;ms-received-port=1991;ms-received-cid=400

    CONTENT-LENGTH: 0



    ------------EndOfOutgoing SipMessage


    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:23.848.00000023 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem CompressionTransport.Send 0x2C3F3CC, arg1=<TransportsDataBuffer_F05482>, arg2=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:23.848.00000024 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(138))( 00EF18DE )Starting Dispatcher on new thread pool thread
    TL_INFO(TF_PROTOCOL) [0]0C88.0FC8::08/02/2007-15:09:23.848.00000025 (S4,SipMessage.DataLoggingHelper:26.idx(500))

    >>>>>>>>>>>>Outgoing RawDataBuffer 135.124.126.115:5061->135.124.126.96:3446

    SIP/2.0 100 Trying

    FROM: "devtest05"<sipBig Smileevtest05@devlcs.du>;tag=7c17d28779;epid=48568094a6

    TO: <sipBig Smileevtest05@devlcs.du;gruu;opaque=app:conf:audio-video:id:A7AFFEFC81D71F4495D1B08F99586CED>

    CSEQ: 1 INVITE

    CALL-ID: ca849a8b2d524f0a882d88635b044803

    MAX-FORWARDS: 70

    VIA: SIP/2.0/TLS 135.124.126.96:3446;branch=z9hG4bK82C30DB9.A5C40080;branched=FALSE,SIP/2.0/TLS 135.124.126.46:1991;ms-received-port=1991;ms-received-cid=400

    CONTENT-LENGTH: 0



    ------------EndOfOutgoing RawDataBuffer


    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:23.848.00000026 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 02B4F0D0 )Finished  Workitem Microsoft.Rtc.Internal.Sip.SipConnection+MessageProcessingWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:23.848.00000027 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(306))( 02B4F0D0 )Finished
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:23.848.00000028 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(169))( 02015BD6 )Started
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:23.848.00000029 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 02015BD6 )Executing Workitem Microsoft.Rtc.Internal.Sip.DispatchEventWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000002a (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 02B4F0D0 )Queueing Workitem Microsoft.Rtc.Internal.Sip.SipConnection+MessageProcessingWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000002b (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(138))( 02B4F0D0 )Starting Dispatcher on new thread pool thread
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000002c (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 02015BD6 )Finished  Workitem Microsoft.Rtc.Internal.Sip.DispatchEventWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000002d (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(306))( 02015BD6 )Finished
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000002e (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(169))( 00EF18DE )Started
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000002f (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem CompressionTransport.Send 0x2C3F3CC, arg1=<TransportsDataBuffer_F05482>, arg2=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000030 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem TlsTransport.Send 0x21542C4, arg1=<TransportsDataBuffer_F05482>, arg2=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000031 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem CompressionTransport.Send 0x2C3F3CC, arg1=<TransportsDataBuffer_F05482>, arg2=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000032 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem TlsTransport.Send 0x21542C4, arg1=<TransportsDataBuffer_F05482>, arg2=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000033 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem TcpTransport.Send 0x65150F, arg1=<TransportsDataBuffer_26755B7>, arg2=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000034 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem TlsTransport.Send 0x21542C4, arg1=<TransportsDataBuffer_F05482>, arg2=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000035 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem TcpTransport.Send 0x65150F, arg1=<TransportsDataBuffer_26755B7>, arg2=<SipResponse_496B41>
    TL_INFO(TF_PROTOCOL) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000036 (S4,TcpTransport.TraceNetworkPacket:0.idx(559))( 0375709A )Packet size=473

    >>> Outgoing TCP packet BEGIN

    \0x17\0x03\0x01\0x01\0xd4\0x07\0xb3\0x1a\0x0e\0xe1\0x07\0xad\0xbe\0xc5\0xa65`\r\0x93 @[\0x84\0x1e\0x18f\0xf4\t\0xb29WD\0x94\0xd9\0x01\0x92\0xfb\0xf9\0xe1N\0xa2\0xfa\0xef\0x95\0xc7o\0xf3<\0x9e\0xd4\0xd1\0x8f\0xaf\0xba\0xe1E\0xcf\0xcd\0xec\0x8c\0xbc5\0x86N\0xf7... the rest is skipped (non-printable data)

    <<< Outgoing TCP packet END
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000037 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem TlsTransport.OnSent 0x114C854, arg=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000038 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem TcpTransport.Send 0x65150F, arg1=<TransportsDataBuffer_26755B7>, arg2=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000039 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem TlsTransport.OnSent 0x114C854, arg=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000003a (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem CompressionTransport.OnSent 0x3404163, arg=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000003b (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem TlsTransport.OnSent 0x114C854, arg=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000003c (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem CompressionTransport.OnSent 0x3404163, arg=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000003d (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem SipTlsConnection.OnSent 0x253AADD, arg=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000003e (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem CompressionTransport.OnSent 0x3404163, arg=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000003f (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem SipTlsConnection.OnSent 0x253AADD, arg=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000040 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 02F8CBA9 )Queueing Workitem Microsoft.Rtc.Internal.Sip.SipStack+MessageSentWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000041 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(138))( 02F8CBA9 )Starting Dispatcher on new thread pool thread
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000042 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem SipTlsConnection.OnSent 0x253AADD, arg=<SipResponse_496B41>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000043 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(306))( 00EF18DE )Finished
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000044 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(169))( 02B4F0D0 )Started
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000045 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 02B4F0D0 )Executing Workitem Microsoft.Rtc.Internal.Sip.SipConnection+MessageProcessingWorkitem
    TL_INFO(TF_PROTOCOL) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000046 (S4,SipMessage.DataLoggingHelper:26.idx(500))

    >>>>>>>>>>>>Outgoing SipMessage c=[<SipTlsConnection_355EF5C>], 135.124.126.115:5061->135.124.126.96:3446

    SIP/2.0 493 Unsupported request syntax

    FROM: "devtest05"<sipBig Smileevtest05@devlcs.du>;tag=7c17d28779;epid=48568094a6

    TO: <sipBig Smileevtest05@devlcs.du;gruu;opaque=app:conf:audio-video:id:A7AFFEFC81D71F4495D1B08F99586CED>;tag=df3d9555e2

    CSEQ: 1 INVITE

    CALL-ID: ca849a8b2d524f0a882d88635b044803

    MAX-FORWARDS: 70

    VIA: SIP/2.0/TLS 135.124.126.96:3446;branch=z9hG4bK82C30DB9.A5C40080;branched=FALSE,SIP/2.0/TLS 135.124.126.46:1991;ms-received-port=1991;ms-received-cid=400

    CONTENT-LENGTH: 0



    ------------EndOfOutgoing SipMessage


    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000047 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem CompressionTransport.Send 0x32A64BC, arg1=<TransportsDataBuffer_3C04CAA>, arg2=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000048 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(138))( 00EF18DE )Starting Dispatcher on new thread pool thread
    TL_INFO(TF_PROTOCOL) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000049 (S4,SipMessage.DataLoggingHelper:26.idx(500))

    >>>>>>>>>>>>Outgoing RawDataBuffer 135.124.126.115:5061->135.124.126.96:3446

    SIP/2.0 493 Unsupported request syntax

    FROM: "devtest05"<sipBig Smileevtest05@devlcs.du>;tag=7c17d28779;epid=48568094a6

    TO: <sipBig Smileevtest05@devlcs.du;gruu;opaque=app:conf:audio-video:id:A7AFFEFC81D71F4495D1B08F99586CED>;tag=df3d9555e2

    CSEQ: 1 INVITE

    CALL-ID: ca849a8b2d524f0a882d88635b044803

    MAX-FORWARDS: 70

    VIA: SIP/2.0/TLS 135.124.126.96:3446;branch=z9hG4bK82C30DB9.A5C40080;branched=FALSE,SIP/2.0/TLS 135.124.126.46:1991;ms-received-port=1991;ms-received-cid=400

    CONTENT-LENGTH: 0



    ------------EndOfOutgoing RawDataBuffer


    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000004a (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 02B4F0D0 )Finished  Workitem Microsoft.Rtc.Internal.Sip.SipConnection+MessageProcessingWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000004b (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(306))( 02B4F0D0 )Finished
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000004c (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(169))( 02F8CBA9 )Started
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000004d (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 02F8CBA9 )Executing Workitem Microsoft.Rtc.Internal.Sip.SipStack+MessageSentWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000004e (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 02F8CBA9 )Finished  Workitem Microsoft.Rtc.Internal.Sip.SipStack+MessageSentWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000004f (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(306))( 02F8CBA9 )Finished
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000050 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(169))( 00EF18DE )Started
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000051 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem CompressionTransport.Send 0x32A64BC, arg1=<TransportsDataBuffer_3C04CAA>, arg2=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000052 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem TlsTransport.Send 0xAF8F67, arg1=<TransportsDataBuffer_3C04CAA>, arg2=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000053 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem CompressionTransport.Send 0x32A64BC, arg1=<TransportsDataBuffer_3C04CAA>, arg2=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000054 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem TlsTransport.Send 0xAF8F67, arg1=<TransportsDataBuffer_3C04CAA>, arg2=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000055 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem TcpTransport.Send 0xCE21FF, arg1=<TransportsDataBuffer_20039F2>, arg2=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000056 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem TlsTransport.Send 0xAF8F67, arg1=<TransportsDataBuffer_3C04CAA>, arg2=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000057 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem TcpTransport.Send 0xCE21FF, arg1=<TransportsDataBuffer_20039F2>, arg2=<SipResponse_D70F29>
    TL_INFO(TF_PROTOCOL) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000058 (S4,TcpTransport.TraceNetworkPacket:0.idx(559))( 0375709A )Packet size=508

    >>> Outgoing TCP packet BEGIN

    \0x17\0x03\0x01\0x01\0xf7\0xfek\0xa3]\0xda\0xf3\0x9bm\0xfe\0xa9\0x1c\0xc5\0xd3\0x91\0xa2}\0xe6+\0xac1\0xa4\0xdc\0x1bM\0xef\0x11\0xf3\t|\0xe3\0x1f\0x95\0x16\0x81\0xa9I\0xce\\0x87\0xa0\0xfb}\0xb96W\0xa5I\0x0b\0x06A\0x86i1Z-,!\0xd2\0xc2\0x0c`\0xe4\0xfb\0x00\0x06~D\0x99\0x9d\0xd7\0xcb... the rest is skipped (non-printable data)

    <<< Outgoing TCP packet END
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000059 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem TlsTransport.OnSent 0x2116E06, arg=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000005a (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem TcpTransport.Send 0xCE21FF, arg1=<TransportsDataBuffer_20039F2>, arg2=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000005b (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem TlsTransport.OnSent 0x2116E06, arg=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000005c (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem CompressionTransport.OnSent 0x33E17DB, arg=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000005d (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem TlsTransport.OnSent 0x2116E06, arg=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000005e (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem CompressionTransport.OnSent 0x33E17DB, arg=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.0000005f (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem SipTlsConnection.OnSent 0x1AD2CF2, arg=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000060 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem CompressionTransport.OnSent 0x33E17DB, arg=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000061 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem SipTlsConnection.OnSent 0x1AD2CF2, arg=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000062 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 02F8CBA9 )Queueing Workitem Microsoft.Rtc.Internal.Sip.SipStack+MessageSentWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000063 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(138))( 02F8CBA9 )Starting Dispatcher on new thread pool thread
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000064 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem SipTlsConnection.OnSent 0x1AD2CF2, arg=<SipResponse_D70F29>
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000065 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(306))( 00EF18DE )Finished
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000066 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(169))( 02F8CBA9 )Started
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000067 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 02F8CBA9 )Executing Workitem Microsoft.Rtc.Internal.Sip.SipStack+MessageSentWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000068 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 02F8CBA9 )Finished  Workitem Microsoft.Rtc.Internal.Sip.SipStack+MessageSentWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.400.00000069 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(306))( 02F8CBA9 )Finished
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.0000006a (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem TcpTransport.OnReceived 0x3255062, arg=<OverlappedAsyncResult_796922>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.0000006b (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(133))( 00EF18DE )Starting Dispatcher on current worker thread
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.0000006c (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(169))( 00EF18DE )Started
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.0000006d (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem TcpTransport.OnReceived 0x3255062, arg=<OverlappedAsyncResult_796922>
    TL_INFO(TF_PROTOCOL) [0]0C88.09B8::08/02/2007-15:09:25.490.0000006e (S4,TcpTransport.TraceNetworkPacket:0.idx(559))( 0375709A )Packet size=447

    >>> Incoming TCP packet BEGIN

    \0x17\0x03\0x01\0x01\0xba:\0xd4\0xd4@u\0xb9\0x8cq!ur\0x18z\0x8e\0xe1Or\0x0b\0xcf/f\0x1a\0xb03\0x11VC\0x81V\0xc3UoR^\0xded\0x1c\0x8a2S\0x05\0x06\0x8fK\0xb1\0xbbGz}\0x01=T\0xab\0x1e\0xb7\0xfd\0xa8\0xb8n\0x16~\0xb1=\0xe1c\0x15\0x0b\0x8a\0xcd\0xb4\0xbe\0x07\0xfb... the rest is skipped (non-printable data)

    <<< Incoming TCP packet END
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.0000006f (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem TlsTransport.OnReceived 0x2D3B1A2, arg=<TransportsDataBuffer_3C01A23>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.00000070 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem TcpTransport.OnReceived 0x3255062, arg=<OverlappedAsyncResult_796922>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.00000071 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem TlsTransport.OnReceived 0x2D3B1A2, arg=<TransportsDataBuffer_3C01A23>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.00000072 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem CompressionTransport.OnReceived 0x3C6A2E5, arg=<TransportsDataBuffer_16F5C28>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.00000073 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem TlsTransport.OnReceived 0x2D3B1A2, arg=<TransportsDataBuffer_3C01A23>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.00000074 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem CompressionTransport.OnReceived 0x3C6A2E5, arg=<TransportsDataBuffer_16F5C28>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.00000075 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem SipTlsConnection.OnReceived 0x146662C, arg=<TransportsDataBuffer_16F5C28>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.00000076 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem CompressionTransport.OnReceived 0x3C6A2E5, arg=<TransportsDataBuffer_16F5C28>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.00000077 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem SipTlsConnection.OnReceived 0x146662C, arg=<TransportsDataBuffer_16F5C28>
    TL_INFO(TF_PROTOCOL) [0]0C88.09B8::08/02/2007-15:09:25.490.00000078 (S4,SipMessage.DataLoggingHelper:26.idx(550))

    <<<<<<<<<<<<Incoming RawDataBuffer 135.124.126.115:5061<-135.124.126.96:3446

    ACK sip:MSAdapter.devlcs.du:5063;transport=tls SIP/2.0

    Via: SIP/2.0/TLS 135.124.126.96:3446;branch=z9hG4bKEBD21BBC.7E5517C9;branched=FALSE

    Max-Forwards: 70

    CSeq: 1 ACK

    CALL-ID: db995d6e06f747618470eb045af28959

    To: <sipBig Smileevtest05@devlcs.du;gruu;opaque=app:conf:audio-video:id:C2121C2F33C38245AEFF0033970B3277>;tag=76b3b9c599

    From: "devtest05"<sipBig Smileevtest05@devlcs.du>;tag=a282655f24;epid=48568094a6

    Content-Length: ------------EndOfIncoming RawDataBuffer


    TL_INFO(TF_PROTOCOL) [0]0C88.09B8::08/02/2007-15:09:25.490.00000079 (S4,SipMessage.DataLoggingHelper:26.idx(550))

    <<<<<<<<<<<<Incoming SipMessage c=[<SipTlsConnection_355EF5C>], 135.124.126.115:5061<-135.124.126.96:3446

    ACK sip:MSAdapter.devlcs.du:5063;transport=tls SIP/2.0

    FROM: "devtest05"<sipBig Smileevtest05@devlcs.du>;tag=7c17d28779;epid=48568094a6

    TO: <sipBig Smileevtest05@devlcs.du;gruu;opaque=app:conf:audio-video:id:A7AFFEFC81D71F4495D1B08F99586CED>;tag=df3d9555e2

    CSEQ: 1 ACK

    CALL-ID: ca849a8b2d524f0a882d88635b044803

    MAX-FORWARDS: 70

    VIA: SIP/2.0/TLS 135.124.126.96:3446;branch=z9hG4bK82C30DB9.A5C40080;branched=FALSE

    CONTENT-LENGTH: 0



    ------------EndOfIncoming SipMessage


    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.0000007a (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 02015BD6 )Queueing Workitem Microsoft.Rtc.Internal.Sip.DispatchEventWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.0000007b (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(138))( 02015BD6 )Starting Dispatcher on new thread pool thread
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.0000007c (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem CompressionTransport.Receive 0x2DFF131
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.0000007d (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem SipTlsConnection.OnReceived 0x146662C, arg=<TransportsDataBuffer_16F5C28>
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.0000007e (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem CompressionTransport.Receive 0x2DFF131
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.0000007f (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem TlsTransport.Receive 0x2DC3D77
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.00000080 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem CompressionTransport.Receive 0x2DFF131
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.490.00000081 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem TlsTransport.Receive 0x2DC3D77
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.500.00000082 (S4,SingleThreadedDispatcherQueue.Enqueue:35.idx(79))( 00EF18DE )Queueing Workitem TcpTransport.Receive 0x1EB9B3E
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.500.00000083 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem TlsTransport.Receive 0x2DC3D77
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.500.00000084 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 00EF18DE )Executing Workitem TcpTransport.Receive 0x1EB9B3E
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.500.00000085 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 00EF18DE )Finished  Workitem TcpTransport.Receive 0x1EB9B3E
    TL_INFO(TF_COMPONENT) [0]0C88.09B8::08/02/2007-15:09:25.500.00000086 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(306))( 00EF18DE )Finished
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.500.00000087 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(169))( 02015BD6 )Started
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.500.00000088 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(204))( 02015BD6 )Executing Workitem Microsoft.Rtc.Internal.Sip.DispatchEventWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.500.00000089 (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(274))( 02015BD6 )Finished  Workitem Microsoft.Rtc.Internal.Sip.DispatchEventWorkitem
    TL_INFO(TF_COMPONENT) [0]0C88.0FC8::08/02/2007-15:09:25.500.0000008a (S4,SingleThreadedDispatcherQueue.DispatcherCallback:35.idx(306))( 02015BD6 )Finished


    Thursday, August 2, 2007 3:41 PM

All replies

  • Hi Jmzou,

    Can you update this thread? Have you implemented the RTM version and confirmed this is still an issue.?

     

    Wednesday, September 19, 2007 6:56 PM