Uploaded image for project: 'Motor'
  1. Motor
  2. MOTOR-409

Test failure - test_cmap_wait_queue_timeout_must_aggressively_timeout_threads_enqueued_longer_than_waitQueueTimeoutMS

    • Type: Icon: Bug Bug
    • Resolution: Fixed
    • Priority: Icon: Major - P3 Major - P3
    • 2.1
    • Affects Version/s: None
    • Component/s: None
    • None

      This test is failing occasionally:

       [2019/10/03 16:38:19.790] FAIL: test_cmap_wait_queue_timeout_must_aggressively_timeout_threads_enqueued_longer_than_waitQueueTimeoutMS (test.test_cmap.TestCMAP)
       [2019/10/03 16:38:19.790] ----------------------------------------------------------------------
       [2019/10/03 16:38:19.790] Traceback (most recent call last):
       [2019/10/03 16:38:19.790]   File "/data/mci/195799d145bf507251262b1f6c22d9a7/src/.tox/synchro/tmp/mongo-python-driver/test/__init__.py", line 432, in wrap
       [2019/10/03 16:38:19.790]     return f(*args, **kwargs)
       [2019/10/03 16:38:19.790]   File "/data/mci/195799d145bf507251262b1f6c22d9a7/src/.tox/synchro/tmp/mongo-python-driver/test/test_cmap.py", line 424, in run_scenario
       [2019/10/03 16:38:19.790]     self.run_scenario(scenario_def, test)
       [2019/10/03 16:38:19.790]   File "/data/mci/195799d145bf507251262b1f6c22d9a7/src/.tox/synchro/tmp/mongo-python-driver/test/test_cmap.py", line 250, in run_scenario
       [2019/10/03 16:38:19.790]     self.run_operations(test['operations'])
       [2019/10/03 16:38:19.790]   File "/data/mci/195799d145bf507251262b1f6c22d9a7/src/.tox/synchro/tmp/mongo-python-driver/test/test_cmap.py", line 178, in run_operations
       [2019/10/03 16:38:19.790]     self.run_operation(op)
       [2019/10/03 16:38:19.790]   File "/data/mci/195799d145bf507251262b1f6c22d9a7/src/.tox/synchro/tmp/mongo-python-driver/test/test_cmap.py", line 172, in run_operation
       [2019/10/03 16:38:19.790]     meth(op)
       [2019/10/03 16:38:19.790]   File "/data/mci/195799d145bf507251262b1f6c22d9a7/src/.tox/synchro/tmp/mongo-python-driver/test/test_cmap.py", line 139, in wait_for_event
       [2019/10/03 16:38:19.790]     'find %s %s event(s)' % (count, event))
       [2019/10/03 16:38:19.790]   File "/data/mci/195799d145bf507251262b1f6c22d9a7/src/.tox/synchro/tmp/mongo-python-driver/test/utils.py", line 617, in wait_until
       [2019/10/03 16:38:19.790]     raise AssertionError("Didn't ever %s" % success_description)
       [2019/10/03 16:38:19.790] AssertionError: Didn't ever find 1 <class 'pymongo.monitoring.ConnectionCheckOutFailedEvent'> event(s)
       [2019/10/03 16:38:19.790] ----------------------------------------------------------------------
       [2019/10/03 16:38:19.790] Ran 1740 tests in 81.297s
       [2019/10/03 16:38:19.790] FAILED (SKIP=457, failures=1)
       [2019/10/03 16:38:19.790] Skipping test 'Valid options specific to single-threaded drivers are parsed correctly'
       [2019/10/03 16:38:19.790] Skipping test 'Invalid serverSelectionTryOnce causes a warning'
       [2019/10/03 16:38:19.790] ()
       [2019/10/03 16:38:19.790] Failed test: u'must aggressively timeout threads enqueued longer than waitQueueTimeoutMS'
       [2019/10/03 16:38:19.790] Operations:
       [2019/10/03 16:38:19.790] {u'label': u'conn0', u'name': u'checkOut'}
       [2019/10/03 16:38:19.790] {u'name': u'start', u'target': u'thread1'}
       [2019/10/03 16:38:19.790] {u'name': u'checkOut', u'thread': u'thread1'}
       [2019/10/03 16:38:19.790] {u'count': 1, u'event': u'ConnectionCheckOutFailed', u'name': u'waitForEvent'}
       [2019/10/03 16:38:19.790] Threads:
       [2019/10/03 16:38:19.790] {u'thread1': <CMAPThread(thread1, started daemon 139632398165760)>}
       [2019/10/03 16:38:19.790] Connections:
       [2019/10/03 16:38:19.790] {u'conn0': SocketInfo(<socket._socketobject object at 0x7eff53b62c20>) at 139635085914704}
       [2019/10/03 16:38:19.790] Events:
       [2019/10/03 16:38:19.790] PoolCreatedEvent(('localhost', 27017), {'maxPoolSize': 1, 'waitQueueTimeoutMS': 20.0})
       [2019/10/03 16:38:19.790] ConnectionCheckOutStartedEvent(('localhost', 27017))
       [2019/10/03 16:38:19.790] ConnectionCreatedEvent(('localhost', 27017), 1)
       [2019/10/03 16:38:19.790] ConnectionReadyEvent(('localhost', 27017), 1)
       [2019/10/03 16:38:19.790] ConnectionCheckedOutEvent(('localhost', 27017), 1)
       [2019/10/03 16:38:19.790] ConnectionCheckOutStartedEvent(('localhost', 27017))
       [2019/10/03 16:38:20.270] ERROR: InvocationError for command /data/mci/195799d145bf507251262b1f6c22d9a7/src/.tox/synchro/bin/python -m synchro.synchrotest -v -w .tox/synchro/tmp/mongo-python-driver --check-exclude-patterns (exited with code 1)
      

      Let's just skip this test as we've had problems with it in PyMongo too.

            Assignee:
            shane.harvey@mongodb.com Shane Harvey
            Reporter:
            shane.harvey@mongodb.com Shane Harvey
            Votes:
            0 Vote for this issue
            Watchers:
            1 Start watching this issue

              Created:
              Updated:
              Resolved: