Results 1 to 10 of 13

Hybrid View

  1. #1
    Member
    Join Date
    Mar 2007
    Location
    Boston
    Posts
    26

    Client only in polling mode

    for client version Lightstreamer Silverlight Client Library version 1.1.3537.25900 user only can poll instead of stream. There is no proxy involved, here is the log entry

    15.Apr.10 13:05:40,563 < INFO> Serving request: /lightstreamer/create_session.tx
    t?LS_user=3931be67-a465-46c9-ae19-c25d7460ab16&LS_adapter_set=SAdapter&LS_con
    tent_length=50000000&LS_polling=true&LS_polling_mi llis=0&LS_idle_millis=30000&LS
    _report_info=true from 10.35.185.113:41159
    15.Apr.10 13:05:40,565 < INFO> Starting new session: S78c524cd6a396481T0540564 from 10.35.185.113:41159
    15.Apr.10 13:05:40,739 < INFO> Serving request: /lightstreamer/control.txt?LS_session=S78c524cd6a396481T0540564&L S_op=add&LS_table=1&LS_id=S_ADAPTER&LS_mode=RAW&LS _schema=MESSAGEID+DATA+MESSAGE_TS&LS_data_adapter= S_ADAPTER from 10.35.185.113:41159
    15.Apr.10 13:05:40,739 < INFO> Controlling session: S78c524cd6a396481T0540564 fr
    om 10.35.185.113:41159
    15.Apr.10 13:06:10,898 < INFO> Polling (2) to session: S78c524cd6a396481T0540564
    from 10.35.185.113:41159

    Thanks.

  2. #2
    Administrator
    Join Date
    Jul 2006
    Location
    Milan
    Posts
    1,091
    Indeed, the log reports a normal long polling session.

    In a normal case, this happens when the isPolling attribute of ConnectionInfo is set as true. Please check that on the source code first.

    Note that, even with no proxy, it is always possible that some intermediate node (an antivirus, for instance) causes the Stream-sense mechanism to come into play.
    This can be checked in the previous part of the log.

  3. #3
    Member
    Join Date
    Mar 2007
    Location
    Boston
    Posts
    26

    Question another strange behavior

    The same application I noticed another strange behavior and the developer claims it's not from the application code but from the Silverlight client library. Here is the logs

    25-May-10 14:05:08,022 |INFO |LightstreamerLogger.requests |SERVER POOLED THREAD 2 |Serving request: /lightstreamer/create_session.txt?LS_user=LSUser&LS_adapter_set=A dapter&LS_content_length=50000000&LS_polling=true& LS_polling_millis=0&LS_idle_millis=0&LS_report_inf o=true from 10.35.185.113:52531

    (No Bind session request)

    25-May-10 14:05:08,070 |INFO |LightstreamerLogger.requests |SERVER POOLED THREAD 9 |Serving request: /lightstreamer/control.txt?LS_session=S737de3212f2fbeeeT0416469&L S_op=destroy from 10.35.185.113:52531

    Why the library sent a DESTROY request 50ms after the create session?

    Thanks

  4. #4
    Administrator
    Join Date
    Jul 2006
    Location
    Milan
    Posts
    1,091
    The Silverlight library may issue DESTROY requests simply to ensure that a session that is no longer needed is closed as soon as possible on the Server side.
    In fact, just closing the connection stream on the client side, sometimes is not enough to ensure that.

    Hence, if the session mentioned in DESTROY request (i.e. S737de3212f2fbeeeT0416469) is being closed by the client together with the opening of a new session at 14:05:08,022 then the log pattern is correct.
    If the session being destroyed were the same opened at 14:05:08,022 there would be something unusual happening.
    A full log snippet would be needed to shed full light on the case.

  5. #5
    Member
    Join Date
    Mar 2007
    Location
    Boston
    Posts
    26

    detail log

    On the client side here is the HttpWatch log;
    1. <entry method="POST" URL="https://*******.com/lightstreamer/create_session.txt">
    <started>00:00:09.860</started>
    <startedDateTime>2010-08-11T09:10:58.756</startedDateTime>
    <time>1.718</time>
    <result>200</result>
    <response><content>
    <contentLength>149</contentLength>
    <text><![CDATA[ OK SessionId:S4abfa93fa2681585T1101270 KeepaliveMillis:0 MaxBandwidth:0.0 RequestLimit:50000 ServerName:AMS3 HTTP Server PROBE LOOP ]]></text>
    <mimeType>text/plain; charset=iso-8859-1</mimeType>
    </content>
    </response>
    2. <entry method="GET" URL="https://*******.com/lightstreamer/bind_session.txt?LS_session=S4abfa93fa2681585T1101 270&amp;LS_content_length=50000000&amp;LS_report_i nfo=true&amp;LS_silverlight_version=1.0">
    <started>00:00:15.250</started>
    <startedDateTime>2010-08-11T09:11:04.146</startedDateTime>
    <time>4.238</time>
    <result>200</result>
    <summary>
    <response><content>
    <contentLength>2074</contentLength>
    <text><![CDATA[ OK SessionId:S4abfa93fa2681585T1101270 KeepaliveMillis:2000 MaxBandwidth:0.0 RequestLimit:50000 Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push Preamble: preparing push PROBE PROBE END ]]></text>
    <mimeType>text/plain; charset=iso-8859-1</mimeType>
    </content>
    </response>

    3. <entry method="POST" URL="https://*******.com/lightstreamer/create_session.txt">
    <started>00:00:18.031</started>
    <startedDateTime>2010-08-11T09:11:06.927</startedDateTime>
    <time>0.529</time>
    <result>200</result>
    <response><content>
    <contentLength>146</contentLength>
    <text><![CDATA[ OK SessionId:S92957313c3dc0a6eT1108268 KeepaliveMillis:30000 MaxBandwidth:0.0 RequestLimit:50000 ServerName:AMSATBTP3 HTTP Server LOOP ]]></text>

    4. <entry method="POST" URL="https://ecaalerts.fidelity.com/lightstreamer/control.txt">
    <started>00:00:18.047</started>
    <startedDateTime>2010-08-11T09:11:06.943</startedDateTime>
    <time>1.436</time>
    <result>200</result>
    <summary>
    5. <entry method="POST" URL="https://*****.com/lightstreamer/bind_session.txt">
    <started>00:00:19.610</started>
    <startedDateTime>2010-08-11T09:11:08.506</startedDateTime>
    <time>31.093</time>
    <result>200</result>
    <summary>
    <response><content>
    <contentLength>119</contentLength>
    <text><![CDATA[ OK SessionId:S92957313c3dc0a6eT1108268 KeepaliveMillis:30000 MaxBandwidth:0.0 RequestLimit:50000 PROBE LOOP ]]></text>
    <mimeType>text/plain; charset=iso-8859-1</mimeType>
    </content>
    </response>

    (#5 repeats until the app was closed)

    Eric

  6. #6
    Member
    Join Date
    Mar 2007
    Location
    Boston
    Posts
    26

    log on server

    continued from above thread
    09:11:01,270 |DEBUG|Logger.METADATA |SERVER POOLED THREAD 10 |New Session S4abfa93fa2681585T1101270 for user ad04d127-55a3-454a-a628-cd00fe3408be from 10.41.220.7
    09:11:01,270 |INFO |Logger.METADATA |SERVER POOLED THREAD 10 |User ad04d127-55a3-454a-a628-cd00fe3408be has 1 concurrent session(s) after this new session S4abfa93fa2681585T1101270 added.
    09:11:09,195 |DEBUG|Logger.METADATA |SERVER POOLED THREAD 8 |notifySessionClose: session id is S4abfa93fa2681585T1101270
    server-3.log:09:11:01,272 |INFO |LightstreamerLogger.requests |SERVER POOLED THREAD 10 |Starting new session: S4abfa93fa2681585T1101270 from 10.41.220.7:44852
    server-3.log:11-Aug-10 09:11:05,188 |INFO |LightstreamerLogger.requests |SERVER POOLED THREAD 9 |Serving request: /lightstreamer/bind_session.txt?LS_session=S4abfa93fa2681585T1101 270&LS_content_length=50000000&LS_report_info=true &LS_silverlight_version=1.0 from 10.41.220.7:44852
    server-3.log:11-Aug-10 09:11:05,190 |INFO |LightstreamerLogger.requests |SERVER POOLED THREAD 9 |Attaching session: S4abfa93fa2681585T1101270 from 10.41.220.7:44852
    server-3.log:11-Aug-10 09:11:09,194 |INFO |LightstreamerLogger.requests |SERVER POOLED THREAD 8 |Serving request: /lightstreamer/control.txt?LS_session=S4abfa93fa2681585T1101270&L S_op=destroy from 10.41.220.7:44878
    atbt-ams-server-3.log:11-Aug-10 09:11:09,194 |INFO |LightstreamerLogger.requests |SERVER POOLED THREAD 8 |Destroying session: S4abfa93fa2681585T1101270 from 10.41.220.7:44878
    second session started
    09:11:08,268 |DEBUG|ATBTLogger.METADATA
    |SERVER POOLED THREAD 5 |New Session S92957313c3dc0a6eT1108268 for user
    ad04d127-55a3-454a-a628-cd00fe3408be from 10.41.220.7

    server-3.log:11-Aug-10 09:11:08,268 |INFO |LightstreamerLogger.requests
    |SERVER POOLED THREAD 5 |Starting new session: S92957313c3dc0a6eT110826
    8 from 10.41.220.7:44878
    server-3.log:11-Aug-10 09:11:11,136 |INFO |LightstreamerLogger.requests
    |SERVER POOLED THREAD 6 |Serving request: /lightstreamer/control.txt?LS
    _session=S92957313c3dc0a6eT1108268&LS_op=add&LS_ta ble=1&LS_id=ADAPTER&L
    S_mode=RAW&LS_schema=MESSAGEID+DATA+MESSAGE_TS&LS_ data_adapter=ADAPTER from 10.41.220.7:44889
    server-3.log:11-Aug-10 09:11:11,137 |INFO |LightstreamerLogger.requests
    |SERVER POOLED THREAD 6 |Controlling session: S92957313c3dc0a6eT1108268
    from 10.41.220.7:44889
    server-3.log:11-Aug-10 09:11:40,461 |INFO |LightstreamerLogger.requests
    |SERVER POOLED THREAD 9 |Polling (2) to session: S92957313c3dc0a6eT1108
    268 from 10.41.220.7:44878
    -server-3.log:11-Aug-10 09:12:10,702 |INFO |LightstreamerLogger.requests
    |SERVER POOLED THREAD 9 |Polling (3) to session: S92957313c3dc0a6eT1108
    268 from 10.41.220.7:44878
    server-3.log:11-Aug-10 09:12:40,880 |INFO |LightstreamerLogger.requests
    |SERVER POOLED THREAD 9 |Polling (4) to session: S92957313c3dc0a6eT1108
    268 from 10.41.220.7:44878
    .....



    So this is what confused me.
    1. Why the client issued the second create_session even the first session was still valid on server?
    2. Why the second bind_session request submittd as POST and in POLLING mode?
    3. Will lightstream automatically subscriber the same items for second session or the application needs to make the call?

    Thanks

    Eric

 

 

Similar Threads

  1. Replies: 1
    Last Post: January 19th, 2011, 11:23 AM
  2. Lightstreamer going into polling mode randomly
    By GoatHunter in forum Client SDKs
    Replies: 3
    Last Post: August 31st, 2009, 09:57 AM
  3. Degrade from STREAMING to POLLING
    By riwang in forum Client SDKs
    Replies: 9
    Last Post: March 31st, 2009, 02:16 PM
  4. Replies: 3
    Last Post: February 1st, 2008, 09:49 AM
  5. Smart polling mode benefits...
    By ddhanis in forum General
    Replies: 1
    Last Post: December 14th, 2007, 05:39 PM

Bookmarks

Posting Permissions

  • You may not post new threads
  • You may not post replies
  • You may not post attachments
  • You may not edit your posts
  •  
All times are GMT +1. The time now is 01:23 PM.