Skip to content

Instantly share code, notes, and snippets.

@benomatis
Created March 22, 2021 11:24
Show Gist options
  • Save benomatis/6771cb18e1b437da82f4d13fad398a87 to your computer and use it in GitHub Desktop.
Save benomatis/6771cb18e1b437da82f4d13fad398a87 to your computer and use it in GitHub Desktop.
[ 0.015s] [diagnostic]
********************************************************
[TEST 1/6: webchannel.googleapis.com with default options] STARTING at 2021-03-22T11:22:49.174Z]
********************************************************
[ 0.336s] [diagnostic] >>> [TEST 1/6: webchannel.googleapis.com with default options] createWebChannel("https://webchannel.googleapis.com/staging/channel/generator", {"backgroundChannelTest":true,"httpSessionIdParam":"gsessionid","initMessageHeaders":{},"sendRawJson":true,"supportsCrossDomainXhr":true,"internalChannelParams":{"forwardChannelRequestTimeoutMs":600000},"httpHeadersOverwriteParam":"$httpHeaders","disableRedact":true})
[ 0.344s] [diagnostic] >>> [TEST 1/6: webchannel.googleapis.com with default options] open()
[ 0.345s] [goog.labs.net.webChannel.WebChannelDebug] connect()
[ 0.347s] [goog.labs.net.webChannel.WebChannelDebug] Origin Trials enabled.
[ 0.352s] [goog.labs.net.webChannel.WebChannelDebug] connectChannel_()
[ 0.363s] [goog.labs.net.webChannel.WebChannelDebug] GetForwardChannelUri: https://webchannel.googleapis.com/staging/channel/generator?VER=8
[ 0.364s] [diagnostic] >>> [TEST 1/6: webchannel.googleapis.com with default options] channel.send({"message":"Hello","message_size":0,"delay_ms":0,"num_messages":5,"message_interval":500,"server_send_raw":0,"server_close":0,"server_half_close":0,"shutdown_server":0})
[ 0.369s] [goog.labs.net.webChannel.WebChannelDebug] Origin Trials invoked: https://webchannel.googleapis.com/staging/channel/generator
[ 0.372s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_
[ 0.374s] [goog.labs.net.webChannel.WebChannelDebug] open_()
[ 0.390s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (4546) [attempt 1]: POST
https://webchannel.googleapis.com/staging/channel/generator?VER=8&RID=4546&CVER=22&X-HTTP-Session-Id=gsessionid&zx=u1jxi9qp3qne&t=1
count=1&ofs=0&req0___data__=%7B%22message%22%3A%22Hello%22%2C%22message_size%22%3A0%2C%22delay_ms%22%3A0%2C%22num_messages%22%3A5%2C%22message_interval%22%3A500%2C%22server_send_raw%22%3A0%2C%22server_close%22%3A0%2C%22server_half_close%22%3A0%2C%22shutdown_server%22%3A0%7D
[ 1.250s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (4546) [ attempt 1]: POST
https://webchannel.googleapis.com/staging/channel/generator?VER=8&RID=4546&CVER=22&X-HTTP-Session-Id=gsessionid&zx=u1jxi9qp3qne&t=1
3 200
[ 1.252s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (4546): [[0,["c","9kZpFrOJhG2Fm8-Tbg5k5w","",8,12,30000]]]
[ 1.255s] [goog.labs.net.webChannel.WebChannelDebug] VER=8
[ 1.255s] [goog.labs.net.webChannel.WebChannelDebug] SVER=12
[ 1.255s] [goog.labs.net.webChannel.WebChannelDebug] backChannelRequestTimeoutMs_=45000
[ 1.257s] [goog.labs.net.webChannel.WebChannelBaseTransport] WebChannel opened on https://webchannel.googleapis.com/staging/channel/generator
[ 1.259s] [diagnostic] >>> [TEST 1/6: webchannel.googleapis.com with default options] channel opened: 923ms (1616412170421)
concurrent request limit : 10
isSpdyEnabled : true
[ 1.261s] [goog.labs.net.webChannel.WebChannelDebug] GetBackChannelUri: https://webchannel.googleapis.com/staging/channel/generator?gsessionid=MtaWK-eREbeTwYUZTo9GQbnk6EP9A32EbGcxaTO-EZU&VER=8
[ 1.262s] [goog.labs.net.webChannel.WebChannelDebug] Creating new HttpRequest
[ 1.265s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (rpc) [attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=MtaWK-eREbeTwYUZTo9GQbnk6EP9A32EbGcxaTO-EZU&VER=8&RID=rpc&SID=9kZpFrOJhG2Fm8-Tbg5k5w&CI=0&AID=0&TYPE=xmlhttp&zx=vygk3yvz7wwm&t=1
null
[ 1.269s] [goog.labs.net.webChannel.WebChannelDebug] New Request created
[ 1.272s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (4546) [ attempt 1]: POST
https://webchannel.googleapis.com/staging/channel/generator?VER=8&RID=4546&CVER=22&X-HTTP-Session-Id=gsessionid&zx=u1jxi9qp3qne&t=1
4 200
[ 1.276s] [goog.labs.net.webChannel.WebChannelDebug] Request complete
[ 1.279s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_
[ 1.280s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_ returned: nothing to send
[ 1.902s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=MtaWK-eREbeTwYUZTo9GQbnk6EP9A32EbGcxaTO-EZU&VER=8&RID=rpc&SID=9kZpFrOJhG2Fm8-Tbg5k5w&CI=0&AID=0&TYPE=xmlhttp&zx=vygk3yvz7wwm&t=1
3 200
[ 1.904s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[1,{"message":"Hello"}],[2,{"message":"Hello"}]]
[ 1.906s] [diagnostic] >>> [TEST 1/6: webchannel.googleapis.com with default options] Received message: {"message":"Hello"}
[ 1.910s] [diagnostic] >>> [TEST 1/6: webchannel.googleapis.com with default options] Received message: {"message":"Hello"}
[ 2.247s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=MtaWK-eREbeTwYUZTo9GQbnk6EP9A32EbGcxaTO-EZU&VER=8&RID=rpc&SID=9kZpFrOJhG2Fm8-Tbg5k5w&CI=0&AID=0&TYPE=xmlhttp&zx=vygk3yvz7wwm&t=1
3 200
[ 2.250s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[3,{"message":"Hello"}]]
[ 2.251s] [diagnostic] >>> [TEST 1/6: webchannel.googleapis.com with default options] Received message: {"message":"Hello"}
[ 2.748s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=MtaWK-eREbeTwYUZTo9GQbnk6EP9A32EbGcxaTO-EZU&VER=8&RID=rpc&SID=9kZpFrOJhG2Fm8-Tbg5k5w&CI=0&AID=0&TYPE=xmlhttp&zx=vygk3yvz7wwm&t=1
3 200
[ 2.748s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[4,{"message":"Hello"}]]
[ 2.750s] [diagnostic] >>> [TEST 1/6: webchannel.googleapis.com with default options] Received message: {"message":"Hello"}
[ 3.249s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=MtaWK-eREbeTwYUZTo9GQbnk6EP9A32EbGcxaTO-EZU&VER=8&RID=rpc&SID=9kZpFrOJhG2Fm8-Tbg5k5w&CI=0&AID=0&TYPE=xmlhttp&zx=vygk3yvz7wwm&t=1
3 200
[ 3.252s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[5,{"message":"Hello"}]]
[ 3.253s] [diagnostic] >>> [TEST 1/6: webchannel.googleapis.com with default options] Received message: {"message":"Hello"}
[ 3.255s] [diagnostic]
********************************************************
[TEST 1/6: webchannel.googleapis.com with default options] completed successfully.
********************************************************
[ 3.256s] [goog.labs.net.webChannel.WebChannelDebug] disconnect()
[ 3.264s] [goog.labs.net.webChannel.WebChannelBaseTransport] WebChannel closed on https://webchannel.googleapis.com/staging/channel/generator
[ 3.265s] [diagnostic] >>> [TEST 1/6: webchannel.googleapis.com with default options] channel closed
[ 4.769s] [diagnostic]
********************************************************
[TEST 2/6: webchannel.sandbox.google.com with default options] STARTING at 2021-03-22T11:22:53.932Z]
********************************************************
[ 4.772s] [diagnostic] >>> [TEST 2/6: webchannel.sandbox.google.com with default options] createWebChannel("https://webchannel.sandbox.google.com/staging/channel/generator", {"backgroundChannelTest":true,"httpSessionIdParam":"gsessionid","initMessageHeaders":{},"sendRawJson":true,"supportsCrossDomainXhr":true,"internalChannelParams":{"forwardChannelRequestTimeoutMs":600000},"httpHeadersOverwriteParam":"$httpHeaders","disableRedact":true})
[ 4.773s] [diagnostic] >>> [TEST 2/6: webchannel.sandbox.google.com with default options] open()
[ 4.774s] [goog.labs.net.webChannel.WebChannelDebug] connect()
[ 4.774s] [goog.labs.net.webChannel.WebChannelDebug] Origin Trials enabled.
[ 4.774s] [goog.labs.net.webChannel.WebChannelDebug] connectChannel_()
[ 4.775s] [goog.labs.net.webChannel.WebChannelDebug] GetForwardChannelUri: https://webchannel.sandbox.google.com/staging/channel/generator?VER=8
[ 4.776s] [diagnostic] >>> [TEST 2/6: webchannel.sandbox.google.com with default options] channel.send({"message":"Hello","message_size":0,"delay_ms":0,"num_messages":5,"message_interval":500,"server_send_raw":0,"server_close":0,"server_half_close":0,"shutdown_server":0})
[ 4.777s] [goog.labs.net.webChannel.WebChannelDebug] Origin Trials invoked: https://webchannel.sandbox.google.com/staging/channel/generator
[ 4.778s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_
[ 4.778s] [goog.labs.net.webChannel.WebChannelDebug] open_()
[ 4.780s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (23367) [attempt 1]: POST
https://webchannel.sandbox.google.com/staging/channel/generator?VER=8&RID=23367&CVER=22&X-HTTP-Session-Id=gsessionid&zx=ma633qxd0m3s&t=1
count=1&ofs=0&req0___data__=%7B%22message%22%3A%22Hello%22%2C%22message_size%22%3A0%2C%22delay_ms%22%3A0%2C%22num_messages%22%3A5%2C%22message_interval%22%3A500%2C%22server_send_raw%22%3A0%2C%22server_close%22%3A0%2C%22server_half_close%22%3A0%2C%22shutdown_server%22%3A0%7D
[ 5.629s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (23367) [ attempt 1]: POST
https://webchannel.sandbox.google.com/staging/channel/generator?VER=8&RID=23367&CVER=22&X-HTTP-Session-Id=gsessionid&zx=ma633qxd0m3s&t=1
3 200
[ 5.631s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (23367): [[0,["c","us5mEeT0KO8cimeS7iYf4w","",8,12,30000]]]
[ 5.632s] [goog.labs.net.webChannel.WebChannelDebug] VER=8
[ 5.633s] [goog.labs.net.webChannel.WebChannelDebug] SVER=12
[ 5.633s] [goog.labs.net.webChannel.WebChannelDebug] backChannelRequestTimeoutMs_=45000
[ 5.634s] [goog.labs.net.webChannel.WebChannelBaseTransport] WebChannel opened on https://webchannel.sandbox.google.com/staging/channel/generator
[ 5.635s] [diagnostic] >>> [TEST 2/6: webchannel.sandbox.google.com with default options] channel opened: 863ms (1616412174798)
concurrent request limit : 10
isSpdyEnabled : true
[ 5.636s] [goog.labs.net.webChannel.WebChannelDebug] GetBackChannelUri: https://webchannel.sandbox.google.com/staging/channel/generator?gsessionid=3tbbr_rxhSxFPFHYSIVctOLE6P0L_Mdd1e8vQ5wwBtE&VER=8
[ 5.636s] [goog.labs.net.webChannel.WebChannelDebug] Creating new HttpRequest
[ 5.637s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (rpc) [attempt 1]: GET
https://webchannel.sandbox.google.com/staging/channel/generator?gsessionid=3tbbr_rxhSxFPFHYSIVctOLE6P0L_Mdd1e8vQ5wwBtE&VER=8&RID=rpc&SID=us5mEeT0KO8cimeS7iYf4w&CI=0&AID=0&TYPE=xmlhttp&zx=y3v0im5kzxzv&t=1
null
[ 5.640s] [goog.labs.net.webChannel.WebChannelDebug] New Request created
[ 5.646s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (23367) [ attempt 1]: POST
https://webchannel.sandbox.google.com/staging/channel/generator?VER=8&RID=23367&CVER=22&X-HTTP-Session-Id=gsessionid&zx=ma633qxd0m3s&t=1
4 200
[ 5.647s] [goog.labs.net.webChannel.WebChannelDebug] Request complete
[ 5.647s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_
[ 5.648s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_ returned: nothing to send
[ 6.299s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.sandbox.google.com/staging/channel/generator?gsessionid=3tbbr_rxhSxFPFHYSIVctOLE6P0L_Mdd1e8vQ5wwBtE&VER=8&RID=rpc&SID=us5mEeT0KO8cimeS7iYf4w&CI=0&AID=0&TYPE=xmlhttp&zx=y3v0im5kzxzv&t=1
3 200
[ 6.300s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[1,{"message":"Hello"}],[2,{"message":"Hello"}]]
[ 6.301s] [diagnostic] >>> [TEST 2/6: webchannel.sandbox.google.com with default options] Received message: {"message":"Hello"}
[ 6.302s] [diagnostic] >>> [TEST 2/6: webchannel.sandbox.google.com with default options] Received message: {"message":"Hello"}
[ 6.631s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.sandbox.google.com/staging/channel/generator?gsessionid=3tbbr_rxhSxFPFHYSIVctOLE6P0L_Mdd1e8vQ5wwBtE&VER=8&RID=rpc&SID=us5mEeT0KO8cimeS7iYf4w&CI=0&AID=0&TYPE=xmlhttp&zx=y3v0im5kzxzv&t=1
3 200
[ 6.632s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[3,{"message":"Hello"}]]
[ 6.633s] [diagnostic] >>> [TEST 2/6: webchannel.sandbox.google.com with default options] Received message: {"message":"Hello"}
[ 7.132s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.sandbox.google.com/staging/channel/generator?gsessionid=3tbbr_rxhSxFPFHYSIVctOLE6P0L_Mdd1e8vQ5wwBtE&VER=8&RID=rpc&SID=us5mEeT0KO8cimeS7iYf4w&CI=0&AID=0&TYPE=xmlhttp&zx=y3v0im5kzxzv&t=1
3 200
[ 7.136s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[4,{"message":"Hello"}]]
[ 7.137s] [diagnostic] >>> [TEST 2/6: webchannel.sandbox.google.com with default options] Received message: {"message":"Hello"}
[ 7.632s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.sandbox.google.com/staging/channel/generator?gsessionid=3tbbr_rxhSxFPFHYSIVctOLE6P0L_Mdd1e8vQ5wwBtE&VER=8&RID=rpc&SID=us5mEeT0KO8cimeS7iYf4w&CI=0&AID=0&TYPE=xmlhttp&zx=y3v0im5kzxzv&t=1
3 200
[ 7.633s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[5,{"message":"Hello"}]]
[ 7.634s] [diagnostic] >>> [TEST 2/6: webchannel.sandbox.google.com with default options] Received message: {"message":"Hello"}
[ 7.634s] [diagnostic]
********************************************************
[TEST 2/6: webchannel.sandbox.google.com with default options] completed successfully.
********************************************************
[ 7.635s] [goog.labs.net.webChannel.WebChannelDebug] disconnect()
[ 7.638s] [goog.labs.net.webChannel.WebChannelBaseTransport] WebChannel closed on https://webchannel.sandbox.google.com/staging/channel/generator
[ 7.643s] [diagnostic] >>> [TEST 2/6: webchannel.sandbox.google.com with default options] channel closed
[ 9.146s] [diagnostic]
********************************************************
[TEST 3/6: webchannel.googleapis.com with forceLongPolling] STARTING at 2021-03-22T11:22:58.309Z]
********************************************************
[ 9.149s] [diagnostic] >>> [TEST 3/6: webchannel.googleapis.com with forceLongPolling] createWebChannel("https://webchannel.googleapis.com/staging/channel/generator", {"backgroundChannelTest":true,"httpSessionIdParam":"gsessionid","initMessageHeaders":{},"sendRawJson":true,"supportsCrossDomainXhr":true,"internalChannelParams":{"forwardChannelRequestTimeoutMs":600000},"httpHeadersOverwriteParam":"$httpHeaders","disableRedact":true,"forceLongPolling":true})
[ 9.151s] [diagnostic] >>> [TEST 3/6: webchannel.googleapis.com with forceLongPolling] open()
[ 9.151s] [goog.labs.net.webChannel.WebChannelDebug] connect()
[ 9.152s] [goog.labs.net.webChannel.WebChannelDebug] Origin Trials enabled.
[ 9.152s] [goog.labs.net.webChannel.WebChannelDebug] connectChannel_()
[ 9.153s] [goog.labs.net.webChannel.WebChannelDebug] GetForwardChannelUri: https://webchannel.googleapis.com/staging/channel/generator?VER=8
[ 9.154s] [diagnostic] >>> [TEST 3/6: webchannel.googleapis.com with forceLongPolling] channel.send({"message":"Hello","message_size":0,"delay_ms":0,"num_messages":5,"message_interval":500,"server_send_raw":0,"server_close":0,"server_half_close":0,"shutdown_server":0})
[ 9.156s] [goog.labs.net.webChannel.WebChannelDebug] Origin Trials invoked: https://webchannel.googleapis.com/staging/channel/generator
[ 9.156s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_
[ 9.157s] [goog.labs.net.webChannel.WebChannelDebug] open_()
[ 9.158s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (20049) [attempt 1]: POST
https://webchannel.googleapis.com/staging/channel/generator?VER=8&RID=20049&CVER=22&X-HTTP-Session-Id=gsessionid&zx=fdudr98uylng&t=1
count=1&ofs=0&req0___data__=%7B%22message%22%3A%22Hello%22%2C%22message_size%22%3A0%2C%22delay_ms%22%3A0%2C%22num_messages%22%3A5%2C%22message_interval%22%3A500%2C%22server_send_raw%22%3A0%2C%22server_close%22%3A0%2C%22server_half_close%22%3A0%2C%22shutdown_server%22%3A0%7D
[ 9.806s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (20049) [ attempt 1]: POST
https://webchannel.googleapis.com/staging/channel/generator?VER=8&RID=20049&CVER=22&X-HTTP-Session-Id=gsessionid&zx=fdudr98uylng&t=1
3 200
[ 9.807s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (20049): [[0,["c","mrhTWafXfycPrmhCLL6y_A","",8,12,30000]]]
[ 9.809s] [goog.labs.net.webChannel.WebChannelDebug] VER=8
[ 9.810s] [goog.labs.net.webChannel.WebChannelDebug] SVER=12
[ 9.811s] [goog.labs.net.webChannel.WebChannelDebug] backChannelRequestTimeoutMs_=45000
[ 9.812s] [goog.labs.net.webChannel.WebChannelBaseTransport] WebChannel opened on https://webchannel.googleapis.com/staging/channel/generator
[ 9.813s] [diagnostic] >>> [TEST 3/6: webchannel.googleapis.com with forceLongPolling] channel opened: 664ms (1616412178976)
concurrent request limit : 10
isSpdyEnabled : true
[ 9.814s] [goog.labs.net.webChannel.WebChannelDebug] GetBackChannelUri: https://webchannel.googleapis.com/staging/channel/generator?gsessionid=GAHO5LLuPm17oJ-EWipbYxibkGMUlyOH1Jdp0Eq4PY8&VER=8
[ 9.816s] [goog.labs.net.webChannel.WebChannelDebug] Creating new HttpRequest
[ 9.817s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (rpc) [attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=GAHO5LLuPm17oJ-EWipbYxibkGMUlyOH1Jdp0Eq4PY8&VER=8&RID=rpc&SID=mrhTWafXfycPrmhCLL6y_A&CI=1&AID=0&TYPE=xmlhttp&zx=u7zqyp8q3mzh&t=1
null
[ 9.818s] [goog.labs.net.webChannel.WebChannelDebug] New Request created
[ 9.825s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (20049) [ attempt 1]: POST
https://webchannel.googleapis.com/staging/channel/generator?VER=8&RID=20049&CVER=22&X-HTTP-Session-Id=gsessionid&zx=fdudr98uylng&t=1
4 200
[ 9.829s] [goog.labs.net.webChannel.WebChannelDebug] Request complete
[ 9.829s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_
[ 9.830s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_ returned: nothing to send
[ 10.460s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=GAHO5LLuPm17oJ-EWipbYxibkGMUlyOH1Jdp0Eq4PY8&VER=8&RID=rpc&SID=mrhTWafXfycPrmhCLL6y_A&CI=1&AID=0&TYPE=xmlhttp&zx=u7zqyp8q3mzh&t=1
3 200
[ 10.462s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[1,{"message":"Hello"}],[2,{"message":"Hello"}]]
[ 10.463s] [diagnostic] >>> [TEST 3/6: webchannel.googleapis.com with forceLongPolling] Received message: {"message":"Hello"}
[ 10.465s] [diagnostic] >>> [TEST 3/6: webchannel.googleapis.com with forceLongPolling] Received message: {"message":"Hello"}
[ 10.467s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=GAHO5LLuPm17oJ-EWipbYxibkGMUlyOH1Jdp0Eq4PY8&VER=8&RID=rpc&SID=mrhTWafXfycPrmhCLL6y_A&CI=1&AID=0&TYPE=xmlhttp&zx=u7zqyp8q3mzh&t=1
4 200
[ 10.473s] [goog.labs.net.webChannel.WebChannelDebug] Request complete
[ 10.474s] [goog.labs.net.webChannel.WebChannelDebug] Creating new HttpRequest
[ 10.476s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (rpc) [attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=GAHO5LLuPm17oJ-EWipbYxibkGMUlyOH1Jdp0Eq4PY8&VER=8&RID=rpc&SID=mrhTWafXfycPrmhCLL6y_A&CI=1&AID=2&TYPE=xmlhttp&zx=ri2rpgku7fwd&t=1
null
[ 10.484s] [goog.labs.net.webChannel.WebChannelDebug] New Request created
[ 10.622s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=GAHO5LLuPm17oJ-EWipbYxibkGMUlyOH1Jdp0Eq4PY8&VER=8&RID=rpc&SID=mrhTWafXfycPrmhCLL6y_A&CI=1&AID=2&TYPE=xmlhttp&zx=ri2rpgku7fwd&t=1
3 200
[ 10.624s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[3,["noop"]]]
[ 10.800s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=GAHO5LLuPm17oJ-EWipbYxibkGMUlyOH1Jdp0Eq4PY8&VER=8&RID=rpc&SID=mrhTWafXfycPrmhCLL6y_A&CI=1&AID=2&TYPE=xmlhttp&zx=ri2rpgku7fwd&t=1
3 200
[ 10.802s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[4,{"message":"Hello"}]]
[ 10.804s] [diagnostic] >>> [TEST 3/6: webchannel.googleapis.com with forceLongPolling] Received message: {"message":"Hello"}
[ 10.805s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=GAHO5LLuPm17oJ-EWipbYxibkGMUlyOH1Jdp0Eq4PY8&VER=8&RID=rpc&SID=mrhTWafXfycPrmhCLL6y_A&CI=1&AID=2&TYPE=xmlhttp&zx=ri2rpgku7fwd&t=1
4 200
[ 10.806s] [goog.labs.net.webChannel.WebChannelDebug] Request complete
[ 10.807s] [goog.labs.net.webChannel.WebChannelDebug] Creating new HttpRequest
[ 10.809s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (rpc) [attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=GAHO5LLuPm17oJ-EWipbYxibkGMUlyOH1Jdp0Eq4PY8&VER=8&RID=rpc&SID=mrhTWafXfycPrmhCLL6y_A&CI=1&AID=4&TYPE=xmlhttp&zx=j3eqp3nhevrv&t=1
null
[ 10.810s] [goog.labs.net.webChannel.WebChannelDebug] New Request created
[ 11.447s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=GAHO5LLuPm17oJ-EWipbYxibkGMUlyOH1Jdp0Eq4PY8&VER=8&RID=rpc&SID=mrhTWafXfycPrmhCLL6y_A&CI=1&AID=4&TYPE=xmlhttp&zx=j3eqp3nhevrv&t=1
3 200
[ 11.449s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[5,{"message":"Hello"}]]
[ 11.450s] [diagnostic] >>> [TEST 3/6: webchannel.googleapis.com with forceLongPolling] Received message: {"message":"Hello"}
[ 11.452s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=GAHO5LLuPm17oJ-EWipbYxibkGMUlyOH1Jdp0Eq4PY8&VER=8&RID=rpc&SID=mrhTWafXfycPrmhCLL6y_A&CI=1&AID=4&TYPE=xmlhttp&zx=j3eqp3nhevrv&t=1
4 200
[ 11.453s] [goog.labs.net.webChannel.WebChannelDebug] Request complete
[ 11.454s] [goog.labs.net.webChannel.WebChannelDebug] Creating new HttpRequest
[ 11.455s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (rpc) [attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=GAHO5LLuPm17oJ-EWipbYxibkGMUlyOH1Jdp0Eq4PY8&VER=8&RID=rpc&SID=mrhTWafXfycPrmhCLL6y_A&CI=1&AID=5&TYPE=xmlhttp&zx=j13aibyigp8b&t=1
null
[ 11.456s] [goog.labs.net.webChannel.WebChannelDebug] New Request created
[ 12.093s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=GAHO5LLuPm17oJ-EWipbYxibkGMUlyOH1Jdp0Eq4PY8&VER=8&RID=rpc&SID=mrhTWafXfycPrmhCLL6y_A&CI=1&AID=5&TYPE=xmlhttp&zx=j13aibyigp8b&t=1
3 200
[ 12.094s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[6,{"message":"Hello"}]]
[ 12.096s] [diagnostic] >>> [TEST 3/6: webchannel.googleapis.com with forceLongPolling] Received message: {"message":"Hello"}
[ 12.097s] [diagnostic]
********************************************************
[TEST 3/6: webchannel.googleapis.com with forceLongPolling] completed successfully.
********************************************************
[ 12.097s] [goog.labs.net.webChannel.WebChannelDebug] disconnect()
[ 12.100s] [goog.labs.net.webChannel.WebChannelBaseTransport] WebChannel closed on https://webchannel.googleapis.com/staging/channel/generator
[ 12.104s] [diagnostic] >>> [TEST 3/6: webchannel.googleapis.com with forceLongPolling] channel closed
[ 13.605s] [diagnostic]
********************************************************
[TEST 4/6: webchannel.googleapis.com with detectBufferingProxy] STARTING at 2021-03-22T11:23:02.768Z]
********************************************************
[ 13.608s] [diagnostic] >>> [TEST 4/6: webchannel.googleapis.com with detectBufferingProxy] createWebChannel("https://webchannel.googleapis.com/staging/channel/generator", {"backgroundChannelTest":true,"httpSessionIdParam":"gsessionid","initMessageHeaders":{},"sendRawJson":true,"supportsCrossDomainXhr":true,"internalChannelParams":{"forwardChannelRequestTimeoutMs":600000},"httpHeadersOverwriteParam":"$httpHeaders","disableRedact":true,"forceLongPolling":true,"detectBufferingProxy":true})
[ 13.610s] [diagnostic] >>> [TEST 4/6: webchannel.googleapis.com with detectBufferingProxy] open()
[ 13.611s] [goog.labs.net.webChannel.WebChannelDebug] connect()
[ 13.611s] [goog.labs.net.webChannel.WebChannelDebug] Origin Trials enabled.
[ 13.611s] [goog.labs.net.webChannel.WebChannelDebug] connectChannel_()
[ 13.613s] [goog.labs.net.webChannel.WebChannelDebug] GetForwardChannelUri: https://webchannel.googleapis.com/staging/channel/generator?VER=8
[ 13.613s] [diagnostic] >>> [TEST 4/6: webchannel.googleapis.com with detectBufferingProxy] channel.send({"message":"Hello","message_size":0,"delay_ms":0,"num_messages":5,"message_interval":500,"server_send_raw":0,"server_close":0,"server_half_close":0,"shutdown_server":0})
[ 13.615s] [goog.labs.net.webChannel.WebChannelDebug] Origin Trials invoked: https://webchannel.googleapis.com/staging/channel/generator
[ 13.616s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_
[ 13.616s] [goog.labs.net.webChannel.WebChannelDebug] open_()
[ 13.618s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (24406) [attempt 1]: POST
https://webchannel.googleapis.com/staging/channel/generator?VER=8&RID=24406&CVER=22&X-HTTP-Session-Id=gsessionid&zx=us0yk62kfitg&t=1
count=1&ofs=0&req0___data__=%7B%22message%22%3A%22Hello%22%2C%22message_size%22%3A0%2C%22delay_ms%22%3A0%2C%22num_messages%22%3A5%2C%22message_interval%22%3A500%2C%22server_send_raw%22%3A0%2C%22server_close%22%3A0%2C%22server_half_close%22%3A0%2C%22shutdown_server%22%3A0%7D
[ 13.760s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (24406) [ attempt 1]: POST
https://webchannel.googleapis.com/staging/channel/generator?VER=8&RID=24406&CVER=22&X-HTTP-Session-Id=gsessionid&zx=us0yk62kfitg&t=1
3 200
[ 13.762s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (24406): [[0,["c","uHCLzRT0knTBrFOwdtmLyg","",8,12,30000]]]
[ 13.763s] [goog.labs.net.webChannel.WebChannelDebug] VER=8
[ 13.764s] [goog.labs.net.webChannel.WebChannelDebug] SVER=12
[ 13.765s] [goog.labs.net.webChannel.WebChannelDebug] backChannelRequestTimeoutMs_=45000
[ 13.766s] [goog.labs.net.webChannel.WebChannelBaseTransport] WebChannel opened on https://webchannel.googleapis.com/staging/channel/generator
[ 13.767s] [diagnostic] >>> [TEST 4/6: webchannel.googleapis.com with detectBufferingProxy] channel opened: 159ms (1616412182930)
concurrent request limit : 10
isSpdyEnabled : true
[ 13.768s] [goog.labs.net.webChannel.WebChannelDebug] GetBackChannelUri: https://webchannel.googleapis.com/staging/channel/generator?gsessionid=42CJc6mARg-3X-T-1hKQJJ5ll7hGtt7HV2ooWakQESQ&VER=8
[ 13.768s] [goog.labs.net.webChannel.WebChannelDebug] Creating new HttpRequest
[ 13.771s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (rpc) [attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=42CJc6mARg-3X-T-1hKQJJ5ll7hGtt7HV2ooWakQESQ&VER=8&RID=rpc&SID=uHCLzRT0knTBrFOwdtmLyg&CI=1&AID=0&TYPE=xmlhttp&zx=3v8hqta7de5p&t=1
null
[ 13.774s] [goog.labs.net.webChannel.WebChannelDebug] New Request created
[ 13.776s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (24406) [ attempt 1]: POST
https://webchannel.googleapis.com/staging/channel/generator?VER=8&RID=24406&CVER=22&X-HTTP-Session-Id=gsessionid&zx=us0yk62kfitg&t=1
4 200
[ 13.777s] [goog.labs.net.webChannel.WebChannelDebug] Request complete
[ 13.777s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_
[ 13.778s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_ returned: nothing to send
[ 14.407s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=42CJc6mARg-3X-T-1hKQJJ5ll7hGtt7HV2ooWakQESQ&VER=8&RID=rpc&SID=uHCLzRT0knTBrFOwdtmLyg&CI=1&AID=0&TYPE=xmlhttp&zx=3v8hqta7de5p&t=1
3 200
[ 14.409s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[1,{"message":"Hello"}],[2,{"message":"Hello"}]]
[ 14.409s] [diagnostic] >>> [TEST 4/6: webchannel.googleapis.com with detectBufferingProxy] Received message: {"message":"Hello"}
[ 14.410s] [diagnostic] >>> [TEST 4/6: webchannel.googleapis.com with detectBufferingProxy] Received message: {"message":"Hello"}
[ 14.412s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=42CJc6mARg-3X-T-1hKQJJ5ll7hGtt7HV2ooWakQESQ&VER=8&RID=rpc&SID=uHCLzRT0knTBrFOwdtmLyg&CI=1&AID=0&TYPE=xmlhttp&zx=3v8hqta7de5p&t=1
4 200
[ 14.413s] [goog.labs.net.webChannel.WebChannelDebug] Request complete
[ 14.416s] [goog.labs.net.webChannel.WebChannelDebug] Creating new HttpRequest
[ 14.420s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (rpc) [attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=42CJc6mARg-3X-T-1hKQJJ5ll7hGtt7HV2ooWakQESQ&VER=8&RID=rpc&SID=uHCLzRT0knTBrFOwdtmLyg&CI=1&AID=2&TYPE=xmlhttp&zx=z8q8rhrwmn3a&t=1
null
[ 14.428s] [goog.labs.net.webChannel.WebChannelDebug] New Request created
[ 15.058s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=42CJc6mARg-3X-T-1hKQJJ5ll7hGtt7HV2ooWakQESQ&VER=8&RID=rpc&SID=uHCLzRT0knTBrFOwdtmLyg&CI=1&AID=2&TYPE=xmlhttp&zx=z8q8rhrwmn3a&t=1
3 200
[ 15.060s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[3,{"message":"Hello"}]]
[ 15.061s] [diagnostic] >>> [TEST 4/6: webchannel.googleapis.com with detectBufferingProxy] Received message: {"message":"Hello"}
[ 15.062s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=42CJc6mARg-3X-T-1hKQJJ5ll7hGtt7HV2ooWakQESQ&VER=8&RID=rpc&SID=uHCLzRT0knTBrFOwdtmLyg&CI=1&AID=2&TYPE=xmlhttp&zx=z8q8rhrwmn3a&t=1
4 200
[ 15.064s] [goog.labs.net.webChannel.WebChannelDebug] Request complete
[ 15.065s] [goog.labs.net.webChannel.WebChannelDebug] Creating new HttpRequest
[ 15.067s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (rpc) [attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=42CJc6mARg-3X-T-1hKQJJ5ll7hGtt7HV2ooWakQESQ&VER=8&RID=rpc&SID=uHCLzRT0knTBrFOwdtmLyg&CI=1&AID=3&TYPE=xmlhttp&zx=nclz9hnw4wst&t=1
null
[ 15.070s] [goog.labs.net.webChannel.WebChannelDebug] New Request created
[ 15.706s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=42CJc6mARg-3X-T-1hKQJJ5ll7hGtt7HV2ooWakQESQ&VER=8&RID=rpc&SID=uHCLzRT0knTBrFOwdtmLyg&CI=1&AID=3&TYPE=xmlhttp&zx=nclz9hnw4wst&t=1
3 200
[ 15.708s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[4,{"message":"Hello"}]]
[ 15.709s] [diagnostic] >>> [TEST 4/6: webchannel.googleapis.com with detectBufferingProxy] Received message: {"message":"Hello"}
[ 15.721s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=42CJc6mARg-3X-T-1hKQJJ5ll7hGtt7HV2ooWakQESQ&VER=8&RID=rpc&SID=uHCLzRT0knTBrFOwdtmLyg&CI=1&AID=3&TYPE=xmlhttp&zx=nclz9hnw4wst&t=1
4 200
[ 15.727s] [goog.labs.net.webChannel.WebChannelDebug] Request complete
[ 15.728s] [goog.labs.net.webChannel.WebChannelDebug] Creating new HttpRequest
[ 15.731s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (rpc) [attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=42CJc6mARg-3X-T-1hKQJJ5ll7hGtt7HV2ooWakQESQ&VER=8&RID=rpc&SID=uHCLzRT0knTBrFOwdtmLyg&CI=1&AID=4&TYPE=xmlhttp&zx=h9uf1yxprgnw&t=1
null
[ 15.734s] [goog.labs.net.webChannel.WebChannelDebug] New Request created
[ 16.371s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://webchannel.googleapis.com/staging/channel/generator?gsessionid=42CJc6mARg-3X-T-1hKQJJ5ll7hGtt7HV2ooWakQESQ&VER=8&RID=rpc&SID=uHCLzRT0knTBrFOwdtmLyg&CI=1&AID=4&TYPE=xmlhttp&zx=h9uf1yxprgnw&t=1
3 200
[ 16.373s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[5,{"message":"Hello"}]]
[ 16.375s] [diagnostic] >>> [TEST 4/6: webchannel.googleapis.com with detectBufferingProxy] Received message: {"message":"Hello"}
[ 16.375s] [diagnostic]
********************************************************
[TEST 4/6: webchannel.googleapis.com with detectBufferingProxy] completed successfully.
********************************************************
[ 16.376s] [goog.labs.net.webChannel.WebChannelDebug] disconnect()
[ 16.381s] [goog.labs.net.webChannel.WebChannelBaseTransport] WebChannel closed on https://webchannel.googleapis.com/staging/channel/generator
[ 16.384s] [diagnostic] >>> [TEST 4/6: webchannel.googleapis.com with detectBufferingProxy] channel closed
[ 17.887s] [diagnostic]
********************************************************
[TEST 5/6: Firestore listen test with default options] STARTING at 2021-03-22T11:23:07.049Z]
********************************************************
[ 17.888s] [diagnostic] >>> [TEST 5/6: Firestore listen test with default options] createWebChannel("https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel", {"backgroundChannelTest":true,"httpSessionIdParam":"gsessionid","initMessageHeaders":{},"sendRawJson":true,"supportsCrossDomainXhr":true,"internalChannelParams":{"forwardChannelRequestTimeoutMs":600000},"httpHeadersOverwriteParam":"$httpHeaders","disableRedact":true,"forceLongPolling":true,"detectBufferingProxy":true,"messageUrlParams":{"database":"projects/debug-my/databases/(default)"}})
[ 17.890s] [diagnostic] >>> [TEST 5/6: Firestore listen test with default options] open()
[ 17.891s] [goog.labs.net.webChannel.WebChannelDebug] connect()
[ 17.891s] [goog.labs.net.webChannel.WebChannelDebug] Origin Trials enabled.
[ 17.893s] [goog.labs.net.webChannel.WebChannelDebug] connectChannel_()
[ 17.894s] [goog.labs.net.webChannel.WebChannelDebug] GetForwardChannelUri: https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel?database=projects%2Fdebug-my%2Fdatabases%2F(default)&VER=8
[ 17.894s] [diagnostic] >>> [TEST 5/6: Firestore listen test with default options] channel.send({"database":"projects/debug-my/databases/(default)","addTarget":{"query":{"structuredQuery":{"from":[{"collectionId":"debug"}],"orderBy":[{"field":{"fieldPath":"__name__"},"direction":"ASCENDING"}]},"parent":"projects/debug-my/databases/(default)/documents"},"targetId":2}})
[ 17.896s] [goog.labs.net.webChannel.WebChannelDebug] Origin Trials invoked: https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel
[ 17.897s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_
[ 17.898s] [goog.labs.net.webChannel.WebChannelDebug] open_()
[ 17.902s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (65832) [attempt 1]: POST
https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel?database=projects%2Fdebug-my%2Fdatabases%2F(default)&VER=8&RID=65832&CVER=22&X-HTTP-Session-Id=gsessionid&zx=rgydn1ulk9d1&t=1
count=1&ofs=0&req0___data__=%7B%22database%22%3A%22projects%2Fdebug-my%2Fdatabases%2F(default)%22%2C%22addTarget%22%3A%7B%22query%22%3A%7B%22structuredQuery%22%3A%7B%22from%22%3A%5B%7B%22collectionId%22%3A%22debug%22%7D%5D%2C%22orderBy%22%3A%5B%7B%22field%22%3A%7B%22fieldPath%22%3A%22__name__%22%7D%2C%22direction%22%3A%22ASCENDING%22%7D%5D%7D%2C%22parent%22%3A%22projects%2Fdebug-my%2Fdatabases%2F(default)%2Fdocuments%22%7D%2C%22targetId%22%3A2%7D%7D
[ 18.118s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (65832) [ attempt 1]: POST
https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel?database=projects%2Fdebug-my%2Fdatabases%2F(default)&VER=8&RID=65832&CVER=22&X-HTTP-Session-Id=gsessionid&zx=rgydn1ulk9d1&t=1
3 200
[ 18.120s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (65832): [[0,["c","qxJX9sDUUixtzY1VoGv7BA","",8,12,30000]]]
[ 18.122s] [goog.labs.net.webChannel.WebChannelDebug] VER=8
[ 18.122s] [goog.labs.net.webChannel.WebChannelDebug] SVER=12
[ 18.123s] [goog.labs.net.webChannel.WebChannelDebug] backChannelRequestTimeoutMs_=45000
[ 18.124s] [goog.labs.net.webChannel.WebChannelBaseTransport] WebChannel opened on https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel
[ 18.126s] [diagnostic] >>> [TEST 5/6: Firestore listen test with default options] channel opened: 238ms (1616412187289)
concurrent request limit : 10
isSpdyEnabled : true
[ 18.126s] [goog.labs.net.webChannel.WebChannelDebug] GetBackChannelUri: https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel?database=projects%2Fdebug-my%2Fdatabases%2F(default)&gsessionid=tR4LmMljLWNa_nT9Nxu-7lJggT-1H73HR5z7INUrP-A&VER=8
[ 18.127s] [goog.labs.net.webChannel.WebChannelDebug] Creating new HttpRequest
[ 18.130s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (rpc) [attempt 1]: GET
https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel?database=projects%2Fdebug-my%2Fdatabases%2F(default)&gsessionid=tR4LmMljLWNa_nT9Nxu-7lJggT-1H73HR5z7INUrP-A&VER=8&RID=rpc&SID=qxJX9sDUUixtzY1VoGv7BA&CI=1&AID=0&TYPE=xmlhttp&zx=8o4odibj3yev&t=1
null
[ 18.132s] [goog.labs.net.webChannel.WebChannelDebug] New Request created
[ 18.135s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (65832) [ attempt 1]: POST
https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel?database=projects%2Fdebug-my%2Fdatabases%2F(default)&VER=8&RID=65832&CVER=22&X-HTTP-Session-Id=gsessionid&zx=rgydn1ulk9d1&t=1
4 200
[ 18.136s] [goog.labs.net.webChannel.WebChannelDebug] Request complete
[ 18.137s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_
[ 18.138s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_ returned: nothing to send
[ 18.270s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel?database=projects%2Fdebug-my%2Fdatabases%2F(default)&gsessionid=tR4LmMljLWNa_nT9Nxu-7lJggT-1H73HR5z7INUrP-A&VER=8&RID=rpc&SID=qxJX9sDUUixtzY1VoGv7BA&CI=1&AID=0&TYPE=xmlhttp&zx=8o4odibj3yev&t=1
3 200
[ 18.273s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[1,[{
"targetChange": {
"targetChangeType": "ADD",
"targetIds": [
2
]
}
}
]],[2,[{
"documentChange": {
"document": {
"name": "projects/debug-my/databases/(default)/documents/debug/000",
"fields": {
"desc": {
"stringValue": "Diagnostic Document 0"
}
},
"createTime": "2019-12-28T19:50:18.256728Z",
"updateTime": "2019-12-28T19:50:18.256728Z"
},
"targetIds": [
2
]
}
}
]],[3,[{
"documentChange": {
"document": {
"name": "projects/debug-my/databases/(default)/documents/debug/001",
"fields": {
"desc": {
"stringValue": "Diagnostic Document 1"
}
},
"createTime": "2019-12-28T19:50:31.803733Z",
"updateTime": "2019-12-28T19:50:31.803733Z"
},
"targetIds": [
2
]
}
}
]],[4,[{
"documentChange": {
"document": {
"name": "projects/debug-my/databases/(default)/documents/debug/002",
"fields": {
"desc": {
"stringValue": "Diagnostic Document 2"
}
},
"createTime": "2019-12-28T19:50:37.682905Z",
"updateTime": "2019-12-28T19:50:43.797778Z"
},
"targetIds": [
2
]
}
}
]],[5,[{
"documentChange": {
"document": {
"name": "projects/debug-my/databases/(default)/documents/debug/003",
"fields": {
"desc": {
"stringValue": "Diagnostic Document 3"
}
},
"createTime": "2019-12-28T19:50:52.602052Z",
"updateTime": "2019-12-28T19:50:52.602052Z"
},
"targetIds": [
2
]
}
}
]],[6,[{
"documentChange": {
"document": {
"name": "projects/debug-my/databases/(default)/documents/debug/004",
"fields": {
"desc": {
"stringValue": "Diagnostic Document 4"
}
},
"createTime": "2019-12-28T19:50:59.545646Z",
"updateTime": "2019-12-28T19:50:59.545646Z"
},
"targetIds": [
2
]
}
}
]],[7,[{
"targetChange": {
"targetChangeType": "CURRENT",
"targetIds": [
2
],
"resumeToken": "CgkIhtuh0uTD7wI=",
"readTime": "2021-03-22T11:23:08.110214Z"
}
}
]],[8,[{
"targetChange": {
"resumeToken": "CgkIhtuh0uTD7wI=",
"readTime": "2021-03-22T11:23:08.110214Z"
}
}
]]]
[ 18.278s] [diagnostic] >>> [TEST 5/6: Firestore listen test with default options] Received message: [{"targetChange":{"targetChangeType":"ADD","targetIds":[2]}}]
[ 18.280s] [diagnostic] >>> [TEST 5/6: Firestore listen test with default options] Received message: [{"documentChange":{"document":{"name":"projects/debug-my/databases/(default)/documents/debug/000","fields":{"desc":{"stringValue":"Diagnostic Document 0"}},"createTime":"2019-12-28T19:50:18.256728Z","updateTime":"2019-12-28T19:50:18.256728Z"},"targetIds":[2]}}]
[ 18.281s] [diagnostic] >>> [TEST 5/6: Firestore listen test with default options] Received message: [{"documentChange":{"document":{"name":"projects/debug-my/databases/(default)/documents/debug/001","fields":{"desc":{"stringValue":"Diagnostic Document 1"}},"createTime":"2019-12-28T19:50:31.803733Z","updateTime":"2019-12-28T19:50:31.803733Z"},"targetIds":[2]}}]
[ 18.283s] [diagnostic] >>> [TEST 5/6: Firestore listen test with default options] Received message: [{"documentChange":{"document":{"name":"projects/debug-my/databases/(default)/documents/debug/002","fields":{"desc":{"stringValue":"Diagnostic Document 2"}},"createTime":"2019-12-28T19:50:37.682905Z","updateTime":"2019-12-28T19:50:43.797778Z"},"targetIds":[2]}}]
[ 18.284s] [diagnostic] >>> [TEST 5/6: Firestore listen test with default options] Received message: [{"documentChange":{"document":{"name":"projects/debug-my/databases/(default)/documents/debug/003","fields":{"desc":{"stringValue":"Diagnostic Document 3"}},"createTime":"2019-12-28T19:50:52.602052Z","updateTime":"2019-12-28T19:50:52.602052Z"},"targetIds":[2]}}]
[ 18.286s] [diagnostic]
********************************************************
[TEST 5/6: Firestore listen test with default options] completed successfully.
********************************************************
[ 18.287s] [goog.labs.net.webChannel.WebChannelDebug] disconnect()
[ 18.289s] [goog.labs.net.webChannel.WebChannelBaseTransport] WebChannel closed on https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel
[ 18.292s] [diagnostic] >>> [TEST 5/6: Firestore listen test with default options] channel closed
[ 19.798s] [diagnostic]
********************************************************
[TEST 6/6: Firestore listen test with forceLongPolling] STARTING at 2021-03-22T11:23:08.961Z]
********************************************************
[ 19.801s] [diagnostic] >>> [TEST 6/6: Firestore listen test with forceLongPolling] createWebChannel("https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel", {"backgroundChannelTest":true,"httpSessionIdParam":"gsessionid","initMessageHeaders":{},"sendRawJson":true,"supportsCrossDomainXhr":true,"internalChannelParams":{"forwardChannelRequestTimeoutMs":600000},"httpHeadersOverwriteParam":"$httpHeaders","disableRedact":true,"forceLongPolling":true,"detectBufferingProxy":true,"messageUrlParams":{"database":"projects/debug-my/databases/(default)"}})
[ 19.803s] [diagnostic] >>> [TEST 6/6: Firestore listen test with forceLongPolling] open()
[ 19.804s] [goog.labs.net.webChannel.WebChannelDebug] connect()
[ 19.805s] [goog.labs.net.webChannel.WebChannelDebug] Origin Trials enabled.
[ 19.805s] [goog.labs.net.webChannel.WebChannelDebug] connectChannel_()
[ 19.806s] [goog.labs.net.webChannel.WebChannelDebug] GetForwardChannelUri: https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel?database=projects%2Fdebug-my%2Fdatabases%2F(default)&VER=8
[ 19.808s] [diagnostic] >>> [TEST 6/6: Firestore listen test with forceLongPolling] channel.send({"database":"projects/debug-my/databases/(default)","addTarget":{"query":{"structuredQuery":{"from":[{"collectionId":"debug"}],"orderBy":[{"field":{"fieldPath":"__name__"},"direction":"ASCENDING"}]},"parent":"projects/debug-my/databases/(default)/documents"},"targetId":2}})
[ 19.810s] [goog.labs.net.webChannel.WebChannelDebug] Origin Trials invoked: https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel
[ 19.813s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_
[ 19.813s] [goog.labs.net.webChannel.WebChannelDebug] open_()
[ 19.815s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (84183) [attempt 1]: POST
https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel?database=projects%2Fdebug-my%2Fdatabases%2F(default)&VER=8&RID=84183&CVER=22&X-HTTP-Session-Id=gsessionid&zx=2k2w24yrvvmp&t=1
count=1&ofs=0&req0___data__=%7B%22database%22%3A%22projects%2Fdebug-my%2Fdatabases%2F(default)%22%2C%22addTarget%22%3A%7B%22query%22%3A%7B%22structuredQuery%22%3A%7B%22from%22%3A%5B%7B%22collectionId%22%3A%22debug%22%7D%5D%2C%22orderBy%22%3A%5B%7B%22field%22%3A%7B%22fieldPath%22%3A%22__name__%22%7D%2C%22direction%22%3A%22ASCENDING%22%7D%5D%7D%2C%22parent%22%3A%22projects%2Fdebug-my%2Fdatabases%2F(default)%2Fdocuments%22%7D%2C%22targetId%22%3A2%7D%7D
[ 19.957s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (84183) [ attempt 1]: POST
https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel?database=projects%2Fdebug-my%2Fdatabases%2F(default)&VER=8&RID=84183&CVER=22&X-HTTP-Session-Id=gsessionid&zx=2k2w24yrvvmp&t=1
3 200
[ 19.959s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (84183): [[0,["c","oFPzn2rmR3Q7hNijwknN3w","",8,12,30000]]]
[ 19.960s] [goog.labs.net.webChannel.WebChannelDebug] VER=8
[ 19.961s] [goog.labs.net.webChannel.WebChannelDebug] SVER=12
[ 19.962s] [goog.labs.net.webChannel.WebChannelDebug] backChannelRequestTimeoutMs_=45000
[ 19.963s] [goog.labs.net.webChannel.WebChannelBaseTransport] WebChannel opened on https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel
[ 19.965s] [diagnostic] >>> [TEST 6/6: Firestore listen test with forceLongPolling] channel opened: 163ms (1616412189128)
concurrent request limit : 10
isSpdyEnabled : true
[ 19.965s] [goog.labs.net.webChannel.WebChannelDebug] GetBackChannelUri: https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel?database=projects%2Fdebug-my%2Fdatabases%2F(default)&gsessionid=MiZKTcdsDxieC5hRnMAA8bLcVkzk8GwaEoLE9bkV2DI&VER=8
[ 19.968s] [goog.labs.net.webChannel.WebChannelDebug] Creating new HttpRequest
[ 19.970s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP REQ (rpc) [attempt 1]: GET
https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel?database=projects%2Fdebug-my%2Fdatabases%2F(default)&gsessionid=MiZKTcdsDxieC5hRnMAA8bLcVkzk8GwaEoLE9bkV2DI&VER=8&RID=rpc&SID=oFPzn2rmR3Q7hNijwknN3w&CI=1&AID=0&TYPE=xmlhttp&zx=yigp1hxl770l&t=1
null
[ 19.972s] [goog.labs.net.webChannel.WebChannelDebug] New Request created
[ 19.978s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (84183) [ attempt 1]: POST
https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel?database=projects%2Fdebug-my%2Fdatabases%2F(default)&VER=8&RID=84183&CVER=22&X-HTTP-Session-Id=gsessionid&zx=2k2w24yrvvmp&t=1
4 200
[ 19.981s] [goog.labs.net.webChannel.WebChannelDebug] Request complete
[ 19.982s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_
[ 19.984s] [goog.labs.net.webChannel.WebChannelDebug] startForwardChannel_ returned: nothing to send
[ 20.109s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP RESP (rpc) [ attempt 1]: GET
https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel?database=projects%2Fdebug-my%2Fdatabases%2F(default)&gsessionid=MiZKTcdsDxieC5hRnMAA8bLcVkzk8GwaEoLE9bkV2DI&VER=8&RID=rpc&SID=oFPzn2rmR3Q7hNijwknN3w&CI=1&AID=0&TYPE=xmlhttp&zx=yigp1hxl770l&t=1
3 200
[ 20.112s] [goog.labs.net.webChannel.WebChannelDebug] XMLHTTP TEXT (rpc): [[1,[{
"targetChange": {
"targetChangeType": "ADD",
"targetIds": [
2
]
}
}
]],[2,[{
"documentChange": {
"document": {
"name": "projects/debug-my/databases/(default)/documents/debug/000",
"fields": {
"desc": {
"stringValue": "Diagnostic Document 0"
}
},
"createTime": "2019-12-28T19:50:18.256728Z",
"updateTime": "2019-12-28T19:50:18.256728Z"
},
"targetIds": [
2
]
}
}
]],[3,[{
"documentChange": {
"document": {
"name": "projects/debug-my/databases/(default)/documents/debug/001",
"fields": {
"desc": {
"stringValue": "Diagnostic Document 1"
}
},
"createTime": "2019-12-28T19:50:31.803733Z",
"updateTime": "2019-12-28T19:50:31.803733Z"
},
"targetIds": [
2
]
}
}
]],[4,[{
"documentChange": {
"document": {
"name": "projects/debug-my/databases/(default)/documents/debug/002",
"fields": {
"desc": {
"stringValue": "Diagnostic Document 2"
}
},
"createTime": "2019-12-28T19:50:37.682905Z",
"updateTime": "2019-12-28T19:50:43.797778Z"
},
"targetIds": [
2
]
}
}
]],[5,[{
"documentChange": {
"document": {
"name": "projects/debug-my/databases/(default)/documents/debug/003",
"fields": {
"desc": {
"stringValue": "Diagnostic Document 3"
}
},
"createTime": "2019-12-28T19:50:52.602052Z",
"updateTime": "2019-12-28T19:50:52.602052Z"
},
"targetIds": [
2
]
}
}
]],[6,[{
"documentChange": {
"document": {
"name": "projects/debug-my/databases/(default)/documents/debug/004",
"fields": {
"desc": {
"stringValue": "Diagnostic Document 4"
}
},
"createTime": "2019-12-28T19:50:59.545646Z",
"updateTime": "2019-12-28T19:50:59.545646Z"
},
"targetIds": [
2
]
}
}
]],[7,[{
"targetChange": {
"targetChangeType": "CURRENT",
"targetIds": [
2
],
"resumeToken": "CgkItqyS0+TD7wI=",
"readTime": "2021-03-22T11:23:09.955638Z"
}
}
]],[8,[{
"targetChange": {
"resumeToken": "CgkItqyS0+TD7wI=",
"readTime": "2021-03-22T11:23:09.955638Z"
}
}
]]]
[ 20.117s] [diagnostic] >>> [TEST 6/6: Firestore listen test with forceLongPolling] Received message: [{"targetChange":{"targetChangeType":"ADD","targetIds":[2]}}]
[ 20.118s] [diagnostic] >>> [TEST 6/6: Firestore listen test with forceLongPolling] Received message: [{"documentChange":{"document":{"name":"projects/debug-my/databases/(default)/documents/debug/000","fields":{"desc":{"stringValue":"Diagnostic Document 0"}},"createTime":"2019-12-28T19:50:18.256728Z","updateTime":"2019-12-28T19:50:18.256728Z"},"targetIds":[2]}}]
[ 20.119s] [diagnostic] >>> [TEST 6/6: Firestore listen test with forceLongPolling] Received message: [{"documentChange":{"document":{"name":"projects/debug-my/databases/(default)/documents/debug/001","fields":{"desc":{"stringValue":"Diagnostic Document 1"}},"createTime":"2019-12-28T19:50:31.803733Z","updateTime":"2019-12-28T19:50:31.803733Z"},"targetIds":[2]}}]
[ 20.121s] [diagnostic] >>> [TEST 6/6: Firestore listen test with forceLongPolling] Received message: [{"documentChange":{"document":{"name":"projects/debug-my/databases/(default)/documents/debug/002","fields":{"desc":{"stringValue":"Diagnostic Document 2"}},"createTime":"2019-12-28T19:50:37.682905Z","updateTime":"2019-12-28T19:50:43.797778Z"},"targetIds":[2]}}]
[ 20.124s] [diagnostic] >>> [TEST 6/6: Firestore listen test with forceLongPolling] Received message: [{"documentChange":{"document":{"name":"projects/debug-my/databases/(default)/documents/debug/003","fields":{"desc":{"stringValue":"Diagnostic Document 3"}},"createTime":"2019-12-28T19:50:52.602052Z","updateTime":"2019-12-28T19:50:52.602052Z"},"targetIds":[2]}}]
[ 20.126s] [diagnostic]
********************************************************
[TEST 6/6: Firestore listen test with forceLongPolling] completed successfully.
********************************************************
[ 20.127s] [goog.labs.net.webChannel.WebChannelDebug] disconnect()
[ 20.128s] [goog.labs.net.webChannel.WebChannelBaseTransport] WebChannel closed on https://firestore.googleapis.com/google.firestore.v1.Firestore/Listen/channel
[ 20.134s] [diagnostic] >>> [TEST 6/6: Firestore listen test with forceLongPolling] channel closed
[ 21.637s] [diagnostic]
********************************************************
All tests done.
1: webchannel.googleapis.com with default options: SUCCEEDED (3244ms)
2: webchannel.sandbox.google.com with default options: SUCCEEDED (2865ms)
3: webchannel.googleapis.com with forceLongPolling: SUCCEEDED (2951ms)
4: webchannel.googleapis.com with detectBufferingProxy: SUCCEEDED (2770ms)
5: Firestore listen test with default options: SUCCEEDED (400ms)
6: Firestore listen test with forceLongPolling: SUCCEEDED (328ms)
********************************************************
Sign up for free to join this conversation on GitHub. Already have an account? Sign in to comment