builder: mozilla-central_ubuntu64_hw_styloseq_test-dromaeojs-e10s slave: talos-linux64-ix-013 starttime: 1501547850.61 results: success (0) revision: 8b19670d12fde57d3aee50a5a7d1c734d9b709d5 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-07-31 17:37:30.610890) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-07-31 17:37:30.611455) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-07-31 17:37:30.611783) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-07-31 17:37:30.658145) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-31 17:37:30.658466) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-07-31 17:37:30-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 107M=0s 2017-07-31 17:37:30 (107 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.116498 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-31 17:37:30.815803) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-07-31 17:37:30.816145) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.023198 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-07-31 17:37:30.885346) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-31 17:37:30.885664) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 8b19670d12fde57d3aee50a5a7d1c734d9b709d5 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 8b19670d12fde57d3aee50a5a7d1c734d9b709d5 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-07-31 17:37:30,899 truncating revision to first 12 chars 2017-07-31 17:37:30,899 Setting DEBUG logging. 2017-07-31 17:37:30,899 attempt 1/10 2017-07-31 17:37:30,899 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/8b19670d12fd?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-07-31 17:37:31,461 unpacking tar archive at: mozilla-central-8b19670d12fd/testing/mozharness/ program finished with exit code 0 elapsedTime=0.876264 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-31 17:37:31.784024) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-07-31 17:37:31.787432) ========= script_repo_revision: 8b19670d12fde57d3aee50a5a7d1c734d9b709d5 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-07-31 17:37:31.787886) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-07-31 17:37:31.788188) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-07-31 17:37:31.798853) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 59 secs) (at 2017-07-31 17:37:31.799281) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 17:37:31 INFO - MultiFileLogger online at 20170731 17:37:31 in /builds/slave/test 17:37:31 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 17:37:31 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 17:37:31 INFO - {'append_to_log': False, 17:37:31 INFO - 'base_work_dir': '/builds/slave/test', 17:37:31 INFO - 'blob_upload_branch': 'Firefox', 17:37:31 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 17:37:31 INFO - 'branch': 'Firefox', 17:37:31 INFO - 'buildbot_json_path': 'buildprops.json', 17:37:31 INFO - 'code_coverage': False, 17:37:31 INFO - 'config_files': ('talos/linux_config.py',), 17:37:31 INFO - 'default_actions': ('clobber', 17:37:31 INFO - 'read-buildbot-config', 17:37:31 INFO - 'download-and-extract', 17:37:31 INFO - 'populate-webroot', 17:37:31 INFO - 'create-virtualenv', 17:37:31 INFO - 'install', 17:37:31 INFO - 'setup-mitmproxy', 17:37:31 INFO - 'run-tests'), 17:37:31 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 17:37:31 INFO - 'disable_ccov_upload': False, 17:37:31 INFO - 'download_minidump_stackwalk': True, 17:37:31 INFO - 'download_symbols': 'ondemand', 17:37:31 INFO - 'enable_stylo': False, 17:37:31 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 17:37:31 INFO - 'tooltool.py': '/tools/tooltool.py', 17:37:31 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 17:37:31 INFO - '/tools/misc-python/virtualenv.py')}, 17:37:31 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 17:37:31 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 17:37:31 INFO - 'gecko_profile': False, 17:37:31 INFO - 'gecko_profile_interval': 0, 17:37:31 INFO - 'installer_path': 'installer.exe', 17:37:31 INFO - 'log_level': 'info', 17:37:31 INFO - 'log_name': 'talos', 17:37:31 INFO - 'log_to_console': True, 17:37:31 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 17:37:31 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 17:37:31 INFO - 'opt_config_files': (), 17:37:31 INFO - 'pip_index': False, 17:37:31 INFO - 'suite': 'dromaeojs-e10s', 17:37:31 INFO - 'system_bits': '32', 17:37:31 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 17:37:31 INFO - 'title': 'talos-linux64-ix-013', 17:37:31 INFO - 'tooltool_cache': '/builds/tooltool_cache', 17:37:31 INFO - 'use_talos_json': True, 17:37:31 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 17:37:31 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 17:37:31 INFO - 'work_dir': 'build'} 17:37:31 INFO - [mozharness: 2017-08-01 00:37:31.913623Z] Running clobber step. 17:37:31 INFO - Running pre-action listener: _resource_record_pre_action 17:37:31 INFO - Running main action method: clobber 17:37:31 INFO - rmtree: /builds/slave/test/build 17:37:31 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 17:37:33 INFO - Running post-action listener: _resource_record_post_action 17:37:33 INFO - [mozharness: 2017-08-01 00:37:33.463758Z] Finished clobber step (success) 17:37:33 INFO - [mozharness: 2017-08-01 00:37:33.463859Z] Running read-buildbot-config step. 17:37:33 INFO - Running pre-action listener: _resource_record_pre_action 17:37:33 INFO - Running main action method: read_buildbot_config 17:37:33 INFO - Using buildbot properties: 17:37:33 INFO - { 17:37:33 INFO - "project": "", 17:37:33 INFO - "product": "firefox", 17:37:33 INFO - "who": "kwierso@gmail.com", 17:37:33 INFO - "installer_path": "public/build/target.tar.bz2", 17:37:33 INFO - "builddir": "mozilla-central_ubuntu64_hw_styloseq_test-dromaeojs-e10s", 17:37:33 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 17:37:33 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo-sequential mozilla-central talos dromaeojs-e10s", 17:37:33 INFO - "stage_platform": "linux64-stylosequential", 17:37:33 INFO - "basedir": "/builds/slave/test", 17:37:33 INFO - "buildnumber": 130, 17:37:33 INFO - "platform": "ubuntu64_hw_styloseq", 17:37:33 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 17:37:33 INFO - "slavebuilddir": "test", 17:37:33 INFO - "taskId": "YtdervDvQGqJDdl5EJk74A", 17:37:33 INFO - "branch": "mozilla-central", 17:37:33 INFO - "script_repo_revision": "production", 17:37:33 INFO - "revision": "8b19670d12fde57d3aee50a5a7d1c734d9b709d5", 17:37:33 INFO - "slavename": "talos-linux64-ix-013", 17:37:33 INFO - "repo_path": "mozilla-central" 17:37:33 INFO - } 17:37:33 INFO - Finding installer, test and symbols from parent task. 17:37:33 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/YtdervDvQGqJDdl5EJk74A'}, attempt #1 17:37:33 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/YtdervDvQGqJDdl5EJk74A'}, attempt #1 17:37:34 INFO - Task dependencies: DsdJJjUsSgahxwFgH6hwYA 17:37:34 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA'}, attempt #1 17:37:34 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.tar.bz2 17:37:34 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.test_packages.json 17:37:34 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.crashreporter-symbols.zip 17:37:34 INFO - Running post-action listener: _resource_record_post_action 17:37:34 INFO - [mozharness: 2017-08-01 00:37:34.826808Z] Finished read-buildbot-config step (success) 17:37:34 INFO - [mozharness: 2017-08-01 00:37:34.827031Z] Running download-and-extract step. 17:37:34 INFO - Running pre-action listener: _resource_record_pre_action 17:37:34 INFO - Running main action method: download_and_extract 17:37:34 INFO - mkdir: /builds/slave/test/build/tests 17:37:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:37:34 INFO - trying https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.test_packages.json 17:37:34 INFO - Downloading https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 17:37:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 17:37:35 INFO - Downloaded 989 bytes. 17:37:35 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 17:37:35 INFO - Using the following test package requirements: 17:37:35 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 17:37:35 INFO - u'common': [u'target.common.tests.zip'], 17:37:35 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 17:37:35 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 17:37:35 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 17:37:35 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 17:37:35 INFO - u'mozbase': [u'target.common.tests.zip'], 17:37:35 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 17:37:35 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 17:37:35 INFO - u'web-platform': [u'target.common.tests.zip', 17:37:35 INFO - u'target.web-platform.tests.tar.gz'], 17:37:35 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 17:37:35 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 17:37:35 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.common.tests.zip 17:37:35 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.common.tests.zip'}, attempt #1 17:37:35 INFO - Fetch https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.common.tests.zip into memory 17:37:37 INFO - Content-Length response header: 72389642 17:37:37 INFO - Bytes received: 72389642 17:37:48 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 17:37:48 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.common.tests.zip 17:37:48 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.common.tests.zip'}, attempt #1 17:37:48 INFO - Fetch https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.common.tests.zip into memory 17:37:50 INFO - Content-Length response header: 72389642 17:37:50 INFO - Bytes received: 72389642 17:38:02 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.talos.tests.zip 17:38:02 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.talos.tests.zip'}, attempt #1 17:38:02 INFO - Fetch https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.talos.tests.zip into memory 17:38:03 INFO - Content-Length response header: 14496467 17:38:03 INFO - Bytes received: 14496467 17:38:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:03 INFO - trying https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.tar.bz2 17:38:03 INFO - Downloading https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 17:38:03 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 17:38:04 INFO - Downloaded 62118329 bytes. 17:38:04 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.tar.bz2 17:38:04 INFO - mkdir: /builds/slave/test/properties 17:38:04 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 17:38:04 INFO - Writing to file /builds/slave/test/properties/build_url 17:38:04 INFO - Contents: 17:38:04 INFO - build_url:https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.tar.bz2 17:38:04 INFO - Running post-action listener: _resource_record_post_action 17:38:04 INFO - Running post-action listener: set_extra_try_arguments 17:38:04 INFO - [mozharness: 2017-08-01 00:38:04.915634Z] Finished download-and-extract step (success) 17:38:04 INFO - [mozharness: 2017-08-01 00:38:04.915732Z] Running populate-webroot step. 17:38:04 INFO - Running pre-action listener: _resource_record_pre_action 17:38:04 INFO - Running main action method: populate_webroot 17:38:04 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 17:38:04 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 17:38:04 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 17:38:04 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:38:04 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 17:38:04 INFO - 'tests': ['damp', 'tps']}, 17:38:04 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 17:38:04 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 17:38:04 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 17:38:04 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 17:38:04 INFO - 'other-e10s': {'tests': ['a11yr', 17:38:04 INFO - 'ts_paint', 17:38:04 INFO - 'tpaint', 17:38:04 INFO - 'sessionrestore', 17:38:04 INFO - 'sessionrestore_many_windows', 17:38:04 INFO - 'sessionrestore_no_auto_restore', 17:38:04 INFO - 'tabpaint']}, 17:38:04 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 17:38:04 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 17:38:04 INFO - 'quantum-pageload-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 17:38:04 INFO - 'talos_options': ['--mitmproxy', 17:38:04 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 17:38:04 INFO - '--firstNonBlankPaint'], 17:38:04 INFO - 'tests': ['quantum_pageload_google', 17:38:04 INFO - 'quantum_pageload_youtube', 17:38:04 INFO - 'quantum_pageload_amazon', 17:38:04 INFO - 'quantum_pageload_facebook']}, 17:38:04 INFO - 'quantum-pageload-stylo-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 17:38:04 INFO - 'talos_options': ['--stylo', 17:38:04 INFO - '--mitmproxy', 17:38:04 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 17:38:04 INFO - '--firstNonBlankPaint'], 17:38:04 INFO - 'tests': ['quantum_pageload_google', 17:38:04 INFO - 'quantum_pageload_youtube', 17:38:04 INFO - 'quantum_pageload_amazon', 17:38:04 INFO - 'quantum_pageload_facebook']}, 17:38:04 INFO - 'svgr-e10s': {'tests': ['tsvgx', 17:38:04 INFO - 'tsvgr_opacity', 17:38:04 INFO - 'tart', 17:38:04 INFO - 'tscrollx', 17:38:04 INFO - 'cart', 17:38:04 INFO - 'tsvg_static']}, 17:38:04 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 17:38:04 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 17:38:04 INFO - 'talos_options': ['--stylo', 17:38:04 INFO - '--stylo-threads=1', 17:38:04 INFO - '--mitmproxy', 17:38:04 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 17:38:04 INFO - '--firstNonBlankPaint'], 17:38:04 INFO - 'tests': ['tp6_google', 17:38:04 INFO - 'tp6_youtube', 17:38:04 INFO - 'tp6_amazon', 17:38:04 INFO - 'tp6_facebook']}, 17:38:04 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 17:38:04 INFO - 'talos_options': ['--xperf_path', 17:38:04 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:38:04 INFO - 'tests': ['tp5n']}}} 17:38:04 INFO - Running post-action listener: _resource_record_post_action 17:38:04 INFO - [mozharness: 2017-08-01 00:38:04.924379Z] Finished populate-webroot step (success) 17:38:04 INFO - [mozharness: 2017-08-01 00:38:04.924470Z] Running create-virtualenv step. 17:38:04 INFO - Running pre-action listener: _resource_record_pre_action 17:38:04 INFO - Running main action method: create_virtualenv 17:38:04 INFO - Creating virtualenv /builds/slave/test/build/venv 17:38:04 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 17:38:04 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 17:38:04 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 17:38:05 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 17:38:05 INFO - Using real prefix '/usr' 17:38:05 INFO - New python executable in /builds/slave/test/build/venv/bin/python 17:38:05 INFO - Installing distribute.............................................................................................................................................................................................done. 17:38:07 INFO - Installing pip.................done. 17:38:07 INFO - Return code: 0 17:38:07 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 17:38:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 17:38:07 INFO - Reading from file tmpfile_stdout 17:38:07 INFO - Output received: 17:38:07 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 17:38:07 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 17:38:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:38:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:38:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x113d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1309a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14acd10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14a9eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aadb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14ab240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:38:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 17:38:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 17:38:07 INFO - Using env: {'DISPLAY': ':0', 17:38:07 INFO - 'HOME': '/home/cltbld', 17:38:07 INFO - 'LANG': 'en_US.UTF-8', 17:38:07 INFO - 'LANGUAGE': 'en_US:en', 17:38:07 INFO - 'LOGNAME': 'cltbld', 17:38:07 INFO - 'MAIL': '/var/mail/cltbld', 17:38:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:38:07 INFO - 'MOZ_NO_REMOTE': '1', 17:38:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:38:07 INFO - 'NO_EM_RESTART': '1', 17:38:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:38:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:38:07 INFO - 'PWD': '/builds/slave/test', 17:38:07 INFO - 'SHELL': '/bin/bash', 17:38:07 INFO - 'SHLVL': '1', 17:38:07 INFO - 'TERM': 'linux', 17:38:07 INFO - 'TMOUT': '86400', 17:38:07 INFO - 'USER': 'cltbld', 17:38:07 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 17:38:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:38:07 INFO - '_': '/tools/buildbot/bin/python'} 17:38:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:38:07 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 17:38:07 INFO - Cleaning up... 17:38:07 INFO - Return code: 0 17:38:07 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 17:38:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:38:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:38:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x113d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1309a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14acd10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14a9eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aadb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14ab240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:38:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 17:38:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 17:38:07 INFO - Using env: {'DISPLAY': ':0', 17:38:07 INFO - 'HOME': '/home/cltbld', 17:38:07 INFO - 'LANG': 'en_US.UTF-8', 17:38:07 INFO - 'LANGUAGE': 'en_US:en', 17:38:07 INFO - 'LOGNAME': 'cltbld', 17:38:07 INFO - 'MAIL': '/var/mail/cltbld', 17:38:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:38:07 INFO - 'MOZ_NO_REMOTE': '1', 17:38:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:38:07 INFO - 'NO_EM_RESTART': '1', 17:38:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:38:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:38:07 INFO - 'PWD': '/builds/slave/test', 17:38:07 INFO - 'SHELL': '/bin/bash', 17:38:07 INFO - 'SHLVL': '1', 17:38:07 INFO - 'TERM': 'linux', 17:38:07 INFO - 'TMOUT': '86400', 17:38:07 INFO - 'USER': 'cltbld', 17:38:07 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 17:38:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:38:07 INFO - '_': '/tools/buildbot/bin/python'} 17:38:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:38:08 INFO - Downloading/unpacking psutil>=3.1.1 17:38:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 17:38:09 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:38:09 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:38:09 INFO - Installing collected packages: psutil 17:38:09 INFO - Running setup.py install for psutil 17:38:09 INFO - building 'psutil._psutil_linux' extension 17:38:09 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 17:38:09 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 17:38:09 INFO - building 'psutil._psutil_posix' extension 17:38:09 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 17:38:09 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 17:38:09 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:38:09 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:38:09 INFO - Successfully installed psutil 17:38:09 INFO - Cleaning up... 17:38:09 INFO - Return code: 0 17:38:09 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 17:38:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:38:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:38:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x113d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1309a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14acd10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14a9eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aadb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14ab240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:38:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 17:38:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 17:38:09 INFO - Using env: {'DISPLAY': ':0', 17:38:09 INFO - 'HOME': '/home/cltbld', 17:38:09 INFO - 'LANG': 'en_US.UTF-8', 17:38:09 INFO - 'LANGUAGE': 'en_US:en', 17:38:09 INFO - 'LOGNAME': 'cltbld', 17:38:09 INFO - 'MAIL': '/var/mail/cltbld', 17:38:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:38:09 INFO - 'MOZ_NO_REMOTE': '1', 17:38:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:38:09 INFO - 'NO_EM_RESTART': '1', 17:38:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:38:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:38:09 INFO - 'PWD': '/builds/slave/test', 17:38:09 INFO - 'SHELL': '/bin/bash', 17:38:09 INFO - 'SHLVL': '1', 17:38:09 INFO - 'TERM': 'linux', 17:38:09 INFO - 'TMOUT': '86400', 17:38:09 INFO - 'USER': 'cltbld', 17:38:09 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 17:38:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:38:09 INFO - '_': '/tools/buildbot/bin/python'} 17:38:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:38:10 INFO - Downloading/unpacking mozsystemmonitor==0.3 17:38:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:11 INFO - Downloading mozsystemmonitor-0.3.tar.gz 17:38:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 17:38:11 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 17:38:11 INFO - Installing collected packages: mozsystemmonitor 17:38:11 INFO - Running setup.py install for mozsystemmonitor 17:38:11 INFO - Successfully installed mozsystemmonitor 17:38:11 INFO - Cleaning up... 17:38:11 INFO - Return code: 0 17:38:11 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 17:38:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:38:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:38:11 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x113d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1309a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14acd10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14a9eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aadb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14ab240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:38:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 17:38:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 17:38:11 INFO - Using env: {'DISPLAY': ':0', 17:38:11 INFO - 'HOME': '/home/cltbld', 17:38:11 INFO - 'LANG': 'en_US.UTF-8', 17:38:11 INFO - 'LANGUAGE': 'en_US:en', 17:38:11 INFO - 'LOGNAME': 'cltbld', 17:38:11 INFO - 'MAIL': '/var/mail/cltbld', 17:38:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:38:11 INFO - 'MOZ_NO_REMOTE': '1', 17:38:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:38:11 INFO - 'NO_EM_RESTART': '1', 17:38:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:38:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:38:11 INFO - 'PWD': '/builds/slave/test', 17:38:11 INFO - 'SHELL': '/bin/bash', 17:38:11 INFO - 'SHLVL': '1', 17:38:11 INFO - 'TERM': 'linux', 17:38:11 INFO - 'TMOUT': '86400', 17:38:11 INFO - 'USER': 'cltbld', 17:38:11 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 17:38:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:38:11 INFO - '_': '/tools/buildbot/bin/python'} 17:38:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:38:11 INFO - Downloading/unpacking jsonschema==2.5.1 17:38:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:12 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 17:38:12 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 17:38:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:12 INFO - Downloading functools32-3.2.3-2.tar.gz 17:38:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 17:38:12 INFO - warning: no files found matching '*.txt' 17:38:12 INFO - no previously-included directories found matching 'build' 17:38:12 INFO - no previously-included directories found matching 'dist' 17:38:12 INFO - no previously-included directories found matching '.git*' 17:38:12 INFO - Installing collected packages: jsonschema, functools32 17:38:12 INFO - Running setup.py install for functools32 17:38:12 INFO - warning: no files found matching '*.txt' 17:38:12 INFO - no previously-included directories found matching 'build' 17:38:12 INFO - no previously-included directories found matching 'dist' 17:38:12 INFO - no previously-included directories found matching '.git*' 17:38:12 INFO - Successfully installed jsonschema functools32 17:38:12 INFO - Cleaning up... 17:38:12 INFO - Return code: 0 17:38:12 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 17:38:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:38:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:38:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x113d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1309a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14acd10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14a9eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aadb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14ab240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:38:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 17:38:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 17:38:12 INFO - Using env: {'DISPLAY': ':0', 17:38:12 INFO - 'HOME': '/home/cltbld', 17:38:12 INFO - 'LANG': 'en_US.UTF-8', 17:38:12 INFO - 'LANGUAGE': 'en_US:en', 17:38:12 INFO - 'LOGNAME': 'cltbld', 17:38:12 INFO - 'MAIL': '/var/mail/cltbld', 17:38:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:38:12 INFO - 'MOZ_NO_REMOTE': '1', 17:38:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:38:12 INFO - 'NO_EM_RESTART': '1', 17:38:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:38:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:38:12 INFO - 'PWD': '/builds/slave/test', 17:38:12 INFO - 'SHELL': '/bin/bash', 17:38:12 INFO - 'SHLVL': '1', 17:38:12 INFO - 'TERM': 'linux', 17:38:12 INFO - 'TMOUT': '86400', 17:38:12 INFO - 'USER': 'cltbld', 17:38:12 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 17:38:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:38:12 INFO - '_': '/tools/buildbot/bin/python'} 17:38:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:38:13 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 17:38:13 INFO - Cleaning up... 17:38:13 INFO - Return code: 0 17:38:13 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 17:38:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:38:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:38:13 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x113d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1309a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14acd10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14a9eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aadb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14ab240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:38:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 17:38:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 17:38:13 INFO - Using env: {'DISPLAY': ':0', 17:38:13 INFO - 'HOME': '/home/cltbld', 17:38:13 INFO - 'LANG': 'en_US.UTF-8', 17:38:13 INFO - 'LANGUAGE': 'en_US:en', 17:38:13 INFO - 'LOGNAME': 'cltbld', 17:38:13 INFO - 'MAIL': '/var/mail/cltbld', 17:38:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:38:13 INFO - 'MOZ_NO_REMOTE': '1', 17:38:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:38:13 INFO - 'NO_EM_RESTART': '1', 17:38:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:38:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:38:13 INFO - 'PWD': '/builds/slave/test', 17:38:13 INFO - 'SHELL': '/bin/bash', 17:38:13 INFO - 'SHLVL': '1', 17:38:13 INFO - 'TERM': 'linux', 17:38:13 INFO - 'TMOUT': '86400', 17:38:13 INFO - 'USER': 'cltbld', 17:38:13 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 17:38:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:38:13 INFO - '_': '/tools/buildbot/bin/python'} 17:38:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:38:13 INFO - Downloading/unpacking blobuploader==1.2.4 17:38:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:14 INFO - Downloading blobuploader-1.2.4.tar.gz 17:38:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 17:38:14 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 17:38:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 17:38:14 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 17:38:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:14 INFO - Downloading docopt-0.6.1.tar.gz 17:38:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 17:38:15 INFO - Installing collected packages: blobuploader, requests, docopt 17:38:15 INFO - Running setup.py install for blobuploader 17:38:15 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 17:38:15 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 17:38:15 INFO - Running setup.py install for requests 17:38:15 INFO - Running setup.py install for docopt 17:38:15 INFO - Successfully installed blobuploader requests docopt 17:38:15 INFO - Cleaning up... 17:38:15 INFO - Return code: 0 17:38:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:38:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:38:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:38:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x113d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1309a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14acd10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14a9eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aadb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14ab240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:38:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 17:38:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:38:15 INFO - Using env: {'DISPLAY': ':0', 17:38:15 INFO - 'HOME': '/home/cltbld', 17:38:15 INFO - 'LANG': 'en_US.UTF-8', 17:38:15 INFO - 'LANGUAGE': 'en_US:en', 17:38:15 INFO - 'LOGNAME': 'cltbld', 17:38:15 INFO - 'MAIL': '/var/mail/cltbld', 17:38:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:38:15 INFO - 'MOZ_NO_REMOTE': '1', 17:38:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:38:15 INFO - 'NO_EM_RESTART': '1', 17:38:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:38:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:38:15 INFO - 'PWD': '/builds/slave/test', 17:38:15 INFO - 'SHELL': '/bin/bash', 17:38:15 INFO - 'SHLVL': '1', 17:38:15 INFO - 'TERM': 'linux', 17:38:15 INFO - 'TMOUT': '86400', 17:38:15 INFO - 'USER': 'cltbld', 17:38:15 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 17:38:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:38:15 INFO - '_': '/tools/buildbot/bin/python'} 17:38:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:38:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:38:15 INFO - Running setup.py (path:/tmp/pip-wBT26r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:38:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:38:15 INFO - Running setup.py (path:/tmp/pip-2lMHpU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:38:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:38:16 INFO - Running setup.py (path:/tmp/pip-r37OAp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:38:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:38:16 INFO - Running setup.py (path:/tmp/pip-42PJgD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:38:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:38:16 INFO - Running setup.py (path:/tmp/pip-XSWMqZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:38:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:38:16 INFO - Running setup.py (path:/tmp/pip-D7i5YV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:38:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:38:16 INFO - Running setup.py (path:/tmp/pip-UXF8is-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:38:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:38:16 INFO - Running setup.py (path:/tmp/pip-geIcUn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:38:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:38:16 INFO - Running setup.py (path:/tmp/pip-ioAGcp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:38:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:38:16 INFO - Running setup.py (path:/tmp/pip-vk_TID-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:38:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:38:16 INFO - Running setup.py (path:/tmp/pip-ZhLBiy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:38:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:38:16 INFO - Running setup.py (path:/tmp/pip-D1LLti-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:38:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:38:16 INFO - Running setup.py (path:/tmp/pip-PxJSrC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:38:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:38:16 INFO - Running setup.py (path:/tmp/pip-Pi31_6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:38:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:38:16 INFO - Running setup.py (path:/tmp/pip-9vWthM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:38:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:38:16 INFO - Running setup.py (path:/tmp/pip-ijwf5t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:38:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:38:17 INFO - Running setup.py (path:/tmp/pip-raLjwC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:38:17 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 17:38:17 INFO - Running setup.py install for manifestparser 17:38:17 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 17:38:17 INFO - Running setup.py install for mozcrash 17:38:17 INFO - Running setup.py install for mozdebug 17:38:17 INFO - Running setup.py install for mozdevice 17:38:17 INFO - Installing dm script to /builds/slave/test/build/venv/bin 17:38:17 INFO - Running setup.py install for mozfile 17:38:17 INFO - Running setup.py install for mozhttpd 17:38:17 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 17:38:17 INFO - Running setup.py install for mozinfo 17:38:17 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 17:38:17 INFO - Running setup.py install for mozInstall 17:38:17 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 17:38:17 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 17:38:17 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 17:38:17 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 17:38:17 INFO - Running setup.py install for mozleak 17:38:17 INFO - Running setup.py install for mozlog 17:38:18 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 17:38:18 INFO - Running setup.py install for moznetwork 17:38:18 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 17:38:18 INFO - Running setup.py install for mozprocess 17:38:18 INFO - Running setup.py install for mozprofile 17:38:18 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 17:38:18 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 17:38:18 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 17:38:18 INFO - Running setup.py install for mozrunner 17:38:18 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 17:38:18 INFO - Running setup.py install for mozscreenshot 17:38:18 INFO - Running setup.py install for moztest 17:38:18 INFO - Running setup.py install for mozversion 17:38:18 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 17:38:18 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 17:38:18 INFO - Cleaning up... 17:38:18 INFO - Return code: 0 17:38:18 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:38:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:38:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:38:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x113d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1309a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14acd10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14a9eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aadb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14ab240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:38:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 17:38:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:38:18 INFO - Using env: {'DISPLAY': ':0', 17:38:18 INFO - 'HOME': '/home/cltbld', 17:38:18 INFO - 'LANG': 'en_US.UTF-8', 17:38:18 INFO - 'LANGUAGE': 'en_US:en', 17:38:18 INFO - 'LOGNAME': 'cltbld', 17:38:18 INFO - 'MAIL': '/var/mail/cltbld', 17:38:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:38:18 INFO - 'MOZ_NO_REMOTE': '1', 17:38:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:38:18 INFO - 'NO_EM_RESTART': '1', 17:38:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:38:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:38:18 INFO - 'PWD': '/builds/slave/test', 17:38:18 INFO - 'SHELL': '/bin/bash', 17:38:18 INFO - 'SHLVL': '1', 17:38:18 INFO - 'TERM': 'linux', 17:38:18 INFO - 'TMOUT': '86400', 17:38:18 INFO - 'USER': 'cltbld', 17:38:18 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 17:38:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:38:18 INFO - '_': '/tools/buildbot/bin/python'} 17:38:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:38:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:38:19 INFO - Running setup.py (path:/tmp/pip-I0cDYT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:38:19 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 17:38:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:38:19 INFO - Running setup.py (path:/tmp/pip-xvX7P_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:38:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:38:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:38:19 INFO - Running setup.py (path:/tmp/pip-Iqvf8O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:38:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 17:38:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:38:19 INFO - Running setup.py (path:/tmp/pip-IlmBST-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:38:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:38:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:38:19 INFO - Running setup.py (path:/tmp/pip-GsizIM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:38:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 17:38:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:38:19 INFO - Running setup.py (path:/tmp/pip-QMy_tx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:38:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 17:38:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:38:19 INFO - Running setup.py (path:/tmp/pip-dFRYU6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:38:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 17:38:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:38:19 INFO - Running setup.py (path:/tmp/pip-bgavWX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:38:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 17:38:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:38:19 INFO - Running setup.py (path:/tmp/pip-m2YSbn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:38:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 17:38:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:38:19 INFO - Running setup.py (path:/tmp/pip-p6hN0C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:38:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.5 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 17:38:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:38:19 INFO - Running setup.py (path:/tmp/pip-Uk7F7G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:38:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 17:38:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:38:19 INFO - Running setup.py (path:/tmp/pip-o4A35o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:38:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 17:38:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:38:19 INFO - Running setup.py (path:/tmp/pip-noMuzq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:38:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 17:38:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:38:20 INFO - Running setup.py (path:/tmp/pip-t_ciNt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:38:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 17:38:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:38:20 INFO - Running setup.py (path:/tmp/pip-xMZBbq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:38:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 17:38:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:38:20 INFO - Running setup.py (path:/tmp/pip-XrVlwz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:38:20 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 17:38:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:38:20 INFO - Running setup.py (path:/tmp/pip-kPii5t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:38:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 17:38:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:38:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:38:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 17:38:20 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:38:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:38:20 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 17:38:20 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 17:38:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:21 INFO - Downloading blessings-1.6.tar.gz 17:38:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 17:38:21 INFO - Installing collected packages: blessings 17:38:21 INFO - Running setup.py install for blessings 17:38:21 INFO - Successfully installed blessings 17:38:21 INFO - Cleaning up... 17:38:21 INFO - Return code: 0 17:38:21 INFO - Done creating virtualenv /builds/slave/test/build/venv. 17:38:21 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:38:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:38:21 INFO - Reading from file tmpfile_stdout 17:38:21 INFO - Current package versions: 17:38:21 INFO - argparse == 1.2.1 17:38:21 INFO - blessings == 1.6 17:38:21 INFO - blobuploader == 1.2.4 17:38:21 INFO - docopt == 0.6.1 17:38:21 INFO - functools32 == 3.2.3-2 17:38:21 INFO - jsonschema == 2.5.1 17:38:21 INFO - manifestparser == 1.1 17:38:21 INFO - mozInstall == 1.13 17:38:21 INFO - mozcrash == 1.0 17:38:21 INFO - mozdebug == 0.1 17:38:21 INFO - mozdevice == 0.51 17:38:21 INFO - mozfile == 1.2 17:38:21 INFO - mozhttpd == 0.7 17:38:21 INFO - mozinfo == 0.10 17:38:21 INFO - mozleak == 0.1 17:38:21 INFO - mozlog == 3.5 17:38:21 INFO - moznetwork == 0.27 17:38:21 INFO - mozprocess == 0.25 17:38:21 INFO - mozprofile == 0.28 17:38:21 INFO - mozrunner == 6.13 17:38:21 INFO - mozscreenshot == 0.1 17:38:21 INFO - mozsystemmonitor == 0.3 17:38:21 INFO - moztest == 0.8 17:38:21 INFO - mozversion == 1.4 17:38:21 INFO - psutil == 3.1.1 17:38:21 INFO - requests == 1.2.3 17:38:21 INFO - wsgiref == 0.1.2 17:38:21 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:38:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:38:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:38:21 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x113d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1309a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14acd10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14a9eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aadb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14ab240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:38:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 17:38:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:38:21 INFO - Using env: {'DISPLAY': ':0', 17:38:21 INFO - 'HOME': '/home/cltbld', 17:38:21 INFO - 'LANG': 'en_US.UTF-8', 17:38:21 INFO - 'LANGUAGE': 'en_US:en', 17:38:21 INFO - 'LOGNAME': 'cltbld', 17:38:21 INFO - 'MAIL': '/var/mail/cltbld', 17:38:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:38:21 INFO - 'MOZ_NO_REMOTE': '1', 17:38:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:38:21 INFO - 'NO_EM_RESTART': '1', 17:38:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:38:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:38:21 INFO - 'PWD': '/builds/slave/test', 17:38:21 INFO - 'SHELL': '/bin/bash', 17:38:21 INFO - 'SHLVL': '1', 17:38:21 INFO - 'TERM': 'linux', 17:38:21 INFO - 'TMOUT': '86400', 17:38:21 INFO - 'USER': 'cltbld', 17:38:21 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 17:38:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:38:21 INFO - '_': '/tools/buildbot/bin/python'} 17:38:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:38:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 17:38:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 17:38:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 17:38:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 17:38:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 17:38:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 17:38:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 17:38:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 17:38:22 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 17:38:22 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 17:38:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:38:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:38:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 17:38:23 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 17:38:23 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 17:38:23 INFO - Installing collected packages: simplejson 17:38:23 INFO - Running setup.py install for simplejson 17:38:23 INFO - building 'simplejson._speedups' extension 17:38:23 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c simplejson/_speedups.c -o build/temp.linux-x86_64-2.7/simplejson/_speedups.o 17:38:24 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/simplejson/_speedups.o -o build/lib.linux-x86_64-2.7/simplejson/_speedups.so 17:38:24 INFO - Successfully installed simplejson 17:38:24 INFO - Cleaning up... 17:38:24 INFO - Return code: 0 17:38:24 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 17:38:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:38:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:38:24 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x113d1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1309a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14acd10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14a9eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aadb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14ab240>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 17:38:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 17:38:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 17:38:24 INFO - Using env: {'DISPLAY': ':0', 17:38:24 INFO - 'HOME': '/home/cltbld', 17:38:24 INFO - 'LANG': 'en_US.UTF-8', 17:38:24 INFO - 'LANGUAGE': 'en_US:en', 17:38:24 INFO - 'LOGNAME': 'cltbld', 17:38:24 INFO - 'MAIL': '/var/mail/cltbld', 17:38:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:38:24 INFO - 'MOZ_NO_REMOTE': '1', 17:38:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:38:24 INFO - 'NO_EM_RESTART': '1', 17:38:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:38:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:38:24 INFO - 'PWD': '/builds/slave/test', 17:38:24 INFO - 'SHELL': '/bin/bash', 17:38:24 INFO - 'SHLVL': '1', 17:38:24 INFO - 'TERM': 'linux', 17:38:24 INFO - 'TMOUT': '86400', 17:38:24 INFO - 'USER': 'cltbld', 17:38:24 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 17:38:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:38:24 INFO - '_': '/tools/buildbot/bin/python'} 17:38:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:38:24 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 17:38:24 INFO - Cleaning up... 17:38:24 INFO - Return code: 0 17:38:24 INFO - Running post-action listener: _resource_record_post_action 17:38:24 INFO - Running post-action listener: _start_resource_monitoring 17:38:24 INFO - Starting resource monitoring. 17:38:24 INFO - [mozharness: 2017-08-01 00:38:24.551693Z] Finished create-virtualenv step (success) 17:38:24 INFO - [mozharness: 2017-08-01 00:38:24.552205Z] Running install step. 17:38:24 INFO - Running pre-action listener: _resource_record_pre_action 17:38:24 INFO - Running main action method: install 17:38:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:38:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:38:24 INFO - Reading from file tmpfile_stdout 17:38:24 INFO - Detecting whether we're running mozinstall >=1.0... 17:38:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 17:38:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 17:38:24 INFO - Reading from file tmpfile_stdout 17:38:24 INFO - Output received: 17:38:24 INFO - Usage: mozinstall [options] installer 17:38:24 INFO - Options: 17:38:24 INFO - -h, --help show this help message and exit 17:38:24 INFO - -d DEST, --destination=DEST 17:38:24 INFO - Directory to install application into. [default: 17:38:24 INFO - "/builds/slave/test"] 17:38:24 INFO - --app=APP Application being installed. [default: firefox] 17:38:24 INFO - mkdir: /builds/slave/test/build/application 17:38:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 17:38:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 17:38:42 INFO - Reading from file tmpfile_stdout 17:38:42 INFO - Output received: 17:38:42 INFO - /builds/slave/test/build/application/firefox/firefox 17:38:42 INFO - Running post-action listener: _resource_record_post_action 17:38:42 INFO - [mozharness: 2017-08-01 00:38:42.924061Z] Finished install step (success) 17:38:42 INFO - [mozharness: 2017-08-01 00:38:42.924314Z] Running setup-mitmproxy step. 17:38:42 INFO - Running pre-action listener: _resource_record_pre_action 17:38:42 INFO - Running main action method: setup_mitmproxy 17:38:42 INFO - Skipping: mitmproxy is not required 17:38:42 INFO - Running post-action listener: _resource_record_post_action 17:38:42 INFO - [mozharness: 2017-08-01 00:38:42.925492Z] Finished setup-mitmproxy step (success) 17:38:42 INFO - [mozharness: 2017-08-01 00:38:42.925713Z] Running run-tests step. 17:38:42 INFO - Running pre-action listener: _resource_record_pre_action 17:38:42 INFO - Running pre-action listener: _set_gcov_prefix 17:38:42 INFO - Running main action method: run_tests 17:38:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 17:38:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 17:38:42 INFO - Python 2.7.3 17:38:42 INFO - Return code: 0 17:38:42 INFO - grabbing minidump binary from tooltool 17:38:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:38:42 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14a9eb0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14aadb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x14ab240>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 17:38:42 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 17:38:42 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 17:38:42 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 17:38:42 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 17:38:43 INFO - Return code: 0 17:38:43 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 17:38:43 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 17:38:43 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 17:38:43 INFO - ENV: RUST_BACKTRACE is now 1 17:38:43 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 17:38:43 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 17:38:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-013', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 17:38:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-013 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 17:38:43 INFO - Using env: {'DISPLAY': ':0', 17:38:43 INFO - 'HOME': '/home/cltbld', 17:38:43 INFO - 'LANG': 'en_US.UTF-8', 17:38:43 INFO - 'LANGUAGE': 'en_US:en', 17:38:43 INFO - 'LOGNAME': 'cltbld', 17:38:43 INFO - 'MAIL': '/var/mail/cltbld', 17:38:43 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 17:38:43 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 17:38:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:38:43 INFO - 'MOZ_NO_REMOTE': '1', 17:38:43 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 17:38:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:38:43 INFO - 'NO_EM_RESTART': '1', 17:38:43 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:38:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:38:43 INFO - 'PWD': '/builds/slave/test', 17:38:43 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 17:38:43 INFO - 'RUST_BACKTRACE': '1', 17:38:43 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 17:38:43 INFO - 'SHELL': '/bin/bash', 17:38:43 INFO - 'SHLVL': '1', 17:38:43 INFO - 'STYLO_FORCE_ENABLED': '1', 17:38:43 INFO - 'TERM': 'linux', 17:38:43 INFO - 'TMOUT': '86400', 17:38:43 INFO - 'USER': 'cltbld', 17:38:43 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027', 17:38:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:38:43 INFO - '_': '/tools/buildbot/bin/python'} 17:38:43 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-013', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 17:38:43 INFO - mozversion application_buildid: 20170731234331 17:38:43 INFO - mozversion application_changeset: 8b19670d12fde57d3aee50a5a7d1c734d9b709d5 17:38:43 INFO - mozversion application_display_name: Nightly 17:38:43 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 17:38:43 INFO - mozversion application_name: Firefox 17:38:43 INFO - mozversion application_remotingname: firefox 17:38:43 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 17:38:43 INFO - mozversion application_vendor: Mozilla 17:38:43 INFO - mozversion application_version: 56.0a1 17:38:43 INFO - mozversion platform_buildid: 20170731234331 17:38:43 INFO - mozversion platform_changeset: 8b19670d12fde57d3aee50a5a7d1c734d9b709d5 17:38:43 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 17:38:43 INFO - mozversion platform_version: 56.0a1 17:38:43 INFO - using testdate: 1501547923 17:38:43 INFO - actual date: 1501547923 17:38:43 INFO - starting webserver on 'localhost:45173' 17:38:43 INFO - SUITE-START | Running 2 tests 17:38:43 INFO - TEST-START | dromaeo_css 17:38:43 INFO - Initialising browser for dromaeo_css test... 17:38:43 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:45173/getInfo.html -profile /tmp/tmpsX8r2o/profile 17:38:43 INFO - TEST-INFO | started process 20367 (/builds/slave/test/build/application/firefox/firefox http://localhost:45173/getInfo.html) 17:38:49 INFO - TEST-INFO | 20367: exit 0 17:38:49 INFO - Browser initialized. 17:38:49 INFO - Running cycle 1/1 for dromaeo_css test... 17:38:49 INFO - TEST-INFO | started process 20591 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpsX8r2o/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 17:38:50 INFO - PID 20591 | 17:38:50 INFO - PID 20591 | (/builds/slave/test/build/application/firefox/firefox:20645): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 17:38:50 INFO - PID 20591 | 17:39:01 INFO - PID 20591 | RSS: Main: 174059520 17:39:01 INFO - PID 20591 | 17:42:00 INFO - PID 20591 | Cycle 1(1): loaded http://localhost:45173/tests/dromaeo/cssquery-dojo.html (next: http://localhost:45173/tests/dromaeo/cssquery-ext.html) 17:42:02 INFO - PID 20591 | RSS: Main: 174108672 17:42:02 INFO - PID 20591 | 17:45:04 INFO - PID 20591 | Cycle 1(1): loaded http://localhost:45173/tests/dromaeo/cssquery-ext.html (next: http://localhost:45173/tests/dromaeo/cssquery-jquery.html) 17:45:05 INFO - PID 20591 | RSS: Main: 173436928 17:45:05 INFO - PID 20591 | 17:48:06 INFO - PID 20591 | Cycle 1(1): loaded http://localhost:45173/tests/dromaeo/cssquery-jquery.html (next: http://localhost:45173/tests/dromaeo/cssquery-mootools.html) 17:48:07 INFO - PID 20591 | RSS: Main: 175222784 17:48:07 INFO - PID 20591 | 17:51:09 INFO - PID 20591 | Cycle 1(1): loaded http://localhost:45173/tests/dromaeo/cssquery-mootools.html (next: http://localhost:45173/tests/dromaeo/cssquery-prototype.html) 17:51:10 INFO - PID 20591 | RSS: Main: 174141440 17:51:10 INFO - PID 20591 | 17:54:14 INFO - PID 20591 | Cycle 1(1): loaded http://localhost:45173/tests/dromaeo/cssquery-prototype.html (next: http://localhost:45173/tests/dromaeo/cssquery-yui.html) 17:54:14 INFO - PID 20591 | RSS: Main: 177676288 17:54:14 INFO - PID 20591 | 17:57:16 INFO - PID 20591 | Cycle 1(1): loaded http://localhost:45173/tests/dromaeo/cssquery-yui.html (next: http://localhost:45173/tests/dromaeo/cssquery-dojo.html) 17:57:16 INFO - PID 20591 | RSS: Main: 177991680 17:57:16 INFO - PID 20591 | 17:57:16 INFO - PID 20591 | __start_tp_report 17:57:16 INFO - PID 20591 | _x_x_mozilla_page_load 17:57:16 INFO - PID 20591 | _x_x_mozilla_page_load_details 17:57:16 INFO - PID 20591 | |i|pagename|runs| 17:57:16 INFO - PID 20591 | |0;dojo.html;3134.357456721371;3165.6201255849296;3177.5233714942765;3191.6010498687665;3222.548843161958;6124.326324104345;6160.6611636359985;6241.750329986795;6267.185265915436;6268.529860260482;6054.969725151379;6141.60079594826;6180.907286390708;6190.814275571729;6193.597416167946;5644.266245388104;5646.6894320812335;5675.971620141893;5692.117721753135;5729.713514324288;5685.545156387499;5687.118496633007;5691;5703.17303990921;5717.771289148429;5658.292713410824;5698.373178950312;5701.059325211335;5739.885202295952;5761.683107429089;5612.747426365823;5713.200151978726;5757.654540727549;5761.567882408836;5771.682557459338;5514.779408823642;5588.273524441837;5611.607187496877;5637.323521177444;5645.971770141164;5411.377691565481;6094.817155485298;6096.390360963913;6174.84562885927;6207.87584248317;6524.445422139124;6607.108040414579;6681.198256209237;6689.93310066898;6706.9329306706795;6595.703193356262;6640.302768209365;6670.599764014175;6671.032700258484;6684.030815531721;6186.721597528122;6189.6286222825875;6193.59741616798;6198.101275315054;6213.099100630383;6835.316468353224;6839.076724642209;6854.451643868479;6857.142857142857;6870.725170993104;6439;6505.4795616350575;6514.022896565459;6514.543981921315;6515.6742162892615;6677.432418244503;6679.799606011828;6688.297728738413;6706.094677218513;6707.664616769142;6555.901661475082;6584.604923704593;6673.733050677918;6684.9331506685285;6698.229703584053;6589.7364105435245;6595.637239951753;6596.340365963365;6675.833104172338;6686.765963191265;5275.340582427197;5369;5378.13949768043;5386.973065134727;5457.372402173722;4678.345031695565;4696.788644510937;4758.3100450434495;4772.7136371817105;4773.832915847998;5710.857228569319;5877.38287479817;5878.353381128072;5885.205497257901;5894.734736936848;6652.401283884474;6670.866582668319;6681.832954176088;6685.765998190137;6700.798976030727;5815.854603634943;5827.533797296206;5828.125781132864;5834.766609335664;5841.561882858802;5734.258150070716;5904.911426328608;5908.379620139909;5914.497267732291;5927.525797936155;6473.029045643191;6500.252470965805;6504.1869766279215;6513.153290072355;6553.442957348679;6524.282328943717;6692.330766923464;6712.83217919556;6778.051072849904;6808.455323574102;6457.903131452938;6487.967560162169;6534.444572211225;6542.738290468328;6555.2133743951035;6578.80263592093;6603.20761508622;6604.735810567716;6623.867522649616;6627;6735.865282694416;6739.59562426256;6753.986901964745;6757.222919364336;6758.087658166085;5927.436893495111;6435.163428754232;6440.162778838721;6537.084808126771;6543.770968016097;6435.51733619971;6444;6522.05430212626;6535.836604084936;6552.3775241352;6311.179546658905;6363.936360636334;6388.552801303864;6410.326915673787;6410.935890641221;6460.903086453613;6499.057636642566;6512;6534.477241820738;6560.40956313934;6025.78909738157;6345.8730825384155;6395.16862807832;6396.360363963567;6439.903401448888 17:57:16 INFO - PID 20591 | |1;ext.html;818.7461886815088;879.7272845417921;901.5537309032026;901.8331608652396;1171.7773623011633;29413.117606471813;29918.85040574797;39411.802940985326;39720.20559588807;39737.40393894094;40591;40852.18295634093;40859.79570102145;40893;40978.38532422016;7197.568145911262;7664.310212080925;7843.294103530681;7881.566513841736;7921.801954951115;7445.4415918806035;7829.804254893616;7847.450678452511;7855.214478552128;7858.607069646523;7823.960880195591;7832.843343133134;7858.960705196466;7870.881936770953;7903.051633803922;7744.612769361537;7761.96119019407;7774.455788094836;7834.33408160307;7854.528728276322;7730.381569474429;7796.337311328544;7827.982362292865;7830.295273425362;7834.56909869957;36320.45519317212;36384.272314553564;36580.0854978625;36584.45123323152;36657.63342366569;3467.6358982306747;3504.3516949364193;3507.824608769551;3510.315488479722;3513.6662017108333;30095.398092038038;30257;30282.242943926358;30316.54525182124;30346.848265758752;4745.59662428694;4768.928466073012;4873.02539492103;4885.340479035321;4891.902161956741;183706;186676.0666196674;187053;187359.99999999863;187691;47295.52704472911;47410;47410.288845666655;47446.52553474421;47467.762661186476;49774;49922;49930;49970.50029499731;50021.74989125104;15574;15939.44211952576;15959.920200398923;15961.680766384607;16003.199840007954;9861;9907.45508997012;11746.353950532632;13171.40728667193;13186.604401867959;13660.385282662304;13671.31643417845;13811.723765524634;13856.653583660489;13974.510892118727;5610.429079857647;5669.234653321749;5677.659340439587;5808.564357673192;5866.149408335853;982.921366290695;993.5926270229171;998.7003898830321;1021.1830535571513;1021.7905329407454;22461.88769056144;22614.208502702328;23303.30090097266;29228.561571576443;29349.853250734035;1033.1631378583222;1054.926155169146;1082.3938594387168;1086.098538213281;1093.7265683579105;12328;12465.563705270453;12739.681507962376;12774.169678970837;12823.871761282267;250489;254356;255537;256009;256569;56448;57193.714031429576;57372.42627573754;57446;57550;1396.6578188343922;1445.0607105381375;1457.0383546859234;1459.7153555056875;1472.9926350368394;26804.463910721286;28452.857735712016;28568;28861.27846803847;29198.416031679673;38765.61234387733;39273.80363098166;39298.41052384274;39321.41017884791;39387.2122557553;212082;213837;214036;214225;214941;29319.212272747638;30902.84548577243;31477.527837082005;31524.52713209258;34191.31617367688;41565.168696626504;43695.344569832116;43768.562314376446;43792.78103609462;43951.12097757963;22602.88698556497;22890.31329060131;23665.52668946646;24461.877690611433;24854.627180591942;22784.658230126894;23168.76831231666;24326.51346973086;24722;24809;35419.29161416706;35425.291494169454;35556.111097222776;35684;35847.46228806622;27462.450750985266;29209.415811684074;29682.554761679025;30131.698683012888;30786.538201927437;23883.641745373487;24197.758022420254;24245.56869827249;24381.63427548553;24767.38081547976 17:57:16 INFO - PID 20591 | |2;jquery.html;565.1776664952495;567.9105665181413;572.1989215098864;586.5483577645211;606.5420607441382;22708.88645556772;23184.88407557964;23556.17553385632;23566.646500302486;23568.76431235687;26005.609915851277;26294.605580916254;26321.86839065802;26371.20886373412;26639.334016649544;6623.470122390221;6785;6799.490038247127;6800.285969973131;6810;6634.469242460592;6708.597484150942;6709.261981182066;6790.5246632735725;7039.7536086237;7088.220295767462;7090.29097090292;7093.503454758169;7093.929060709404;7093.964530177368;7058.470614703918;7059.682314295869;7073.610951397671;7078.823029424279;7087.610181440019;6954.756583519553;7004.299570042955;7006.894896576556;7018.543794653331;7019.649017549102;30454.84772576145;31698.207544811332;32228.6777132228;33452.996410107495;33576.328473430636;1944.0668479129956;2022.3326302320347;2023.7976202379643;2027.0371573502468;2027.3613811649432;20495.48761280965;20868.895655521777;20869.5826083479;20876.06057727406;20903.895480522653;2339.979572375266;2390.9282721518207;2439.7682220189054;2470.6170543565777;2483.0688491815567;138540;141319;141411.29294353566;142350.28824855914;142822;20413.183472660927;21821.45446363822;22771.886140569524;23176.884115579312;23250.41873953131;21604;43755.78122109433;43990.780046099564;44106;44459.333110003376;9936.602535898628;9980.900190997998;10003.34978226413;10258.333208341433;10266.281360304707;9253.72238832836;9315.627374905063;9347.953260233791;9427.915789684137;9488.051194880456;9107.590158442754;9444.197243234403;9502.809943801223;9503.90705068912;9674.274429417821;2720.177481087676;2726;2749.3539018330675;2780.79144064196;2785.7075007124367;934.2245935873209;947.3842002698163;966.9371490853213;981.1464026297167;987.6395115782688;19797.703034454495;20049.298274560613;20503.794962050488;20962.895185523976;21105.68341474879;997.1424574865609;1004.487711267259;1018.1142406106586;1021.2851004297022;1033.963811266602;10275.794484110276;11359.943200283946;11406.144539159597;11407.117107684044;11483.42582870853;509634;513698;517766;519102;540777;109799.45100274608;116498;118604;122954;124421.37789311177;1160.0197832831243;1160.7156246719608;1199.6461043992044;1202.212550779241;1202.9338386388833;19645.214191432184;21251.574968500852;21647.13411463524;21971.450713732283;22616.208432704778;46093;48851.51148488612;56790.432095678516;60364.396356035875;60490.69754651198;71631.64184179046;72260.9160862598;72261;72589.27410725826;72719.27280727337;14295.57113286603;14872.479463218735;14932;15018.023828451116;15030.849691502945;23434.76565234326;23564.410889727893;24797.25608231684;25060.498790023732;25146.874265628554;18850;19174;19194;19216.327428539935;19265.90367048156;12807.679808004874;13202.075854690464;13237.933810330887;13745.725085498034;14157.575272741835;17841.73237401414;19426.514337141685;19478.415647530597;19858.50353741168;19925.800741992396;14553.345099470762;14875.628109297355;14894.255287235812;14905.701885962004;15000;18224.817751822844;18322.541936451697;18399.172037258624;18918.14868330956;19002.334918277793 17:57:16 INFO - PID 20591 | |3;mootools.html;1349.2848790141225;1415.073127101748;1423.629856237378;1423.8220222472191;1426.8715815576595;13650.658733531667;14144.71710565788;14217.146971181737;14234.359453824576;14271.644193801598;13793.44826206953;14632.634184145401;14680.486182983597;14681.265936703176;14740.484083057096;2518.5340711968297;2589.753973372536;2602;2607.739226077396;2608.3479130217447;2535.6450096986437;2549.54108260513;2558.2069558436942;2639.208237528743;2641.03602185202;2652.7082020977678;2653.5223659741237;2658.9202323930217;2680.8793604287853;2681.9731802682018;2549.2861998640224;2563.1285362976582;2575.304667739709;2587.39196288871;2590;2531.708853481855;2546.261584140597;2548.210054882992;2558.6417901493805;2562.987185064063;13310.068295219338;13639.727205455934;13642.113262637897;13646.658833529142;13655.38550765218;7532.39740820733;7837.294643482114;7842.843143137163;7845.097813751435;7846.686132554691;4949.381327334083;5101.7194054327;5120.462351453119;5147.124988751883;5176.378834539842;1644.629958259394;1659.4192032788549;1668.9415870444598;1702.5743564108973;1707.0440553290198;22844.31467055991;22966.54066918652;22996.19513317026;23028.309150725505;23150.3054908353;6423.678816059179;6725.361090696376;7168.964155179191;7248.347648711641;7261.056062711814;15649.687006259812;15659.843401566066;15664.921675391777;15678.294476748573;15759.448419305269;7606.771796846104;7690.846183076307;7877.4091943104495;7920.326772224425;7923.207679232146;6872.037914691947;6952.791416257419;7010.439164866799;7027.43780497559;7034.050403195605;4634.837780677727;4955.82654607087;5078.619103567247;5111;5135.666181698178;1402.9088109272864;1491.1947548324001;1507.8793696504254;1512.160750783304;1514.8939574229698;824.171707434037;842.8693552499373;847.3475423923544;859.1923591823665;878.1043335797451;7307.744228951961;7431.665575049135;7441.702331906663;7633;7723.922760772432;930.5719369090294;931.0968360690119;938.4463166731662;944.15498129174;950.5864948747317;4565.56627120423;4615.976920115378;4678.883027924261;4704.647151463654;4869.318295438641;18221.180046897658;18381.08094595265;19145.904270478557;19146.617067658568;19271.90364048171;18764.343247986257;18939.43181704551;19010.23959041623;19206.231750729814;19742.802571974098;10610.310329828537;10639.734006649896;10758.246922715334;10866.402347870942;10892.074173695324;6598.8350291243105;7144.749933752501;7502.324790768857;7522.473426860067;7641.923580764121;16048.43720647929;16614.667706645556;16624.168791560616;17020.404285849934;17139.400120995706;16923.830761692225;17483.388081417088;17499.650007000044;17780.555486112433;17809.198586063398;11376.886231137583;11738.882611173778;11745.47145378477;11749.29504229749;11772.234804737665;12676.492940282655;13042.347882606022;13255.933720331337;13295.335233238106;13301.26843023643;8354.039285482004;8720.91279087201;9841.45871977048;9894.307398482037;9977.900220997988;8850.424722393023;9197.31020173503;9237.445753254826;9295.72112836616;9300.20948219409;8861.778455538662;8887.289016878505;8938.37431379797;8952.23905967974;8999.955000224956;6493.350664933469;6602.471802255712;6643.56816806906;6689.364510371507;6800.557963732342;6126.387361263838;6191.442770150528;6421.325760795236;6682.131322927989;6778.356056174655 17:57:16 INFO - PID 20591 | |4;prototype.html;492.83553968962275;502.052308422945;513.1174380066285;513.2737176894694;525.068004292381;6021.518278537717;6094.634321940686;6127.908081378778;6137.1408002879525;6140.815775526741;5724.656520608766;5865.208196893418;5969.432903874125;5989.885259664971;6011.617328014549;4781;4811.446683631392;4843.321934929113;4875.390576177978;4881.3166156738;4779.928301075487;4799.664023518355;4829.5653391194965;4862.829800956967;4864.537868902448;4627.722336659795;4767.308740232665;4856.878578035542;4859.343988561534;4861.927071093936;4840.249761287007;4842.539958703917;4856.975715121437;4897.338859254009;4920.360353154085;4349.304111342201;4380.583844534796;4396.758178300192;4406.889827754299;4419.779011049434;5871.471567558898;5907.438793314671;5924.911126333109;5927.822165335004;6000.489958353545;5584.6090773645865;5587.161925711135;5630.930123276565;5647.774089036434;5654.3529423521595;6410.948496481128;6429.164208652892;6479.64361960092;6483.805485835433;6494.285628580852;4757.405324334458;4774.28385742138;4783.106220736439;4808.158572249842;4829.647698644385;6631.336866313378;6722.697478613474;6812.795616131573;6820.522563420612;6826.941824017285;4927.581155601814;4954.232094025359;4955.82654607087;4967.40391153064;4980.90038199234;4915.65590408668;4918.409790825124;4926.4088309403105;4929.260610908393;4948.084604348207;5534.1145416733125;5535.474129957647;5563.165525171256;5564.165375193753;5633.155026746021;6417.080228496023;6428.614283143026;6519.706613202417;6530.477561795045;6544.672766361663;1631.820499745027;1732.3070771691173;1738.8695847811464;1739.625980414217;1747.5019619408408;1114.5151858941385;1145.6652999255941;1146.2148428326623;1214.40494157862;1220.6704189868685;5674.2339784129435;5675.290588676416;5705.001624715658;5705.914411283834;5757.798477053283;6402.391772781578;6488.578242414228;6507.414332709984;6532.510061745388;6545.541812073109;5613.943860561342;5647.519960803295;5656.773729050874;5689.487946084872;5697.800576979786;3438.8452519636676;3448.4482482803132;3524.101354154674;3525.6250062475656;3546.4857595648486;6384.744610215539;6399.424051835357;6411;6449.677516124175;6475.611463312216;6635.578014024846;6641.634710090895;6645.471541545472;6719.731210751613;6729.05793188954;6306.288296032658;6364.204474440695;6388.968055159695;6420.229572451242;6455.386738259858;6502.284748677547;6576.408123268929;6577.14497115372;6596.175478065242;6644.966775166094;6338.366163383625;6481.157449531531;6491.28595854465;6500.806979498292;6591.802245932629;6270.742532688319;6299.889537005155;6358;6436.13112229843;6464.547481676237;4837.943873853668;4871.244957031666;4872.395586171035;4881.463039065629;4889.486603906538;6395.296517382991;6425.9036114457385;6430.196225471816;6548.476121910331;6573;6314.179156709598;6321.52588555851;6333.683315834282;6389.233292004989;6449.871002580016;6384.297727249906;6387.776427825004;6411.5832470889245;6432;6459.838504037249;5714.685692286798;6198.194234749454;6272;6311;6320.62076275425;6229.345918678474;6278.6546739929745;6333.493320534439;6419.422251997343;6419.940709782833;6136.723847426966;6209.720562574605;6240.656763878031;6257.906131407942;6271.96864015677 17:57:16 INFO - PID 20591 | |5;yui.html;880.0715245416084;897.6319708919342;913.7669894176984;914.9451032938022;917.7659696777321;17959.730604040935;18876.811231887677;18913.7162942556;18955.52611184721;21396;18548.629027419443;18670.25318987239;18831.623367532677;18864.528386790338;18930.716039259423;749.0861149397726;1017.4251547875464;1028.465198096991;1053.4048262731533;1059.629129804566;1072.265498133781;1073.9140868730522;1074.5862842805536;1075.0969185883855;1075.575147816612;1101.4767985207043;1105.309181761399;1110.7167672243606;1111.8109921313396;1112.8720197177347;1094.644240621797;1095.5508241620978;1096.5175322857956;1096.819024860897;1098.9560417583286;811.995940020302;813.2802469814197;815.3273549321774;816.0574536410455;816.1878930464226;17698.557536061573;17880.821191788047;19417.9029104855;19932.90033549823;20105.497362565908;19300.32448864297;20086.995650217577;20599.38201853947;20622.27822026222;20722;15862.444814431556;16155.676886462323;16388.26252818626;16412.83587164125;16816.159192040348;3476.4785282207617;3484.564429446319;3485.42490489069;3513.578370595519;3524.048506903122;121477;124995.3750231252;127245;128852;130312;14649.633759155893;14770.70458590822;14893.180875051976;15108.622284442758;15166.620834479227;27961.72038279632;30619.69380306213;30663.540046899314;30812.075637730457;30819.845900770353;8062.919370806334;8204.220599043081;8246.09292977772;8249.505029698237;8268.421210515206;3716.8141592920247;3903.1998440319667;4099.262132816062;4230.111676547959;4238.237117318912;5125.2568377585785;5253.448387919213;5255.710935898563;5257.710825904612;5258.553022993012;1030.4281123976266;1076.316538997742;1082.199172612277;1089.5587287148717;1092.9508172132273;624.8219257511587;639.3638329861817;661.0943008078963;675.1762849323817;698.8218004408944;11364;13218.471261149638;13530.864691352961;13674;13764.587062387944;661.6923130744227;679.9728010879609;697.1738489889498;706.321930946287;720.0099862688803;5431.131019036935;5452.700101494456;5456.345238571397;5525.751341189656;5716.628419152742;102594;103136.48431757794;105970;107853.46073269741;109158.45420772846;82330.58834705788;87812.56093719491;88296.558517207;88778.55610721905;90613;80957.59521202356;81428;82057;84575.30849382978;84635.15364846397;10937.835932460861;11931.284122952651;11966.401679916144;12127.838015934978;12487.562935297221;34388.79639212716;34789.47815782714;35792.28415431729;35899.82050089733;35940;60460.395396047235;65633.67183164053;67076.32923670701;67399;68917.65541172463;18382.1728022242;18820.435386938414;18833.340833070775;19042.143103560094;19046.428607141806;18940.621187575896;19026.619467610293;19441.51396215106;19492.8050719491;19603.31388401399;17700;18298.451046468093;18374.265029398674;18440.631187376446;18617.162227700057;17719.73420398721;17904.373346932796;17989.370372036916;18035.819641803413;18207.817921820613;17984.010879401234;18141.45575632733;18396;18422;18746;11710.414479275832;11917;12483.188592741442;12587.055970802043;12654.367281635698;12573.93713031429;13475.258860762751;13944.442222310994;14005.299735013412;14218.217998010208 17:57:16 INFO - PID 20591 | __end_tp_report 17:57:16 INFO - PID 20591 | __start_cc_report 17:57:16 INFO - PID 20591 | _x_x_mozilla_cycle_collect,377 17:57:16 INFO - PID 20591 | __end_cc_report 17:57:16 INFO - PID 20591 | __startTimestamp1501549036702__endTimestamp 17:57:16 INFO - PID 20591 | 17:57:16 INFO - PID 20591 | ------- Summary: start ------- 17:57:16 INFO - PID 20591 | Number of tests: 6 17:57:16 INFO - PID 20591 | 17:57:16 INFO - PID 20591 | [#0] dojo.html Cycles:165 Average:6129.21 Median:6396.36 stddev:713.84 (11.2%) stddev-sans-first:676.27 17:57:16 INFO - PID 20591 | Values: 3134.4 3165.6 3177.5 3191.6 3222.5 6124.3 6160.7 6241.8 6267.2 6268.5 6055.0 6141.6 6180.9 6190.8 6193.6 5644.3 5646.7 5676.0 5692.1 5729.7 5685.5 5687.1 5691.0 5703.2 5717.8 5658.3 5698.4 5701.1 5739.9 5761.7 5612.7 5713.2 5757.7 5761.6 5771.7 5514.8 5588.3 5611.6 5637.3 5646.0 5411.4 6094.8 6096.4 6174.8 6207.9 6524.4 6607.1 6681.2 6689.9 6706.9 6595.7 6640.3 6670.6 6671.0 6684.0 6186.7 6189.6 6193.6 6198.1 6213.1 6835.3 6839.1 6854.5 6857.1 6870.7 6439.0 6505.5 6514.0 6514.5 6515.7 6677.4 6679.8 6688.3 6706.1 6707.7 6555.9 6584.6 6673.7 6684.9 6698.2 6589.7 6595.6 6596.3 6675.8 6686.8 5275.3 5369.0 5378.1 5387.0 5457.4 4678.3 4696.8 4758.3 4772.7 4773.8 5710.9 5877.4 5878.4 5885.2 5894.7 6652.4 6670.9 6681.8 6685.8 6700.8 5815.9 5827.5 5828.1 5834.8 5841.6 5734.3 5904.9 5908.4 5914.5 5927.5 6473.0 6500.3 6504.2 6513.2 6553.4 6524.3 6692.3 6712.8 6778.1 6808.5 6457.9 6488.0 6534.4 6542.7 6555.2 6578.8 6603.2 6604.7 6623.9 6627.0 6735.9 6739.6 6754.0 6757.2 6758.1 5927.4 6435.2 6440.2 6537.1 6543.8 6435.5 6444.0 6522.1 6535.8 6552.4 6311.2 6363.9 6388.6 6410.3 6410.9 6460.9 6499.1 6512.0 6534.5 6560.4 6025.8 6345.9 6395.2 6396.4 6439.9 17:57:16 INFO - PID 20591 | 17:57:16 INFO - PID 20591 | [#1] ext.html Cycles:180 Average:38022.70 Median:3509.07 stddev:57253.87 (1631.6%) stddev-sans-first:57346.33 17:57:16 INFO - PID 20591 | Values: 818.7 879.7 901.6 901.8 1171.8 29413.1 29918.9 39411.8 39720.2 39737.4 40591.0 40852.2 40859.8 40893.0 40978.4 7197.6 7664.3 7843.3 7881.6 7921.8 7445.4 7829.8 7847.5 7855.2 7858.6 7824.0 7832.8 7859.0 7870.9 7903.1 7744.6 7762.0 7774.5 7834.3 7854.5 7730.4 7796.3 7828.0 7830.3 7834.6 36320.5 36384.3 36580.1 36584.5 36657.6 3467.6 3504.4 3507.8 3510.3 3513.7 30095.4 30257.0 30282.2 30316.5 30346.8 4745.6 4768.9 4873.0 4885.3 4891.9 183706.0 186676.1 187053.0 187360.0 187691.0 47295.5 47410.0 47410.3 47446.5 47467.8 49774.0 49922.0 49930.0 49970.5 50021.7 15574.0 15939.4 15959.9 15961.7 16003.2 9861.0 9907.5 11746.4 13171.4 13186.6 13660.4 13671.3 13811.7 13856.7 13974.5 5610.4 5669.2 5677.7 5808.6 5866.1 982.9 993.6 998.7 1021.2 1021.8 22461.9 22614.2 23303.3 29228.6 29349.9 1033.2 1054.9 1082.4 1086.1 1093.7 12328.0 12465.6 12739.7 12774.2 12823.9 250489.0 254356.0 255537.0 256009.0 256569.0 56448.0 57193.7 57372.4 57446.0 57550.0 1396.7 1445.1 1457.0 1459.7 1473.0 26804.5 28452.9 28568.0 28861.3 29198.4 38765.6 39273.8 39298.4 39321.4 39387.2 212082.0 213837.0 214036.0 214225.0 214941.0 29319.2 30902.8 31477.5 31524.5 34191.3 41565.2 43695.3 43768.6 43792.8 43951.1 22602.9 22890.3 23665.5 24461.9 24854.6 22784.7 23168.8 24326.5 24722.0 24809.0 35419.3 35425.3 35556.1 35684.0 35847.5 27462.5 29209.4 29682.6 30131.7 30786.5 23883.6 24197.8 24245.6 24381.6 24767.4 17:57:16 INFO - PID 20591 | 17:57:16 INFO - PID 20591 | [#2] jquery.html Cycles:180 Average:36764.10 Median:12979.85 stddev:87329.52 (672.8%) stddev-sans-first:87532.21 17:57:16 INFO - PID 20591 | Values: 565.2 567.9 572.2 586.5 606.5 22708.9 23184.9 23556.2 23566.6 23568.8 26005.6 26294.6 26321.9 26371.2 26639.3 6623.5 6785.0 6799.5 6800.3 6810.0 6634.5 6708.6 6709.3 6790.5 7039.8 7088.2 7090.3 7093.5 7093.9 7094.0 7058.5 7059.7 7073.6 7078.8 7087.6 6954.8 7004.3 7006.9 7018.5 7019.6 30454.8 31698.2 32228.7 33453.0 33576.3 1944.1 2022.3 2023.8 2027.0 2027.4 20495.5 20868.9 20869.6 20876.1 20903.9 2340.0 2390.9 2439.8 2470.6 2483.1 138540.0 141319.0 141411.3 142350.3 142822.0 20413.2 21821.5 22771.9 23176.9 23250.4 21604.0 43755.8 43990.8 44106.0 44459.3 9936.6 9980.9 10003.3 10258.3 10266.3 9253.7 9315.6 9348.0 9427.9 9488.1 9107.6 9444.2 9502.8 9503.9 9674.3 2720.2 2726.0 2749.4 2780.8 2785.7 934.2 947.4 966.9 981.1 987.6 19797.7 20049.3 20503.8 20962.9 21105.7 997.1 1004.5 1018.1 1021.3 1034.0 10275.8 11359.9 11406.1 11407.1 11483.4 509634.0 513698.0 517766.0 519102.0 540777.0 109799.5 116498.0 118604.0 122954.0 124421.4 1160.0 1160.7 1199.6 1202.2 1202.9 19645.2 21251.6 21647.1 21971.5 22616.2 46093.0 48851.5 56790.4 60364.4 60490.7 71631.6 72260.9 72261.0 72589.3 72719.3 14295.6 14872.5 14932.0 15018.0 15030.8 23434.8 23564.4 24797.3 25060.5 25146.9 18850.0 19174.0 19194.0 19216.3 19265.9 12807.7 13202.1 13237.9 13745.7 14157.6 17841.7 19426.5 19478.4 19858.5 19925.8 14553.3 14875.6 14894.3 14905.7 15000.0 18224.8 18322.5 18399.2 18918.1 19002.3 17:57:16 INFO - PID 20591 | 17:57:16 INFO - PID 20591 | [#3] mootools.html Cycles:180 Average:8542.22 Median:2604.87 stddev:5916.24 (227.1%) stddev-sans-first:5908.15 17:57:16 INFO - PID 20591 | Values: 1349.3 1415.1 1423.6 1423.8 1426.9 13650.7 14144.7 14217.1 14234.4 14271.6 13793.4 14632.6 14680.5 14681.3 14740.5 2518.5 2589.8 2602.0 2607.7 2608.3 2535.6 2549.5 2558.2 2639.2 2641.0 2652.7 2653.5 2658.9 2680.9 2682.0 2549.3 2563.1 2575.3 2587.4 2590.0 2531.7 2546.3 2548.2 2558.6 2563.0 13310.1 13639.7 13642.1 13646.7 13655.4 7532.4 7837.3 7842.8 7845.1 7846.7 4949.4 5101.7 5120.5 5147.1 5176.4 1644.6 1659.4 1668.9 1702.6 1707.0 22844.3 22966.5 22996.2 23028.3 23150.3 6423.7 6725.4 7169.0 7248.3 7261.1 15649.7 15659.8 15664.9 15678.3 15759.4 7606.8 7690.8 7877.4 7920.3 7923.2 6872.0 6952.8 7010.4 7027.4 7034.1 4634.8 4955.8 5078.6 5111.0 5135.7 1402.9 1491.2 1507.9 1512.2 1514.9 824.2 842.9 847.3 859.2 878.1 7307.7 7431.7 7441.7 7633.0 7723.9 930.6 931.1 938.4 944.2 950.6 4565.6 4616.0 4678.9 4704.6 4869.3 18221.2 18381.1 19145.9 19146.6 19271.9 18764.3 18939.4 19010.2 19206.2 19742.8 10610.3 10639.7 10758.2 10866.4 10892.1 6598.8 7144.7 7502.3 7522.5 7641.9 16048.4 16614.7 16624.2 17020.4 17139.4 16923.8 17483.4 17499.7 17780.6 17809.2 11376.9 11738.9 11745.5 11749.3 11772.2 12676.5 13042.3 13255.9 13295.3 13301.3 8354.0 8720.9 9841.5 9894.3 9977.9 8850.4 9197.3 9237.4 9295.7 9300.2 8861.8 8887.3 8938.4 8952.2 9000.0 6493.4 6602.5 6643.6 6689.4 6800.6 6126.4 6191.4 6421.3 6682.1 6778.4 17:57:16 INFO - PID 20591 | 17:57:16 INFO - PID 20591 | [#4] prototype.html Cycles:180 Average:5381.86 Median:5926.37 stddev:1509.14 (25.5%) stddev-sans-first:1468.08 17:57:16 INFO - PID 20591 | Values: 492.8 502.1 513.1 513.3 525.1 6021.5 6094.6 6127.9 6137.1 6140.8 5724.7 5865.2 5969.4 5989.9 6011.6 4781.0 4811.4 4843.3 4875.4 4881.3 4779.9 4799.7 4829.6 4862.8 4864.5 4627.7 4767.3 4856.9 4859.3 4861.9 4840.2 4842.5 4857.0 4897.3 4920.4 4349.3 4380.6 4396.8 4406.9 4419.8 5871.5 5907.4 5924.9 5927.8 6000.5 5584.6 5587.2 5630.9 5647.8 5654.4 6410.9 6429.2 6479.6 6483.8 6494.3 4757.4 4774.3 4783.1 4808.2 4829.6 6631.3 6722.7 6812.8 6820.5 6826.9 4927.6 4954.2 4955.8 4967.4 4980.9 4915.7 4918.4 4926.4 4929.3 4948.1 5534.1 5535.5 5563.2 5564.2 5633.2 6417.1 6428.6 6519.7 6530.5 6544.7 1631.8 1732.3 1738.9 1739.6 1747.5 1114.5 1145.7 1146.2 1214.4 1220.7 5674.2 5675.3 5705.0 5705.9 5757.8 6402.4 6488.6 6507.4 6532.5 6545.5 5613.9 5647.5 5656.8 5689.5 5697.8 3438.8 3448.4 3524.1 3525.6 3546.5 6384.7 6399.4 6411.0 6449.7 6475.6 6635.6 6641.6 6645.5 6719.7 6729.1 6306.3 6364.2 6389.0 6420.2 6455.4 6502.3 6576.4 6577.1 6596.2 6645.0 6338.4 6481.2 6491.3 6500.8 6591.8 6270.7 6299.9 6358.0 6436.1 6464.5 4837.9 4871.2 4872.4 4881.5 4889.5 6395.3 6425.9 6430.2 6548.5 6573.0 6314.2 6321.5 6333.7 6389.2 6449.9 6384.3 6387.8 6411.6 6432.0 6459.8 5714.7 6198.2 6272.0 6311.0 6320.6 6229.3 6278.7 6333.5 6419.4 6419.9 6136.7 6209.7 6240.7 6257.9 6272.0 17:57:16 INFO - PID 20591 | 17:57:16 INFO - PID 20591 | [#5] yui.html Cycles:180 Average:22808.01 Median:18922.22 stddev:30839.14 (163.0%) stddev-sans-first:30881.70 17:57:16 INFO - PID 20591 | Values: 880.1 897.6 913.8 914.9 917.8 17959.7 18876.8 18913.7 18955.5 21396.0 18548.6 18670.3 18831.6 18864.5 18930.7 749.1 1017.4 1028.5 1053.4 1059.6 1072.3 1073.9 1074.6 1075.1 1075.6 1101.5 1105.3 1110.7 1111.8 1112.9 1094.6 1095.6 1096.5 1096.8 1099.0 812.0 813.3 815.3 816.1 816.2 17698.6 17880.8 19417.9 19932.9 20105.5 19300.3 20087.0 20599.4 20622.3 20722.0 15862.4 16155.7 16388.3 16412.8 16816.2 3476.5 3484.6 3485.4 3513.6 3524.0 121477.0 124995.4 127245.0 128852.0 130312.0 14649.6 14770.7 14893.2 15108.6 15166.6 27961.7 30619.7 30663.5 30812.1 30819.8 8062.9 8204.2 8246.1 8249.5 8268.4 3716.8 3903.2 4099.3 4230.1 4238.2 5125.3 5253.4 5255.7 5257.7 5258.6 1030.4 1076.3 1082.2 1089.6 1093.0 624.8 639.4 661.1 675.2 698.8 11364.0 13218.5 13530.9 13674.0 13764.6 661.7 680.0 697.2 706.3 720.0 5431.1 5452.7 5456.3 5525.8 5716.6 102594.0 103136.5 105970.0 107853.5 109158.5 82330.6 87812.6 88296.6 88778.6 90613.0 80957.6 81428.0 82057.0 84575.3 84635.2 10937.8 11931.3 11966.4 12127.8 12487.6 34388.8 34789.5 35792.3 35899.8 35940.0 60460.4 65633.7 67076.3 67399.0 68917.7 18382.2 18820.4 18833.3 19042.1 19046.4 18940.6 19026.6 19441.5 19492.8 19603.3 17700.0 18298.5 18374.3 18440.6 18617.2 17719.7 17904.4 17989.4 18035.8 18207.8 17984.0 18141.5 18396.0 18422.0 18746.0 11710.4 11917.0 12483.2 12587.1 12654.4 12573.9 13475.3 13944.4 14005.3 14218.2 17:57:16 INFO - PID 20591 | -------- Summary: end -------- 17:57:16 INFO - PID 20591 | 17:57:17 INFO - TEST-INFO | 20591: exit 0 17:57:17 INFO - TEST-OK | dromaeo_css | took 1114161ms 17:57:17 INFO - TEST-START | kraken 17:57:17 INFO - Initialising browser for kraken test... 17:57:17 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:45173/getInfo.html -profile /tmp/tmpCtGlSW/profile 17:57:17 INFO - TEST-INFO | started process 20959 (/builds/slave/test/build/application/firefox/firefox http://localhost:45173/getInfo.html) 17:57:23 INFO - TEST-INFO | 20959: exit 0 17:57:23 INFO - Browser initialized. 17:57:23 INFO - Running cycle 1/1 for kraken test... 17:57:23 INFO - TEST-INFO | started process 21186 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpCtGlSW/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 17:57:24 INFO - PID 21186 | 17:57:24 INFO - PID 21186 | (/builds/slave/test/build/application/firefox/firefox:21241): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 17:57:24 INFO - PID 21186 | 17:57:35 INFO - PID 21186 | RSS: Main: 174514176 17:57:35 INFO - PID 21186 | 17:57:37 INFO - PID 21186 | Cycle 1(1): loaded http://localhost:45173/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:45173/tests/kraken/driver.html?testName=audio-beat-detection) 17:57:38 INFO - PID 21186 | RSS: Main: 179392512 17:57:38 INFO - PID 21186 | 17:57:41 INFO - PID 21186 | Cycle 1(1): loaded http://localhost:45173/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:45173/tests/kraken/driver.html?testName=audio-dft) 17:57:42 INFO - PID 21186 | RSS: Main: 180207616 17:57:42 INFO - PID 21186 | 17:57:45 INFO - PID 21186 | Cycle 1(1): loaded http://localhost:45173/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:45173/tests/kraken/driver.html?testName=audio-fft) 17:57:45 INFO - PID 21186 | RSS: Main: 174800896 17:57:45 INFO - PID 21186 | 17:57:48 INFO - PID 21186 | Cycle 1(1): loaded http://localhost:45173/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:45173/tests/kraken/driver.html?testName=audio-oscillator) 17:57:48 INFO - PID 21186 | RSS: Main: 175198208 17:57:48 INFO - PID 21186 | 17:57:50 INFO - PID 21186 | Cycle 1(1): loaded http://localhost:45173/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:45173/tests/kraken/driver.html?testName=imaging-gaussian-blur) 17:57:51 INFO - PID 21186 | RSS: Main: 175890432 17:57:51 INFO - PID 21186 | 17:57:54 INFO - PID 21186 | Cycle 1(1): loaded http://localhost:45173/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:45173/tests/kraken/driver.html?testName=imaging-darkroom) 17:57:55 INFO - PID 21186 | RSS: Main: 177389568 17:57:55 INFO - PID 21186 | 17:57:58 INFO - PID 21186 | Cycle 1(1): loaded http://localhost:45173/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:45173/tests/kraken/driver.html?testName=imaging-desaturate) 17:57:59 INFO - PID 21186 | RSS: Main: 176648192 17:57:59 INFO - PID 21186 | 17:58:02 INFO - PID 21186 | Cycle 1(1): loaded http://localhost:45173/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:45173/tests/kraken/driver.html?testName=json-parse-financial) 17:58:03 INFO - PID 21186 | RSS: Main: 177803264 17:58:03 INFO - PID 21186 | 17:58:04 INFO - PID 21186 | Cycle 1(1): loaded http://localhost:45173/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:45173/tests/kraken/driver.html?testName=json-stringify-tinderbox) 17:58:05 INFO - PID 21186 | RSS: Main: 177602560 17:58:05 INFO - PID 21186 | 17:58:07 INFO - PID 21186 | Cycle 1(1): loaded http://localhost:45173/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:45173/tests/kraken/driver.html?testName=stanford-crypto-aes) 17:58:07 INFO - PID 21186 | RSS: Main: 174997504 17:58:07 INFO - PID 21186 | 17:58:10 INFO - PID 21186 | Cycle 1(1): loaded http://localhost:45173/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:45173/tests/kraken/driver.html?testName=stanford-crypto-ccm) 17:58:10 INFO - PID 21186 | RSS: Main: 175177728 17:58:10 INFO - PID 21186 | 17:58:13 INFO - PID 21186 | Cycle 1(1): loaded http://localhost:45173/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:45173/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 17:58:14 INFO - PID 21186 | RSS: Main: 175730688 17:58:14 INFO - PID 21186 | 17:58:17 INFO - PID 21186 | Cycle 1(1): loaded http://localhost:45173/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:45173/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 17:58:18 INFO - PID 21186 | RSS: Main: 175448064 17:58:18 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | Cycle 1(1): loaded http://localhost:45173/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:45173/tests/kraken/driver.html?testName=ai-astar) 17:58:20 INFO - PID 21186 | RSS: Main: 177094656 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | __start_tp_report 17:58:20 INFO - PID 21186 | _x_x_mozilla_page_load 17:58:20 INFO - PID 21186 | _x_x_mozilla_page_load_details 17:58:20 INFO - PID 21186 | |i|pagename|runs| 17:58:20 INFO - PID 21186 | |0;ai-astar;100;117;104;110;110;113;117;99;110;108 17:58:20 INFO - PID 21186 | |1;audio-beat-detection;140;127;141;169;122;144;154;118;165;124 17:58:20 INFO - PID 21186 | |2;audio-dft;163;163;165;165;161;168;165;179;168;166 17:58:20 INFO - PID 21186 | |3;audio-fft;79;76;75;168;79;81;78;75;161;77 17:58:20 INFO - PID 21186 | |4;audio-oscillator;78;85;131;82;79;79;127;79;85;130 17:58:20 INFO - PID 21186 | |5;imaging-gaussian-blur;123;118;114;114;119;114;115;115;120;118 17:58:20 INFO - PID 21186 | |6;imaging-darkroom;152;151;151;151;155;151;156;152;152;151 17:58:20 INFO - PID 21186 | |7;imaging-desaturate;98;99;94;94;95;95;94;95;94;95 17:58:20 INFO - PID 21186 | |8;json-parse-financial;55;55;56;56;62;59;56;56;59;56 17:58:20 INFO - PID 21186 | |9;json-stringify-tinderbox;64;54;54;53;54;62;54;64;53;54 17:58:20 INFO - PID 21186 | |10;stanford-crypto-aes;81;80;85;85;81;80;79;81;81;80 17:58:20 INFO - PID 21186 | |11;stanford-crypto-ccm;130;134;135;135;138;140;142;137;130;185 17:58:20 INFO - PID 21186 | |12;stanford-crypto-pbkdf2;180;190;185;196;181;184;188;183;180;187 17:58:20 INFO - PID 21186 | |13;stanford-crypto-sha256-iterative;76;68;67;74;68;68;69;70;68;71 17:58:20 INFO - PID 21186 | __end_tp_report 17:58:20 INFO - PID 21186 | __start_cc_report 17:58:20 INFO - PID 21186 | _x_x_mozilla_cycle_collect,980 17:58:20 INFO - PID 21186 | __end_cc_report 17:58:20 INFO - PID 21186 | __startTimestamp1501549100266__endTimestamp 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | ------- Summary: start ------- 17:58:20 INFO - PID 21186 | Number of tests: 14 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | [#0] ai-astar Cycles:10 Average:108.80 Median:111.50 stddev:6.27 (5.6%) stddev-sans-first:5.78 17:58:20 INFO - PID 21186 | Values: 100.0 117.0 104.0 110.0 110.0 113.0 117.0 99.0 110.0 108.0 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | [#1] audio-beat-detection Cycles:10 Average:140.40 Median:142.50 stddev:17.98 (12.6%) stddev-sans-first:19.07 17:58:20 INFO - PID 21186 | Values: 140.0 127.0 141.0 169.0 122.0 144.0 154.0 118.0 165.0 124.0 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | [#2] audio-dft Cycles:10 Average:166.30 Median:165.50 stddev:4.97 (3.0%) stddev-sans-first:5.12 17:58:20 INFO - PID 21186 | Values: 163.0 163.0 165.0 165.0 161.0 168.0 165.0 179.0 168.0 166.0 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | [#3] audio-fft Cycles:10 Average:94.90 Median:77.50 stddev:36.77 (47.4%) stddev-sans-first:38.55 17:58:20 INFO - PID 21186 | Values: 79.0 76.0 75.0 168.0 79.0 81.0 78.0 75.0 161.0 77.0 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | [#4] audio-oscillator Cycles:10 Average:95.50 Median:79.00 stddev:23.50 (29.7%) stddev-sans-first:24.05 17:58:20 INFO - PID 21186 | Values: 78.0 85.0 131.0 82.0 79.0 79.0 127.0 79.0 85.0 130.0 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | [#5] imaging-gaussian-blur Cycles:10 Average:117.00 Median:118.00 stddev:3.09 (2.6%) stddev-sans-first:2.40 17:58:20 INFO - PID 21186 | Values: 123.0 118.0 114.0 114.0 119.0 114.0 115.0 115.0 120.0 118.0 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | [#6] imaging-darkroom Cycles:10 Average:152.20 Median:152.00 stddev:1.81 (1.2%) stddev-sans-first:1.92 17:58:20 INFO - PID 21186 | Values: 152.0 151.0 151.0 151.0 155.0 151.0 156.0 152.0 152.0 151.0 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | [#7] imaging-desaturate Cycles:10 Average:95.30 Median:95.00 stddev:1.77 (1.9%) stddev-sans-first:1.58 17:58:20 INFO - PID 21186 | Values: 98.0 99.0 94.0 94.0 95.0 95.0 94.0 95.0 94.0 95.0 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | [#8] json-parse-financial Cycles:10 Average:57.00 Median:56.00 stddev:2.26 (4.0%) stddev-sans-first:2.28 17:58:20 INFO - PID 21186 | Values: 55.0 55.0 56.0 56.0 62.0 59.0 56.0 56.0 59.0 56.0 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | [#9] json-stringify-tinderbox Cycles:10 Average:56.60 Median:54.00 stddev:4.70 (8.7%) stddev-sans-first:4.15 17:58:20 INFO - PID 21186 | Values: 64.0 54.0 54.0 53.0 54.0 62.0 54.0 64.0 53.0 54.0 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | [#10] stanford-crypto-aes Cycles:10 Average:81.30 Median:81.00 stddev:2.06 (2.5%) stddev-sans-first:2.18 17:58:20 INFO - PID 21186 | Values: 81.0 80.0 85.0 85.0 81.0 80.0 79.0 81.0 81.0 80.0 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | [#11] stanford-crypto-ccm Cycles:10 Average:140.60 Median:137.50 stddev:16.07 (11.7%) stddev-sans-first:16.58 17:58:20 INFO - PID 21186 | Values: 130.0 134.0 135.0 135.0 138.0 140.0 142.0 137.0 130.0 185.0 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:185.40 Median:186.00 stddev:5.04 (2.7%) stddev-sans-first:4.95 17:58:20 INFO - PID 21186 | Values: 180.0 190.0 185.0 196.0 181.0 184.0 188.0 183.0 180.0 187.0 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.90 Median:69.50 stddev:2.96 (4.3%) stddev-sans-first:2.17 17:58:20 INFO - PID 21186 | Values: 76.0 68.0 67.0 74.0 68.0 68.0 69.0 70.0 68.0 71.0 17:58:20 INFO - PID 21186 | -------- Summary: end -------- 17:58:20 INFO - PID 21186 | 17:58:20 INFO - PID 21186 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 17:58:20 INFO - TEST-INFO | 21186: exit 0 17:58:21 INFO - TEST-OK | kraken | took 63571ms 17:58:21 INFO - SUITE-END | took 1177s 17:58:21 INFO - Completed test suite (00:19:38) 17:58:21 INFO - javascript benchmark 17:58:21 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8418.406088694013, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3134.357456721371, 3165.6201255849296, 3177.5233714942765, 3191.6010498687665, 3222.548843161958, 6124.326324104345, 6160.6611636359985, 6241.750329986795, 6267.185265915436, 6268.529860260482, 6054.969725151379, 6141.60079594826, 6180.907286390708, 6190.814275571729, 6193.597416167946, 5644.266245388104, 5646.6894320812335, 5675.971620141893, 5692.117721753135, 5729.713514324288, 5685.545156387499, 5687.118496633007, 5691.0, 5703.17303990921, 5717.771289148429, 5658.292713410824, 5698.373178950312, 5701.059325211335, 5739.885202295952, 5761.683107429089, 5612.747426365823, 5713.200151978726, 5757.654540727549, 5761.567882408836, 5771.682557459338, 5514.779408823642, 5588.273524441837, 5611.607187496877, 5637.323521177444, 5645.971770141164, 5411.377691565481, 6094.817155485298, 6096.390360963913, 6174.84562885927, 6207.87584248317, 6524.445422139124, 6607.108040414579, 6681.198256209237, 6689.93310066898, 6706.9329306706795, 6595.703193356262, 6640.302768209365, 6670.599764014175, 6671.032700258484, 6684.030815531721, 6186.721597528122, 6189.6286222825875, 6193.59741616798, 6198.101275315054, 6213.099100630383, 6835.316468353224, 6839.076724642209, 6854.451643868479, 6857.142857142857, 6870.725170993104, 6439.0, 6505.4795616350575, 6514.022896565459, 6514.543981921315, 6515.6742162892615, 6677.432418244503, 6679.799606011828, 6688.297728738413, 6706.094677218513, 6707.664616769142, 6555.901661475082, 6584.604923704593, 6673.733050677918, 6684.9331506685285, 6698.229703584053, 6589.7364105435245, 6595.637239951753, 6596.340365963365, 6675.833104172338, 6686.765963191265, 5275.340582427197, 5369.0, 5378.13949768043, 5386.973065134727, 5457.372402173722, 4678.345031695565, 4696.788644510937, 4758.3100450434495, 4772.7136371817105, 4773.832915847998, 5710.857228569319, 5877.38287479817, 5878.353381128072, 5885.205497257901, 5894.734736936848, 6652.401283884474, 6670.866582668319, 6681.832954176088, 6685.765998190137, 6700.798976030727, 5815.854603634943, 5827.533797296206, 5828.125781132864, 5834.766609335664, 5841.561882858802, 5734.258150070716, 5904.911426328608, 5908.379620139909, 5914.497267732291, 5927.525797936155, 6473.029045643191, 6500.252470965805, 6504.1869766279215, 6513.153290072355, 6553.442957348679, 6524.282328943717, 6692.330766923464, 6712.83217919556, 6778.051072849904, 6808.455323574102, 6457.903131452938, 6487.967560162169, 6534.444572211225, 6542.738290468328, 6555.2133743951035, 6578.80263592093, 6603.20761508622, 6604.735810567716, 6623.867522649616, 6627.0, 6735.865282694416, 6739.59562426256, 6753.986901964745, 6757.222919364336, 6758.087658166085, 5927.436893495111, 6435.163428754232, 6440.162778838721, 6537.084808126771, 6543.770968016097, 6435.51733619971, 6444.0, 6522.05430212626, 6535.836604084936, 6552.3775241352, 6311.179546658905, 6363.936360636334, 6388.552801303864, 6410.326915673787, 6410.935890641221, 6460.903086453613, 6499.057636642566, 6512.0, 6534.477241820738, 6560.40956313934, 6025.78909738157, 6345.8730825384155, 6395.16862807832, 6396.360363963567, 6439.903401448888], "value": 6077.019456286367, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [818.7461886815088, 879.7272845417921, 901.5537309032026, 901.8331608652396, 1171.7773623011633, 29413.117606471813, 29918.85040574797, 39411.802940985326, 39720.20559588807, 39737.40393894094, 40591.0, 40852.18295634093, 40859.79570102145, 40893.0, 40978.38532422016, 7197.568145911262, 7664.310212080925, 7843.294103530681, 7881.566513841736, 7921.801954951115, 7445.4415918806035, 7829.804254893616, 7847.450678452511, 7855.214478552128, 7858.607069646523, 7823.960880195591, 7832.843343133134, 7858.960705196466, 7870.881936770953, 7903.051633803922, 7744.612769361537, 7761.96119019407, 7774.455788094836, 7834.33408160307, 7854.528728276322, 7730.381569474429, 7796.337311328544, 7827.982362292865, 7830.295273425362, 7834.56909869957, 36320.45519317212, 36384.272314553564, 36580.0854978625, 36584.45123323152, 36657.63342366569, 3467.6358982306747, 3504.3516949364193, 3507.824608769551, 3510.315488479722, 3513.6662017108333, 30095.398092038038, 30257.0, 30282.242943926358, 30316.54525182124, 30346.848265758752, 4745.59662428694, 4768.928466073012, 4873.02539492103, 4885.340479035321, 4891.902161956741, 183706.0, 186676.0666196674, 187053.0, 187359.99999999863, 187691.0, 47295.52704472911, 47410.0, 47410.288845666655, 47446.52553474421, 47467.762661186476, 49774.0, 49922.0, 49930.0, 49970.50029499731, 50021.74989125104, 15574.0, 15939.44211952576, 15959.920200398923, 15961.680766384607, 16003.199840007954, 9861.0, 9907.45508997012, 11746.353950532632, 13171.40728667193, 13186.604401867959, 13660.385282662304, 13671.31643417845, 13811.723765524634, 13856.653583660489, 13974.510892118727, 5610.429079857647, 5669.234653321749, 5677.659340439587, 5808.564357673192, 5866.149408335853, 982.921366290695, 993.5926270229171, 998.7003898830321, 1021.1830535571513, 1021.7905329407454, 22461.88769056144, 22614.208502702328, 23303.30090097266, 29228.561571576443, 29349.853250734035, 1033.1631378583222, 1054.926155169146, 1082.3938594387168, 1086.098538213281, 1093.7265683579105, 12328.0, 12465.563705270453, 12739.681507962376, 12774.169678970837, 12823.871761282267, 250489.0, 254356.0, 255537.0, 256009.0, 256569.0, 56448.0, 57193.714031429576, 57372.42627573754, 57446.0, 57550.0, 1396.6578188343922, 1445.0607105381375, 1457.0383546859234, 1459.7153555056875, 1472.9926350368394, 26804.463910721286, 28452.857735712016, 28568.0, 28861.27846803847, 29198.416031679673, 38765.61234387733, 39273.80363098166, 39298.41052384274, 39321.41017884791, 39387.2122557553, 212082.0, 213837.0, 214036.0, 214225.0, 214941.0, 29319.212272747638, 30902.84548577243, 31477.527837082005, 31524.52713209258, 34191.31617367688, 41565.168696626504, 43695.344569832116, 43768.562314376446, 43792.78103609462, 43951.12097757963, 22602.88698556497, 22890.31329060131, 23665.52668946646, 24461.877690611433, 24854.627180591942, 22784.658230126894, 23168.76831231666, 24326.51346973086, 24722.0, 24809.0, 35419.29161416706, 35425.291494169454, 35556.111097222776, 35684.0, 35847.46228806622, 27462.450750985266, 29209.415811684074, 29682.554761679025, 30131.698683012888, 30786.538201927437, 23883.641745373487, 24197.758022420254, 24245.56869827249, 24381.63427548553, 24767.38081547976], "value": 16898.14191054762, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [565.1776664952495, 567.9105665181413, 572.1989215098864, 586.5483577645211, 606.5420607441382, 22708.88645556772, 23184.88407557964, 23556.17553385632, 23566.646500302486, 23568.76431235687, 26005.609915851277, 26294.605580916254, 26321.86839065802, 26371.20886373412, 26639.334016649544, 6623.470122390221, 6785.0, 6799.490038247127, 6800.285969973131, 6810.0, 6634.469242460592, 6708.597484150942, 6709.261981182066, 6790.5246632735725, 7039.7536086237, 7088.220295767462, 7090.29097090292, 7093.503454758169, 7093.929060709404, 7093.964530177368, 7058.470614703918, 7059.682314295869, 7073.610951397671, 7078.823029424279, 7087.610181440019, 6954.756583519553, 7004.299570042955, 7006.894896576556, 7018.543794653331, 7019.649017549102, 30454.84772576145, 31698.207544811332, 32228.6777132228, 33452.996410107495, 33576.328473430636, 1944.0668479129956, 2022.3326302320347, 2023.7976202379643, 2027.0371573502468, 2027.3613811649432, 20495.48761280965, 20868.895655521777, 20869.5826083479, 20876.06057727406, 20903.895480522653, 2339.979572375266, 2390.9282721518207, 2439.7682220189054, 2470.6170543565777, 2483.0688491815567, 138540.0, 141319.0, 141411.29294353566, 142350.28824855914, 142822.0, 20413.183472660927, 21821.45446363822, 22771.886140569524, 23176.884115579312, 23250.41873953131, 21604.0, 43755.78122109433, 43990.780046099564, 44106.0, 44459.333110003376, 9936.602535898628, 9980.900190997998, 10003.34978226413, 10258.333208341433, 10266.281360304707, 9253.72238832836, 9315.627374905063, 9347.953260233791, 9427.915789684137, 9488.051194880456, 9107.590158442754, 9444.197243234403, 9502.809943801223, 9503.90705068912, 9674.274429417821, 2720.177481087676, 2726.0, 2749.3539018330675, 2780.79144064196, 2785.7075007124367, 934.2245935873209, 947.3842002698163, 966.9371490853213, 981.1464026297167, 987.6395115782688, 19797.703034454495, 20049.298274560613, 20503.794962050488, 20962.895185523976, 21105.68341474879, 997.1424574865609, 1004.487711267259, 1018.1142406106586, 1021.2851004297022, 1033.963811266602, 10275.794484110276, 11359.943200283946, 11406.144539159597, 11407.117107684044, 11483.42582870853, 509634.0, 513698.0, 517766.0, 519102.0, 540777.0, 109799.45100274608, 116498.0, 118604.0, 122954.0, 124421.37789311177, 1160.0197832831243, 1160.7156246719608, 1199.6461043992044, 1202.212550779241, 1202.9338386388833, 19645.214191432184, 21251.574968500852, 21647.13411463524, 21971.450713732283, 22616.208432704778, 46093.0, 48851.51148488612, 56790.432095678516, 60364.396356035875, 60490.69754651198, 71631.64184179046, 72260.9160862598, 72261.0, 72589.27410725826, 72719.27280727337, 14295.57113286603, 14872.479463218735, 14932.0, 15018.023828451116, 15030.849691502945, 23434.76565234326, 23564.410889727893, 24797.25608231684, 25060.498790023732, 25146.874265628554, 18850.0, 19174.0, 19194.0, 19216.327428539935, 19265.90367048156, 12807.679808004874, 13202.075854690464, 13237.933810330887, 13745.725085498034, 14157.575272741835, 17841.73237401414, 19426.514337141685, 19478.415647530597, 19858.50353741168, 19925.800741992396, 14553.345099470762, 14875.628109297355, 14894.255287235812, 14905.701885962004, 15000.0, 18224.817751822844, 18322.541936451697, 18399.172037258624, 18918.14868330956, 19002.334918277793], "value": 12586.076574125365, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1349.2848790141225, 1415.073127101748, 1423.629856237378, 1423.8220222472191, 1426.8715815576595, 13650.658733531667, 14144.71710565788, 14217.146971181737, 14234.359453824576, 14271.644193801598, 13793.44826206953, 14632.634184145401, 14680.486182983597, 14681.265936703176, 14740.484083057096, 2518.5340711968297, 2589.753973372536, 2602.0, 2607.739226077396, 2608.3479130217447, 2535.6450096986437, 2549.54108260513, 2558.2069558436942, 2639.208237528743, 2641.03602185202, 2652.7082020977678, 2653.5223659741237, 2658.9202323930217, 2680.8793604287853, 2681.9731802682018, 2549.2861998640224, 2563.1285362976582, 2575.304667739709, 2587.39196288871, 2590.0, 2531.708853481855, 2546.261584140597, 2548.210054882992, 2558.6417901493805, 2562.987185064063, 13310.068295219338, 13639.727205455934, 13642.113262637897, 13646.658833529142, 13655.38550765218, 7532.39740820733, 7837.294643482114, 7842.843143137163, 7845.097813751435, 7846.686132554691, 4949.381327334083, 5101.7194054327, 5120.462351453119, 5147.124988751883, 5176.378834539842, 1644.629958259394, 1659.4192032788549, 1668.9415870444598, 1702.5743564108973, 1707.0440553290198, 22844.31467055991, 22966.54066918652, 22996.19513317026, 23028.309150725505, 23150.3054908353, 6423.678816059179, 6725.361090696376, 7168.964155179191, 7248.347648711641, 7261.056062711814, 15649.687006259812, 15659.843401566066, 15664.921675391777, 15678.294476748573, 15759.448419305269, 7606.771796846104, 7690.846183076307, 7877.4091943104495, 7920.326772224425, 7923.207679232146, 6872.037914691947, 6952.791416257419, 7010.439164866799, 7027.43780497559, 7034.050403195605, 4634.837780677727, 4955.82654607087, 5078.619103567247, 5111.0, 5135.666181698178, 1402.9088109272864, 1491.1947548324001, 1507.8793696504254, 1512.160750783304, 1514.8939574229698, 824.171707434037, 842.8693552499373, 847.3475423923544, 859.1923591823665, 878.1043335797451, 7307.744228951961, 7431.665575049135, 7441.702331906663, 7633.0, 7723.922760772432, 930.5719369090294, 931.0968360690119, 938.4463166731662, 944.15498129174, 950.5864948747317, 4565.56627120423, 4615.976920115378, 4678.883027924261, 4704.647151463654, 4869.318295438641, 18221.180046897658, 18381.08094595265, 19145.904270478557, 19146.617067658568, 19271.90364048171, 18764.343247986257, 18939.43181704551, 19010.23959041623, 19206.231750729814, 19742.802571974098, 10610.310329828537, 10639.734006649896, 10758.246922715334, 10866.402347870942, 10892.074173695324, 6598.8350291243105, 7144.749933752501, 7502.324790768857, 7522.473426860067, 7641.923580764121, 16048.43720647929, 16614.667706645556, 16624.168791560616, 17020.404285849934, 17139.400120995706, 16923.830761692225, 17483.388081417088, 17499.650007000044, 17780.555486112433, 17809.198586063398, 11376.886231137583, 11738.882611173778, 11745.47145378477, 11749.29504229749, 11772.234804737665, 12676.492940282655, 13042.347882606022, 13255.933720331337, 13295.335233238106, 13301.26843023643, 8354.039285482004, 8720.91279087201, 9841.45871977048, 9894.307398482037, 9977.900220997988, 8850.424722393023, 9197.31020173503, 9237.445753254826, 9295.72112836616, 9300.20948219409, 8861.778455538662, 8887.289016878505, 8938.37431379797, 8952.23905967974, 8999.955000224956, 6493.350664933469, 6602.471802255712, 6643.56816806906, 6689.364510371507, 6800.557963732342, 6126.387361263838, 6191.442770150528, 6421.325760795236, 6682.131322927989, 6778.356056174655], "value": 6211.6644200662395, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [492.83553968962275, 502.052308422945, 513.1174380066285, 513.2737176894694, 525.068004292381, 6021.518278537717, 6094.634321940686, 6127.908081378778, 6137.1408002879525, 6140.815775526741, 5724.656520608766, 5865.208196893418, 5969.432903874125, 5989.885259664971, 6011.617328014549, 4781.0, 4811.446683631392, 4843.321934929113, 4875.390576177978, 4881.3166156738, 4779.928301075487, 4799.664023518355, 4829.5653391194965, 4862.829800956967, 4864.537868902448, 4627.722336659795, 4767.308740232665, 4856.878578035542, 4859.343988561534, 4861.927071093936, 4840.249761287007, 4842.539958703917, 4856.975715121437, 4897.338859254009, 4920.360353154085, 4349.304111342201, 4380.583844534796, 4396.758178300192, 4406.889827754299, 4419.779011049434, 5871.471567558898, 5907.438793314671, 5924.911126333109, 5927.822165335004, 6000.489958353545, 5584.6090773645865, 5587.161925711135, 5630.930123276565, 5647.774089036434, 5654.3529423521595, 6410.948496481128, 6429.164208652892, 6479.64361960092, 6483.805485835433, 6494.285628580852, 4757.405324334458, 4774.28385742138, 4783.106220736439, 4808.158572249842, 4829.647698644385, 6631.336866313378, 6722.697478613474, 6812.795616131573, 6820.522563420612, 6826.941824017285, 4927.581155601814, 4954.232094025359, 4955.82654607087, 4967.40391153064, 4980.90038199234, 4915.65590408668, 4918.409790825124, 4926.4088309403105, 4929.260610908393, 4948.084604348207, 5534.1145416733125, 5535.474129957647, 5563.165525171256, 5564.165375193753, 5633.155026746021, 6417.080228496023, 6428.614283143026, 6519.706613202417, 6530.477561795045, 6544.672766361663, 1631.820499745027, 1732.3070771691173, 1738.8695847811464, 1739.625980414217, 1747.5019619408408, 1114.5151858941385, 1145.6652999255941, 1146.2148428326623, 1214.40494157862, 1220.6704189868685, 5674.2339784129435, 5675.290588676416, 5705.001624715658, 5705.914411283834, 5757.798477053283, 6402.391772781578, 6488.578242414228, 6507.414332709984, 6532.510061745388, 6545.541812073109, 5613.943860561342, 5647.519960803295, 5656.773729050874, 5689.487946084872, 5697.800576979786, 3438.8452519636676, 3448.4482482803132, 3524.101354154674, 3525.6250062475656, 3546.4857595648486, 6384.744610215539, 6399.424051835357, 6411.0, 6449.677516124175, 6475.611463312216, 6635.578014024846, 6641.634710090895, 6645.471541545472, 6719.731210751613, 6729.05793188954, 6306.288296032658, 6364.204474440695, 6388.968055159695, 6420.229572451242, 6455.386738259858, 6502.284748677547, 6576.408123268929, 6577.14497115372, 6596.175478065242, 6644.966775166094, 6338.366163383625, 6481.157449531531, 6491.28595854465, 6500.806979498292, 6591.802245932629, 6270.742532688319, 6299.889537005155, 6358.0, 6436.13112229843, 6464.547481676237, 4837.943873853668, 4871.244957031666, 4872.395586171035, 4881.463039065629, 4889.486603906538, 6395.296517382991, 6425.9036114457385, 6430.196225471816, 6548.476121910331, 6573.0, 6314.179156709598, 6321.52588555851, 6333.683315834282, 6389.233292004989, 6449.871002580016, 6384.297727249906, 6387.776427825004, 6411.5832470889245, 6432.0, 6459.838504037249, 5714.685692286798, 6198.194234749454, 6272.0, 6311.0, 6320.62076275425, 6229.345918678474, 6278.6546739929745, 6333.493320534439, 6419.422251997343, 6419.940709782833, 6136.723847426966, 6209.720562574605, 6240.656763878031, 6257.906131407942, 6271.96864015677], "value": 4937.957657317765, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [880.0715245416084, 897.6319708919342, 913.7669894176984, 914.9451032938022, 917.7659696777321, 17959.730604040935, 18876.811231887677, 18913.7162942556, 18955.52611184721, 21396.0, 18548.629027419443, 18670.25318987239, 18831.623367532677, 18864.528386790338, 18930.716039259423, 749.0861149397726, 1017.4251547875464, 1028.465198096991, 1053.4048262731533, 1059.629129804566, 1072.265498133781, 1073.9140868730522, 1074.5862842805536, 1075.0969185883855, 1075.575147816612, 1101.4767985207043, 1105.309181761399, 1110.7167672243606, 1111.8109921313396, 1112.8720197177347, 1094.644240621797, 1095.5508241620978, 1096.5175322857956, 1096.819024860897, 1098.9560417583286, 811.995940020302, 813.2802469814197, 815.3273549321774, 816.0574536410455, 816.1878930464226, 17698.557536061573, 17880.821191788047, 19417.9029104855, 19932.90033549823, 20105.497362565908, 19300.32448864297, 20086.995650217577, 20599.38201853947, 20622.27822026222, 20722.0, 15862.444814431556, 16155.676886462323, 16388.26252818626, 16412.83587164125, 16816.159192040348, 3476.4785282207617, 3484.564429446319, 3485.42490489069, 3513.578370595519, 3524.048506903122, 121477.0, 124995.3750231252, 127245.0, 128852.0, 130312.0, 14649.633759155893, 14770.70458590822, 14893.180875051976, 15108.622284442758, 15166.620834479227, 27961.72038279632, 30619.69380306213, 30663.540046899314, 30812.075637730457, 30819.845900770353, 8062.919370806334, 8204.220599043081, 8246.09292977772, 8249.505029698237, 8268.421210515206, 3716.8141592920247, 3903.1998440319667, 4099.262132816062, 4230.111676547959, 4238.237117318912, 5125.2568377585785, 5253.448387919213, 5255.710935898563, 5257.710825904612, 5258.553022993012, 1030.4281123976266, 1076.316538997742, 1082.199172612277, 1089.5587287148717, 1092.9508172132273, 624.8219257511587, 639.3638329861817, 661.0943008078963, 675.1762849323817, 698.8218004408944, 11364.0, 13218.471261149638, 13530.864691352961, 13674.0, 13764.587062387944, 661.6923130744227, 679.9728010879609, 697.1738489889498, 706.321930946287, 720.0099862688803, 5431.131019036935, 5452.700101494456, 5456.345238571397, 5525.751341189656, 5716.628419152742, 102594.0, 103136.48431757794, 105970.0, 107853.46073269741, 109158.45420772846, 82330.58834705788, 87812.56093719491, 88296.558517207, 88778.55610721905, 90613.0, 80957.59521202356, 81428.0, 82057.0, 84575.30849382978, 84635.15364846397, 10937.835932460861, 11931.284122952651, 11966.401679916144, 12127.838015934978, 12487.562935297221, 34388.79639212716, 34789.47815782714, 35792.28415431729, 35899.82050089733, 35940.0, 60460.395396047235, 65633.67183164053, 67076.32923670701, 67399.0, 68917.65541172463, 18382.1728022242, 18820.435386938414, 18833.340833070775, 19042.143103560094, 19046.428607141806, 18940.621187575896, 19026.619467610293, 19441.51396215106, 19492.8050719491, 19603.31388401399, 17700.0, 18298.451046468093, 18374.265029398674, 18440.631187376446, 18617.162227700057, 17719.73420398721, 17904.373346932796, 17989.370372036916, 18035.819641803413, 18207.817921820613, 17984.010879401234, 18141.45575632733, 18396.0, 18422.0, 18746.0, 11710.414479275832, 11917.0, 12483.188592741442, 12587.055970802043, 12654.367281635698, 12573.93713031429, 13475.258860762751, 13944.442222310994, 14005.299735013412, 14218.217998010208], "value": 8977.916462427336, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1561.1999999999998, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [100.0, 117.0, 104.0, 110.0, 110.0, 113.0, 117.0, 99.0, 110.0, 108.0], "value": 108.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [140.0, 127.0, 141.0, 169.0, 122.0, 144.0, 154.0, 118.0, 165.0, 124.0], "value": 140.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 163.0, 165.0, 165.0, 161.0, 168.0, 165.0, 179.0, 168.0, 166.0], "value": 166.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 76.0, 75.0, 168.0, 79.0, 81.0, 78.0, 75.0, 161.0, 77.0], "value": 94.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 85.0, 131.0, 82.0, 79.0, 79.0, 127.0, 79.0, 85.0, 130.0], "value": 95.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [123.0, 118.0, 114.0, 114.0, 119.0, 114.0, 115.0, 115.0, 120.0, 118.0], "value": 117.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 151.0, 151.0, 151.0, 155.0, 151.0, 156.0, 152.0, 152.0, 151.0], "value": 152.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [98.0, 99.0, 94.0, 94.0, 95.0, 95.0, 94.0, 95.0, 94.0, 95.0], "value": 95.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 55.0, 56.0, 56.0, 62.0, 59.0, 56.0, 56.0, 59.0, 56.0], "value": 57.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 54.0, 54.0, 53.0, 54.0, 62.0, 54.0, 64.0, 53.0, 54.0], "value": 56.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 80.0, 85.0, 85.0, 81.0, 80.0, 79.0, 81.0, 81.0, 80.0], "value": 81.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [130.0, 134.0, 135.0, 135.0, 138.0, 140.0, 142.0, 137.0, 130.0, 185.0], "value": 140.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [180.0, 190.0, 185.0, 196.0, 181.0, 184.0, 188.0, 183.0, 180.0, 187.0], "value": 185.4, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 68.0, 67.0, 74.0, 68.0, 68.0, 69.0, 70.0, 68.0, 71.0], "value": 69.9, "unit": "score"}]}]} 17:58:21 INFO - Return code: 0 17:58:21 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 17:58:21 INFO - # TBPL SUCCESS # 17:58:21 INFO - Running post-action listener: _package_coverage_data 17:58:21 INFO - Running post-action listener: _resource_record_post_action 17:58:21 INFO - [mozharness: 2017-08-01 00:58:21.548100Z] Finished run-tests step (success) 17:58:21 INFO - Running post-run listener: _resource_record_post_run 17:58:21 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 16384; Write bytes: 430673920; Read time: 276; Write time: 308620 17:58:21 INFO - TinderboxPrint: CPU usage
13.1% 17:58:21 INFO - TinderboxPrint: I/O read bytes / time
16,384 / 276 17:58:21 INFO - TinderboxPrint: I/O write bytes / time
430,673,920 / 308,620 17:58:21 INFO - TinderboxPrint: CPU idle
8,281.1 (86.8%) 17:58:21 INFO - TinderboxPrint: CPU user
1,203.3 (12.6%) 17:58:21 INFO - TinderboxPrint: Swap in / out
0 / 0 17:58:21 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 107433984; Read time: 0; Write time: 91448 17:58:21 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 17:58:21 INFO - run-tests - Wall time: 1179s; CPU: 13.0%; Read bytes: 12288; Write bytes: 323239936; Read time: 268; Write time: 217172 17:58:22 INFO - Running post-run listener: _upload_blobber_files 17:58:22 INFO - Blob upload gear active. 17:58:22 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 17:58:22 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 17:58:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 17:58:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 17:58:22 INFO - (blobuploader) - INFO - Open directory for files ... 17:58:22 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 17:58:22 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:58:22 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:58:23 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 17:58:23 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:58:23 INFO - (blobuploader) - INFO - Done attempting. 17:58:23 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 17:58:23 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:58:23 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:58:24 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 17:58:24 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:58:24 INFO - (blobuploader) - INFO - Done attempting. 17:58:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 17:58:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:58:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:58:30 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 17:58:30 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:58:30 INFO - (blobuploader) - INFO - Done attempting. 17:58:30 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 17:58:30 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:58:30 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:58:31 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 17:58:31 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:58:31 INFO - (blobuploader) - INFO - Done attempting. 17:58:31 INFO - (blobuploader) - INFO - Iteration through files over. 17:58:31 INFO - Return code: 0 17:58:31 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 17:58:31 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 17:58:31 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/466bc54128055f75503aa77ac682d69992a53069be7af0a0227beb55a7be1fd14ce4716a9e559cc62756ccd6823614c95a8c4a12ab1b5b2eaa800f8cd2085a95", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7a30c2ddb33e24a50fe7a78f677980bc9cd560032d96c90dc086c7be3ab77f22d5053497e56dc4d8884708c3647ff96b7ed7aa841e3d8033f09fe0a9d7aa40e3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1e1c568244db36c77f2b38bdc6a07d7eac458397130b3a892460cecee9e7eb6782f389d943faa4e39f88db37a2f4b3a5f1ef50842ee289ad21a93b15f1974603", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/35a35aee7765dbf508d9fc67e81b6ff518771b9f7de17d53dc1772e8920ee3cdf9c18284af04ff23a70ac3a5270653f684414b583f980df9101750fe67a8fef5"} 17:58:31 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 17:58:31 INFO - Writing to file /builds/slave/test/properties/blobber_files 17:58:31 INFO - Contents: 17:58:31 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/466bc54128055f75503aa77ac682d69992a53069be7af0a0227beb55a7be1fd14ce4716a9e559cc62756ccd6823614c95a8c4a12ab1b5b2eaa800f8cd2085a95", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7a30c2ddb33e24a50fe7a78f677980bc9cd560032d96c90dc086c7be3ab77f22d5053497e56dc4d8884708c3647ff96b7ed7aa841e3d8033f09fe0a9d7aa40e3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1e1c568244db36c77f2b38bdc6a07d7eac458397130b3a892460cecee9e7eb6782f389d943faa4e39f88db37a2f4b3a5f1ef50842ee289ad21a93b15f1974603", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/35a35aee7765dbf508d9fc67e81b6ff518771b9f7de17d53dc1772e8920ee3cdf9c18284af04ff23a70ac3a5270653f684414b583f980df9101750fe67a8fef5"} 17:58:31 INFO - Running post-run listener: copy_logs_to_upload_dir 17:58:31 INFO - Copying logs to upload dir... 17:58:31 INFO - mkdir: /builds/slave/test/build/upload/logs 17:58:31 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1260.067149 ========= master_lag: -0.11 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 59 secs) (at 2017-07-31 17:58:31.753521) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-07-31 17:58:31.756666) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/466bc54128055f75503aa77ac682d69992a53069be7af0a0227beb55a7be1fd14ce4716a9e559cc62756ccd6823614c95a8c4a12ab1b5b2eaa800f8cd2085a95", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7a30c2ddb33e24a50fe7a78f677980bc9cd560032d96c90dc086c7be3ab77f22d5053497e56dc4d8884708c3647ff96b7ed7aa841e3d8033f09fe0a9d7aa40e3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1e1c568244db36c77f2b38bdc6a07d7eac458397130b3a892460cecee9e7eb6782f389d943faa4e39f88db37a2f4b3a5f1ef50842ee289ad21a93b15f1974603", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/35a35aee7765dbf508d9fc67e81b6ff518771b9f7de17d53dc1772e8920ee3cdf9c18284af04ff23a70ac3a5270653f684414b583f980df9101750fe67a8fef5"} build_url:https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011455 build_url: 'https://queue.taskcluster.net/v1/task/DsdJJjUsSgahxwFgH6hwYA/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/466bc54128055f75503aa77ac682d69992a53069be7af0a0227beb55a7be1fd14ce4716a9e559cc62756ccd6823614c95a8c4a12ab1b5b2eaa800f8cd2085a95", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/7a30c2ddb33e24a50fe7a78f677980bc9cd560032d96c90dc086c7be3ab77f22d5053497e56dc4d8884708c3647ff96b7ed7aa841e3d8033f09fe0a9d7aa40e3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/1e1c568244db36c77f2b38bdc6a07d7eac458397130b3a892460cecee9e7eb6782f389d943faa4e39f88db37a2f4b3a5f1ef50842ee289ad21a93b15f1974603", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/35a35aee7765dbf508d9fc67e81b6ff518771b9f7de17d53dc1772e8920ee3cdf9c18284af04ff23a70ac3a5270653f684414b583f980df9101750fe67a8fef5"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-07-31 17:58:31.783706) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-07-31 17:58:31.783999) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c3a94c35cc88655b05d2c08000001b2-1501546855.80430-1745705027 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004588 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-07-31 17:58:31.863931) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-07-31 17:58:31.867256) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-07-31 17:58:31.867541) ========= ========= Total master_lag: 0.09 =========