ServerConnectionDebug Class Logs Invalid Values for Responses Which are Not
Fully Received
------------------------------------------------------------------------------------------
Key: SYNAPSE-642
URL: https://issues.apache.org/jira/browse/SYNAPSE-642
Project: Synapse
Issue Type: Bug
Affects Versions: 2.0
Reporter: Hiranya Jayathilaka
Assignee: Hiranya Jayathilaka
Fix For: 2.0
Steps to reproduce:
1. Setup a simple mediation scenario using Synapse and the sample Axis2 server
(a simple proxy service or a forwarding sequence would do)
2. Edit the StockQuoteClient and set a small client timeout value (eg: 5ms)
3. Send a request to Synapse using the modified client
The client will timeout before Synapse can send the response back resulting in
an error. ServerConnectionDebug will dump the following error log:
C2E-Req-StartTime=12:12:48.520, C2E-Req-EndTime=12:12:48.520,
C2E-Req-ConnCreateTime=12:12:48.482
C2E-Req-URL=/services/StockQuoteProxy, C2E-Req-Protocol=HTTP/1.1,
C2E-Req-Method=POST
C2E-Req-IP=127.0.0.1, C2E-Req-Info{Content-Type=text/xml; charset=UTF-8,
SOAPAction="urn:getQuote", User-Agent=Axis2, Host=localhost:8280,
Transfer-Encoding=chunked}
E2S-Req-Start=12:12:48.522, E2S-Req-End=12:12:48.523,
E2S-Req-ConnCreateTime=12:10:13.968
E2S-Req-URL=Address: http://localhost:9000/services/SimpleStockQuoteService,
E2S-Req-Protocol=HTTP/1.1, E2S-Req-Method=POST
E2S-Previous-Attempts=Attempt-Info={Req-Start-Time=12:12:48.522,
Req-URL=Address: http://localhost:9000/services/SimpleStockQuoteService}
S2E-Resp-Start=12:12:48.588, S2E-Resp-End=05:30:00.000
S2E-Resp-Status=HTTP/1.1 200 OK, S2E-Resp-Info={Content-Type=text/xml;
charset=UTF-8, SOAPAction="urn:getQuote"}
E2C-Resp-Start=12:12:48.594, E2C-Resp-End=12:12:48.594
Total-Time=74ms, Svc-Time=-1273041768522ms, ESB-Time=1273041768596ms
Note that S2E-Resp-End time, Svc-Time and ESB-Time are logged as invalid
values. The problem occurs because the error has occurred before Synapse could
properly compute the S2E response end time in the ClientConnectionDebug.
Therefore Synapse takes the response end time as 0 for calculations which
results in some incorrect results.
--
This message is automatically generated by JIRA.
-
You can reply to this email to add a comment to the issue online.
---------------------------------------------------------------------
To unsubscribe, e-mail: [email protected]
For additional commands, e-mail: [email protected]
