builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-028 starttime: 1476202674.49 results: success (0) buildid: 20161011063006 builduid: 45db9453e63c4aff867c02f084bf8a5d revision: 8654fba1417d44e510b8f2791f5ccf06c0496744 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-11 09:17:54.493916) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-11 09:17:54.494369) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-11 09:17:54.494636) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-11 09:17:54.516060) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-11 09:17:54.516365) ========= 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=836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-10-11 09:17:54-- 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% 46.9M=0s 2016-10-11 09:17:54 (46.9 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.278814 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-11 09:17:54.818485) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-11 09:17:54.818844) ========= 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=836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.053304 ========= master_lag: 0.01 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-11 09:17:54.884441) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-11 09:17:54.884825) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 8654fba1417d44e510b8f2791f5ccf06c0496744 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 8654fba1417d44e510b8f2791f5ccf06c0496744 --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=836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-10-11 09:17:54,937 truncating revision to first 12 chars 2016-10-11 09:17:54,937 Setting DEBUG logging. 2016-10-11 09:17:54,937 attempt 1/10 2016-10-11 09:17:54,937 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/8654fba1417d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-11 09:17:55,289 unpacking tar archive at: fx-team-8654fba1417d/testing/mozharness/ program finished with exit code 0 elapsedTime=0.756062 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-11 09:17:55.654636) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-11 09:17:55.654968) ========= script_repo_revision: 8654fba1417d44e510b8f2791f5ccf06c0496744 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-11 09:17:55.655356) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-11 09:17:55.655617) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-11 09:17:55.666566) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 43 secs) (at 2016-10-11 09:17:55.666961) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 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', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 09:17:55 INFO - MultiFileLogger online at 20161011 09:17:55 in /builds/slave/test 09:17:55 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 09:17:55 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 09:17:55 INFO - {'append_to_log': False, 09:17:55 INFO - 'base_work_dir': '/builds/slave/test', 09:17:55 INFO - 'blob_upload_branch': 'Fx-Team', 09:17:55 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 09:17:55 INFO - 'branch': 'Fx-Team', 09:17:55 INFO - 'buildbot_json_path': 'buildprops.json', 09:17:55 INFO - 'config_files': ('talos/linux_config.py',), 09:17:55 INFO - 'default_actions': ('clobber', 09:17:55 INFO - 'read-buildbot-config', 09:17:55 INFO - 'download-and-extract', 09:17:55 INFO - 'populate-webroot', 09:17:55 INFO - 'create-virtualenv', 09:17:55 INFO - 'install', 09:17:55 INFO - 'run-tests'), 09:17:55 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 09:17:55 INFO - 'download_minidump_stackwalk': True, 09:17:55 INFO - 'download_symbols': 'ondemand', 09:17:55 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 09:17:55 INFO - 'tooltool.py': '/tools/tooltool.py', 09:17:55 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 09:17:55 INFO - '/tools/misc-python/virtualenv.py')}, 09:17:55 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 09:17:55 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 09:17:55 INFO - 'installer_path': 'installer.exe', 09:17:55 INFO - 'log_level': 'info', 09:17:55 INFO - 'log_name': 'talos', 09:17:55 INFO - 'log_to_console': True, 09:17:55 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 09:17:55 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 09:17:55 INFO - 'opt_config_files': (), 09:17:55 INFO - 'pip_index': False, 09:17:55 INFO - 'sps_profile': False, 09:17:55 INFO - 'sps_profile_interval': 0, 09:17:55 INFO - 'suite': 'dromaeojs-e10s', 09:17:55 INFO - 'system_bits': '32', 09:17:55 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 09:17:55 INFO - 'title': 'talos-linux64-ix-028', 09:17:55 INFO - 'tooltool_cache': '/builds/tooltool_cache', 09:17:55 INFO - 'use_talos_json': True, 09:17:55 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 09:17:55 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 09:17:55 INFO - 'work_dir': 'build'} 09:17:55 INFO - [mozharness: 2016-10-11 16:17:55.928291Z] Running clobber step. 09:17:55 INFO - Running pre-action listener: _resource_record_pre_action 09:17:55 INFO - Running main action method: clobber 09:17:55 INFO - rmtree: /builds/slave/test/build 09:17:55 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 09:17:56 INFO - Running post-action listener: _resource_record_post_action 09:17:56 INFO - [mozharness: 2016-10-11 16:17:56.939507Z] Finished clobber step (success) 09:17:56 INFO - [mozharness: 2016-10-11 16:17:56.939669Z] Running read-buildbot-config step. 09:17:56 INFO - Running pre-action listener: _resource_record_pre_action 09:17:56 INFO - Running main action method: read_buildbot_config 09:17:56 INFO - Using buildbot properties: 09:17:56 INFO - { 09:17:56 INFO - "project": "", 09:17:56 INFO - "product": "firefox", 09:17:56 INFO - "script_repo_revision": "production", 09:17:56 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 09:17:56 INFO - "repository": "", 09:17:56 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 09:17:56 INFO - "buildid": "20161011063006", 09:17:56 INFO - "pgo_build": "True", 09:17:56 INFO - "basedir": "/builds/slave/test", 09:17:56 INFO - "buildnumber": 837, 09:17:56 INFO - "slavename": "talos-linux64-ix-028", 09:17:56 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 09:17:56 INFO - "platform": "ubuntu64_hw", 09:17:56 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 09:17:56 INFO - "branch": "fx-team", 09:17:56 INFO - "repo_path": "integration/fx-team", 09:17:56 INFO - "revision": "8654fba1417d44e510b8f2791f5ccf06c0496744", 09:17:56 INFO - "stage_platform": "linux64-pgo", 09:17:56 INFO - "builduid": "45db9453e63c4aff867c02f084bf8a5d", 09:17:56 INFO - "slavebuilddir": "test" 09:17:56 INFO - } 09:17:56 INFO - Found installer url https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 09:17:56 INFO - Running post-action listener: _resource_record_post_action 09:17:56 INFO - [mozharness: 2016-10-11 16:17:56.943083Z] Finished read-buildbot-config step (success) 09:17:56 INFO - [mozharness: 2016-10-11 16:17:56.943208Z] Running download-and-extract step. 09:17:56 INFO - Running pre-action listener: _resource_record_pre_action 09:17:56 INFO - Running main action method: download_and_extract 09:17:56 INFO - mkdir: /builds/slave/test/build/tests 09:17:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:17:56 INFO - trying https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 09:17:56 INFO - Downloading https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 09:17:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 09:17:57 INFO - Downloaded 1361 bytes. 09:17:57 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 09:17:57 INFO - Using the following test package requirements: 09:17:57 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 09:17:57 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 09:17:57 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 09:17:57 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 09:17:57 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 09:17:57 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 09:17:57 INFO - u'jsshell-linux-x86_64.zip'], 09:17:57 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 09:17:57 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 09:17:57 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 09:17:57 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 09:17:57 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 09:17:57 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 09:17:57 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 09:17:57 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 09:17:57 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 09:17:57 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 09:17:57 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 09:17:57 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 09:17:57 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 09:17:57 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 09:17:57 INFO - Fetch https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 09:17:58 INFO - Http code: 200 09:17:58 INFO - via: 1.1 0cf1d7257c633ae75623c5e75bf3805e.cloudfront.net (CloudFront) 09:17:58 INFO - x-amz-cf-id: qhFJ_hoeFRoCOdUYyhtHNXIdL56DYld_wh30GFE1d_FVZ0Y7RFiD5A== 09:17:58 INFO - x-amz-version-id: ZYWUrk74TBqGIS9v3Hi8g5Nqv3cQ2aCA 09:17:58 INFO - Expected file size: 22100582 09:17:58 INFO - Obtained file size: 22100582 09:18:02 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 09:18:02 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 09:18:02 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 09:18:02 INFO - Fetch https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 09:18:03 INFO - Http code: 200 09:18:03 INFO - via: 1.1 bfd7406fdd888e34dfca79886cb7c964.cloudfront.net (CloudFront) 09:18:03 INFO - x-amz-cf-id: lnn7o3ZxTXt0UA6xq65wK0Ho4nmTKONgmUOpsC4V6l4Yt6aYXSTJ1A== 09:18:03 INFO - x-amz-version-id: ZYWUrk74TBqGIS9v3Hi8g5Nqv3cQ2aCA 09:18:03 INFO - Expected file size: 22100582 09:18:03 INFO - Obtained file size: 22100582 09:18:08 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 09:18:08 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 09:18:08 INFO - Fetch https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 09:18:08 INFO - Http code: 200 09:18:08 INFO - via: 1.1 6cd88b9fd84ad5daa3b3867fb8c5c91a.cloudfront.net (CloudFront) 09:18:08 INFO - x-amz-cf-id: 3ODKjdpqYSRiYz0k-J4cf607Yvm77vLQkTe7Rd-9w4sSuqTtzxjLnw== 09:18:08 INFO - x-amz-version-id: MDmR0GihNguBeFmWyKcCKD52VgeIBtiv 09:18:09 INFO - Expected file size: 14409006 09:18:09 INFO - Obtained file size: 14409006 09:18:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:09 INFO - trying https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 09:18:09 INFO - Downloading https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 09:18:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 09:18:10 INFO - Downloaded 59756893 bytes. 09:18:10 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 09:18:10 INFO - mkdir: /builds/slave/test/properties 09:18:10 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 09:18:10 INFO - Writing to file /builds/slave/test/properties/build_url 09:18:10 INFO - Contents: 09:18:10 INFO - build_url:https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 09:18:11 INFO - Running post-action listener: _resource_record_post_action 09:18:11 INFO - Running post-action listener: set_extra_try_arguments 09:18:11 INFO - [mozharness: 2016-10-11 16:18:11.207600Z] Finished download-and-extract step (success) 09:18:11 INFO - [mozharness: 2016-10-11 16:18:11.207829Z] Running populate-webroot step. 09:18:11 INFO - Running pre-action listener: _resource_record_pre_action 09:18:11 INFO - Running main action method: populate_webroot 09:18:11 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 09:18:11 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 09:18:11 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 09:18:11 INFO - '--tppagecycles', 09:18:11 INFO - '7'], 09:18:11 INFO - 'tests': ['tsvgm']}}, 09:18:11 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 09:18:11 INFO - 'tests': ['tresize', 'tcanvasmark']}, 09:18:11 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 09:18:11 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 09:18:11 INFO - 'tests': ['dromaeo_css', 'kraken']}, 09:18:11 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 09:18:11 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:18:11 INFO - 'talos_options': ['--disable-e10s'], 09:18:11 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:18:11 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:18:11 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:18:11 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:18:11 INFO - 'talos_options': ['--disable-e10s'], 09:18:11 INFO - 'tests': ['damp', 'tps']}, 09:18:11 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:18:11 INFO - 'tests': ['damp', 'tps']}, 09:18:11 INFO - 'g3': {'talos_options': ['--disable-e10s'], 09:18:11 INFO - 'tests': ['dromaeo_dom']}, 09:18:11 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 09:18:11 INFO - 'g4': {'talos_options': ['--disable-e10s'], 09:18:11 INFO - 'tests': ['basic_compositor_video']}, 09:18:11 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 09:18:11 INFO - 'other': {'talos_options': ['--disable-e10s'], 09:18:11 INFO - 'tests': ['a11yr', 09:18:11 INFO - 'ts_paint', 09:18:11 INFO - 'tpaint', 09:18:11 INFO - 'sessionrestore', 09:18:11 INFO - 'sessionrestore_no_auto_restore', 09:18:11 INFO - 'tabpaint']}, 09:18:11 INFO - 'other-e10s': {'tests': ['a11yr', 09:18:11 INFO - 'ts_paint', 09:18:11 INFO - 'tpaint', 09:18:11 INFO - 'sessionrestore', 09:18:11 INFO - 'sessionrestore_no_auto_restore', 09:18:11 INFO - 'tabpaint']}, 09:18:11 INFO - 'other-e10s_l64': {'tests': ['a11yr', 09:18:11 INFO - 'ts_paint', 09:18:11 INFO - 'tpaint', 09:18:11 INFO - 'sessionrestore', 09:18:11 INFO - 'sessionrestore_no_auto_restore', 09:18:11 INFO - 'tabpaint']}, 09:18:11 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 09:18:11 INFO - 'ts_paint', 09:18:11 INFO - 'tpaint', 09:18:11 INFO - 'sessionrestore', 09:18:11 INFO - 'sessionrestore_no_auto_restore', 09:18:11 INFO - 'tabpaint']}, 09:18:11 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 09:18:11 INFO - 'tests': ['a11yr', 09:18:11 INFO - 'ts_paint', 09:18:11 INFO - 'tpaint', 09:18:11 INFO - 'sessionrestore', 09:18:11 INFO - 'sessionrestore_no_auto_restore', 09:18:11 INFO - 'tabpaint']}, 09:18:11 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 09:18:11 INFO - 'tests': ['a11yr', 09:18:11 INFO - 'ts_paint', 09:18:11 INFO - 'tpaint', 09:18:11 INFO - 'sessionrestore', 09:18:11 INFO - 'sessionrestore_no_auto_restore', 09:18:11 INFO - 'tabpaint']}, 09:18:11 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 09:18:11 INFO - 'tests': ['tsvgx', 09:18:11 INFO - 'tsvgr_opacity', 09:18:11 INFO - 'tart', 09:18:11 INFO - 'tscrollx', 09:18:11 INFO - 'cart']}, 09:18:11 INFO - 'svgr-e10s': {'tests': ['tsvgx', 09:18:11 INFO - 'tsvgr_opacity', 09:18:11 INFO - 'tart', 09:18:11 INFO - 'tscrollx', 09:18:11 INFO - 'cart']}, 09:18:11 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:18:11 INFO - 'talos_options': ['--disable-e10s'], 09:18:11 INFO - 'tests': ['tp5o']}, 09:18:11 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:18:11 INFO - 'tests': ['tp5o']}, 09:18:11 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:18:11 INFO - 'talos_options': ['--disable-e10s', 09:18:11 INFO - '--xperf_path', 09:18:11 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:18:11 INFO - 'tests': ['tp5n']}, 09:18:11 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:18:11 INFO - 'talos_options': ['--xperf_path', 09:18:11 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:18:11 INFO - 'tests': ['tp5n']}}, 09:18:11 INFO - 'talos.zip': {'path': '', 09:18:11 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 09:18:11 INFO - Running post-action listener: _resource_record_post_action 09:18:11 INFO - [mozharness: 2016-10-11 16:18:11.232805Z] Finished populate-webroot step (success) 09:18:11 INFO - [mozharness: 2016-10-11 16:18:11.232894Z] Running create-virtualenv step. 09:18:11 INFO - Running pre-action listener: _resource_record_pre_action 09:18:11 INFO - Running main action method: create_virtualenv 09:18:11 INFO - Creating virtualenv /builds/slave/test/build/venv 09:18:11 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 09:18:11 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 09:18:11 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 09:18:11 INFO - Using real prefix '/usr' 09:18:11 INFO - New python executable in /builds/slave/test/build/venv/bin/python 09:18:12 INFO - Installing distribute.............................................................................................................................................................................................done. 09:18:14 INFO - Installing pip.................done. 09:18:14 INFO - Return code: 0 09:18:14 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 09:18:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 09:18:14 INFO - Reading from file tmpfile_stdout 09:18:14 INFO - Output received: 09:18:14 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) 09:18:14 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 09:18:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:18:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:18:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:14 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f9ebb780f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x216b790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2168930>, '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 0x2169830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2169cc0>, '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': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', '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 09:18:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:18:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 09:18:14 INFO - Using env: {'DISPLAY': ':0', 09:18:14 INFO - 'HOME': '/home/cltbld', 09:18:14 INFO - 'LANG': 'en_US.UTF-8', 09:18:14 INFO - 'LANGUAGE': 'en_US:en', 09:18:14 INFO - 'LOGNAME': 'cltbld', 09:18:14 INFO - 'MAIL': '/var/mail/cltbld', 09:18:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:18:14 INFO - 'MOZ_NO_REMOTE': '1', 09:18:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:18:14 INFO - 'NO_EM_RESTART': '1', 09:18:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:18:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:18:14 INFO - 'PWD': '/builds/slave/test', 09:18:14 INFO - 'SHELL': '/bin/bash', 09:18:14 INFO - 'SHLVL': '1', 09:18:14 INFO - 'TERM': 'linux', 09:18:14 INFO - 'TMOUT': '86400', 09:18:14 INFO - 'USER': 'cltbld', 09:18:14 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', 09:18:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:18:14 INFO - '_': '/tools/buildbot/bin/python'} 09:18:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:18:14 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 09:18:14 INFO - Cleaning up... 09:18:14 INFO - Return code: 0 09:18:14 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 09:18:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:18:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:18:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:14 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f9ebb780f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x216b790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2168930>, '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 0x2169830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2169cc0>, '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': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', '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 09:18:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:18:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 09:18:14 INFO - Using env: {'DISPLAY': ':0', 09:18:14 INFO - 'HOME': '/home/cltbld', 09:18:14 INFO - 'LANG': 'en_US.UTF-8', 09:18:14 INFO - 'LANGUAGE': 'en_US:en', 09:18:14 INFO - 'LOGNAME': 'cltbld', 09:18:14 INFO - 'MAIL': '/var/mail/cltbld', 09:18:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:18:14 INFO - 'MOZ_NO_REMOTE': '1', 09:18:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:18:14 INFO - 'NO_EM_RESTART': '1', 09:18:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:18:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:18:14 INFO - 'PWD': '/builds/slave/test', 09:18:14 INFO - 'SHELL': '/bin/bash', 09:18:14 INFO - 'SHLVL': '1', 09:18:14 INFO - 'TERM': 'linux', 09:18:14 INFO - 'TMOUT': '86400', 09:18:14 INFO - 'USER': 'cltbld', 09:18:14 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', 09:18:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:18:14 INFO - '_': '/tools/buildbot/bin/python'} 09:18:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:18:15 INFO - Downloading/unpacking psutil>=3.1.1 09:18:15 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 09:18:15 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 09:18:15 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:15 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:15 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 09:18:15 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 09:18:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 09:18:17 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:18:17 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:18:17 INFO - Installing collected packages: psutil 09:18:17 INFO - Running setup.py install for psutil 09:18:17 INFO - building 'psutil._psutil_linux' extension 09:18:17 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 09:18:18 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 09:18:18 INFO - building 'psutil._psutil_posix' extension 09:18:18 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 09:18:18 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 09:18:18 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:18:18 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:18:18 INFO - Successfully installed psutil 09:18:18 INFO - Cleaning up... 09:18:18 INFO - Return code: 0 09:18:18 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 09:18:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:18:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:18:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:18 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f9ebb780f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x216b790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2168930>, '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 0x2169830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2169cc0>, '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': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', '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 09:18:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:18:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 09:18:18 INFO - Using env: {'DISPLAY': ':0', 09:18:18 INFO - 'HOME': '/home/cltbld', 09:18:18 INFO - 'LANG': 'en_US.UTF-8', 09:18:18 INFO - 'LANGUAGE': 'en_US:en', 09:18:18 INFO - 'LOGNAME': 'cltbld', 09:18:18 INFO - 'MAIL': '/var/mail/cltbld', 09:18:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:18:18 INFO - 'MOZ_NO_REMOTE': '1', 09:18:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:18:18 INFO - 'NO_EM_RESTART': '1', 09:18:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:18:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:18:18 INFO - 'PWD': '/builds/slave/test', 09:18:18 INFO - 'SHELL': '/bin/bash', 09:18:18 INFO - 'SHLVL': '1', 09:18:18 INFO - 'TERM': 'linux', 09:18:18 INFO - 'TMOUT': '86400', 09:18:18 INFO - 'USER': 'cltbld', 09:18:18 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', 09:18:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:18:18 INFO - '_': '/tools/buildbot/bin/python'} 09:18:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:18:19 INFO - Downloading/unpacking mozsystemmonitor==0.3 09:18:19 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 09:18:19 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 09:18:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:19 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 09:18:19 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 09:18:21 INFO - Downloading mozsystemmonitor-0.3.tar.gz 09:18:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 09:18:21 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 09:18:21 INFO - Installing collected packages: mozsystemmonitor 09:18:21 INFO - Running setup.py install for mozsystemmonitor 09:18:21 INFO - Successfully installed mozsystemmonitor 09:18:21 INFO - Cleaning up... 09:18:21 INFO - Return code: 0 09:18:21 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 09:18:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:18:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:18:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:21 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f9ebb780f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x216b790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2168930>, '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 0x2169830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2169cc0>, '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': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', '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 09:18:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:18:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 09:18:21 INFO - Using env: {'DISPLAY': ':0', 09:18:21 INFO - 'HOME': '/home/cltbld', 09:18:21 INFO - 'LANG': 'en_US.UTF-8', 09:18:21 INFO - 'LANGUAGE': 'en_US:en', 09:18:21 INFO - 'LOGNAME': 'cltbld', 09:18:21 INFO - 'MAIL': '/var/mail/cltbld', 09:18:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:18:21 INFO - 'MOZ_NO_REMOTE': '1', 09:18:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:18:21 INFO - 'NO_EM_RESTART': '1', 09:18:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:18:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:18:21 INFO - 'PWD': '/builds/slave/test', 09:18:21 INFO - 'SHELL': '/bin/bash', 09:18:21 INFO - 'SHLVL': '1', 09:18:21 INFO - 'TERM': 'linux', 09:18:21 INFO - 'TMOUT': '86400', 09:18:21 INFO - 'USER': 'cltbld', 09:18:21 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', 09:18:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:18:21 INFO - '_': '/tools/buildbot/bin/python'} 09:18:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:18:21 INFO - Downloading/unpacking jsonschema==2.5.1 09:18:21 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 09:18:21 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 09:18:21 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:21 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:21 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 09:18:21 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 09:18:23 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 09:18:23 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 09:18:23 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 09:18:23 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 09:18:23 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:23 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:23 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 09:18:23 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 09:18:23 INFO - Downloading functools32-3.2.3-2.tar.gz 09:18:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 09:18:23 INFO - warning: no files found matching '*.txt' 09:18:23 INFO - no previously-included directories found matching 'build' 09:18:23 INFO - no previously-included directories found matching 'dist' 09:18:23 INFO - no previously-included directories found matching '.git*' 09:18:23 INFO - Installing collected packages: jsonschema, functools32 09:18:23 INFO - Running setup.py install for functools32 09:18:23 INFO - warning: no files found matching '*.txt' 09:18:23 INFO - no previously-included directories found matching 'build' 09:18:23 INFO - no previously-included directories found matching 'dist' 09:18:23 INFO - no previously-included directories found matching '.git*' 09:18:23 INFO - Successfully installed jsonschema functools32 09:18:23 INFO - Cleaning up... 09:18:23 INFO - Return code: 0 09:18:23 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 09:18:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:18:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:18:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:23 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f9ebb780f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x216b790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2168930>, '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 0x2169830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2169cc0>, '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': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', '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 09:18:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:18:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 09:18:23 INFO - Using env: {'DISPLAY': ':0', 09:18:23 INFO - 'HOME': '/home/cltbld', 09:18:23 INFO - 'LANG': 'en_US.UTF-8', 09:18:23 INFO - 'LANGUAGE': 'en_US:en', 09:18:23 INFO - 'LOGNAME': 'cltbld', 09:18:23 INFO - 'MAIL': '/var/mail/cltbld', 09:18:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:18:23 INFO - 'MOZ_NO_REMOTE': '1', 09:18:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:18:23 INFO - 'NO_EM_RESTART': '1', 09:18:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:18:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:18:23 INFO - 'PWD': '/builds/slave/test', 09:18:23 INFO - 'SHELL': '/bin/bash', 09:18:23 INFO - 'SHLVL': '1', 09:18:23 INFO - 'TERM': 'linux', 09:18:23 INFO - 'TMOUT': '86400', 09:18:23 INFO - 'USER': 'cltbld', 09:18:23 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', 09:18:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:18:23 INFO - '_': '/tools/buildbot/bin/python'} 09:18:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:18:24 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 09:18:24 INFO - Cleaning up... 09:18:24 INFO - Return code: 0 09:18:24 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 09:18:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:18:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:18:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18: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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f9ebb780f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x216b790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2168930>, '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 0x2169830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2169cc0>, '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': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', '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 09:18:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:18:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 09:18:24 INFO - Using env: {'DISPLAY': ':0', 09:18:24 INFO - 'HOME': '/home/cltbld', 09:18:24 INFO - 'LANG': 'en_US.UTF-8', 09:18:24 INFO - 'LANGUAGE': 'en_US:en', 09:18:24 INFO - 'LOGNAME': 'cltbld', 09:18:24 INFO - 'MAIL': '/var/mail/cltbld', 09:18:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:18:24 INFO - 'MOZ_NO_REMOTE': '1', 09:18:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:18:24 INFO - 'NO_EM_RESTART': '1', 09:18:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:18:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:18:24 INFO - 'PWD': '/builds/slave/test', 09:18:24 INFO - 'SHELL': '/bin/bash', 09:18:24 INFO - 'SHLVL': '1', 09:18:24 INFO - 'TERM': 'linux', 09:18:24 INFO - 'TMOUT': '86400', 09:18:24 INFO - 'USER': 'cltbld', 09:18:24 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', 09:18:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:18:24 INFO - '_': '/tools/buildbot/bin/python'} 09:18:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:18:24 INFO - Downloading/unpacking blobuploader==1.2.4 09:18:24 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 09:18:24 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 09:18:24 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:24 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:24 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 09:18:24 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 09:18:26 INFO - Downloading blobuploader-1.2.4.tar.gz 09:18:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 09:18:26 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 09:18:26 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 09:18:26 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 09:18:26 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:26 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:26 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 09:18:26 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 09:18:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 09:18:26 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 09:18:26 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 09:18:26 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 09:18:26 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:26 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:26 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 09:18:26 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 09:18:26 INFO - Downloading docopt-0.6.1.tar.gz 09:18:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 09:18:27 INFO - Installing collected packages: blobuploader, requests, docopt 09:18:27 INFO - Running setup.py install for blobuploader 09:18:27 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 09:18:27 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 09:18:27 INFO - Running setup.py install for requests 09:18:27 INFO - Running setup.py install for docopt 09:18:27 INFO - Successfully installed blobuploader requests docopt 09:18:27 INFO - Cleaning up... 09:18:27 INFO - Return code: 0 09:18:27 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:18:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:18:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:18:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:27 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f9ebb780f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x216b790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2168930>, '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 0x2169830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2169cc0>, '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': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', '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 09:18:27 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:18:27 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:18:27 INFO - Using env: {'DISPLAY': ':0', 09:18:27 INFO - 'HOME': '/home/cltbld', 09:18:27 INFO - 'LANG': 'en_US.UTF-8', 09:18:27 INFO - 'LANGUAGE': 'en_US:en', 09:18:27 INFO - 'LOGNAME': 'cltbld', 09:18:27 INFO - 'MAIL': '/var/mail/cltbld', 09:18:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:18:27 INFO - 'MOZ_NO_REMOTE': '1', 09:18:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:18:27 INFO - 'NO_EM_RESTART': '1', 09:18:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:18:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:18:27 INFO - 'PWD': '/builds/slave/test', 09:18:27 INFO - 'SHELL': '/bin/bash', 09:18:27 INFO - 'SHLVL': '1', 09:18:27 INFO - 'TERM': 'linux', 09:18:27 INFO - 'TMOUT': '86400', 09:18:27 INFO - 'USER': 'cltbld', 09:18:27 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', 09:18:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:18:27 INFO - '_': '/tools/buildbot/bin/python'} 09:18:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:18:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:18:27 INFO - Running setup.py (path:/tmp/pip-8yqorI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:18:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:18:27 INFO - Running setup.py (path:/tmp/pip-jT7Slr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:18:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:18:28 INFO - Running setup.py (path:/tmp/pip-B6MlvM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:18:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:18:28 INFO - Running setup.py (path:/tmp/pip-b_PYnP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:18:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:18:28 INFO - Running setup.py (path:/tmp/pip-ltvaVT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:18:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:18:28 INFO - Running setup.py (path:/tmp/pip-HjoMI8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:18:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:18:28 INFO - Running setup.py (path:/tmp/pip-oGzgf4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:18:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:18:28 INFO - Running setup.py (path:/tmp/pip-kSJJ6g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:18:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:18:28 INFO - Running setup.py (path:/tmp/pip-H1sFW3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:18:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:18:28 INFO - Running setup.py (path:/tmp/pip-rrlyfu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:18:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:18:28 INFO - Running setup.py (path:/tmp/pip-zthS3K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:18:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:18:28 INFO - Running setup.py (path:/tmp/pip-32wbo8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:18:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:18:28 INFO - Running setup.py (path:/tmp/pip-MwB8lp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:18:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:18:28 INFO - Running setup.py (path:/tmp/pip-o00lKr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:18:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:18:28 INFO - Running setup.py (path:/tmp/pip-_P2gIS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:18:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:18:28 INFO - Running setup.py (path:/tmp/pip-RkOJbV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:18:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:18:29 INFO - Running setup.py (path:/tmp/pip-UgDThK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:18:29 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 09:18:29 INFO - Running setup.py install for manifestparser 09:18:29 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 09:18:29 INFO - Running setup.py install for mozcrash 09:18:29 INFO - Running setup.py install for mozdebug 09:18:29 INFO - Running setup.py install for mozdevice 09:18:29 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 09:18:29 INFO - Installing dm script to /builds/slave/test/build/venv/bin 09:18:29 INFO - Running setup.py install for mozfile 09:18:29 INFO - Running setup.py install for mozhttpd 09:18:29 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 09:18:29 INFO - Running setup.py install for mozinfo 09:18:29 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 09:18:29 INFO - Running setup.py install for mozInstall 09:18:29 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 09:18:29 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 09:18:29 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 09:18:29 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 09:18:29 INFO - Running setup.py install for mozleak 09:18:29 INFO - Running setup.py install for mozlog 09:18:30 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 09:18:30 INFO - Running setup.py install for moznetwork 09:18:30 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 09:18:30 INFO - Running setup.py install for mozprocess 09:18:30 INFO - Running setup.py install for mozprofile 09:18:30 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 09:18:30 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 09:18:30 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 09:18:30 INFO - Running setup.py install for mozrunner 09:18:30 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 09:18:30 INFO - Running setup.py install for mozscreenshot 09:18:30 INFO - Running setup.py install for moztest 09:18:30 INFO - Running setup.py install for mozversion 09:18:30 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 09:18:30 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 09:18:30 INFO - Cleaning up... 09:18:30 INFO - Return code: 0 09:18:30 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:18:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:18:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:18:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:30 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f9ebb780f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x216b790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2168930>, '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 0x2169830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2169cc0>, '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': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', '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 09:18:30 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:18:30 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:18:30 INFO - Using env: {'DISPLAY': ':0', 09:18:30 INFO - 'HOME': '/home/cltbld', 09:18:30 INFO - 'LANG': 'en_US.UTF-8', 09:18:30 INFO - 'LANGUAGE': 'en_US:en', 09:18:30 INFO - 'LOGNAME': 'cltbld', 09:18:30 INFO - 'MAIL': '/var/mail/cltbld', 09:18:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:18:30 INFO - 'MOZ_NO_REMOTE': '1', 09:18:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:18:30 INFO - 'NO_EM_RESTART': '1', 09:18:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:18:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:18:30 INFO - 'PWD': '/builds/slave/test', 09:18:30 INFO - 'SHELL': '/bin/bash', 09:18:30 INFO - 'SHLVL': '1', 09:18:30 INFO - 'TERM': 'linux', 09:18:30 INFO - 'TMOUT': '86400', 09:18:30 INFO - 'USER': 'cltbld', 09:18:30 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', 09:18:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:18:30 INFO - '_': '/tools/buildbot/bin/python'} 09:18:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:18:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:18:31 INFO - Running setup.py (path:/tmp/pip-seKBz0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:18:31 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)) 09:18:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:18:31 INFO - Running setup.py (path:/tmp/pip-zk2Q9x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:18:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 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)) 09:18:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:18:31 INFO - Running setup.py (path:/tmp/pip-Qhr7mN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:18:31 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)) 09:18:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:18:31 INFO - Running setup.py (path:/tmp/pip-Aw8xSM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:18:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 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)) 09:18:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:18:31 INFO - Running setup.py (path:/tmp/pip-En71Aq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:18:31 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)) 09:18:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:18:31 INFO - Running setup.py (path:/tmp/pip-hy20sK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:18:31 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)) 09:18:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:18:31 INFO - Running setup.py (path:/tmp/pip-1XNQh4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:18:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 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)) 09:18:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:18:31 INFO - Running setup.py (path:/tmp/pip-CHBKZg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:18:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 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)) 09:18:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:18:31 INFO - Running setup.py (path:/tmp/pip-4LO_NN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:18:31 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)) 09:18:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:18:31 INFO - Running setup.py (path:/tmp/pip-ZPlJ4H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:18:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 09:18:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:18:31 INFO - Running setup.py (path:/tmp/pip-p2PMw0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:18:31 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)) 09:18:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:18:31 INFO - Running setup.py (path:/tmp/pip-UX6y0f-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:18:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 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)) 09:18:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:18:31 INFO - Running setup.py (path:/tmp/pip-4zOaRa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:18:32 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)) 09:18:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:18:32 INFO - Running setup.py (path:/tmp/pip-oASG6x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:18:32 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 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)) 09:18:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:18:32 INFO - Running setup.py (path:/tmp/pip-ygrzpp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:18:32 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)) 09:18:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:18:32 INFO - Running setup.py (path:/tmp/pip-CSkCTw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:18:32 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 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)) 09:18:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:18:32 INFO - Running setup.py (path:/tmp/pip-ROk2GA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:18:32 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)) 09:18:32 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:18:32 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:18:32 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)) 09:18:32 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:18:32 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:18:32 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:18:32 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 09:18:32 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 09:18:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:18:32 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 09:18:32 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 09:18:34 INFO - Downloading blessings-1.6.tar.gz 09:18:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 09:18:34 INFO - Installing collected packages: blessings 09:18:34 INFO - Running setup.py install for blessings 09:18:34 INFO - Successfully installed blessings 09:18:34 INFO - Cleaning up... 09:18:34 INFO - Return code: 0 09:18:34 INFO - Done creating virtualenv /builds/slave/test/build/venv. 09:18:34 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:18:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:18:34 INFO - Reading from file tmpfile_stdout 09:18:34 INFO - Current package versions: 09:18:34 INFO - argparse == 1.2.1 09:18:34 INFO - blessings == 1.6 09:18:34 INFO - blobuploader == 1.2.4 09:18:34 INFO - docopt == 0.6.1 09:18:34 INFO - functools32 == 3.2.3-2 09:18:34 INFO - jsonschema == 2.5.1 09:18:34 INFO - manifestparser == 1.1 09:18:34 INFO - mozInstall == 1.12 09:18:34 INFO - mozcrash == 0.17 09:18:34 INFO - mozdebug == 0.1 09:18:34 INFO - mozdevice == 0.48 09:18:34 INFO - mozfile == 1.2 09:18:34 INFO - mozhttpd == 0.7 09:18:34 INFO - mozinfo == 0.9 09:18:34 INFO - mozleak == 0.1 09:18:34 INFO - mozlog == 3.4 09:18:34 INFO - moznetwork == 0.27 09:18:34 INFO - mozprocess == 0.23 09:18:34 INFO - mozprofile == 0.28 09:18:34 INFO - mozrunner == 6.12 09:18:34 INFO - mozscreenshot == 0.1 09:18:34 INFO - mozsystemmonitor == 0.3 09:18:34 INFO - moztest == 0.7 09:18:34 INFO - mozversion == 1.4 09:18:34 INFO - psutil == 3.1.1 09:18:34 INFO - requests == 1.2.3 09:18:34 INFO - wsgiref == 0.1.2 09:18:34 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:18:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:18:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:18:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:34 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f9ebb780f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x216b790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2168930>, '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 0x2169830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2169cc0>, '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': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', '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 09:18:34 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:18:34 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:18:34 INFO - Using env: {'DISPLAY': ':0', 09:18:34 INFO - 'HOME': '/home/cltbld', 09:18:34 INFO - 'LANG': 'en_US.UTF-8', 09:18:34 INFO - 'LANGUAGE': 'en_US:en', 09:18:34 INFO - 'LOGNAME': 'cltbld', 09:18:34 INFO - 'MAIL': '/var/mail/cltbld', 09:18:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:18:34 INFO - 'MOZ_NO_REMOTE': '1', 09:18:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:18:34 INFO - 'NO_EM_RESTART': '1', 09:18:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:18:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:18:34 INFO - 'PWD': '/builds/slave/test', 09:18:34 INFO - 'SHELL': '/bin/bash', 09:18:34 INFO - 'SHLVL': '1', 09:18:34 INFO - 'TERM': 'linux', 09:18:34 INFO - 'TMOUT': '86400', 09:18:34 INFO - 'USER': 'cltbld', 09:18:34 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', 09:18:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:18:34 INFO - '_': '/tools/buildbot/bin/python'} 09:18:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:18:34 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)) 09:18:34 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)) 09:18:34 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)) 09:18:34 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)) 09:18:34 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)) 09:18:34 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)) 09:18:34 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)) 09:18:35 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)) 09:18:35 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)) 09:18:35 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)) 09:18:35 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)) 09:18:35 INFO - Cleaning up... 09:18:35 INFO - Return code: 0 09:18:35 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 09:18:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:18:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:18:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:18:35 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f9ebb780f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x209e8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x216b790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2168930>, '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 0x2169830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2169cc0>, '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': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', '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 09:18:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 09:18:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 09:18:35 INFO - Using env: {'DISPLAY': ':0', 09:18:35 INFO - 'HOME': '/home/cltbld', 09:18:35 INFO - 'LANG': 'en_US.UTF-8', 09:18:35 INFO - 'LANGUAGE': 'en_US:en', 09:18:35 INFO - 'LOGNAME': 'cltbld', 09:18:35 INFO - 'MAIL': '/var/mail/cltbld', 09:18:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:18:35 INFO - 'MOZ_NO_REMOTE': '1', 09:18:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:18:35 INFO - 'NO_EM_RESTART': '1', 09:18:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:18:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:18:35 INFO - 'PWD': '/builds/slave/test', 09:18:35 INFO - 'SHELL': '/bin/bash', 09:18:35 INFO - 'SHLVL': '1', 09:18:35 INFO - 'TERM': 'linux', 09:18:35 INFO - 'TMOUT': '86400', 09:18:35 INFO - 'USER': 'cltbld', 09:18:35 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', 09:18:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:18:35 INFO - '_': '/tools/buildbot/bin/python'} 09:18:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:18:35 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 09:18:35 INFO - Cleaning up... 09:18:35 INFO - Return code: 0 09:18:35 INFO - Running post-action listener: _resource_record_post_action 09:18:35 INFO - Running post-action listener: _start_resource_monitoring 09:18:35 INFO - Starting resource monitoring. 09:18:35 INFO - [mozharness: 2016-10-11 16:18:35.274648Z] Finished create-virtualenv step (success) 09:18:35 INFO - [mozharness: 2016-10-11 16:18:35.275104Z] Running install step. 09:18:35 INFO - Running pre-action listener: _resource_record_pre_action 09:18:35 INFO - Running main action method: install 09:18:35 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:18:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:18:35 INFO - Reading from file tmpfile_stdout 09:18:35 INFO - Detecting whether we're running mozinstall >=1.0... 09:18:35 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 09:18:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 09:18:35 INFO - Reading from file tmpfile_stdout 09:18:35 INFO - Output received: 09:18:35 INFO - Usage: mozinstall [options] installer 09:18:35 INFO - Options: 09:18:35 INFO - -h, --help show this help message and exit 09:18:35 INFO - -d DEST, --destination=DEST 09:18:35 INFO - Directory to install application into. [default: 09:18:35 INFO - "/builds/slave/test"] 09:18:35 INFO - --app=APP Application being installed. [default: firefox] 09:18:35 INFO - mkdir: /builds/slave/test/build/application 09:18:35 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 09:18:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 09:18:52 INFO - Reading from file tmpfile_stdout 09:18:52 INFO - Output received: 09:18:52 INFO - /builds/slave/test/build/application/firefox/firefox 09:18:52 INFO - Running post-action listener: _resource_record_post_action 09:18:52 INFO - [mozharness: 2016-10-11 16:18:52.601641Z] Finished install step (success) 09:18:52 INFO - [mozharness: 2016-10-11 16:18:52.601895Z] Running run-tests step. 09:18:52 INFO - Running pre-action listener: _resource_record_pre_action 09:18:52 INFO - Running main action method: run_tests 09:18:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 09:18:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 09:18:52 INFO - Python 2.7.3 09:18:52 INFO - Return code: 0 09:18:52 INFO - grabbing minidump binary from tooltool 09:18:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 09:18:52 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 0x2168930>, '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 0x2169830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2169cc0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 09:18:52 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 09:18:52 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 09:18:52 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 09:18:52 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 09:18:52 INFO - Return code: 0 09:18:52 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 09:18:52 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 09:18:52 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 09:18:52 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 09:18:52 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 09:18:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-028', '--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 09:18:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-028 --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 09:18:52 INFO - Using env: {'DISPLAY': ':0', 09:18:52 INFO - 'HOME': '/home/cltbld', 09:18:52 INFO - 'LANG': 'en_US.UTF-8', 09:18:52 INFO - 'LANGUAGE': 'en_US:en', 09:18:52 INFO - 'LOGNAME': 'cltbld', 09:18:52 INFO - 'MAIL': '/var/mail/cltbld', 09:18:52 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 09:18:52 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 09:18:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:18:52 INFO - 'MOZ_NO_REMOTE': '1', 09:18:52 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 09:18:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:18:52 INFO - 'NO_EM_RESTART': '1', 09:18:52 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:18:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:18:52 INFO - 'PWD': '/builds/slave/test', 09:18:52 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 09:18:52 INFO - 'SHELL': '/bin/bash', 09:18:52 INFO - 'SHLVL': '1', 09:18:52 INFO - 'TERM': 'linux', 09:18:52 INFO - 'TMOUT': '86400', 09:18:52 INFO - 'USER': 'cltbld', 09:18:52 INFO - 'XDG_SESSION_COOKIE': '836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704', 09:18:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:18:52 INFO - '_': '/tools/buildbot/bin/python'} 09:18:52 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-028', '--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 09:18:52 INFO - mozversion application_buildid: 20161011063006 09:18:52 INFO - mozversion application_changeset: 8654fba1417d44e510b8f2791f5ccf06c0496744 09:18:52 INFO - mozversion application_display_name: Nightly 09:18:52 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 09:18:52 INFO - mozversion application_name: Firefox 09:18:52 INFO - mozversion application_remotingname: firefox 09:18:52 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 09:18:52 INFO - mozversion application_vendor: Mozilla 09:18:52 INFO - mozversion application_version: 52.0a1 09:18:52 INFO - mozversion platform_buildid: 20161011063006 09:18:52 INFO - mozversion platform_changeset: 8654fba1417d44e510b8f2791f5ccf06c0496744 09:18:52 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 09:18:52 INFO - mozversion platform_version: 52.0a1 09:18:52 INFO - using testdate: 1476202732 09:18:52 INFO - actual date: 1476202732 09:18:52 INFO - starting webserver on 'localhost:41255' 09:18:52 INFO - SUITE-START | Running 2 tests 09:18:52 INFO - TEST-START | dromaeo_css 09:18:52 INFO - operating with platform_type : linux_ 09:18:52 INFO - Initialising browser for dromaeo_css test... 09:18:53 INFO - TEST-INFO | started process 3341 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpit3zTi/profile http://localhost:41255/getInfo.html) 09:18:59 INFO - PROCESS | 3341 | __metrics Screen width/height:1600/1200 09:18:59 INFO - PROCESS | 3341 | colorDepth:24 09:18:59 INFO - PROCESS | 3341 | Browser inner width/height: 1024/697 09:18:59 INFO - PROCESS | 3341 | __metrics 09:18:59 ERROR - PROCESS | 3341 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3083: TypeError: this.tabs is undefined 09:19:00 INFO - TEST-INFO | 3341: exit 0 09:19:00 INFO - Browser initialized. 09:19:00 INFO - Running cycle 1/1 for dromaeo_css test... 09:19:00 INFO - TEST-INFO | started process 3463 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpit3zTi/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:19:12 INFO - PROCESS | 3463 | RSS: Main: 184762368 09:19:12 INFO - PROCESS | 3463 | 09:20:02 INFO - PROCESS | 3463 | 1476202802428 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 09:22:13 INFO - PROCESS | 3463 | Cycle 1(1): loaded http://localhost:41255/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41255/tests/dromaeo/cssquery-ext.html) 09:22:14 INFO - PROCESS | 3463 | RSS: Main: 201936896 09:22:14 INFO - PROCESS | 3463 | 09:25:16 INFO - PROCESS | 3463 | Cycle 1(1): loaded http://localhost:41255/tests/dromaeo/cssquery-ext.html (next: http://localhost:41255/tests/dromaeo/cssquery-jquery.html) 09:25:17 INFO - PROCESS | 3463 | RSS: Main: 202964992 09:25:17 INFO - PROCESS | 3463 | 09:28:19 INFO - PROCESS | 3463 | Cycle 1(1): loaded http://localhost:41255/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41255/tests/dromaeo/cssquery-mootools.html) 09:28:19 INFO - PROCESS | 3463 | RSS: Main: 203284480 09:28:19 INFO - PROCESS | 3463 | 09:31:21 INFO - PROCESS | 3463 | Cycle 1(1): loaded http://localhost:41255/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41255/tests/dromaeo/cssquery-prototype.html) 09:31:22 INFO - PROCESS | 3463 | RSS: Main: 195768320 09:31:22 INFO - PROCESS | 3463 | 09:34:25 INFO - PROCESS | 3463 | Cycle 1(1): loaded http://localhost:41255/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41255/tests/dromaeo/cssquery-yui.html) 09:34:25 INFO - PROCESS | 3463 | RSS: Main: 197865472 09:34:25 INFO - PROCESS | 3463 | 09:37:28 INFO - PROCESS | 3463 | Cycle 1(1): loaded http://localhost:41255/tests/dromaeo/cssquery-yui.html (next: http://localhost:41255/tests/dromaeo/cssquery-dojo.html) 09:37:28 INFO - PROCESS | 3463 | RSS: Main: 199241728 09:37:28 INFO - PROCESS | 3463 | 09:37:28 INFO - PROCESS | 3463 | __start_tp_report 09:37:28 INFO - PROCESS | 3463 | _x_x_mozilla_page_load 09:37:28 INFO - PROCESS | 3463 | _x_x_mozilla_page_load_details 09:37:28 INFO - PROCESS | 3463 | |i|pagename|runs| 09:37:28 INFO - PROCESS | 3463 | |0;dojo.html;3004.384101259242;3021.3050998270382;3021.4108248891475;3032.1813110460175;3049.283418396677;5173.974130129353;5207.5573576246015;5226.398964119127;5271.103912334903;5283.603729720267;5126.7436628168625;5216.452272511388;5226.529612334889;5245;5284.920726189111;4793.880152996186;4802.519748025187;4893.632977526682;4897.926531102036;4965.975170124144;4792.472827988919;4852.49048849871;4924.975375123119;4936.481669424713;4976.626752993522;4676.181668208084;4712.057588482283;4833.509684406097;4879.316895634614;4887.266909963499;4637.489876113625;4646.605038571725;4688.390509233812;4696.671233013691;4744.5492678195515;4647.976760116211;4654.371659825914;4663.743494107823;4674.018456124218;4701.435827700664;5104.285400043997;5131.281620573122;5150.227465880148;5226.477352264781;5256.710880901549;5508.228847961289;5671.63134396267;5683.261176047087;5717.857053573653;5781.277340332458;5753.971230143864;5775.48020678141;5776.508996735282;5783.190353350535;5783.5084017858535;5377.7311134443125;5385.596080293915;5385.703786291713;5391.838244852661;5395.163749618815;5505.174223866452;5529.281193444826;5609;5613.607047506635;5634.802781902614;5448.673079615236;5461.6996065216;5463.508284254436;5466.945330546644;5512.3385193777;5490.972545137249;5498.725063746797;5546.750396232099;5554.166874968706;5566.997940370691;5435.755391007414;5462.918056229159;5466.043442397565;5496.0107180707855;5537.169424586345;5522.723863806794;5523.806666766724;5524.392316845144;5532.474414930575;5579.553635709133;4281.7645029523055;4287.7641729705165;4288.764117973541;4296.4414626098405;4339.82640694375;3811.542614886176;3820.331441997639;3852.114013776791;3860.1121741998936;3876.9418458723144;5370.650907690988;5416.295881535454;5422.3764267109;5426.538744206708;5456.563474921997;5675.31896172462;5698;5719.456651618089;5721;5731.799387021434;5309.070912590281;5383.300170977826;5384.461553844662;5432.130859062531;5490.368607610176;4934.777934992934;4952.479989601112;4982.177940639826;4998.400191976913;5002.89994200114;5873.3832947539895;5949.315828679671;5952.166696662471;5952.523798096142;5964.135200396005;5532.640378375393;5584.497395234448;5679.9148012779015;5685.772569097356;5695.686737229492;5862.062070068769;5955.91066134017;5975.223220981245;5990.281166260077;6056.212692349966;5617.494425501724;5633.126865335879;5669.54643628517;5669.659820410789;5670.007748643889;5530.5022547970875;5756.683382414008;5767.250257466502;5772.191893135048;5778.451047150514;5423.728813559385;5487.176923461353;5517.337919449692;5530.7511161997;5586.86032849182;5501.394846566955;5510.614257001971;5510.834674959758;5515.503604675599;5521.365043020104;5371.838844834661;5448.509634132947;5472.2065300531995;5488.313960754906;5504.174373843955;5549.861253468695;5586.581006424616;5628.986782379047;5648.011597970421;5708.972384970745;5480.91778623313;5510.173473978775;5516.641418307797;5525.11598144295;5538.501534861882 09:37:28 INFO - PROCESS | 3463 | |1;ext.html;563.5266376243956;567.0898208375557;575.0540361105978;586.103262009126;589.5165963909594;39480.802595987014;41399.379009314805;41614.37578436322;45349.77325113378;45410.54589454104;42967.57032429675;43061.569384306145;43652.781736091354;43777.343339849846;43997.56002439975;8718.084601116887;8857.158569935878;8863.689770858022;8879.955600222022;8882.467051976902;8679.088695686956;8694.608742606599;8701.869471957925;8779.297656187522;8813.779655508599;8868.955655221747;8881.289496840238;8896.777580560505;8926.330525210635;8926.553672316391;8814.030456649763;8842.5136617486;8855.42439741418;8856.911430885673;8876.644934202624;8538;8581.485110893367;8600;8618.396712230146;8633.697820576312;40689.59310406917;40704;40749.592504075175;40996.1800763986;41075.38386924199;3256.153400115963;3289.1777055736065;3299.851506682205;3350.2964377480757;3777.2445510897655;28473.71526284752;30973.69026309753;31009.224769380722;31053.689463105307;31103;3906.511686039245;4164.937525937114;4217.8523751668545;4228.9154216915485;4378.6934914555995;328454;332507.7368423687;333148;333244;334197;58805.41194588085;59238.407615923286;59308.7034564833;59380.406195938354;59643;60604.69697651484;60761.784764305354;61074.69462652658;61238;61297.693511532154;15991.36034558628;16120.919395402949;16316;16347.264373103239;16353.509394718178;11492.367919764327;11992.760144797056;12006.759864802654;12056.397180140957;12294.75410491785;16999.23503442348;17920.641587168182;18039.72940405895;18098.81901180971;18107.45677629673;6685.899711504331;6942.687579058955;7133.357997780121;7177.7487787927175;7220.169680486706;800.9439339246197;956.9234461243084;959.3284700709531;961.8986260731563;979.314479864098;29615.555766663085;30809.383812323627;31517.212069698442;31929;33641;1009.3287963504334;1039.3815679670583;1074.2641290715885;1082.53992053377;1116.7319843237565;15447.768283475756;15718.449854255046;16062.678746425006;16139.193040347936;16242.269097890623;508903;513596;513994;514077;514722;54994.450055498935;55068;55328.72335638296;55458.72270638621;55696;1292.9612111636666;1318.064174436161;1357.7080927600614;1361.5302720561192;1372.8558501357413;29839.254018649706;31055.68944310528;31487.766475895885;32002;32321.838390807894;48198.518014819405;48715.5128448711;48737.26894096662;48877.26684099813;48938.0212395743;380618;383175;383878;384142;385893;28178.577321339788;28380.290492737848;28537.28656783514;28555.143345699664;28574.285642858264;44537.33194002158;44865.77567112144;44942;46074.30888536742;46147.76926115348;38697.4195387075;38891.910366885364;39324.01689957774;39353;40143.39784903287;37758.43362349622;38324.42513362246;38380.23239535138;38892.2221555573;39510.40734388929;37873.24253514969;39438.605613944645;39747.80126099351;39873;40039.599604004754;31134.22164445907;34147.829260853534;34863.47704784481;34908.65091349054;35672.108197295274;26456.338591535365;26681.733182667926;26903.596446053718;27039.729602703723;27318.863405682845 09:37:28 INFO - PROCESS | 3463 | |2;jquery.html;395.7150851387002;395.82979318892865;401.3858796042057;402.9798510074496;421.26279011729474;17667.293308267668;18518.35185768495;19295.938723370207;19334.51663708408;19352.322668706616;18323.81676183238;18403.631927361446;18788.906055469703;18859.245630174777;18996.24015039397;5589.385167631567;5609.80365687201;5750.1949727038245;5765.913511297313;5834.474897259267;5492.505674489295;5715.399883012286;5777.59556831022;5788.218590490272;5794.188813566104;5498.560115190775;5667.121596152582;5684.8294551163535;5702.116171993348;5792.218050563183;5683.488486036256;5737.627054241502;5742.196092547047;5752.252207213057;5770.79802206925;4956.207006878918;5108.591312694975;5119.59043276537;5136.306598609177;5137.48625137487;18460.07699615014;18490.2603895844;18522.53693657656;22337.441563960867;22405.88797056004;2453.7546245375497;2494.1395218649536;2871.8133321334253;3042.8439574835484;3050.9847450762827;14001.5099471518;14050.718985620231;14498.202598857059;14996.775048374284;15142;1869.2709843161178;1904.7428597139346;1947.3184385464974;1961.1959096770256;1962.1758861278297;78468;79358.20641793565;80140.59929700372;81346.18653813445;81706;10506.212034097472;10562.577496900192;10733.195010374253;10753.978372054642;11722.765544689059;15260.618484537976;15326.15706136151;15371.15546134471;15496.612584685474;15535.922320388325;8120.309773669186;8370.707025254087;8388;8559.914400855912;8602.655893764304;8012.479188852706;8098.676052957816;8134.389920755849;8318.168183181633;8358.080611132771;6413.6793160341795;6500.187476565429;6614.933850661432;6681.532292739559;6734.932650673529;1933.9129739161772;1952.716856055864;1955.247229816531;1996.4409965209763;2000.0799232736445;822.7531740477833;863.736560349087;869.8999615044224;884.9955750221336;956.3831328793028;16838.663226735396;17275.654486910193;17883.37408190707;17909.552261193574;18625.90687046583;903.4534106865252;926.6339795780628;937.1846493550654;937.1986951156663;947.7346343023964;7139.464540159509;10237.539310731036;10241.84637230442;10280.485975701185;10377.377357358582;437700;439155;445111;446506;447703;76189.23810761822;76424.61787691026;81579;81778;81884;1030.7165529479303;1035.7410647338165;1044.5195210203392;1074.8280275155937;1076.6662334676275;15569.377224910877;15762.921185394;15809.604759880634;16298.592535186715;16391.67216655684;36878.446823297134;37676.81161594175;38173.61826381701;38505;38600.80699596484;51682.22476662928;52941.20588191103;53905.73047134739;62244.37755622386;62743.372566273756;8035.437519373588;8513.446625969293;8543.829123417621;8664.176903194186;8836.558172091498;10440.582376704846;12791.680207994874;12825.935870320589;12951.417186226454;13127.606171814861;10478.476076196008;10732.46337683097;10759.46202689878;11113.777724445305;11397.607626932933;11264.887351126385;11433.942830285796;11525;11881.831403339575;12044.939775301067;11197.832032519682;11493.770124597628;11533.88466115328;11954.103442241692;11962.880371196177;8054.154313797201;8380.16198380157;8487.321014318963;8751.256143227896;8813.33899957493;9021.50381728985;11043.171762117712;11164.49759760829;11263.155263355446;11363.54545818191 09:37:28 INFO - PROCESS | 3463 | |3;mootools.html;1429.3853642933539;1432.0834665813882;1585.6749366379893;1702.5913780692622;1723.6638855423198;7917.445778795487;8098.67605295789;8439.831203375936;9302.976672566021;9313.394629349095;8597.699080532182;8877.778055548615;8880.978687450945;9129.17837394636;9136.31477639178;2284.8629082255075;2327.080803082781;2336.766323367658;2340.637201233803;2345.8944347504316;2294.6328587426015;2323.2913961241816;2357.351728274721;2359.079958816063;2360.0441821062414;2293.6674182243564;2308.665243539694;2325.6046472099697;2327.2436458151083;2331.825113116515;2255.4474153832334;2265.4109931417784;2265.4562904902787;2268.2968279833303;2273.6362182050793;2258.232201051634;2275;2279.452931296477;2279.7492275849645;2287.7597852225445;8963.910360896372;9073.727788166365;9157.450552966844;9203.171714545722;9242.86135707965;5086.643934924557;5212.973935130338;5242.895142097175;5257.08001099806;5261.605379596507;3195.1692559934354;3243.5621191139367;3391.830408479591;3431.3995050866247;3445.3626079175433;1058.5025038232018;1058.5501162006117;1078.724925144091;1102.5699977008974;1124.3647339253378;12185.695357616041;12226.694332641666;12250.938745306306;12355.75288494225;12417.75164496705;4362.258416069276;4370.934435983463;4525.479569849444;4603.8849028773875;4609.2394754865745;10243;10370.014848589371;10371.688849334532;10392;10439.739006524898;5211.062008838369;5212.9739351303;5268.15709486488;5279.894402111936;5279.947200527946;4379.802908869108;4499.325101234841;4799.9760001199775;4865.367502224688;4890.095332363524;3840.135969406917;3900.6489415952133;3933.9213215735526;3969.6030396960073;4138.52406973196;1308.3915979069777;1308.8822006019504;1321.5506727712432;1325.509561462265;1327.9004074694437;938.1837801112939;949.7625593601599;951.8429459139164;958.5159494455395;974.8391515400021;5916.674582897982;6098.420650038239;6122.479589234876;6129.601575897642;6217;445.4387471785574;448.2894612039888;450.2773049255897;450.82417857035784;454.8840045788369;4154.646855017297;4161.25097482456;4170.645495132948;4181.414601955728;4195.307774217281;10691.41197234144;11033.558657653764;11111.944440277908;11113.444327783578;11286.435678216221;10999.560017599206;11055.72360690989;11155.219134660658;11186.888131118747;11196.496157672924;7907.604619768988;8122.228388303101;8253.298469630148;8270.751877443567;8380.371472139614;6100.328963813889;6169.753209871555;6335.809925702236;6408.23101227837;6415.101885736094;9822.803543929223;10321.48392580383;10439.425831579336;10538.78922421532;10578.8942110581;10087.949560252151;10110.34282771647;10261.486925653538;10427.843582346422;10562.15502759762;7185.640717964186;7402.481826272109;7815.609219539114;7894.092179399213;8074.515529068275;8753.12468753145;8898.644054237759;8906.86639700418;8911.108889111038;8962.68630597952;7657.4256930731535;7710.306072453506;7728.690852365842;7890.053193616803;7981.361491080584;7284.198738138906;7601.581912994839;7701.3068823806125;7709.845803083795;7999.880001799861;7227.168875579376;7300.379467745302;7340.853182936205;7359.963200183965;7360.969464274899;4966.801327946986;5055.6713813602;5077.543021128116;5152.124138896322;5370.087085195604;5119.974400127976;5136.563392111712;5200.531952124327;5326.813561525328;5393.784248630011 09:37:28 INFO - PROCESS | 3463 | |4;prototype.html;342.55125785221355;346.10876991746244;351.87992346114675;353.99823000884993;360.4701089398585;5456.8090116845915;5544.059579147296;5545.667259964405;5558.805441809537;5572.972135139329;5357.196420536921;5427.294451721271;5428.511433970942;5436.972815135929;5440.727963601814;4023.4568333274924;4208.663306935453;4243.745375277478;4247;4285.842822437948;4198.6011328923705;4204.159168166364;4227.8308867645255;4237.936430953539;4238.830446782141;3994.9001274968214;4189.63836753055;4247.320428731404;4250.279820914617;4262.552431994643;4022.678185745148;4100.487439070116;4181.60274773896;4190.790460476964;4195.244855925932;3703.5926048134684;3705.94441083384;3709.6104908984707;3711.5731690855628;3720.5163328767358;5273.578113750891;5299.814506492293;5307.893842123174;5308.495692909206;5316.38861530925;4599.517050709695;4834.2990266411525;4849.612031037544;4855.854324370274;4868.196747536652;5662.801801936954;5669.546436285129;5700.344460387026;5726.141078838166;5742.253507044099;4117.876463706094;4138.482689663792;4141.7929103545;4145.730527515701;4158.875233742992;5660.773569057233;5889.146073819358;5895.705214739289;5909.852253693692;5956.37458066901;4150.481189851269;4179.477565304337;4182.619735487282;4182.937255941163;4214.578542145761;4240.448741663564;4247.5540068293;4249.618873866006;4252.808623611945;4253.97873010633;4665.300204969281;4820.373351464287;4832.903341933142;4843.878903027453;4860.8298709545;5701.173329867146;5708.771649134072;5718.370979192286;5736.598438109292;5751.849630074002;1422.9928850355889;1434.2470203143432;1447.9638009049647;1454.1347898000672;1455.86169313915;961.7211008807368;1021.7956408718137;1024.7694268789612;1029.3000759483623;1040.547361897577;5524.558035357162;5560.666360018412;5563.582731295169;5585.525230355465;5608.738033942331;5779.739911703983;5795.246617939725;5849.210356601804;5865.67738774363;5882.647041177543;5332.440093790096;5395.325584301962;5550.389457159709;5580.246666700024;5636.154576813511;3070.3245286037036;3095.637919315494;3106.968930310668;3122.828244446577;3123.9687603124135;5746.913796293059;6059.303609893644;6081.604695694766;6098.72555734993;6119.4089536719885;6000.849978750566;6012.789552365646;6022.2171117754415;6036.185115009417;6053.909191362133;6178.443940045418;6185.84535386619;6192.907106393408;6197.349278325801;6220.688965551795;5564.360098588552;5821.650700957956;5845.327787304344;5873.618214816023;5994;5780.21967034445;5841.816210165385;5845.444682755132;5861.677607731615;5872.236609240771;5867;6032.832762799565;6047.727852246571;6092.390760923872;6109.69451527413;4173.9582604173565;4194.266003449323;4217.135487225173;4244.4906611205615;4284.635805956404;5938.524918006636;5942.31663358702;5966.463018328372;5995.310539288038;6011.218541589566;5672.631278966854;5696.316442026983;5701.230333904869;5703.572232082527;5832.658488547573;5730.312362516524;5733.197352370588;5765.4522820332;5777.306723193244;5843.590948633725;5580.046983555885;5750.223719797774;5800.216970709069;5825.2135961644635;5830.154627579062;5739.397363276963;5801.738921748447;5809.651420914759;5828.562857785599;5848.707564621667;5709.600327977002;5756.94243057564;5763.308402991668;5775.364709881994;5776.480116789509 09:37:28 INFO - PROCESS | 3463 | |5;yui.html;690.5131882023172;706.798562409713;719.9424046076311;759.5556599389358;764.8967389402429;15085.321160547774;16340.591485212875;16350.182490875468;16429.42497012605;16434.753478697814;13840.169589824618;13948.326200855912;13971.022028458012;14000.369983350749;14030.368633411495;640.0750914927931;649.0167396394443;767.263427109975;770.2451597434517;785.8624740670389;776.4952780692538;780.8828675698634;781.7303030454484;785.7917651822272;786.4691333349995;828.204923273658;830.2195935820309;831.6423937706784;832.267604508032;833.5207255827924;821.0516853034754;821.4537332673765;829.7427797382801;831.8419500294924;833.3624777045565;603.1043899808781;603.1676286724336;604.0908432808595;605.3552966091142;606.8391876152779;15356.923215383964;15457.690846183126;15532.611684707972;15558.066516009076;15566.22168891551;15152.469663561722;15202.391904323813;15227.695446091016;15328.540143795704;15513.689726205414;11887.465064072137;12079.456424460921;12269.345089668634;12327.383630818424;12414.75170496594;3838.865639702625;3867.961320386816;3870.0905287257474;3872.1287710265246;3965.722399432041;77416;79487.20512794914;79581.60209198974;80758;81331.5933420335;11477.827832582518;11529.769404611861;11548;11591.710207244887;11707.648770536898;22703.091876325092;22704.205352812573;22802.543949120925;22866.885665571564;22867.542649146922;7562.773116806505;7724.3434308083315;8161;8195.221453961864;8256.339492840678;4493.842715504941;4539.6368290536675;4558.772061396917;4560.749158796298;4596.5403459654435;3518.2435776308216;3720.981395093007;3725.925481490355;3745.382011967995;3750.5311836020496;603.8399824046631;607.1590846677295;611.3275397063195;619.2414292491661;627.0594108836744;551.837208023634;679.8572299817093;690.2441826200303;697.4455308030128;743.382992116542;9070.591823367964;9275.524419655552;9729.39711085635;10540.367577945348;10567;672.5124284893511;703.3599424523761;708.8830342993348;716.9820754481179;724.2323137474294;4491.618212451913;4914.36113305268;5037.800926732418;5042.773075211624;5075.238714192827;111521.44239278913;115579;116020;118064;120372;79679.20320796718;90250;102608;107768;108090.45954770333;75756.62121689356;81909;82241.58879205685;83692;89169.55415222883;9282.535873206447;9500.287478439006;9776.413415195111;9846;9990.150837178631;49429.75285123551;50399.24401134059;50421.49578504168;50890.491095088575;52872;69065;69530.65234673794;77013.2298677006;77363.2263677356;77613;12867.678308042374;13059.869401305865;13165.47338106465;13190.60428187156;13280.53518126861;14199;14886.255687215813;14921.477748278758;15076;15142.864285178435;13295.66760830987;13582.59252222435;13792.724145516833;14287.357068931715;14302.96404879616;13601;13700.65748356299;13718.45126194941;13829;14283.500077497238;13543.86456135426;14084;14179.291035448392;14212.928935355258;14377.928110359382;10663.573457061631;10808.945955270174;10987.945060274968;11103.333799972028;11142.610008649659;9588.66439674608;10049.397036177852;11269.211155219056;11289.548418063185;11576.768464630828 09:37:28 INFO - PROCESS | 3463 | __end_tp_report 09:37:28 INFO - PROCESS | 3463 | __start_cc_report 09:37:28 INFO - PROCESS | 3463 | _x_x_mozilla_cycle_collect,313 09:37:28 INFO - PROCESS | 3463 | __end_cc_report 09:37:28 INFO - PROCESS | 3463 | __startTimestamp1476203848765__endTimestamp 09:37:28 INFO - PROCESS | 3463 | 09:37:28 INFO - PROCESS | 3463 | ------- Summary: start ------- 09:37:28 INFO - PROCESS | 3463 | Number of tests: 6 09:37:28 INFO - PROCESS | 3463 | 09:37:28 INFO - PROCESS | 3463 | [#0] dojo.html Cycles:165 Average:5247.74 Median:5466.04 stddev:608.21 (11.1%) stddev-sans-first:584.05 09:37:28 INFO - PROCESS | 3463 | Values: 3004.4 3021.3 3021.4 3032.2 3049.3 5174.0 5207.6 5226.4 5271.1 5283.6 5126.7 5216.5 5226.5 5245.0 5284.9 4793.9 4802.5 4893.6 4897.9 4966.0 4792.5 4852.5 4925.0 4936.5 4976.6 4676.2 4712.1 4833.5 4879.3 4887.3 4637.5 4646.6 4688.4 4696.7 4744.5 4648.0 4654.4 4663.7 4674.0 4701.4 5104.3 5131.3 5150.2 5226.5 5256.7 5508.2 5671.6 5683.3 5717.9 5781.3 5754.0 5775.5 5776.5 5783.2 5783.5 5377.7 5385.6 5385.7 5391.8 5395.2 5505.2 5529.3 5609.0 5613.6 5634.8 5448.7 5461.7 5463.5 5466.9 5512.3 5491.0 5498.7 5546.8 5554.2 5567.0 5435.8 5462.9 5466.0 5496.0 5537.2 5522.7 5523.8 5524.4 5532.5 5579.6 4281.8 4287.8 4288.8 4296.4 4339.8 3811.5 3820.3 3852.1 3860.1 3876.9 5370.7 5416.3 5422.4 5426.5 5456.6 5675.3 5698.0 5719.5 5721.0 5731.8 5309.1 5383.3 5384.5 5432.1 5490.4 4934.8 4952.5 4982.2 4998.4 5002.9 5873.4 5949.3 5952.2 5952.5 5964.1 5532.6 5584.5 5679.9 5685.8 5695.7 5862.1 5955.9 5975.2 5990.3 6056.2 5617.5 5633.1 5669.5 5669.7 5670.0 5530.5 5756.7 5767.3 5772.2 5778.5 5423.7 5487.2 5517.3 5530.8 5586.9 5501.4 5510.6 5510.8 5515.5 5521.4 5371.8 5448.5 5472.2 5488.3 5504.2 5549.9 5586.6 5629.0 5648.0 5709.0 5480.9 5510.2 5516.6 5525.1 5538.5 09:37:28 INFO - PROCESS | 3463 | 09:37:28 INFO - PROCESS | 3463 | [#1] ext.html Cycles:180 Average:56943.16 Median:40091.50 stddev:110330.51 (275.2%) stddev-sans-first:110558.81 09:37:28 INFO - PROCESS | 3463 | Values: 563.5 567.1 575.1 586.1 589.5 39480.8 41399.4 41614.4 45349.8 45410.5 42967.6 43061.6 43652.8 43777.3 43997.6 8718.1 8857.2 8863.7 8880.0 8882.5 8679.1 8694.6 8701.9 8779.3 8813.8 8869.0 8881.3 8896.8 8926.3 8926.6 8814.0 8842.5 8855.4 8856.9 8876.6 8538.0 8581.5 8600.0 8618.4 8633.7 40689.6 40704.0 40749.6 40996.2 41075.4 3256.2 3289.2 3299.9 3350.3 3777.2 28473.7 30973.7 31009.2 31053.7 31103.0 3906.5 4164.9 4217.9 4228.9 4378.7 328454.0 332507.7 333148.0 333244.0 334197.0 58805.4 59238.4 59308.7 59380.4 59643.0 60604.7 60761.8 61074.7 61238.0 61297.7 15991.4 16120.9 16316.0 16347.3 16353.5 11492.4 11992.8 12006.8 12056.4 12294.8 16999.2 17920.6 18039.7 18098.8 18107.5 6685.9 6942.7 7133.4 7177.7 7220.2 800.9 956.9 959.3 961.9 979.3 29615.6 30809.4 31517.2 31929.0 33641.0 1009.3 1039.4 1074.3 1082.5 1116.7 15447.8 15718.4 16062.7 16139.2 16242.3 508903.0 513596.0 513994.0 514077.0 514722.0 54994.5 55068.0 55328.7 55458.7 55696.0 1293.0 1318.1 1357.7 1361.5 1372.9 29839.3 31055.7 31487.8 32002.0 32321.8 48198.5 48715.5 48737.3 48877.3 48938.0 380618.0 383175.0 383878.0 384142.0 385893.0 28178.6 28380.3 28537.3 28555.1 28574.3 44537.3 44865.8 44942.0 46074.3 46147.8 38697.4 38891.9 39324.0 39353.0 40143.4 37758.4 38324.4 38380.2 38892.2 39510.4 37873.2 39438.6 39747.8 39873.0 40039.6 31134.2 34147.8 34863.5 34908.7 35672.1 26456.3 26681.7 26903.6 27039.7 27318.9 09:37:28 INFO - PROCESS | 3463 | 09:37:28 INFO - PROCESS | 3463 | [#2] jquery.html Cycles:180 Average:27076.93 Median:38339.31 stddev:73049.07 (190.5%) stddev-sans-first:73226.52 09:37:28 INFO - PROCESS | 3463 | Values: 395.7 395.8 401.4 403.0 421.3 17667.3 18518.4 19295.9 19334.5 19352.3 18323.8 18403.6 18788.9 18859.2 18996.2 5589.4 5609.8 5750.2 5765.9 5834.5 5492.5 5715.4 5777.6 5788.2 5794.2 5498.6 5667.1 5684.8 5702.1 5792.2 5683.5 5737.6 5742.2 5752.3 5770.8 4956.2 5108.6 5119.6 5136.3 5137.5 18460.1 18490.3 18522.5 22337.4 22405.9 2453.8 2494.1 2871.8 3042.8 3051.0 14001.5 14050.7 14498.2 14996.8 15142.0 1869.3 1904.7 1947.3 1961.2 1962.2 78468.0 79358.2 80140.6 81346.2 81706.0 10506.2 10562.6 10733.2 10754.0 11722.8 15260.6 15326.2 15371.2 15496.6 15535.9 8120.3 8370.7 8388.0 8559.9 8602.7 8012.5 8098.7 8134.4 8318.2 8358.1 6413.7 6500.2 6614.9 6681.5 6734.9 1933.9 1952.7 1955.2 1996.4 2000.1 822.8 863.7 869.9 885.0 956.4 16838.7 17275.7 17883.4 17909.6 18625.9 903.5 926.6 937.2 937.2 947.7 7139.5 10237.5 10241.8 10280.5 10377.4 437700.0 439155.0 445111.0 446506.0 447703.0 76189.2 76424.6 81579.0 81778.0 81884.0 1030.7 1035.7 1044.5 1074.8 1076.7 15569.4 15762.9 15809.6 16298.6 16391.7 36878.4 37676.8 38173.6 38505.0 38600.8 51682.2 52941.2 53905.7 62244.4 62743.4 8035.4 8513.4 8543.8 8664.2 8836.6 10440.6 12791.7 12825.9 12951.4 13127.6 10478.5 10732.5 10759.5 11113.8 11397.6 11264.9 11433.9 11525.0 11881.8 12044.9 11197.8 11493.8 11533.9 11954.1 11962.9 8054.2 8380.2 8487.3 8751.3 8813.3 9021.5 11043.2 11164.5 11263.2 11363.5 09:37:28 INFO - PROCESS | 3463 | 09:37:28 INFO - PROCESS | 3463 | [#3] mootools.html Cycles:180 Average:5844.37 Median:450.55 stddev:3374.78 (749.0%) stddev-sans-first:3367.94 09:37:28 INFO - PROCESS | 3463 | Values: 1429.4 1432.1 1585.7 1702.6 1723.7 7917.4 8098.7 8439.8 9303.0 9313.4 8597.7 8877.8 8881.0 9129.2 9136.3 2284.9 2327.1 2336.8 2340.6 2345.9 2294.6 2323.3 2357.4 2359.1 2360.0 2293.7 2308.7 2325.6 2327.2 2331.8 2255.4 2265.4 2265.5 2268.3 2273.6 2258.2 2275.0 2279.5 2279.7 2287.8 8963.9 9073.7 9157.5 9203.2 9242.9 5086.6 5213.0 5242.9 5257.1 5261.6 3195.2 3243.6 3391.8 3431.4 3445.4 1058.5 1058.6 1078.7 1102.6 1124.4 12185.7 12226.7 12250.9 12355.8 12417.8 4362.3 4370.9 4525.5 4603.9 4609.2 10243.0 10370.0 10371.7 10392.0 10439.7 5211.1 5213.0 5268.2 5279.9 5279.9 4379.8 4499.3 4800.0 4865.4 4890.1 3840.1 3900.6 3933.9 3969.6 4138.5 1308.4 1308.9 1321.6 1325.5 1327.9 938.2 949.8 951.8 958.5 974.8 5916.7 6098.4 6122.5 6129.6 6217.0 445.4 448.3 450.3 450.8 454.9 4154.6 4161.3 4170.6 4181.4 4195.3 10691.4 11033.6 11111.9 11113.4 11286.4 10999.6 11055.7 11155.2 11186.9 11196.5 7907.6 8122.2 8253.3 8270.8 8380.4 6100.3 6169.8 6335.8 6408.2 6415.1 9822.8 10321.5 10439.4 10538.8 10578.9 10087.9 10110.3 10261.5 10427.8 10562.2 7185.6 7402.5 7815.6 7894.1 8074.5 8753.1 8898.6 8906.9 8911.1 8962.7 7657.4 7710.3 7728.7 7890.1 7981.4 7284.2 7601.6 7701.3 7709.8 7999.9 7227.2 7300.4 7340.9 7360.0 7361.0 4966.8 5055.7 5077.5 5152.1 5370.1 5120.0 5136.6 5200.5 5326.8 5393.8 09:37:28 INFO - PROCESS | 3463 | 09:37:28 INFO - PROCESS | 3463 | [#4] prototype.html Cycles:180 Average:4831.40 Median:5554.60 stddev:1429.92 (25.7%) stddev-sans-first:1393.67 09:37:28 INFO - PROCESS | 3463 | Values: 342.6 346.1 351.9 354.0 360.5 5456.8 5544.1 5545.7 5558.8 5573.0 5357.2 5427.3 5428.5 5437.0 5440.7 4023.5 4208.7 4243.7 4247.0 4285.8 4198.6 4204.2 4227.8 4237.9 4238.8 3994.9 4189.6 4247.3 4250.3 4262.6 4022.7 4100.5 4181.6 4190.8 4195.2 3703.6 3705.9 3709.6 3711.6 3720.5 5273.6 5299.8 5307.9 5308.5 5316.4 4599.5 4834.3 4849.6 4855.9 4868.2 5662.8 5669.5 5700.3 5726.1 5742.3 4117.9 4138.5 4141.8 4145.7 4158.9 5660.8 5889.1 5895.7 5909.9 5956.4 4150.5 4179.5 4182.6 4182.9 4214.6 4240.4 4247.6 4249.6 4252.8 4254.0 4665.3 4820.4 4832.9 4843.9 4860.8 5701.2 5708.8 5718.4 5736.6 5751.8 1423.0 1434.2 1448.0 1454.1 1455.9 961.7 1021.8 1024.8 1029.3 1040.5 5524.6 5560.7 5563.6 5585.5 5608.7 5779.7 5795.2 5849.2 5865.7 5882.6 5332.4 5395.3 5550.4 5580.2 5636.2 3070.3 3095.6 3107.0 3122.8 3124.0 5746.9 6059.3 6081.6 6098.7 6119.4 6000.8 6012.8 6022.2 6036.2 6053.9 6178.4 6185.8 6192.9 6197.3 6220.7 5564.4 5821.7 5845.3 5873.6 5994.0 5780.2 5841.8 5845.4 5861.7 5872.2 5867.0 6032.8 6047.7 6092.4 6109.7 4174.0 4194.3 4217.1 4244.5 4284.6 5938.5 5942.3 5966.5 5995.3 6011.2 5672.6 5696.3 5701.2 5703.6 5832.7 5730.3 5733.2 5765.5 5777.3 5843.6 5580.0 5750.2 5800.2 5825.2 5830.2 5739.4 5801.7 5809.7 5828.6 5848.7 5709.6 5756.9 5763.3 5775.4 5776.5 09:37:28 INFO - PROCESS | 3463 | 09:37:28 INFO - PROCESS | 3463 | [#5] yui.html Cycles:180 Average:20862.02 Median:4516.74 stddev:29938.33 (662.8%) stddev-sans-first:29984.00 09:37:28 INFO - PROCESS | 3463 | Values: 690.5 706.8 719.9 759.6 764.9 15085.3 16340.6 16350.2 16429.4 16434.8 13840.2 13948.3 13971.0 14000.4 14030.4 640.1 649.0 767.3 770.2 785.9 776.5 780.9 781.7 785.8 786.5 828.2 830.2 831.6 832.3 833.5 821.1 821.5 829.7 831.8 833.4 603.1 603.2 604.1 605.4 606.8 15356.9 15457.7 15532.6 15558.1 15566.2 15152.5 15202.4 15227.7 15328.5 15513.7 11887.5 12079.5 12269.3 12327.4 12414.8 3838.9 3868.0 3870.1 3872.1 3965.7 77416.0 79487.2 79581.6 80758.0 81331.6 11477.8 11529.8 11548.0 11591.7 11707.6 22703.1 22704.2 22802.5 22866.9 22867.5 7562.8 7724.3 8161.0 8195.2 8256.3 4493.8 4539.6 4558.8 4560.7 4596.5 3518.2 3721.0 3725.9 3745.4 3750.5 603.8 607.2 611.3 619.2 627.1 551.8 679.9 690.2 697.4 743.4 9070.6 9275.5 9729.4 10540.4 10567.0 672.5 703.4 708.9 717.0 724.2 4491.6 4914.4 5037.8 5042.8 5075.2 111521.4 115579.0 116020.0 118064.0 120372.0 79679.2 90250.0 102608.0 107768.0 108090.5 75756.6 81909.0 82241.6 83692.0 89169.6 9282.5 9500.3 9776.4 9846.0 9990.2 49429.8 50399.2 50421.5 50890.5 52872.0 69065.0 69530.7 77013.2 77363.2 77613.0 12867.7 13059.9 13165.5 13190.6 13280.5 14199.0 14886.3 14921.5 15076.0 15142.9 13295.7 13582.6 13792.7 14287.4 14303.0 13601.0 13700.7 13718.5 13829.0 14283.5 13543.9 14084.0 14179.3 14212.9 14377.9 10663.6 10808.9 10987.9 11103.3 11142.6 9588.7 10049.4 11269.2 11289.5 11576.8 09:37:28 INFO - PROCESS | 3463 | -------- Summary: end -------- 09:37:28 INFO - PROCESS | 3463 | 09:37:29 INFO - TEST-INFO | 3463: exit 0 09:37:29 INFO - TEST-OK | dromaeo_css | took 1116768ms 09:37:29 INFO - TEST-START | kraken 09:37:29 INFO - operating with platform_type : linux_ 09:37:29 INFO - Initialising browser for kraken test... 09:37:29 INFO - TEST-INFO | started process 3828 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp3QQBxt/profile http://localhost:41255/getInfo.html) 09:37:34 INFO - PROCESS | 3828 | __metrics Screen width/height:1600/1200 09:37:34 INFO - PROCESS | 3828 | colorDepth:24 09:37:34 INFO - PROCESS | 3828 | Browser inner width/height: 1024/697 09:37:34 INFO - PROCESS | 3828 | __metrics 09:37:34 ERROR - PROCESS | 3828 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3083: TypeError: this.tabs is undefined 09:37:35 INFO - TEST-INFO | 3828: exit 0 09:37:35 INFO - Browser initialized. 09:37:35 INFO - Running cycle 1/1 for kraken test... 09:37:35 INFO - TEST-INFO | started process 3952 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp3QQBxt/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:37:47 INFO - PROCESS | 3952 | RSS: Main: 184733696 09:37:47 INFO - PROCESS | 3952 | 09:37:50 INFO - PROCESS | 3952 | Cycle 1(1): loaded http://localhost:41255/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41255/tests/kraken/driver.html?testName=audio-beat-detection) 09:37:51 INFO - PROCESS | 3952 | RSS: Main: 198463488 09:37:51 INFO - PROCESS | 3952 | 09:37:54 INFO - PROCESS | 3952 | Cycle 1(1): loaded http://localhost:41255/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41255/tests/kraken/driver.html?testName=audio-dft) 09:37:54 INFO - PROCESS | 3952 | RSS: Main: 196403200 09:37:54 INFO - PROCESS | 3952 | 09:37:57 INFO - PROCESS | 3952 | Cycle 1(1): loaded http://localhost:41255/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41255/tests/kraken/driver.html?testName=audio-fft) 09:37:58 INFO - PROCESS | 3952 | RSS: Main: 191864832 09:37:58 INFO - PROCESS | 3952 | 09:38:00 INFO - PROCESS | 3952 | Cycle 1(1): loaded http://localhost:41255/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41255/tests/kraken/driver.html?testName=audio-oscillator) 09:38:01 INFO - PROCESS | 3952 | RSS: Main: 192389120 09:38:01 INFO - PROCESS | 3952 | 09:38:03 INFO - PROCESS | 3952 | Cycle 1(1): loaded http://localhost:41255/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41255/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:38:03 INFO - PROCESS | 3952 | RSS: Main: 192405504 09:38:03 INFO - PROCESS | 3952 | 09:38:07 INFO - PROCESS | 3952 | Cycle 1(1): loaded http://localhost:41255/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41255/tests/kraken/driver.html?testName=imaging-darkroom) 09:38:07 INFO - PROCESS | 3952 | RSS: Main: 192864256 09:38:07 INFO - PROCESS | 3952 | 09:38:11 INFO - PROCESS | 3952 | Cycle 1(1): loaded http://localhost:41255/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41255/tests/kraken/driver.html?testName=imaging-desaturate) 09:38:11 INFO - PROCESS | 3952 | RSS: Main: 190828544 09:38:11 INFO - PROCESS | 3952 | 09:38:14 INFO - PROCESS | 3952 | Cycle 1(1): loaded http://localhost:41255/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41255/tests/kraken/driver.html?testName=json-parse-financial) 09:38:15 INFO - PROCESS | 3952 | RSS: Main: 192135168 09:38:15 INFO - PROCESS | 3952 | 09:38:16 INFO - PROCESS | 3952 | Cycle 1(1): loaded http://localhost:41255/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41255/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:38:17 INFO - PROCESS | 3952 | RSS: Main: 192077824 09:38:17 INFO - PROCESS | 3952 | 09:38:19 INFO - PROCESS | 3952 | Cycle 1(1): loaded http://localhost:41255/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41255/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:38:19 INFO - PROCESS | 3952 | RSS: Main: 192491520 09:38:19 INFO - PROCESS | 3952 | 09:38:21 INFO - PROCESS | 3952 | Cycle 1(1): loaded http://localhost:41255/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41255/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:38:22 INFO - PROCESS | 3952 | RSS: Main: 193171456 09:38:22 INFO - PROCESS | 3952 | 09:38:25 INFO - PROCESS | 3952 | Cycle 1(1): loaded http://localhost:41255/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41255/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:38:26 INFO - PROCESS | 3952 | RSS: Main: 193118208 09:38:26 INFO - PROCESS | 3952 | 09:38:28 INFO - PROCESS | 3952 | Cycle 1(1): loaded http://localhost:41255/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41255/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:38:29 INFO - PROCESS | 3952 | RSS: Main: 193593344 09:38:29 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | Cycle 1(1): loaded http://localhost:41255/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41255/tests/kraken/driver.html?testName=ai-astar) 09:38:31 INFO - PROCESS | 3952 | RSS: Main: 194424832 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | __start_tp_report 09:38:31 INFO - PROCESS | 3952 | _x_x_mozilla_page_load 09:38:31 INFO - PROCESS | 3952 | _x_x_mozilla_page_load_details 09:38:31 INFO - PROCESS | 3952 | |i|pagename|runs| 09:38:31 INFO - PROCESS | 3952 | |0;ai-astar;107;112;113;113;113;115;112;112;111;112 09:38:31 INFO - PROCESS | 3952 | |1;audio-beat-detection;154;127;127;165;126;126;125;123;163;126 09:38:31 INFO - PROCESS | 3952 | |2;audio-dft;162;167;167;173;163;163;163;167;164;161 09:38:31 INFO - PROCESS | 3952 | |3;audio-fft;75;78;78;112;78;76;76;77;117;77 09:38:31 INFO - PROCESS | 3952 | |4;audio-oscillator;82;87;107;83;84;82;111;83;82;115 09:38:31 INFO - PROCESS | 3952 | |5;imaging-gaussian-blur;117;119;118;118;119;118;119;118;119;119 09:38:31 INFO - PROCESS | 3952 | |6;imaging-darkroom;149;148;147;147;147;146;146;150;148;148 09:38:31 INFO - PROCESS | 3952 | |7;imaging-desaturate;95;96;96;96;96;95;95;96;96;95 09:38:31 INFO - PROCESS | 3952 | |8;json-parse-financial;53;53;52;52;56;58;58;56;55;54 09:38:31 INFO - PROCESS | 3952 | |9;json-stringify-tinderbox;60;61;60;60;62;61;61;60;61;60 09:38:31 INFO - PROCESS | 3952 | |10;stanford-crypto-aes;80;82;82;85;79;80;79;79;80;82 09:38:31 INFO - PROCESS | 3952 | |11;stanford-crypto-ccm;145;131;137;137;131;137;141;132;175;140 09:38:31 INFO - PROCESS | 3952 | |12;stanford-crypto-pbkdf2;166;168;166;171;168;170;165;165;170;171 09:38:31 INFO - PROCESS | 3952 | |13;stanford-crypto-sha256-iterative;72;66;66;65;70;70;66;66;72;67 09:38:31 INFO - PROCESS | 3952 | __end_tp_report 09:38:31 INFO - PROCESS | 3952 | __start_cc_report 09:38:31 INFO - PROCESS | 3952 | _x_x_mozilla_cycle_collect,809 09:38:31 INFO - PROCESS | 3952 | __end_cc_report 09:38:31 INFO - PROCESS | 3952 | __startTimestamp1476203911496__endTimestamp 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | ------- Summary: start ------- 09:38:31 INFO - PROCESS | 3952 | Number of tests: 14 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | [#0] ai-astar Cycles:10 Average:112.00 Median:112.50 stddev:2.05 (1.8%) stddev-sans-first:1.13 09:38:31 INFO - PROCESS | 3952 | Values: 107.0 112.0 113.0 113.0 113.0 115.0 112.0 112.0 111.0 112.0 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | [#1] audio-beat-detection Cycles:10 Average:136.20 Median:127.00 stddev:17.15 (13.5%) stddev-sans-first:16.93 09:38:31 INFO - PROCESS | 3952 | Values: 154.0 127.0 127.0 165.0 126.0 126.0 125.0 123.0 163.0 126.0 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | [#2] audio-dft Cycles:10 Average:165.00 Median:165.50 stddev:3.56 (2.2%) stddev-sans-first:3.61 09:38:31 INFO - PROCESS | 3952 | Values: 162.0 167.0 167.0 173.0 163.0 163.0 163.0 167.0 164.0 161.0 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | [#3] audio-fft Cycles:10 Average:84.40 Median:77.00 stddev:15.94 (20.7%) stddev-sans-first:16.54 09:38:31 INFO - PROCESS | 3952 | Values: 75.0 78.0 78.0 112.0 78.0 76.0 76.0 77.0 117.0 77.0 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | [#4] audio-oscillator Cycles:10 Average:91.60 Median:82.50 stddev:13.60 (16.5%) stddev-sans-first:13.97 09:38:31 INFO - PROCESS | 3952 | Values: 82.0 87.0 107.0 83.0 84.0 82.0 111.0 83.0 82.0 115.0 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | [#5] imaging-gaussian-blur Cycles:10 Average:118.40 Median:119.00 stddev:0.70 (0.6%) stddev-sans-first:0.53 09:38:31 INFO - PROCESS | 3952 | Values: 117.0 119.0 118.0 118.0 119.0 118.0 119.0 118.0 119.0 119.0 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | [#6] imaging-darkroom Cycles:10 Average:147.60 Median:148.00 stddev:1.26 (0.9%) stddev-sans-first:1.24 09:38:31 INFO - PROCESS | 3952 | Values: 149.0 148.0 147.0 147.0 147.0 146.0 146.0 150.0 148.0 148.0 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.52 (0.5%) stddev-sans-first:0.50 09:38:31 INFO - PROCESS | 3952 | Values: 95.0 96.0 96.0 96.0 96.0 95.0 95.0 96.0 96.0 95.0 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | [#8] json-parse-financial Cycles:10 Average:54.70 Median:55.50 stddev:2.26 (4.1%) stddev-sans-first:2.32 09:38:31 INFO - PROCESS | 3952 | Values: 53.0 53.0 52.0 52.0 56.0 58.0 58.0 56.0 55.0 54.0 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | [#9] json-stringify-tinderbox Cycles:10 Average:60.60 Median:61.00 stddev:0.70 (1.1%) stddev-sans-first:0.71 09:38:31 INFO - PROCESS | 3952 | Values: 60.0 61.0 60.0 60.0 62.0 61.0 61.0 60.0 61.0 60.0 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | [#10] stanford-crypto-aes Cycles:10 Average:80.80 Median:81.00 stddev:1.93 (2.4%) stddev-sans-first:2.03 09:38:31 INFO - PROCESS | 3952 | Values: 80.0 82.0 82.0 85.0 79.0 80.0 79.0 79.0 80.0 82.0 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | [#11] stanford-crypto-ccm Cycles:10 Average:140.60 Median:138.50 stddev:12.91 (9.3%) stddev-sans-first:13.60 09:38:31 INFO - PROCESS | 3952 | Values: 145.0 131.0 137.0 137.0 131.0 137.0 141.0 132.0 175.0 140.0 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:168.00 Median:169.00 stddev:2.40 (1.4%) stddev-sans-first:2.44 09:38:31 INFO - PROCESS | 3952 | Values: 166.0 168.0 166.0 171.0 168.0 170.0 165.0 165.0 170.0 171.0 09:38:31 INFO - PROCESS | 3952 | 09:38:31 INFO - PROCESS | 3952 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.00 Median:68.50 stddev:2.71 (4.0%) stddev-sans-first:2.46 09:38:31 INFO - PROCESS | 3952 | Values: 72.0 66.0 66.0 65.0 70.0 70.0 66.0 66.0 72.0 67.0 09:38:31 INFO - PROCESS | 3952 | -------- Summary: end -------- 09:38:31 INFO - PROCESS | 3952 | 09:38:32 INFO - TEST-INFO | 3952: exit 0 09:38:32 INFO - TEST-OK | kraken | took 62752ms 09:38:32 INFO - SUITE-END | took 1179s 09:38:32 INFO - Completed test suite (00:19:39) 09:38:32 INFO - javascript benchmark 09:38:32 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7196.89005531265, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3004.384101259242, 3021.3050998270382, 3021.4108248891475, 3032.1813110460175, 3049.283418396677, 5173.974130129353, 5207.5573576246015, 5226.398964119127, 5271.103912334903, 5283.603729720267, 5126.7436628168625, 5216.452272511388, 5226.529612334889, 5245.0, 5284.920726189111, 4793.880152996186, 4802.519748025187, 4893.632977526682, 4897.926531102036, 4965.975170124144, 4792.472827988919, 4852.49048849871, 4924.975375123119, 4936.481669424713, 4976.626752993522, 4676.181668208084, 4712.057588482283, 4833.509684406097, 4879.316895634614, 4887.266909963499, 4637.489876113625, 4646.605038571725, 4688.390509233812, 4696.671233013691, 4744.5492678195515, 4647.976760116211, 4654.371659825914, 4663.743494107823, 4674.018456124218, 4701.435827700664, 5104.285400043997, 5131.281620573122, 5150.227465880148, 5226.477352264781, 5256.710880901549, 5508.228847961289, 5671.63134396267, 5683.261176047087, 5717.857053573653, 5781.277340332458, 5753.971230143864, 5775.48020678141, 5776.508996735282, 5783.190353350535, 5783.5084017858535, 5377.7311134443125, 5385.596080293915, 5385.703786291713, 5391.838244852661, 5395.163749618815, 5505.174223866452, 5529.281193444826, 5609.0, 5613.607047506635, 5634.802781902614, 5448.673079615236, 5461.6996065216, 5463.508284254436, 5466.945330546644, 5512.3385193777, 5490.972545137249, 5498.725063746797, 5546.750396232099, 5554.166874968706, 5566.997940370691, 5435.755391007414, 5462.918056229159, 5466.043442397565, 5496.0107180707855, 5537.169424586345, 5522.723863806794, 5523.806666766724, 5524.392316845144, 5532.474414930575, 5579.553635709133, 4281.7645029523055, 4287.7641729705165, 4288.764117973541, 4296.4414626098405, 4339.82640694375, 3811.542614886176, 3820.331441997639, 3852.114013776791, 3860.1121741998936, 3876.9418458723144, 5370.650907690988, 5416.295881535454, 5422.3764267109, 5426.538744206708, 5456.563474921997, 5675.31896172462, 5698.0, 5719.456651618089, 5721.0, 5731.799387021434, 5309.070912590281, 5383.300170977826, 5384.461553844662, 5432.130859062531, 5490.368607610176, 4934.777934992934, 4952.479989601112, 4982.177940639826, 4998.400191976913, 5002.89994200114, 5873.3832947539895, 5949.315828679671, 5952.166696662471, 5952.523798096142, 5964.135200396005, 5532.640378375393, 5584.497395234448, 5679.9148012779015, 5685.772569097356, 5695.686737229492, 5862.062070068769, 5955.91066134017, 5975.223220981245, 5990.281166260077, 6056.212692349966, 5617.494425501724, 5633.126865335879, 5669.54643628517, 5669.659820410789, 5670.007748643889, 5530.5022547970875, 5756.683382414008, 5767.250257466502, 5772.191893135048, 5778.451047150514, 5423.728813559385, 5487.176923461353, 5517.337919449692, 5530.7511161997, 5586.86032849182, 5501.394846566955, 5510.614257001971, 5510.834674959758, 5515.503604675599, 5521.365043020104, 5371.838844834661, 5448.509634132947, 5472.2065300531995, 5488.313960754906, 5504.174373843955, 5549.861253468695, 5586.581006424616, 5628.986782379047, 5648.011597970421, 5708.972384970745, 5480.91778623313, 5510.173473978775, 5516.641418307797, 5525.11598144295, 5538.501534861882], "value": 5205.766039966105, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [563.5266376243956, 567.0898208375557, 575.0540361105978, 586.103262009126, 589.5165963909594, 39480.802595987014, 41399.379009314805, 41614.37578436322, 45349.77325113378, 45410.54589454104, 42967.57032429675, 43061.569384306145, 43652.781736091354, 43777.343339849846, 43997.56002439975, 8718.084601116887, 8857.158569935878, 8863.689770858022, 8879.955600222022, 8882.467051976902, 8679.088695686956, 8694.608742606599, 8701.869471957925, 8779.297656187522, 8813.779655508599, 8868.955655221747, 8881.289496840238, 8896.777580560505, 8926.330525210635, 8926.553672316391, 8814.030456649763, 8842.5136617486, 8855.42439741418, 8856.911430885673, 8876.644934202624, 8538.0, 8581.485110893367, 8600.0, 8618.396712230146, 8633.697820576312, 40689.59310406917, 40704.0, 40749.592504075175, 40996.1800763986, 41075.38386924199, 3256.153400115963, 3289.1777055736065, 3299.851506682205, 3350.2964377480757, 3777.2445510897655, 28473.71526284752, 30973.69026309753, 31009.224769380722, 31053.689463105307, 31103.0, 3906.511686039245, 4164.937525937114, 4217.8523751668545, 4228.9154216915485, 4378.6934914555995, 328454.0, 332507.7368423687, 333148.0, 333244.0, 334197.0, 58805.41194588085, 59238.407615923286, 59308.7034564833, 59380.406195938354, 59643.0, 60604.69697651484, 60761.784764305354, 61074.69462652658, 61238.0, 61297.693511532154, 15991.36034558628, 16120.919395402949, 16316.0, 16347.264373103239, 16353.509394718178, 11492.367919764327, 11992.760144797056, 12006.759864802654, 12056.397180140957, 12294.75410491785, 16999.23503442348, 17920.641587168182, 18039.72940405895, 18098.81901180971, 18107.45677629673, 6685.899711504331, 6942.687579058955, 7133.357997780121, 7177.7487787927175, 7220.169680486706, 800.9439339246197, 956.9234461243084, 959.3284700709531, 961.8986260731563, 979.314479864098, 29615.555766663085, 30809.383812323627, 31517.212069698442, 31929.0, 33641.0, 1009.3287963504334, 1039.3815679670583, 1074.2641290715885, 1082.53992053377, 1116.7319843237565, 15447.768283475756, 15718.449854255046, 16062.678746425006, 16139.193040347936, 16242.269097890623, 508903.0, 513596.0, 513994.0, 514077.0, 514722.0, 54994.450055498935, 55068.0, 55328.72335638296, 55458.72270638621, 55696.0, 1292.9612111636666, 1318.064174436161, 1357.7080927600614, 1361.5302720561192, 1372.8558501357413, 29839.254018649706, 31055.68944310528, 31487.766475895885, 32002.0, 32321.838390807894, 48198.518014819405, 48715.5128448711, 48737.26894096662, 48877.26684099813, 48938.0212395743, 380618.0, 383175.0, 383878.0, 384142.0, 385893.0, 28178.577321339788, 28380.290492737848, 28537.28656783514, 28555.143345699664, 28574.285642858264, 44537.33194002158, 44865.77567112144, 44942.0, 46074.30888536742, 46147.76926115348, 38697.4195387075, 38891.910366885364, 39324.01689957774, 39353.0, 40143.39784903287, 37758.43362349622, 38324.42513362246, 38380.23239535138, 38892.2221555573, 39510.40734388929, 37873.24253514969, 39438.605613944645, 39747.80126099351, 39873.0, 40039.599604004754, 31134.22164445907, 34147.829260853534, 34863.47704784481, 34908.65091349054, 35672.108197295274, 26456.338591535365, 26681.733182667926, 26903.596446053718, 27039.729602703723, 27318.863405682845], "value": 19394.37051233465, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [395.7150851387002, 395.82979318892865, 401.3858796042057, 402.9798510074496, 421.26279011729474, 17667.293308267668, 18518.35185768495, 19295.938723370207, 19334.51663708408, 19352.322668706616, 18323.81676183238, 18403.631927361446, 18788.906055469703, 18859.245630174777, 18996.24015039397, 5589.385167631567, 5609.80365687201, 5750.1949727038245, 5765.913511297313, 5834.474897259267, 5492.505674489295, 5715.399883012286, 5777.59556831022, 5788.218590490272, 5794.188813566104, 5498.560115190775, 5667.121596152582, 5684.8294551163535, 5702.116171993348, 5792.218050563183, 5683.488486036256, 5737.627054241502, 5742.196092547047, 5752.252207213057, 5770.79802206925, 4956.207006878918, 5108.591312694975, 5119.59043276537, 5136.306598609177, 5137.48625137487, 18460.07699615014, 18490.2603895844, 18522.53693657656, 22337.441563960867, 22405.88797056004, 2453.7546245375497, 2494.1395218649536, 2871.8133321334253, 3042.8439574835484, 3050.9847450762827, 14001.5099471518, 14050.718985620231, 14498.202598857059, 14996.775048374284, 15142.0, 1869.2709843161178, 1904.7428597139346, 1947.3184385464974, 1961.1959096770256, 1962.1758861278297, 78468.0, 79358.20641793565, 80140.59929700372, 81346.18653813445, 81706.0, 10506.212034097472, 10562.577496900192, 10733.195010374253, 10753.978372054642, 11722.765544689059, 15260.618484537976, 15326.15706136151, 15371.15546134471, 15496.612584685474, 15535.922320388325, 8120.309773669186, 8370.707025254087, 8388.0, 8559.914400855912, 8602.655893764304, 8012.479188852706, 8098.676052957816, 8134.389920755849, 8318.168183181633, 8358.080611132771, 6413.6793160341795, 6500.187476565429, 6614.933850661432, 6681.532292739559, 6734.932650673529, 1933.9129739161772, 1952.716856055864, 1955.247229816531, 1996.4409965209763, 2000.0799232736445, 822.7531740477833, 863.736560349087, 869.8999615044224, 884.9955750221336, 956.3831328793028, 16838.663226735396, 17275.654486910193, 17883.37408190707, 17909.552261193574, 18625.90687046583, 903.4534106865252, 926.6339795780628, 937.1846493550654, 937.1986951156663, 947.7346343023964, 7139.464540159509, 10237.539310731036, 10241.84637230442, 10280.485975701185, 10377.377357358582, 437700.0, 439155.0, 445111.0, 446506.0, 447703.0, 76189.23810761822, 76424.61787691026, 81579.0, 81778.0, 81884.0, 1030.7165529479303, 1035.7410647338165, 1044.5195210203392, 1074.8280275155937, 1076.6662334676275, 15569.377224910877, 15762.921185394, 15809.604759880634, 16298.592535186715, 16391.67216655684, 36878.446823297134, 37676.81161594175, 38173.61826381701, 38505.0, 38600.80699596484, 51682.22476662928, 52941.20588191103, 53905.73047134739, 62244.37755622386, 62743.372566273756, 8035.437519373588, 8513.446625969293, 8543.829123417621, 8664.176903194186, 8836.558172091498, 10440.582376704846, 12791.680207994874, 12825.935870320589, 12951.417186226454, 13127.606171814861, 10478.476076196008, 10732.46337683097, 10759.46202689878, 11113.777724445305, 11397.607626932933, 11264.887351126385, 11433.942830285796, 11525.0, 11881.831403339575, 12044.939775301067, 11197.832032519682, 11493.770124597628, 11533.88466115328, 11954.103442241692, 11962.880371196177, 8054.154313797201, 8380.16198380157, 8487.321014318963, 8751.256143227896, 8813.33899957493, 9021.50381728985, 11043.171762117712, 11164.49759760829, 11263.155263355446, 11363.54545818191], "value": 9123.294932266472, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1429.3853642933539, 1432.0834665813882, 1585.6749366379893, 1702.5913780692622, 1723.6638855423198, 7917.445778795487, 8098.67605295789, 8439.831203375936, 9302.976672566021, 9313.394629349095, 8597.699080532182, 8877.778055548615, 8880.978687450945, 9129.17837394636, 9136.31477639178, 2284.8629082255075, 2327.080803082781, 2336.766323367658, 2340.637201233803, 2345.8944347504316, 2294.6328587426015, 2323.2913961241816, 2357.351728274721, 2359.079958816063, 2360.0441821062414, 2293.6674182243564, 2308.665243539694, 2325.6046472099697, 2327.2436458151083, 2331.825113116515, 2255.4474153832334, 2265.4109931417784, 2265.4562904902787, 2268.2968279833303, 2273.6362182050793, 2258.232201051634, 2275.0, 2279.452931296477, 2279.7492275849645, 2287.7597852225445, 8963.910360896372, 9073.727788166365, 9157.450552966844, 9203.171714545722, 9242.86135707965, 5086.643934924557, 5212.973935130338, 5242.895142097175, 5257.08001099806, 5261.605379596507, 3195.1692559934354, 3243.5621191139367, 3391.830408479591, 3431.3995050866247, 3445.3626079175433, 1058.5025038232018, 1058.5501162006117, 1078.724925144091, 1102.5699977008974, 1124.3647339253378, 12185.695357616041, 12226.694332641666, 12250.938745306306, 12355.75288494225, 12417.75164496705, 4362.258416069276, 4370.934435983463, 4525.479569849444, 4603.8849028773875, 4609.2394754865745, 10243.0, 10370.014848589371, 10371.688849334532, 10392.0, 10439.739006524898, 5211.062008838369, 5212.9739351303, 5268.15709486488, 5279.894402111936, 5279.947200527946, 4379.802908869108, 4499.325101234841, 4799.9760001199775, 4865.367502224688, 4890.095332363524, 3840.135969406917, 3900.6489415952133, 3933.9213215735526, 3969.6030396960073, 4138.52406973196, 1308.3915979069777, 1308.8822006019504, 1321.5506727712432, 1325.509561462265, 1327.9004074694437, 938.1837801112939, 949.7625593601599, 951.8429459139164, 958.5159494455395, 974.8391515400021, 5916.674582897982, 6098.420650038239, 6122.479589234876, 6129.601575897642, 6217.0, 445.4387471785574, 448.2894612039888, 450.2773049255897, 450.82417857035784, 454.8840045788369, 4154.646855017297, 4161.25097482456, 4170.645495132948, 4181.414601955728, 4195.307774217281, 10691.41197234144, 11033.558657653764, 11111.944440277908, 11113.444327783578, 11286.435678216221, 10999.560017599206, 11055.72360690989, 11155.219134660658, 11186.888131118747, 11196.496157672924, 7907.604619768988, 8122.228388303101, 8253.298469630148, 8270.751877443567, 8380.371472139614, 6100.328963813889, 6169.753209871555, 6335.809925702236, 6408.23101227837, 6415.101885736094, 9822.803543929223, 10321.48392580383, 10439.425831579336, 10538.78922421532, 10578.8942110581, 10087.949560252151, 10110.34282771647, 10261.486925653538, 10427.843582346422, 10562.15502759762, 7185.640717964186, 7402.481826272109, 7815.609219539114, 7894.092179399213, 8074.515529068275, 8753.12468753145, 8898.644054237759, 8906.86639700418, 8911.108889111038, 8962.68630597952, 7657.4256930731535, 7710.306072453506, 7728.690852365842, 7890.053193616803, 7981.361491080584, 7284.198738138906, 7601.581912994839, 7701.3068823806125, 7709.845803083795, 7999.880001799861, 7227.168875579376, 7300.379467745302, 7340.853182936205, 7359.963200183965, 7360.969464274899, 4966.801327946986, 5055.6713813602, 5077.543021128116, 5152.124138896322, 5370.087085195604, 5119.974400127976, 5136.563392111712, 5200.531952124327, 5326.813561525328, 5393.784248630011], "value": 4573.65640218149, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [342.55125785221355, 346.10876991746244, 351.87992346114675, 353.99823000884993, 360.4701089398585, 5456.8090116845915, 5544.059579147296, 5545.667259964405, 5558.805441809537, 5572.972135139329, 5357.196420536921, 5427.294451721271, 5428.511433970942, 5436.972815135929, 5440.727963601814, 4023.4568333274924, 4208.663306935453, 4243.745375277478, 4247.0, 4285.842822437948, 4198.6011328923705, 4204.159168166364, 4227.8308867645255, 4237.936430953539, 4238.830446782141, 3994.9001274968214, 4189.63836753055, 4247.320428731404, 4250.279820914617, 4262.552431994643, 4022.678185745148, 4100.487439070116, 4181.60274773896, 4190.790460476964, 4195.244855925932, 3703.5926048134684, 3705.94441083384, 3709.6104908984707, 3711.5731690855628, 3720.5163328767358, 5273.578113750891, 5299.814506492293, 5307.893842123174, 5308.495692909206, 5316.38861530925, 4599.517050709695, 4834.2990266411525, 4849.612031037544, 4855.854324370274, 4868.196747536652, 5662.801801936954, 5669.546436285129, 5700.344460387026, 5726.141078838166, 5742.253507044099, 4117.876463706094, 4138.482689663792, 4141.7929103545, 4145.730527515701, 4158.875233742992, 5660.773569057233, 5889.146073819358, 5895.705214739289, 5909.852253693692, 5956.37458066901, 4150.481189851269, 4179.477565304337, 4182.619735487282, 4182.937255941163, 4214.578542145761, 4240.448741663564, 4247.5540068293, 4249.618873866006, 4252.808623611945, 4253.97873010633, 4665.300204969281, 4820.373351464287, 4832.903341933142, 4843.878903027453, 4860.8298709545, 5701.173329867146, 5708.771649134072, 5718.370979192286, 5736.598438109292, 5751.849630074002, 1422.9928850355889, 1434.2470203143432, 1447.9638009049647, 1454.1347898000672, 1455.86169313915, 961.7211008807368, 1021.7956408718137, 1024.7694268789612, 1029.3000759483623, 1040.547361897577, 5524.558035357162, 5560.666360018412, 5563.582731295169, 5585.525230355465, 5608.738033942331, 5779.739911703983, 5795.246617939725, 5849.210356601804, 5865.67738774363, 5882.647041177543, 5332.440093790096, 5395.325584301962, 5550.389457159709, 5580.246666700024, 5636.154576813511, 3070.3245286037036, 3095.637919315494, 3106.968930310668, 3122.828244446577, 3123.9687603124135, 5746.913796293059, 6059.303609893644, 6081.604695694766, 6098.72555734993, 6119.4089536719885, 6000.849978750566, 6012.789552365646, 6022.2171117754415, 6036.185115009417, 6053.909191362133, 6178.443940045418, 6185.84535386619, 6192.907106393408, 6197.349278325801, 6220.688965551795, 5564.360098588552, 5821.650700957956, 5845.327787304344, 5873.618214816023, 5994.0, 5780.21967034445, 5841.816210165385, 5845.444682755132, 5861.677607731615, 5872.236609240771, 5867.0, 6032.832762799565, 6047.727852246571, 6092.390760923872, 6109.69451527413, 4173.9582604173565, 4194.266003449323, 4217.135487225173, 4244.4906611205615, 4284.635805956404, 5938.524918006636, 5942.31663358702, 5966.463018328372, 5995.310539288038, 6011.218541589566, 5672.631278966854, 5696.316442026983, 5701.230333904869, 5703.572232082527, 5832.658488547573, 5730.312362516524, 5733.197352370588, 5765.4522820332, 5777.306723193244, 5843.590948633725, 5580.046983555885, 5750.223719797774, 5800.216970709069, 5825.2135961644635, 5830.154627579062, 5739.397363276963, 5801.738921748447, 5809.651420914759, 5828.562857785599, 5848.707564621667, 5709.600327977002, 5756.94243057564, 5763.308402991668, 5775.364709881994, 5776.480116789509], "value": 4380.358367305895, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [690.5131882023172, 706.798562409713, 719.9424046076311, 759.5556599389358, 764.8967389402429, 15085.321160547774, 16340.591485212875, 16350.182490875468, 16429.42497012605, 16434.753478697814, 13840.169589824618, 13948.326200855912, 13971.022028458012, 14000.369983350749, 14030.368633411495, 640.0750914927931, 649.0167396394443, 767.263427109975, 770.2451597434517, 785.8624740670389, 776.4952780692538, 780.8828675698634, 781.7303030454484, 785.7917651822272, 786.4691333349995, 828.204923273658, 830.2195935820309, 831.6423937706784, 832.267604508032, 833.5207255827924, 821.0516853034754, 821.4537332673765, 829.7427797382801, 831.8419500294924, 833.3624777045565, 603.1043899808781, 603.1676286724336, 604.0908432808595, 605.3552966091142, 606.8391876152779, 15356.923215383964, 15457.690846183126, 15532.611684707972, 15558.066516009076, 15566.22168891551, 15152.469663561722, 15202.391904323813, 15227.695446091016, 15328.540143795704, 15513.689726205414, 11887.465064072137, 12079.456424460921, 12269.345089668634, 12327.383630818424, 12414.75170496594, 3838.865639702625, 3867.961320386816, 3870.0905287257474, 3872.1287710265246, 3965.722399432041, 77416.0, 79487.20512794914, 79581.60209198974, 80758.0, 81331.5933420335, 11477.827832582518, 11529.769404611861, 11548.0, 11591.710207244887, 11707.648770536898, 22703.091876325092, 22704.205352812573, 22802.543949120925, 22866.885665571564, 22867.542649146922, 7562.773116806505, 7724.3434308083315, 8161.0, 8195.221453961864, 8256.339492840678, 4493.842715504941, 4539.6368290536675, 4558.772061396917, 4560.749158796298, 4596.5403459654435, 3518.2435776308216, 3720.981395093007, 3725.925481490355, 3745.382011967995, 3750.5311836020496, 603.8399824046631, 607.1590846677295, 611.3275397063195, 619.2414292491661, 627.0594108836744, 551.837208023634, 679.8572299817093, 690.2441826200303, 697.4455308030128, 743.382992116542, 9070.591823367964, 9275.524419655552, 9729.39711085635, 10540.367577945348, 10567.0, 672.5124284893511, 703.3599424523761, 708.8830342993348, 716.9820754481179, 724.2323137474294, 4491.618212451913, 4914.36113305268, 5037.800926732418, 5042.773075211624, 5075.238714192827, 111521.44239278913, 115579.0, 116020.0, 118064.0, 120372.0, 79679.20320796718, 90250.0, 102608.0, 107768.0, 108090.45954770333, 75756.62121689356, 81909.0, 82241.58879205685, 83692.0, 89169.55415222883, 9282.535873206447, 9500.287478439006, 9776.413415195111, 9846.0, 9990.150837178631, 49429.75285123551, 50399.24401134059, 50421.49578504168, 50890.491095088575, 52872.0, 69065.0, 69530.65234673794, 77013.2298677006, 77363.2263677356, 77613.0, 12867.678308042374, 13059.869401305865, 13165.47338106465, 13190.60428187156, 13280.53518126861, 14199.0, 14886.255687215813, 14921.477748278758, 15076.0, 15142.864285178435, 13295.66760830987, 13582.59252222435, 13792.724145516833, 14287.357068931715, 14302.96404879616, 13601.0, 13700.65748356299, 13718.45126194941, 13829.0, 14283.500077497238, 13543.86456135426, 14084.0, 14179.291035448392, 14212.928935355258, 14377.928110359382, 10663.573457061631, 10808.945955270174, 10987.945060274968, 11103.333799972028, 11142.610008649659, 9588.66439674608, 10049.397036177852, 11269.211155219056, 11289.548418063185, 11576.768464630828], "value": 7529.061721214294, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1523.5, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [107.0, 112.0, 113.0, 113.0, 113.0, 115.0, 112.0, 112.0, 111.0, 112.0], "value": 112.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [154.0, 127.0, 127.0, 165.0, 126.0, 126.0, 125.0, 123.0, 163.0, 126.0], "value": 136.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 167.0, 167.0, 173.0, 163.0, 163.0, 163.0, 167.0, 164.0, 161.0], "value": 165.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 78.0, 78.0, 112.0, 78.0, 76.0, 76.0, 77.0, 117.0, 77.0], "value": 84.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 87.0, 107.0, 83.0, 84.0, 82.0, 111.0, 83.0, 82.0, 115.0], "value": 91.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 119.0, 118.0, 118.0, 119.0, 118.0, 119.0, 118.0, 119.0, 119.0], "value": 118.4, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 148.0, 147.0, 147.0, 147.0, 146.0, 146.0, 150.0, 148.0, 148.0], "value": 147.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 96.0, 96.0, 96.0, 95.0, 95.0, 96.0, 96.0, 95.0], "value": 95.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 53.0, 52.0, 52.0, 56.0, 58.0, 58.0, 56.0, 55.0, 54.0], "value": 54.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 61.0, 60.0, 60.0, 62.0, 61.0, 61.0, 60.0, 61.0, 60.0], "value": 60.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 82.0, 82.0, 85.0, 79.0, 80.0, 79.0, 79.0, 80.0, 82.0], "value": 80.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 131.0, 137.0, 137.0, 131.0, 137.0, 141.0, 132.0, 175.0, 140.0], "value": 140.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 168.0, 166.0, 171.0, 168.0, 170.0, 165.0, 165.0, 170.0, 171.0], "value": 168.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 66.0, 66.0, 65.0, 70.0, 70.0, 66.0, 66.0, 72.0, 67.0], "value": 68.0, "unit": "score"}]}]} 09:38:32 INFO - Return code: 0 09:38:32 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 09:38:32 ERROR - # TBPL SUCCESS # 09:38:32 INFO - Running post-action listener: _resource_record_post_action 09:38:32 INFO - [mozharness: 2016-10-11 16:38:32.798843Z] Finished run-tests step (success) 09:38:32 INFO - Running post-run listener: _resource_record_post_run 09:38:32 INFO - Total resource usage - Wall time: 1197s; CPU: 13.0%; Read bytes: 7852032; Write bytes: 426024960; Read time: 1332; Write time: 435120 09:38:32 INFO - TinderboxPrint: CPU usage
13.4% 09:38:32 INFO - TinderboxPrint: I/O read bytes / time
7,852,032 / 1,332 09:38:32 INFO - TinderboxPrint: I/O write bytes / time
426,024,960 / 435,120 09:38:32 INFO - TinderboxPrint: CPU idle
8,267.5 (86.6%) 09:38:32 INFO - TinderboxPrint: CPU user
1,217.1 (12.7%) 09:38:32 INFO - TinderboxPrint: Swap in / out
0 / 0 09:38:32 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 80531456; Read time: 0; Write time: 49420 09:38:32 INFO - run-tests - Wall time: 1180s; CPU: 13.0%; Read bytes: 5505024; Write bytes: 332201984; Read time: 888; Write time: 364728 09:38:33 INFO - Running post-run listener: _upload_blobber_files 09:38:33 INFO - Blob upload gear active. 09:38:33 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 09:38:33 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 09:38:33 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', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 09:38:33 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 Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 09:38:33 INFO - (blobuploader) - INFO - Open directory for files ... 09:38:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 09:38:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:38:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:38:34 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 09:38:34 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:38:34 INFO - (blobuploader) - INFO - Done attempting. 09:38:34 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 09:38:34 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:38:34 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:38:38 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 09:38:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:38:38 INFO - (blobuploader) - INFO - Done attempting. 09:38:38 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 09:38:38 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:38:38 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:38:38 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 09:38:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:38:38 INFO - (blobuploader) - INFO - Done attempting. 09:38:38 INFO - (blobuploader) - INFO - Iteration through files over. 09:38:38 INFO - Return code: 0 09:38:38 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 09:38:38 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 09:38:38 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c622b7e411247bef0965d99a5f63bafc4ebc0bbb185b68603c5e66c5f7b69e326d0c80efe4bcd70b9e41343b96f20fe44cc8f9b1f18dc88243ebc8cc3bde837a", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b7ea064a8945f8d05d9e2b40a05d700303711e565e39c64a17d66968ef2c750ec4338c740acb234b80aedc31af8e38d190bd941e587cfd93c8a4e6c49116b09a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/6c23fc35bcfef127d7956055c838d57ef12324afc57345feb9de6184b74eb1f50dafc4cbe09f32b406480836429eb123e7b97b2f77807260dbab889737e2a90c"} 09:38:38 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 09:38:38 INFO - Writing to file /builds/slave/test/properties/blobber_files 09:38:38 INFO - Contents: 09:38:38 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c622b7e411247bef0965d99a5f63bafc4ebc0bbb185b68603c5e66c5f7b69e326d0c80efe4bcd70b9e41343b96f20fe44cc8f9b1f18dc88243ebc8cc3bde837a", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b7ea064a8945f8d05d9e2b40a05d700303711e565e39c64a17d66968ef2c750ec4338c740acb234b80aedc31af8e38d190bd941e587cfd93c8a4e6c49116b09a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/6c23fc35bcfef127d7956055c838d57ef12324afc57345feb9de6184b74eb1f50dafc4cbe09f32b406480836429eb123e7b97b2f77807260dbab889737e2a90c"} 09:38:38 INFO - Running post-run listener: copy_logs_to_upload_dir 09:38:38 INFO - Copying logs to upload dir... 09:38:38 INFO - mkdir: /builds/slave/test/build/upload/logs 09:38:38 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1243.322994 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 43 secs) (at 2016-10-11 09:38:39.005430) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-11 09:38:39.009085) ========= 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=836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704 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/Fx-Team/sha512/c622b7e411247bef0965d99a5f63bafc4ebc0bbb185b68603c5e66c5f7b69e326d0c80efe4bcd70b9e41343b96f20fe44cc8f9b1f18dc88243ebc8cc3bde837a", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b7ea064a8945f8d05d9e2b40a05d700303711e565e39c64a17d66968ef2c750ec4338c740acb234b80aedc31af8e38d190bd941e587cfd93c8a4e6c49116b09a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/6c23fc35bcfef127d7956055c838d57ef12324afc57345feb9de6184b74eb1f50dafc4cbe09f32b406480836429eb123e7b97b2f77807260dbab889737e2a90c"} build_url:https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011179 build_url: 'https://queue.taskcluster.net/v1/task/OXumNNtiRvOTYjaHkJGKOQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c622b7e411247bef0965d99a5f63bafc4ebc0bbb185b68603c5e66c5f7b69e326d0c80efe4bcd70b9e41343b96f20fe44cc8f9b1f18dc88243ebc8cc3bde837a", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b7ea064a8945f8d05d9e2b40a05d700303711e565e39c64a17d66968ef2c750ec4338c740acb234b80aedc31af8e38d190bd941e587cfd93c8a4e6c49116b09a", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/6c23fc35bcfef127d7956055c838d57ef12324afc57345feb9de6184b74eb1f50dafc4cbe09f32b406480836429eb123e7b97b2f77807260dbab889737e2a90c"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-11 09:38:39.036967) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-11 09:38:39.037667) ========= 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=836cfdc75598d54cb747368e000001a9-1476202673.472309-2098535704 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004365 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-11 09:38:39.122297) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-11 09:38:39.123083) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-11 09:38:39.123738) ========= ========= Total master_lag: 0.16 =========