Closed Bug 1029296 Opened 6 years ago Closed 5 years ago

Intermittent test_cellbroadcast_gsm.js | ScriptTimeoutException: ScriptTimeoutException: timed out | test_cellbroadcast_multi_sim.js | MarionetteException: MarionetteException: Emulator callback still pending when finish() called

Categories

(Firefox OS Graveyard :: RIL, defect)

ARM
Gonk (Firefox OS)
defect
Not set

Tracking

(Not tracked)

RESOLVED WORKSFORME
2.0 S6 (18july)

People

(Reporter: KWierso, Assigned: vicamo)

References

Details

(Keywords: intermittent-failure)

https://tbpl.mozilla.org/php/getParsedLog.php?id=42295241&tree=B2g-Inbound
b2g_emulator_vm b2g-inbound opt test marionette-webapi on 2014-06-23 13:03:49 PDT for push 43af4669b425

slave: tst-linux64-spot-135



13:57:15     INFO -  TEST-START test_cellbroadcast_gsm.js
13:57:47     INFO -  /builds/slave/test/build/tests/marionette/tests/dom/cellbroadcast/tests/marionette/test_cellbroadcast_gsm.js, runTest (marionette_test.MarionetteJSTestCase) ... ERROR
13:57:48     INFO -  START LOG:
13:57:48     INFO -  INFO TEST-START: /builds/slave/test/build/tests/marionette/tests/dom/cellbroadcast/tests/marionette/test_cellbroadcast_gsm.js Mon Jun 23 2014 16:57:16 GMT-0400 (EDT)
13:57:48     INFO -  INFO Test GSM Cell Broadcast message attributes Mon Jun 23 2014 16:57:17 GMT-0400 (EDT)
13:57:48     INFO -  INFO Test receiving GSM Cell Broadcast - Geographical Scope Mon Jun 23 2014 16:57:17 GMT-0400 (EDT)
13:57:48     INFO -  INFO Test receiving GSM Cell Broadcast - Message Code Mon Jun 23 2014 16:57:18 GMT-0400 (EDT)
13:57:48     INFO -  INFO Test receiving GSM Cell Broadcast - Message Identifier Mon Jun 23 2014 16:57:19 GMT-0400 (EDT)
13:57:48     INFO -  INFO Test receiving GSM Cell Broadcast - Language & Body Mon Jun 23 2014 16:57:20 GMT-0400 (EDT)
13:57:48     INFO -  INFO Test receiving GSM Cell Broadcast - Timestamp Mon Jun 23 2014 16:57:38 GMT-0400 (EDT)
13:57:48     INFO -  INFO Test receiving GSM Cell Broadcast - Warning Type Mon Jun 23 2014 16:57:38 GMT-0400 (EDT)
13:57:48     INFO -  INFO Test receiving GSM Cell Broadcast - Emergency User Alert Mon Jun 23 2014 16:57:39 GMT-0400 (EDT)
13:57:48     INFO -  INFO Test receiving GSM Cell Broadcast - Popup Mon Jun 23 2014 16:57:39 GMT-0400 (EDT)
13:57:48     INFO -  INFO Test receiving GSM Cell Broadcast - Multipart Messages Mon Jun 23 2014 16:57:39 GMT-0400 (EDT)
13:57:48     INFO -  END LOG:
13:57:48     INFO -  ======================================================================
13:57:48     INFO -  ERROR: None
13:57:48     INFO -  ----------------------------------------------------------------------
13:57:48    ERROR -  TEST-UNEXPECTED-FAIL | test_cellbroadcast_gsm.js | ScriptTimeoutException: ScriptTimeoutException: timed out
13:57:48     INFO -  ----------------------------------------------------------------------
13:57:48     INFO -  Ran 1 test in 32.534s
13:57:48  WARNING -  FAILED (errors=1)
13:57:48     INFO -  TEST-START test_cellbroadcast_multi_sim.js
13:57:50     INFO -  /builds/slave/test/build/tests/marionette/tests/dom/cellbroadcast/tests/marionette/test_cellbroadcast_multi_sim.js, runTest (marionette_test.MarionetteJSTestCase) ... ERROR
13:57:51     INFO -  START LOG:
13:57:51     INFO -  INFO TEST-START: /builds/slave/test/build/tests/marionette/tests/dom/cellbroadcast/tests/marionette/test_cellbroadcast_multi_sim.js Mon Jun 23 2014 16:57:49 GMT-0400 (EDT)
13:57:51     INFO -  INFO navigator.mozCellBroadcast is instance of [object XrayWrapper function MozCellBroadcast() {
13:57:51     INFO -      [native code]
13:57:51     INFO -  }] Mon Jun 23 2014 16:57:50 GMT-0400 (EDT)
13:57:51     INFO -  INFO Not a Multi-SIM environment. Test is skipped. Mon Jun 23 2014 16:57:50 GMT-0400 (EDT)
13:57:51     INFO -  END LOG:
13:57:51     INFO -  ======================================================================
13:57:51     INFO -  ERROR: None
13:57:51     INFO -  ----------------------------------------------------------------------
13:57:51     INFO -  Traceback (most recent call last):
13:57:51     INFO -    File "/builds/slave/test/build/tests/marionette/marionette/marionette_test.py", line 170, in run
13:57:51     INFO -      testMethod()
13:57:51     INFO -    File "/builds/slave/test/build/tests/marionette/marionette/marionette_test.py", line 497, in runTest
13:57:51     INFO -      filename=os.path.basename(self.jsFile))
13:57:51     INFO -    File "/builds/slave/test/build/tests/marionette/marionette/marionette.py", line 1039, in execute_js_script
13:57:51     INFO -      line=None)
13:57:51     INFO -    File "/builds/slave/test/build/tests/marionette/marionette/decorators.py", line 35, in _
13:57:51     INFO -      return func(*args, **kwargs)
13:57:51     INFO -    File "/builds/slave/test/build/tests/marionette/marionette/marionette.py", line 613, in _send_message
13:57:51     INFO -      self._handle_error(response)
13:57:51     INFO -    File "/builds/slave/test/build/tests/marionette/marionette/marionette.py", line 687, in _handle_error
13:57:51     INFO -      raise errors.MarionetteException(message=message, status=status, stacktrace=stacktrace)
13:57:51    ERROR -  TEST-UNEXPECTED-FAIL | test_cellbroadcast_multi_sim.js | MarionetteException: MarionetteException: Emulator callback still pending when finish() called
13:57:51     INFO -  ----------------------------------------------------------------------
13:57:51     INFO -  Ran 1 test in 2.276s
13:57:51  WARNING -  FAILED (errors=1)
13:57:51     INFO -  TEST-START test_touchcaret.py
(In reply to Wes Kocher (:KWierso) from comment #0)
> 13:57:15     INFO -  TEST-START test_cellbroadcast_gsm.js

Timeout is too short.  Others have 60 seconds, but this one has only 30.

> 13:57:48     INFO -  TEST-START test_cellbroadcast_multi_sim.js
> 13:57:51    ERROR -  TEST-UNEXPECTED-FAIL | test_cellbroadcast_multi_sim.js
> | MarionetteException: MarionetteException: Emulator callback still pending
> when finish() called

Looks we didn't call sendEmulatorCommand at all. Don't know why it's happening yet.
Assignee: nobody → vyang
Component: DOM: Device Interfaces → RIL
Product: Core → Firefox OS
Hardware: x86_64 → ARM
Target Milestone: --- → 2.0 S5 (4july)
Depends on: 921326
I just recall that
When fixing bug 921326, I found that the marionette test case of cellbroadcast was not enabled.
Hence, I enable it by adding it into unit-tests.ini:
https://bugzilla.mozilla.org/page.cgi?id=splinter.html&bug=921326&attachment=8441232

Shall we disable it until bug 1028791 is done?
Flags: needinfo?(vyang)
Flags: needinfo?(vyang)
Target Milestone: 2.0 S5 (4july) → 2.0 S6 (18july)
The original MARIONETTE_TIMEOUT is 30 and is too closed to the time this test case to be executed in the try server.
I've expanded it to 60 seconds while rewriting the CBS test cases with promise in bug 1028791 and the solution has been phased in.
We can keep monitoring if it still happens. :)
Inactive; closing (see bug 1180138).
Status: NEW → RESOLVED
Closed: 5 years ago
Resolution: --- → WORKSFORME
You need to log in before you can comment on or make changes to this bug.