builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-060 starttime: 1482156960.76 results: success (0) buildid: 20161219043738 builduid: 9ba8fedef7534c44b67a3cfdb82ddc48 revision: 818666e181d63b44c88a782c0d81f6a9d6d51134 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-12-19 06:16:00.763399) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-12-19 06:16:00.763849) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-12-19 06:16:00.764119) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-12-19 06:16:00.778590) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-19 06:16:00.778915) ========= 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=337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-12-19 06:16:01-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 81.7M=0s 2016-12-19 06:16:01 (81.7 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.085753 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-19 06:16:00.878438) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-12-19 06:16:00.878751) ========= 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=337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019564 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-12-19 06:16:00.931430) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-19 06:16:00.931739) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 818666e181d63b44c88a782c0d81f6a9d6d51134 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 818666e181d63b44c88a782c0d81f6a9d6d51134 --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=337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-12-19 06:16:02,047 truncating revision to first 12 chars 2016-12-19 06:16:02,047 Setting DEBUG logging. 2016-12-19 06:16:02,047 attempt 1/10 2016-12-19 06:16:02,047 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/818666e181d6?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-12-19 06:16:02,500 unpacking tar archive at: mozilla-aurora-818666e181d6/testing/mozharness/ program finished with exit code 0 elapsedTime=0.754981 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-19 06:16:01.701441) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-12-19 06:16:01.701856) ========= script_repo_revision: 818666e181d63b44c88a782c0d81f6a9d6d51134 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-12-19 06:16:01.702329) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-12-19 06:16:01.702699) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-12-19 06:16:01.716770) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-12-19 06:16:01.717333) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 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', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] 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=337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 06:16:02 INFO - MultiFileLogger online at 20161219 06:16:02 in /builds/slave/test 06:16:02 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 06:16:02 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 06:16:02 INFO - {'append_to_log': False, 06:16:02 INFO - 'base_work_dir': '/builds/slave/test', 06:16:02 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 06:16:02 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 06:16:02 INFO - 'branch': 'Mozilla-Aurora', 06:16:02 INFO - 'buildbot_json_path': 'buildprops.json', 06:16:02 INFO - 'config_files': ('talos/linux_config.py',), 06:16:02 INFO - 'default_actions': ('clobber', 06:16:02 INFO - 'read-buildbot-config', 06:16:02 INFO - 'download-and-extract', 06:16:02 INFO - 'populate-webroot', 06:16:02 INFO - 'create-virtualenv', 06:16:02 INFO - 'install', 06:16:02 INFO - 'run-tests'), 06:16:02 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 06:16:02 INFO - 'download_minidump_stackwalk': True, 06:16:02 INFO - 'download_symbols': 'ondemand', 06:16:02 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 06:16:02 INFO - 'tooltool.py': '/tools/tooltool.py', 06:16:02 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 06:16:02 INFO - '/tools/misc-python/virtualenv.py')}, 06:16:02 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 06:16:02 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 06:16:02 INFO - 'installer_path': 'installer.exe', 06:16:02 INFO - 'log_level': 'info', 06:16:02 INFO - 'log_name': 'talos', 06:16:02 INFO - 'log_to_console': True, 06:16:02 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 06:16:02 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 06:16:02 INFO - 'opt_config_files': (), 06:16:02 INFO - 'pip_index': False, 06:16:02 INFO - 'sps_profile': False, 06:16:02 INFO - 'sps_profile_interval': 0, 06:16:02 INFO - 'suite': 'dromaeojs', 06:16:02 INFO - 'system_bits': '32', 06:16:02 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 06:16:02 INFO - 'title': 'talos-linux64-ix-060', 06:16:02 INFO - 'tooltool_cache': '/builds/tooltool_cache', 06:16:02 INFO - 'use_talos_json': True, 06:16:02 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 06:16:02 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 06:16:02 INFO - 'work_dir': 'build'} 06:16:02 INFO - [mozharness: 2016-12-19 14:16:02.938892Z] Running clobber step. 06:16:02 INFO - Running pre-action listener: _resource_record_pre_action 06:16:02 INFO - Running main action method: clobber 06:16:02 INFO - rmtree: /builds/slave/test/build 06:16:02 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 06:16:03 INFO - Running post-action listener: _resource_record_post_action 06:16:03 INFO - [mozharness: 2016-12-19 14:16:03.930124Z] Finished clobber step (success) 06:16:03 INFO - [mozharness: 2016-12-19 14:16:03.930223Z] Running read-buildbot-config step. 06:16:03 INFO - Running pre-action listener: _resource_record_pre_action 06:16:03 INFO - Running main action method: read_buildbot_config 06:16:03 INFO - Using buildbot properties: 06:16:03 INFO - { 06:16:03 INFO - "project": "", 06:16:03 INFO - "product": "firefox", 06:16:03 INFO - "script_repo_revision": "production", 06:16:03 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 06:16:03 INFO - "repository": "", 06:16:03 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 06:16:03 INFO - "buildid": "20161219043738", 06:16:03 INFO - "pgo_build": "True", 06:16:03 INFO - "basedir": "/builds/slave/test", 06:16:03 INFO - "buildnumber": 646, 06:16:03 INFO - "slavename": "talos-linux64-ix-060", 06:16:03 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 06:16:03 INFO - "platform": "ubuntu64_hw", 06:16:03 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 06:16:03 INFO - "branch": "mozilla-aurora", 06:16:03 INFO - "repo_path": "releases/mozilla-aurora", 06:16:03 INFO - "revision": "818666e181d63b44c88a782c0d81f6a9d6d51134", 06:16:03 INFO - "stage_platform": "linux64-pgo", 06:16:03 INFO - "builduid": "9ba8fedef7534c44b67a3cfdb82ddc48", 06:16:03 INFO - "slavebuilddir": "test" 06:16:03 INFO - } 06:16:03 INFO - Found installer url https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2. 06:16:03 INFO - Running post-action listener: _resource_record_post_action 06:16:03 INFO - [mozharness: 2016-12-19 14:16:03.932660Z] Finished read-buildbot-config step (success) 06:16:03 INFO - [mozharness: 2016-12-19 14:16:03.932747Z] Running download-and-extract step. 06:16:03 INFO - Running pre-action listener: _resource_record_pre_action 06:16:03 INFO - Running main action method: download_and_extract 06:16:03 INFO - mkdir: /builds/slave/test/build/tests 06:16:03 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')]} 06:16:03 INFO - trying https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json 06:16:03 INFO - Downloading https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json 06:16:03 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 06:16:04 INFO - Downloaded 1361 bytes. 06:16:04 INFO - Reading from file /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json 06:16:04 INFO - Using the following test package requirements: 06:16:04 INFO - {u'common': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'], 06:16:04 INFO - u'cppunittest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 06:16:04 INFO - u'firefox-52.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 06:16:04 INFO - u'gtest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 06:16:04 INFO - u'firefox-52.0a2.en-US.linux-x86_64.gtest.tests.zip'], 06:16:04 INFO - u'jittest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 06:16:04 INFO - u'jsshell-linux-x86_64.zip'], 06:16:04 INFO - u'mochitest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 06:16:04 INFO - u'firefox-52.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 06:16:04 INFO - u'mozbase': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'], 06:16:04 INFO - u'reftest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 06:16:04 INFO - u'firefox-52.0a2.en-US.linux-x86_64.reftest.tests.zip'], 06:16:04 INFO - u'talos': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 06:16:04 INFO - u'firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip'], 06:16:04 INFO - u'web-platform': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 06:16:04 INFO - u'firefox-52.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 06:16:04 INFO - u'xpcshell': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 06:16:04 INFO - u'firefox-52.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 06:16:04 INFO - Downloading packages: [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 06:16:04 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip 06:16:04 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 06:16:04 INFO - Fetch https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip into memory 06:16:05 INFO - Http code: 200 06:16:05 INFO - via: 1.1 ae162f6796e551002447afd7c07ec67a.cloudfront.net (CloudFront) 06:16:05 INFO - x-amz-cf-id: 6c4wO9OG6l1DPh1uoeXFKMz2KEEpfwOLMhHL5KRbhVAQ4RV0QCJXNw== 06:16:05 INFO - x-amz-version-id: fg5vlKuhmi8aYgCNd_IKuzslcflbR.Yq 06:16:05 INFO - Expected file size: 21940129 06:16:05 INFO - Obtained file size: 21940129 06:16:09 INFO - Downloading packages: [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 06:16:09 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip 06:16:09 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 06:16:09 INFO - Fetch https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip into memory 06:16:10 INFO - Http code: 200 06:16:10 INFO - via: 1.1 5c2ff4ca1e447265402af29264e83497.cloudfront.net (CloudFront) 06:16:10 INFO - x-amz-cf-id: GrqQKbMcgLyVyC5EaJpQDB_xEzF9-jzARbDOiIBxa-afqqDGKZXdsg== 06:16:10 INFO - x-amz-version-id: fg5vlKuhmi8aYgCNd_IKuzslcflbR.Yq 06:16:10 INFO - Expected file size: 21940129 06:16:10 INFO - Obtained file size: 21940129 06:16:14 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip 06:16:14 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 06:16:14 INFO - Fetch https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip into memory 06:16:15 INFO - Http code: 200 06:16:15 INFO - via: 1.1 24b0e5a3429d07ef12381da50e07f70f.cloudfront.net (CloudFront) 06:16:15 INFO - x-amz-cf-id: uNCMpd3uzjCqsX8WEZjtYzQCQLI6L1RdwFmHTfEjL148Fwh0tBmhrQ== 06:16:15 INFO - x-amz-version-id: rHwne82t1KnjmFsFFCE3W_NpO5WjKyEB 06:16:15 INFO - Expected file size: 14409038 06:16:15 INFO - Obtained file size: 14409038 06:16:15 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')]} 06:16:15 INFO - trying https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 06:16:15 INFO - Downloading https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 06:16:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 06:16:17 INFO - Downloaded 63953665 bytes. 06:16:17 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 06:16:17 INFO - mkdir: /builds/slave/test/properties 06:16:17 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 06:16:17 INFO - Writing to file /builds/slave/test/properties/build_url 06:16:17 INFO - Contents: 06:16:17 INFO - build_url:https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 06:16:17 INFO - Running post-action listener: _resource_record_post_action 06:16:17 INFO - Running post-action listener: set_extra_try_arguments 06:16:17 INFO - [mozharness: 2016-12-19 14:16:17.739203Z] Finished download-and-extract step (success) 06:16:17 INFO - [mozharness: 2016-12-19 14:16:17.739428Z] Running populate-webroot step. 06:16:17 INFO - Running pre-action listener: _resource_record_pre_action 06:16:17 INFO - Running main action method: populate_webroot 06:16:17 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 06:16:17 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 06:16:17 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 06:16:17 INFO - '--tppagecycles', 06:16:17 INFO - '7'], 06:16:17 INFO - 'tests': ['tsvgm']}}, 06:16:17 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 06:16:17 INFO - 'tests': ['tresize', 'tcanvasmark']}, 06:16:17 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 06:16:17 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 06:16:17 INFO - 'tests': ['dromaeo_css', 'kraken']}, 06:16:17 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 06:16:17 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:16:17 INFO - 'talos_options': ['--disable-e10s'], 06:16:17 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:16:17 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:16:17 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:16:17 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:16:17 INFO - 'talos_options': ['--disable-e10s'], 06:16:17 INFO - 'tests': ['damp', 'tps']}, 06:16:17 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:16:17 INFO - 'tests': ['damp', 'tps']}, 06:16:17 INFO - 'g3': {'talos_options': ['--disable-e10s'], 06:16:17 INFO - 'tests': ['dromaeo_dom']}, 06:16:17 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 06:16:17 INFO - 'g4': {'talos_options': ['--disable-e10s'], 06:16:17 INFO - 'tests': ['basic_compositor_video']}, 06:16:17 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 06:16:17 INFO - 'other': {'talos_options': ['--disable-e10s'], 06:16:17 INFO - 'tests': ['a11yr', 06:16:17 INFO - 'ts_paint', 06:16:17 INFO - 'tpaint', 06:16:17 INFO - 'sessionrestore', 06:16:17 INFO - 'sessionrestore_no_auto_restore', 06:16:17 INFO - 'tabpaint']}, 06:16:17 INFO - 'other-e10s': {'tests': ['a11yr', 06:16:17 INFO - 'ts_paint', 06:16:17 INFO - 'tpaint', 06:16:17 INFO - 'sessionrestore', 06:16:17 INFO - 'sessionrestore_no_auto_restore', 06:16:17 INFO - 'tabpaint']}, 06:16:17 INFO - 'other-e10s_l64': {'tests': ['a11yr', 06:16:17 INFO - 'ts_paint', 06:16:17 INFO - 'tpaint', 06:16:17 INFO - 'sessionrestore', 06:16:17 INFO - 'sessionrestore_no_auto_restore', 06:16:17 INFO - 'tabpaint']}, 06:16:17 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 06:16:17 INFO - 'ts_paint', 06:16:17 INFO - 'tpaint', 06:16:17 INFO - 'sessionrestore', 06:16:17 INFO - 'sessionrestore_no_auto_restore', 06:16:17 INFO - 'tabpaint']}, 06:16:17 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 06:16:17 INFO - 'tests': ['a11yr', 06:16:17 INFO - 'ts_paint', 06:16:17 INFO - 'tpaint', 06:16:17 INFO - 'sessionrestore', 06:16:17 INFO - 'sessionrestore_no_auto_restore', 06:16:17 INFO - 'tabpaint']}, 06:16:17 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 06:16:17 INFO - 'tests': ['a11yr', 06:16:17 INFO - 'ts_paint', 06:16:17 INFO - 'tpaint', 06:16:17 INFO - 'sessionrestore', 06:16:17 INFO - 'sessionrestore_no_auto_restore', 06:16:17 INFO - 'tabpaint']}, 06:16:17 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 06:16:17 INFO - 'tests': ['tsvgx', 06:16:17 INFO - 'tsvgr_opacity', 06:16:17 INFO - 'tart', 06:16:17 INFO - 'tscrollx', 06:16:17 INFO - 'cart']}, 06:16:17 INFO - 'svgr-e10s': {'tests': ['tsvgx', 06:16:17 INFO - 'tsvgr_opacity', 06:16:17 INFO - 'tart', 06:16:17 INFO - 'tscrollx', 06:16:17 INFO - 'cart']}, 06:16:17 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:16:17 INFO - 'talos_options': ['--disable-e10s'], 06:16:17 INFO - 'tests': ['tp5o']}, 06:16:17 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:16:17 INFO - 'tests': ['tp5o']}, 06:16:17 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:16:17 INFO - 'talos_options': ['--disable-e10s', 06:16:17 INFO - '--xperf_path', 06:16:17 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:16:17 INFO - 'tests': ['tp5n']}, 06:16:17 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:16:17 INFO - 'talos_options': ['--xperf_path', 06:16:17 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:16:17 INFO - 'tests': ['tp5n']}}, 06:16:17 INFO - 'talos.zip': {'path': '', 06:16:17 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 06:16:17 INFO - Running post-action listener: _resource_record_post_action 06:16:17 INFO - [mozharness: 2016-12-19 14:16:17.754856Z] Finished populate-webroot step (success) 06:16:17 INFO - [mozharness: 2016-12-19 14:16:17.754944Z] Running create-virtualenv step. 06:16:17 INFO - Running pre-action listener: _resource_record_pre_action 06:16:17 INFO - Running main action method: create_virtualenv 06:16:17 INFO - Creating virtualenv /builds/slave/test/build/venv 06:16:17 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 06:16:17 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 06:16:17 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 06:16:17 INFO - Using real prefix '/usr' 06:16:17 INFO - New python executable in /builds/slave/test/build/venv/bin/python 06:16:18 INFO - Installing distribute.............................................................................................................................................................................................done. 06:16:20 INFO - Installing pip.................done. 06:16:20 INFO - Return code: 0 06:16:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 06:16:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 06:16:20 INFO - Reading from file tmpfile_stdout 06:16:20 INFO - Output received: 06:16:20 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) 06:16:20 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 06:16:20 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')]} 06:16:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:16:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:20 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')]} 06:16:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:16:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:20 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 0x7f9ab576bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2990ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x298df60>, '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 0x298ed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x298f1d0>, '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': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', '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 06:16:20 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 06:16:20 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 06:16:20 INFO - Using env: {'DISPLAY': ':0', 06:16:20 INFO - 'HOME': '/home/cltbld', 06:16:20 INFO - 'LANG': 'en_US.UTF-8', 06:16:20 INFO - 'LANGUAGE': 'en_US:en', 06:16:20 INFO - 'LOGNAME': 'cltbld', 06:16:20 INFO - 'MAIL': '/var/mail/cltbld', 06:16:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:16:20 INFO - 'MOZ_NO_REMOTE': '1', 06:16:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:16:20 INFO - 'NO_EM_RESTART': '1', 06:16:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:16:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:16:20 INFO - 'PWD': '/builds/slave/test', 06:16:20 INFO - 'SHELL': '/bin/bash', 06:16:20 INFO - 'SHLVL': '1', 06:16:20 INFO - 'TERM': 'linux', 06:16:20 INFO - 'TMOUT': '86400', 06:16:20 INFO - 'USER': 'cltbld', 06:16:20 INFO - 'XDG_SESSION_COOKIE': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', 06:16:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:16:20 INFO - '_': '/tools/buildbot/bin/python'} 06:16:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:16:20 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 06:16:20 INFO - Cleaning up... 06:16:20 INFO - Return code: 0 06:16:20 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 06:16:20 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')]} 06:16:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:16:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:20 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')]} 06:16:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:16:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:20 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 0x7f9ab576bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2990ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x298df60>, '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 0x298ed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x298f1d0>, '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': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', '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 06:16:20 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 06:16:20 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 06:16:20 INFO - Using env: {'DISPLAY': ':0', 06:16:20 INFO - 'HOME': '/home/cltbld', 06:16:20 INFO - 'LANG': 'en_US.UTF-8', 06:16:20 INFO - 'LANGUAGE': 'en_US:en', 06:16:20 INFO - 'LOGNAME': 'cltbld', 06:16:20 INFO - 'MAIL': '/var/mail/cltbld', 06:16:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:16:20 INFO - 'MOZ_NO_REMOTE': '1', 06:16:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:16:20 INFO - 'NO_EM_RESTART': '1', 06:16:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:16:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:16:20 INFO - 'PWD': '/builds/slave/test', 06:16:20 INFO - 'SHELL': '/bin/bash', 06:16:20 INFO - 'SHLVL': '1', 06:16:20 INFO - 'TERM': 'linux', 06:16:20 INFO - 'TMOUT': '86400', 06:16:20 INFO - 'USER': 'cltbld', 06:16:20 INFO - 'XDG_SESSION_COOKIE': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', 06:16:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:16:20 INFO - '_': '/tools/buildbot/bin/python'} 06:16:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:16:20 INFO - Downloading/unpacking psutil>=3.1.1 06:16:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:16:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:16:20 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 06:16:20 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 06:16:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:16:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:16:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 06:16:23 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:16:23 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:16:23 INFO - Installing collected packages: psutil 06:16:23 INFO - Running setup.py install for psutil 06:16:23 INFO - building 'psutil._psutil_linux' extension 06:16:23 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 06:16:23 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 06:16:23 INFO - building 'psutil._psutil_posix' extension 06:16:23 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 06:16:23 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 06:16:23 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:16:23 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:16:23 INFO - Successfully installed psutil 06:16:23 INFO - Cleaning up... 06:16:23 INFO - Return code: 0 06:16:23 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 06:16: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')]} 06:16:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:16:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16: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')]} 06:16:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:16:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16: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', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9ab576bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2990ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x298df60>, '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 0x298ed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x298f1d0>, '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': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', '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 06:16: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', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 06:16: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 mozsystemmonitor==0.3 06:16:23 INFO - Using env: {'DISPLAY': ':0', 06:16:23 INFO - 'HOME': '/home/cltbld', 06:16:23 INFO - 'LANG': 'en_US.UTF-8', 06:16:23 INFO - 'LANGUAGE': 'en_US:en', 06:16:23 INFO - 'LOGNAME': 'cltbld', 06:16:23 INFO - 'MAIL': '/var/mail/cltbld', 06:16:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:16:23 INFO - 'MOZ_NO_REMOTE': '1', 06:16:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:16:23 INFO - 'NO_EM_RESTART': '1', 06:16:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:16:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:16:23 INFO - 'PWD': '/builds/slave/test', 06:16:23 INFO - 'SHELL': '/bin/bash', 06:16:23 INFO - 'SHLVL': '1', 06:16:23 INFO - 'TERM': 'linux', 06:16:23 INFO - 'TMOUT': '86400', 06:16:23 INFO - 'USER': 'cltbld', 06:16:23 INFO - 'XDG_SESSION_COOKIE': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', 06:16:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:16:23 INFO - '_': '/tools/buildbot/bin/python'} 06:16:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:16:23 INFO - Downloading/unpacking mozsystemmonitor==0.3 06:16: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 06:16: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 06:16: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 06:16: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 06:16: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 06:16: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 06:16:25 INFO - Downloading mozsystemmonitor-0.3.tar.gz 06:16:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 06:16:25 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 06:16:25 INFO - Installing collected packages: mozsystemmonitor 06:16:25 INFO - Running setup.py install for mozsystemmonitor 06:16:26 INFO - Successfully installed mozsystemmonitor 06:16:26 INFO - Cleaning up... 06:16:26 INFO - Return code: 0 06:16:26 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 06:16:26 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')]} 06:16:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:16:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:26 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')]} 06:16:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:16:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:26 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 0x7f9ab576bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2990ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x298df60>, '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 0x298ed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x298f1d0>, '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': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', '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 06:16:26 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 06:16:26 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 06:16:26 INFO - Using env: {'DISPLAY': ':0', 06:16:26 INFO - 'HOME': '/home/cltbld', 06:16:26 INFO - 'LANG': 'en_US.UTF-8', 06:16:26 INFO - 'LANGUAGE': 'en_US:en', 06:16:26 INFO - 'LOGNAME': 'cltbld', 06:16:26 INFO - 'MAIL': '/var/mail/cltbld', 06:16:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:16:26 INFO - 'MOZ_NO_REMOTE': '1', 06:16:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:16:26 INFO - 'NO_EM_RESTART': '1', 06:16:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:16:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:16:26 INFO - 'PWD': '/builds/slave/test', 06:16:26 INFO - 'SHELL': '/bin/bash', 06:16:26 INFO - 'SHLVL': '1', 06:16:26 INFO - 'TERM': 'linux', 06:16:26 INFO - 'TMOUT': '86400', 06:16:26 INFO - 'USER': 'cltbld', 06:16:26 INFO - 'XDG_SESSION_COOKIE': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', 06:16:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:16:26 INFO - '_': '/tools/buildbot/bin/python'} 06:16:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:16:26 INFO - Downloading/unpacking jsonschema==2.5.1 06:16: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 06:16: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 06:16: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 06:16: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 06:16: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 06:16: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 06:16:28 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 06:16:28 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 06:16:28 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 06:16:28 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 06:16:28 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 06:16:28 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 06:16:28 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 06:16:28 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 06:16:28 INFO - Downloading functools32-3.2.3-2.tar.gz 06:16:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 06:16:28 INFO - warning: no files found matching '*.txt' 06:16:28 INFO - no previously-included directories found matching 'build' 06:16:28 INFO - no previously-included directories found matching 'dist' 06:16:28 INFO - no previously-included directories found matching '.git*' 06:16:28 INFO - Installing collected packages: jsonschema, functools32 06:16:28 INFO - Running setup.py install for functools32 06:16:28 INFO - warning: no files found matching '*.txt' 06:16:28 INFO - no previously-included directories found matching 'build' 06:16:28 INFO - no previously-included directories found matching 'dist' 06:16:28 INFO - no previously-included directories found matching '.git*' 06:16:28 INFO - Successfully installed jsonschema functools32 06:16:28 INFO - Cleaning up... 06:16:28 INFO - Return code: 0 06:16:28 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 06:16:28 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')]} 06:16:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:16:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:28 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')]} 06:16:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:16:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:28 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 0x7f9ab576bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2990ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x298df60>, '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 0x298ed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x298f1d0>, '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': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', '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 06:16:28 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 06:16:28 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 06:16:28 INFO - Using env: {'DISPLAY': ':0', 06:16:28 INFO - 'HOME': '/home/cltbld', 06:16:28 INFO - 'LANG': 'en_US.UTF-8', 06:16:28 INFO - 'LANGUAGE': 'en_US:en', 06:16:28 INFO - 'LOGNAME': 'cltbld', 06:16:28 INFO - 'MAIL': '/var/mail/cltbld', 06:16:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:16:28 INFO - 'MOZ_NO_REMOTE': '1', 06:16:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:16:28 INFO - 'NO_EM_RESTART': '1', 06:16:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:16:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:16:28 INFO - 'PWD': '/builds/slave/test', 06:16:28 INFO - 'SHELL': '/bin/bash', 06:16:28 INFO - 'SHLVL': '1', 06:16:28 INFO - 'TERM': 'linux', 06:16:28 INFO - 'TMOUT': '86400', 06:16:28 INFO - 'USER': 'cltbld', 06:16:28 INFO - 'XDG_SESSION_COOKIE': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', 06:16:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:16:28 INFO - '_': '/tools/buildbot/bin/python'} 06:16:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:16:28 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 06:16:28 INFO - Cleaning up... 06:16:28 INFO - Return code: 0 06:16:28 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 06:16:28 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')]} 06:16:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:16:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:28 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')]} 06:16:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:16:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:28 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 0x7f9ab576bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2990ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x298df60>, '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 0x298ed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x298f1d0>, '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': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', '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 06:16:28 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 06:16:28 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 06:16:28 INFO - Using env: {'DISPLAY': ':0', 06:16:28 INFO - 'HOME': '/home/cltbld', 06:16:28 INFO - 'LANG': 'en_US.UTF-8', 06:16:28 INFO - 'LANGUAGE': 'en_US:en', 06:16:28 INFO - 'LOGNAME': 'cltbld', 06:16:28 INFO - 'MAIL': '/var/mail/cltbld', 06:16:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:16:28 INFO - 'MOZ_NO_REMOTE': '1', 06:16:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:16:28 INFO - 'NO_EM_RESTART': '1', 06:16:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:16:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:16:28 INFO - 'PWD': '/builds/slave/test', 06:16:28 INFO - 'SHELL': '/bin/bash', 06:16:28 INFO - 'SHLVL': '1', 06:16:28 INFO - 'TERM': 'linux', 06:16:28 INFO - 'TMOUT': '86400', 06:16:28 INFO - 'USER': 'cltbld', 06:16:28 INFO - 'XDG_SESSION_COOKIE': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', 06:16:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:16:28 INFO - '_': '/tools/buildbot/bin/python'} 06:16:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:16:29 INFO - Downloading/unpacking blobuploader==1.2.4 06:16:29 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 06:16:29 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 06:16:29 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 06:16:29 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 06:16:29 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 06:16:29 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 06:16:31 INFO - Downloading blobuploader-1.2.4.tar.gz 06:16:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 06:16:31 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 06:16:31 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 06:16:31 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 06:16:31 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 06:16:31 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 06:16:31 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 06:16:31 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 06:16:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 06:16:31 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 06:16:31 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 06:16:31 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 06:16:31 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 06:16:31 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 06:16:31 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 06:16:31 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 06:16:31 INFO - Downloading docopt-0.6.1.tar.gz 06:16:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 06:16:31 INFO - Installing collected packages: blobuploader, requests, docopt 06:16:31 INFO - Running setup.py install for blobuploader 06:16:32 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 06:16:32 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 06:16:32 INFO - Running setup.py install for requests 06:16:32 INFO - Running setup.py install for docopt 06:16:32 INFO - Successfully installed blobuploader requests docopt 06:16:32 INFO - Cleaning up... 06:16:32 INFO - Return code: 0 06:16:32 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:16:32 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')]} 06:16:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:16:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:32 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')]} 06:16:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:16:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:32 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 0x7f9ab576bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2990ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x298df60>, '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 0x298ed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x298f1d0>, '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': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', '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 06:16:32 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 06:16:32 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 06:16:32 INFO - Using env: {'DISPLAY': ':0', 06:16:32 INFO - 'HOME': '/home/cltbld', 06:16:32 INFO - 'LANG': 'en_US.UTF-8', 06:16:32 INFO - 'LANGUAGE': 'en_US:en', 06:16:32 INFO - 'LOGNAME': 'cltbld', 06:16:32 INFO - 'MAIL': '/var/mail/cltbld', 06:16:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:16:32 INFO - 'MOZ_NO_REMOTE': '1', 06:16:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:16:32 INFO - 'NO_EM_RESTART': '1', 06:16:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:16:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:16:32 INFO - 'PWD': '/builds/slave/test', 06:16:32 INFO - 'SHELL': '/bin/bash', 06:16:32 INFO - 'SHLVL': '1', 06:16:32 INFO - 'TERM': 'linux', 06:16:32 INFO - 'TMOUT': '86400', 06:16:32 INFO - 'USER': 'cltbld', 06:16:32 INFO - 'XDG_SESSION_COOKIE': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', 06:16:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:16:32 INFO - '_': '/tools/buildbot/bin/python'} 06:16:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:16:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:16:32 INFO - Running setup.py (path:/tmp/pip-hqd4Dc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:16:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:16:32 INFO - Running setup.py (path:/tmp/pip-4Xmx6T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:16:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:16:32 INFO - Running setup.py (path:/tmp/pip-3x6Hxe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:16:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:16:33 INFO - Running setup.py (path:/tmp/pip-54fPud-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:16:33 INFO - Running setup.py (path:/tmp/pip-ibg3Oo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:16:33 INFO - Running setup.py (path:/tmp/pip-rm9ZLO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:16:33 INFO - Running setup.py (path:/tmp/pip-UuXky7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:16:33 INFO - Running setup.py (path:/tmp/pip-D9kgO0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:16:33 INFO - Running setup.py (path:/tmp/pip-qcU4Rs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:16:33 INFO - Running setup.py (path:/tmp/pip-lYIY6s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:16:33 INFO - Running setup.py (path:/tmp/pip-9ouyl4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:16:33 INFO - Running setup.py (path:/tmp/pip-BBmTLW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:16:33 INFO - Running setup.py (path:/tmp/pip-9QCnvN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:16:33 INFO - Running setup.py (path:/tmp/pip-Bs4vCQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:16:33 INFO - Running setup.py (path:/tmp/pip-h_1aJG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:16:33 INFO - Running setup.py (path:/tmp/pip-SuDs3r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:16:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:16:33 INFO - Running setup.py (path:/tmp/pip-D921Jw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:16:33 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 06:16:34 INFO - Running setup.py install for manifestparser 06:16:34 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 06:16:34 INFO - Running setup.py install for mozcrash 06:16:34 INFO - Running setup.py install for mozdebug 06:16:34 INFO - Running setup.py install for mozdevice 06:16:34 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 06:16:34 INFO - Installing dm script to /builds/slave/test/build/venv/bin 06:16:34 INFO - Running setup.py install for mozfile 06:16:34 INFO - Running setup.py install for mozhttpd 06:16:34 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 06:16:34 INFO - Running setup.py install for mozinfo 06:16:34 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 06:16:34 INFO - Running setup.py install for mozInstall 06:16:34 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 06:16:34 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 06:16:34 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 06:16:34 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 06:16:34 INFO - Running setup.py install for mozleak 06:16:34 INFO - Running setup.py install for mozlog 06:16:35 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 06:16:35 INFO - Running setup.py install for moznetwork 06:16:35 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 06:16:35 INFO - Running setup.py install for mozprocess 06:16:35 INFO - Running setup.py install for mozprofile 06:16:35 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 06:16:35 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 06:16:35 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 06:16:35 INFO - Running setup.py install for mozrunner 06:16:35 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 06:16:35 INFO - Running setup.py install for mozscreenshot 06:16:35 INFO - Running setup.py install for moztest 06:16:35 INFO - Running setup.py install for mozversion 06:16:35 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 06:16:35 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 06:16:35 INFO - Cleaning up... 06:16:35 INFO - Return code: 0 06:16:35 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:16: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')]} 06:16:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:16:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16: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')]} 06:16:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:16:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:35 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 0x7f9ab576bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2990ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x298df60>, '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 0x298ed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x298f1d0>, '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': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', '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 06:16:35 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 06:16:35 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 06:16:35 INFO - Using env: {'DISPLAY': ':0', 06:16:35 INFO - 'HOME': '/home/cltbld', 06:16:35 INFO - 'LANG': 'en_US.UTF-8', 06:16:35 INFO - 'LANGUAGE': 'en_US:en', 06:16:35 INFO - 'LOGNAME': 'cltbld', 06:16:35 INFO - 'MAIL': '/var/mail/cltbld', 06:16:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:16:35 INFO - 'MOZ_NO_REMOTE': '1', 06:16:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:16:35 INFO - 'NO_EM_RESTART': '1', 06:16:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:16:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:16:35 INFO - 'PWD': '/builds/slave/test', 06:16:35 INFO - 'SHELL': '/bin/bash', 06:16:35 INFO - 'SHLVL': '1', 06:16:35 INFO - 'TERM': 'linux', 06:16:35 INFO - 'TMOUT': '86400', 06:16:35 INFO - 'USER': 'cltbld', 06:16:35 INFO - 'XDG_SESSION_COOKIE': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', 06:16:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:16:35 INFO - '_': '/tools/buildbot/bin/python'} 06:16:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:16:36 INFO - Running setup.py (path:/tmp/pip-zP9TYd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:16:36 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)) 06:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:16:36 INFO - Running setup.py (path:/tmp/pip-G2iFNB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:16:36 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:16:36 INFO - Running setup.py (path:/tmp/pip-6J5N0S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:16:36 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)) 06:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:16:36 INFO - Running setup.py (path:/tmp/pip-hjGqJL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:16:36 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)) 06:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:16:36 INFO - Running setup.py (path:/tmp/pip-HzRKl8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:16:36 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)) 06:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:16:36 INFO - Running setup.py (path:/tmp/pip-CdZlHL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:16:36 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)) 06:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:16:36 INFO - Running setup.py (path:/tmp/pip-CL1tXw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:16:36 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)) 06:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:16:36 INFO - Running setup.py (path:/tmp/pip-KkM3lJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:16:36 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)) 06:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:16:36 INFO - Running setup.py (path:/tmp/pip-tZkLQ0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:16:36 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)) 06:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:16:36 INFO - Running setup.py (path:/tmp/pip-Ed_BLH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:16:36 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)) 06:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:16:36 INFO - Running setup.py (path:/tmp/pip-sPT20W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:16:36 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)) 06:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:16:36 INFO - Running setup.py (path:/tmp/pip-b_9365-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:16:36 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)) 06:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:16:36 INFO - Running setup.py (path:/tmp/pip-6_juwc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:16:36 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)) 06:16:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:16:36 INFO - Running setup.py (path:/tmp/pip-tp9wB5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:16:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 06:16:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:16:37 INFO - Running setup.py (path:/tmp/pip-rEpCKM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:16:37 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)) 06:16:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:16:37 INFO - Running setup.py (path:/tmp/pip-r802lR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:16:37 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)) 06:16:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:16:37 INFO - Running setup.py (path:/tmp/pip-nmMlAQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:16:37 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)) 06:16:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:16:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:16:37 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)) 06:16:37 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)) 06:16:37 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)) 06:16:37 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 06:16:37 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 06:16:37 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 06:16:37 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 06:16:37 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 06:16:37 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 06:16:37 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 06:16:39 INFO - Downloading blessings-1.6.tar.gz 06:16:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 06:16:39 INFO - Installing collected packages: blessings 06:16:39 INFO - Running setup.py install for blessings 06:16:39 INFO - Successfully installed blessings 06:16:39 INFO - Cleaning up... 06:16:39 INFO - Return code: 0 06:16:39 INFO - Done creating virtualenv /builds/slave/test/build/venv. 06:16:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:16:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:16:39 INFO - Reading from file tmpfile_stdout 06:16:39 INFO - Current package versions: 06:16:39 INFO - argparse == 1.2.1 06:16:39 INFO - blessings == 1.6 06:16:39 INFO - blobuploader == 1.2.4 06:16:39 INFO - docopt == 0.6.1 06:16:39 INFO - functools32 == 3.2.3-2 06:16:39 INFO - jsonschema == 2.5.1 06:16:39 INFO - manifestparser == 1.1 06:16:39 INFO - mozInstall == 1.12 06:16:39 INFO - mozcrash == 1.0 06:16:39 INFO - mozdebug == 0.1 06:16:39 INFO - mozdevice == 0.48 06:16:39 INFO - mozfile == 1.2 06:16:39 INFO - mozhttpd == 0.7 06:16:39 INFO - mozinfo == 0.9 06:16:39 INFO - mozleak == 0.1 06:16:39 INFO - mozlog == 3.4 06:16:39 INFO - moznetwork == 0.27 06:16:39 INFO - mozprocess == 0.23 06:16:39 INFO - mozprofile == 0.28 06:16:39 INFO - mozrunner == 6.13 06:16:39 INFO - mozscreenshot == 0.1 06:16:39 INFO - mozsystemmonitor == 0.3 06:16:39 INFO - moztest == 0.7 06:16:39 INFO - mozversion == 1.4 06:16:39 INFO - psutil == 3.1.1 06:16:39 INFO - requests == 1.2.3 06:16:39 INFO - wsgiref == 0.1.2 06:16:39 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:16:39 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')]} 06:16:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:16:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:39 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')]} 06:16:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:16:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:39 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 0x7f9ab576bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2990ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x298df60>, '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 0x298ed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x298f1d0>, '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': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', '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 06:16:39 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 06:16:39 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 06:16:39 INFO - Using env: {'DISPLAY': ':0', 06:16:39 INFO - 'HOME': '/home/cltbld', 06:16:39 INFO - 'LANG': 'en_US.UTF-8', 06:16:39 INFO - 'LANGUAGE': 'en_US:en', 06:16:39 INFO - 'LOGNAME': 'cltbld', 06:16:39 INFO - 'MAIL': '/var/mail/cltbld', 06:16:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:16:39 INFO - 'MOZ_NO_REMOTE': '1', 06:16:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:16:39 INFO - 'NO_EM_RESTART': '1', 06:16:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:16:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:16:39 INFO - 'PWD': '/builds/slave/test', 06:16:39 INFO - 'SHELL': '/bin/bash', 06:16:39 INFO - 'SHLVL': '1', 06:16:39 INFO - 'TERM': 'linux', 06:16:39 INFO - 'TMOUT': '86400', 06:16:39 INFO - 'USER': 'cltbld', 06:16:39 INFO - 'XDG_SESSION_COOKIE': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', 06:16:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:16:39 INFO - '_': '/tools/buildbot/bin/python'} 06:16:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:16:39 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)) 06:16:39 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)) 06:16:39 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)) 06:16:39 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)) 06:16:39 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)) 06:16:39 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)) 06:16:39 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)) 06:16:39 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)) 06:16:39 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)) 06:16:39 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)) 06:16:39 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)) 06:16:39 INFO - Cleaning up... 06:16:39 INFO - Return code: 0 06:16:39 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 06:16:39 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')]} 06:16:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:16:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:39 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')]} 06:16:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:16:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:16:39 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 0x7f9ab576bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28c38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2990ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x298df60>, '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 0x298ed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x298f1d0>, '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': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', '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 06:16:39 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 06:16:39 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 06:16:39 INFO - Using env: {'DISPLAY': ':0', 06:16:39 INFO - 'HOME': '/home/cltbld', 06:16:39 INFO - 'LANG': 'en_US.UTF-8', 06:16:39 INFO - 'LANGUAGE': 'en_US:en', 06:16:39 INFO - 'LOGNAME': 'cltbld', 06:16:39 INFO - 'MAIL': '/var/mail/cltbld', 06:16:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:16:39 INFO - 'MOZ_NO_REMOTE': '1', 06:16:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:16:39 INFO - 'NO_EM_RESTART': '1', 06:16:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:16:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:16:39 INFO - 'PWD': '/builds/slave/test', 06:16:39 INFO - 'SHELL': '/bin/bash', 06:16:39 INFO - 'SHLVL': '1', 06:16:39 INFO - 'TERM': 'linux', 06:16:39 INFO - 'TMOUT': '86400', 06:16:39 INFO - 'USER': 'cltbld', 06:16:39 INFO - 'XDG_SESSION_COOKIE': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', 06:16:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:16:39 INFO - '_': '/tools/buildbot/bin/python'} 06:16:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:16:40 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 06:16:40 INFO - Cleaning up... 06:16:40 INFO - Return code: 0 06:16:40 INFO - Running post-action listener: _resource_record_post_action 06:16:40 INFO - Running post-action listener: _start_resource_monitoring 06:16:40 INFO - Starting resource monitoring. 06:16:40 INFO - [mozharness: 2016-12-19 14:16:40.232510Z] Finished create-virtualenv step (success) 06:16:40 INFO - [mozharness: 2016-12-19 14:16:40.233019Z] Running install step. 06:16:40 INFO - Running pre-action listener: _resource_record_pre_action 06:16:40 INFO - Running main action method: install 06:16:40 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:16:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:16:40 INFO - Reading from file tmpfile_stdout 06:16:40 INFO - Detecting whether we're running mozinstall >=1.0... 06:16:40 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 06:16:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 06:16:40 INFO - Reading from file tmpfile_stdout 06:16:40 INFO - Output received: 06:16:40 INFO - Usage: mozinstall [options] installer 06:16:40 INFO - Options: 06:16:40 INFO - -h, --help show this help message and exit 06:16:40 INFO - -d DEST, --destination=DEST 06:16:40 INFO - Directory to install application into. [default: 06:16:40 INFO - "/builds/slave/test"] 06:16:40 INFO - --app=APP Application being installed. [default: firefox] 06:16:40 INFO - mkdir: /builds/slave/test/build/application 06:16:40 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 06:16:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 06:16:56 INFO - Reading from file tmpfile_stdout 06:16:56 INFO - Output received: 06:16:56 INFO - /builds/slave/test/build/application/firefox/firefox 06:16:56 INFO - Running post-action listener: _resource_record_post_action 06:16:56 INFO - [mozharness: 2016-12-19 14:16:56.447477Z] Finished install step (success) 06:16:56 INFO - [mozharness: 2016-12-19 14:16:56.447719Z] Running run-tests step. 06:16:56 INFO - Running pre-action listener: _resource_record_pre_action 06:16:56 INFO - Running main action method: run_tests 06:16:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 06:16:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 06:16:56 INFO - Python 2.7.3 06:16:56 INFO - Return code: 0 06:16:56 INFO - grabbing minidump binary from tooltool 06:16: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')]} 06:16:56 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 0x298df60>, '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 0x298ed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x298f1d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 06:16:56 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 06:16:56 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 06:16:56 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 06:16:56 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 06:16:56 INFO - Return code: 0 06:16:56 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 06:16:56 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 06:16:56 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 06:16:56 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 06:16:56 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 06:16:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-060', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 06:16:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-060 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 06:16:56 INFO - Using env: {'DISPLAY': ':0', 06:16:56 INFO - 'HOME': '/home/cltbld', 06:16:56 INFO - 'LANG': 'en_US.UTF-8', 06:16:56 INFO - 'LANGUAGE': 'en_US:en', 06:16:56 INFO - 'LOGNAME': 'cltbld', 06:16:56 INFO - 'MAIL': '/var/mail/cltbld', 06:16:56 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 06:16:56 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 06:16:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:16:56 INFO - 'MOZ_NO_REMOTE': '1', 06:16:56 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 06:16:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:16:56 INFO - 'NO_EM_RESTART': '1', 06:16:56 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:16:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:16:56 INFO - 'PWD': '/builds/slave/test', 06:16:56 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 06:16:56 INFO - 'SHELL': '/bin/bash', 06:16:56 INFO - 'SHLVL': '1', 06:16:56 INFO - 'TERM': 'linux', 06:16:56 INFO - 'TMOUT': '86400', 06:16:56 INFO - 'USER': 'cltbld', 06:16:56 INFO - 'XDG_SESSION_COOKIE': '337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408', 06:16:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:16:56 INFO - '_': '/tools/buildbot/bin/python'} 06:16:56 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-060', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 06:16:56 INFO - mozversion application_buildid: 20161219043738 06:16:56 INFO - mozversion application_changeset: 818666e181d63b44c88a782c0d81f6a9d6d51134 06:16:56 INFO - mozversion application_display_name: FirefoxDeveloperEdition 06:16:56 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 06:16:56 INFO - mozversion application_name: Firefox 06:16:56 INFO - mozversion application_remotingname: firefox-dev 06:16:56 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 06:16:56 INFO - mozversion application_vendor: Mozilla 06:16:56 INFO - mozversion application_version: 52.0a2 06:16:56 INFO - mozversion platform_buildid: 20161219043738 06:16:56 INFO - mozversion platform_changeset: 818666e181d63b44c88a782c0d81f6a9d6d51134 06:16:56 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 06:16:56 INFO - mozversion platform_version: 52.0a2 06:16:56 INFO - using testdate: 1482157016 06:16:56 INFO - actual date: 1482157016 06:16:56 INFO - starting webserver on 'localhost:59645' 06:16:56 INFO - SUITE-START | Running 2 tests 06:16:56 INFO - TEST-START | dromaeo_css 06:16:56 INFO - operating with platform_type : linux_ 06:16:56 INFO - Initialising browser for dromaeo_css test... 06:16:56 INFO - TEST-INFO | started process 6776 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmporXSVU/profile http://localhost:59645/getInfo.html) 06:17:00 INFO - PROCESS | 6776 | __metrics Screen width/height:1600/1200 06:17:00 INFO - PROCESS | 6776 | colorDepth:24 06:17:00 INFO - PROCESS | 6776 | Browser inner width/height: 1024/697 06:17:00 INFO - PROCESS | 6776 | __metrics 06:17:01 INFO - PROCESS | 6776 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 06:17:01 INFO - PROCESS | 6776 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 06:17:01 INFO - PROCESS | 6776 | console.error: PushService: 06:17:01 INFO - PROCESS | 6776 | stateChangeProcessEnqueue: Error transitioning state 06:17:01 INFO - PROCESS | 6776 | UnknownError 06:17:02 INFO - TEST-INFO | 6776: exit 0 06:17:02 INFO - Browser initialized. 06:17:02 INFO - Running cycle 1/1 for dromaeo_css test... 06:17:02 INFO - TEST-INFO | started process 6872 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmporXSVU/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:17:14 INFO - PROCESS | 6872 | RSS: Main: 144355328 06:17:14 INFO - PROCESS | 6872 | 06:18:05 INFO - PROCESS | 6872 | 1482157085307 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] 06:20:15 INFO - PROCESS | 6872 | Cycle 1(1): loaded http://localhost:59645/tests/dromaeo/cssquery-dojo.html (next: http://localhost:59645/tests/dromaeo/cssquery-ext.html) 06:20:16 INFO - PROCESS | 6872 | RSS: Main: 239812608 06:20:16 INFO - PROCESS | 6872 | 06:23:19 INFO - PROCESS | 6872 | Cycle 1(1): loaded http://localhost:59645/tests/dromaeo/cssquery-ext.html (next: http://localhost:59645/tests/dromaeo/cssquery-jquery.html) 06:23:19 INFO - PROCESS | 6872 | RSS: Main: 233070592 06:23:19 INFO - PROCESS | 6872 | 06:26:21 INFO - PROCESS | 6872 | Cycle 1(1): loaded http://localhost:59645/tests/dromaeo/cssquery-jquery.html (next: http://localhost:59645/tests/dromaeo/cssquery-mootools.html) 06:26:22 INFO - PROCESS | 6872 | RSS: Main: 216576000 06:26:22 INFO - PROCESS | 6872 | 06:29:24 INFO - PROCESS | 6872 | Cycle 1(1): loaded http://localhost:59645/tests/dromaeo/cssquery-mootools.html (next: http://localhost:59645/tests/dromaeo/cssquery-prototype.html) 06:29:25 INFO - PROCESS | 6872 | RSS: Main: 174067712 06:29:25 INFO - PROCESS | 6872 | 06:32:27 INFO - PROCESS | 6872 | Cycle 1(1): loaded http://localhost:59645/tests/dromaeo/cssquery-prototype.html (next: http://localhost:59645/tests/dromaeo/cssquery-yui.html) 06:32:28 INFO - PROCESS | 6872 | RSS: Main: 174436352 06:32:28 INFO - PROCESS | 6872 | 06:35:30 INFO - PROCESS | 6872 | Cycle 1(1): loaded http://localhost:59645/tests/dromaeo/cssquery-yui.html (next: http://localhost:59645/tests/dromaeo/cssquery-dojo.html) 06:35:31 INFO - PROCESS | 6872 | RSS: Main: 260124672 06:35:31 INFO - PROCESS | 6872 | 06:35:31 INFO - PROCESS | 6872 | __start_tp_report 06:35:31 INFO - PROCESS | 6872 | _x_x_mozilla_page_load 06:35:31 INFO - PROCESS | 6872 | _x_x_mozilla_page_load_details 06:35:31 INFO - PROCESS | 6872 | |i|pagename|runs| 06:35:31 INFO - PROCESS | 6872 | |0;dojo.html;3173.968260317397;3251.1872031992;3253.707166355028;3260.3642289753507;3283.3597448497553;5524.944750552493;5590.608657393984;5593.608447408683;5603.7478313475885;5607.971960140204;5569.721513924308;5615.578831587627;5629.127485239795;5636.379998200205;5667.979763642543;5106.642535022541;5127.179651255799;5147.099257629919;5194.065068287726;5206.921896171561;5006.799728010893;5032.5470707636305;5044.243363495469;5149.17613181891;5210.505002024802;5026.673266237683;5092.134337162691;5116.616253780962;5124.5644120249635;5130.4356520782685;5119.974400128012;5200.869978250536;5209.505097015796;5211.895762084737;5229.947700522984;4913.950860491421;4921.188003979375;5078.873028174288;5092.28707980883;5158.896822063538;5429.077056900336;5440.619156659035;5458.863528411782;5476.342838859323;5504.311961004874;5860.882782344329;5884.205632239636;5929.9703501482645;5940.37626049263;5941.019731744257;5728.914066289009;5955.464008239279;5982.4316689914385;5982.760689572412;5982.910256346158;5413.052715774724;5522.861928451781;5554.416786237427;5569.27599412082;5615.522680572197;6092.878142437126;6094.8171554853425;6097.298810636745;6099.664518451527;6111.236095488064;5700.714964251771;5881.794137205177;5892.469677729025;5892.6759028253855;5894.38108998549;5831.591788574844;5884.941150588439;5912.556558258062;5937.732802023919;5944.881102377928;5953.107033944856;6014.51883849291;6030.698465076729;6040.9730345840435;6042.667653279024;5986.235231653981;6031.125486804389;6031.517478601701;6039.909401358983;6059.575829691879;4464.531224221475;4498.167838949739;4603.49361570227;4656.906861862743;4664.370310008173;4083.3670781028986;4102.630763231324;4108.096218831853;4133.297339452301;4181.811818468176;5636.971815140898;5646.858828529237;5648.576356773258;5653.717314134276;5686.289213848269;5716.371199168088;6007.8197654070445;6011.729472173763;6011.909821352683;6025.246844144482;5447.836564903059;5551.444855514416;5594.860128496739;5595.748191331319;5699.116636921284;5167.121589329823;5193.428722840485;5207.71357575337;5214.217867319857;5216.947830521646;6262.091996660459;6265.686715664289;6275.843103922256;6282.717277722422;6283.59156654816;5744.511716504144;5807.332156801853;5957.582969192115;5981.3719559445635;6008.699565021819;6271.717772700148;6277.121203031488;6281.780137695341;6283.434490895841;6290.779822706183;5920.200772895776;5949.970250148722;5954.940450595612;5957.702114894151;5959.970200148971;5713;5758.2514273144225;5902.881942361215;5946.167536544801;6071.483923866521;5831.70841457917;5882.49998750111;5882.617629854046;5900.64596124234;5915.201447804491;5858.414158584278;5866.208061911588;5876.44173803488;5876.500497457764;5884.264466941632;5578.107502799533;5606.887862242651;5791.160281759206;5885.264341957255;5941.58408911372;6000.369961154191;6028.57799953999;6047.425494578008;6056.545759068175;6071.150038994632;5840.415958404295;5876.559258055578;5879.559033072451;5887.7056147193325;5890.028145356139 06:35:31 INFO - PROCESS | 6872 | |1;ext.html;565.8132816170664;620.8758248350331;643.584887747403;659.4691273524813;680.6902859199065;34443.827780861095;44954.775226123864;45809.31286030712;45897.541024589744;45987.54012459879;48207.03585928279;48610.75694621522;48664.05343786244;48791;48848.75575622126;8264.132266112061;8719.433236839617;8845.159709827589;8860.424072435304;8862.911370886273;8495.915040849604;10503.422311772849;10787;10799.892001079967;11100.61147859825;10850.29473084247;10859.40273284973;10900.236983411165;10921.890781092206;10922.890771092267;10693.518791654395;10709.732256693605;10730.785384292349;10775.784484310348;10784.46077696116;10683;10709.571617135305;10726.19553533488;10748.032677059024;10749.355038697704;43884.561154388364;44150.33774493385;44235.77882110569;44260;44275;3862.439946207784;3897.1815918657117;3961.4652021976954;3997.960020399788;4019.7588144711117;33713.42299211351;33777.685101059025;33871.49192762111;34193;34625.30749385023;3590.0845284452557;3664.1022949377307;3769.321522126016;3778.1310298631192;3851.6726078283377;371794;376435;377502;377789;379052;38161.42757858634;65503.34496655068;65887;66128.33871661319;66212.66893665597;39192;41212.58787412087;41477.1704565907;41495.58504414917;41535.1692966139;15842.68314633724;15959.521214363587;15961.760573591173;15978.280977356048;15980.76028859568;11994.700132496757;12203.938980305042;12988.220706757626;13082.476700932046;13186.208827470191;9267.814643707223;9324.8601270981;9330.300227482965;9369.016253293443;9458.43249405038;3506.859725610947;3511.17487390463;3567.500549923013;3575.5530558680166;3591.2099338145567;956.7560272130562;1038.2213339995003;1043.7077618266896;1051.5163025008583;1163.9243449175947;29080.418391632473;29312.120636380943;29690.851545742134;29712.405751884842;30126.54810177849;1114.4706264524448;1121.220751577662;1136.494260054268;1200.3878022208562;1207.4807832632052;15471.22643867802;16503.33986640521;16666.83333166677;16719.582010449834;16820.74768878468;545411;550427;550581;550648;551485;62043.06935395973;62594.37405625977;62602.686986564775;62610.68694656497;62829.68585157136;1308.6662900960193;1322.5966080345586;1335.2389138191331;1397.699494608664;1404.1785555450176;32346.191345216557;34483;34737;34770.130746731535;35146.64853351536;54239.45760542502;54829.45170548243;54852.451475486334;54921;55036.44963550313;396914;397101;398242;398772;401025;30412.5438118424;31067;32401.675983239867;32614.83692581617;32660.223880970385;51450.48549514457;51541.742291288305;51746.48253517417;51755.741221293654;52159.73920130527;42986.57013429826;43727.78136109426;43797.78101109474;43944;45311.77344113258;43501.56498435102;44537.55462445334;44593.331100032876;45375.319370210134;45663.086738264385;43250.134997300505;43397;43614.34578481262;43928.12143757171;44108.779456102515;31655.52516712297;33749.325013500085;34131.65868341285;34188.65811341855;34560.82719586386;29069.563956541093;29505;29517.704822951495;29619.259518512208;30053.69946300509 06:35:31 INFO - PROCESS | 6872 | |2;jquery.html;387.55624809593;404.6843462099562;423.9830406783729;424.8215749385257;426.5393375154833;14900.552983410502;16616;20280.391588252376;20540.89729551354;21014;19729.80270197301;20151.496212594655;20347.287844925395;20781.896090519564;21000.89499552504;5590.720463976795;5657.066584013633;5794.623349482291;5839.270091238595;5849.590528662995;3974.3839704845795;5803.303603567578;5862.384449632791;5862.648241105548;5868.9413105868825;4150.273702102135;4293.935590966138;4528.20756367636;6484.578502397329;6568.573042752206;5583.776648934037;6504.382083702065;6544.345565443417;6552.639604821733;6563.146790917174;5643.943560564383;5723.141528770676;5732.197492351074;5733.598648094635;5737.196792449061;24119.87940060306;26086.217413477625;26926.326841828915;27549.724502754918;28515.287117822012;2543.7201907790127;2617.437250991046;2705.8647067646734;2824.985875070632;2841.6732075811337;16359.345626174938;16669.416570420097;16759.74860377083;16806.411775587796;16820.66358672832;2024.004473379392;2124.968125478119;2127.181035301405;2127.8084972352563;2170.3597438755605;84399.57800211021;87582.56208718916;96642.033579664;96711;97663;18629.534261643566;18819.153138108817;19209.711854322195;19372.80627193738;19631.21475141007;34679.65320346764;34850.30299394049;35064.47403288953;35065.474017889755;35088;10326.741831454123;10369;10464.738381540523;10493.108085812639;10891.67324980252;8778.517181555077;8826.77933051666;8856.114388561222;9035.819283614292;9038.502882341403;9188.540572971458;9455.101765332283;9511.429314241168;9542.328148118539;9624.855627165598;3395.185155562647;3421.6920477157178;3452.5684289463816;3481.7040551552896;3594.514740509998;882.580774132282;926.1107341024235;945.4327403557947;945.5603144537823;995.437577768573;18372.81627183738;19311.903440482707;19410.320638777575;19414.514637133903;20037;980.6616717232544;994.9303548751518;1006.8137394582026;1017.699778565325;1019.1541020952592;10187;10631.574737010433;11058.391788451552;11098.223124381217;11196.66410007701;508729;514343;514415;525163;532627;101289;101882.49058754808;102910.48544757228;103122.48438757758;103454.48272758738;1031.6028329093353;1033.89661033896;1059.4861492176442;1066.6213494209444;1066.802641511323;17537.82462175413;17804.821951780315;17962.5509362267;17967.191476383334;18095.431552558406;42631.360529592705;43140;43740.12519749523;44161.11677766491;45153.322700160184;62983;63609;63893;64276.678616606616;65291;8678.349123815613;8709.782255443664;8750.868736968823;8868.068852770366;8880.822383552422;12683.682907927376;12823.230606163661;13636.045476816527;14082.929585352007;14143.080699754482;11435.714107147054;11440.313581185155;11800.76398472043;11965.401729913296;11998.700032499257;10941.507632156412;11395.08839292838;11477.196596238184;11487.770244594894;11547.4803633835;11159.497822598165;11595.768084638428;11814.468348924147;12024;12121.575744848888;8394.622241999246;8670.306375490072;8757.74911794609;8780.868286975572;8891;11130.109591232844;11552.768944621228;11724.824127637921;12057.457414416547;12189.512419503475 06:35:31 INFO - PROCESS | 6872 | |3;mootools.html;1328.4818920620964;1484.2504535209719;1524.154094477565;1686.8650507959364;1848.2329833119256;7506.587137707424;8553.272971797396;8909.509976951273;8921.464712117278;9219.446833190013;8940.955295223532;9021.233195178402;9028.006919238895;9031.412958157714;9043.457392556451;2501.16211069292;2527.9241622751347;2530.5065512225124;2530.6963164420204;2533.4553071089713;2457.447074408262;2537.8984840606445;2544.6564713763682;2546.045233037611;2547.2358292512263;2446.425090103833;2476.3561474016706;2500.237427584586;2500.8374455660323;2503.987480062597;2382.7259865115475;2407.9999999999914;2436.9756302437013;2452.5340185364903;2453.116877923946;2374.655674927126;2381.142788596104;2401.6277476991095;2402.9639555406684;2468.0868078810777;8682.739517814476;8863.867041994376;8943.239824614915;9042.819143617156;9045.412048216846;5479.260299859548;5642.322921249476;5642.407547207526;5647.068233741427;5649.576281778883;3505.6494350564994;3628.2199327144526;3692.630736926286;3774.1319496515957;3777.4145007523603;1080.6595922284534;1092.20814909191;1106.7288514314046;1109.3177695717156;1131.2759833706434;11887.10846686502;11934.880651193464;11957.342346170957;12004.879951200464;12010.219335743148;4638;4731.7634118293945;4799.0401919616215;4817.301491283744;4879.243717223836;9939.751506212258;9947.701568952943;9959.05388988045;9959.05388988045;9968.202543796478;5602.299712535933;5610.523105535994;5614.803481878114;5616.1014237721765;5619.662820230799;4283.700140990163;4489.775511224426;4508.391367165456;4997.950020499821;5146.790504231502;3956.4658771066115;3984.561698213194;4095.488063992001;4101.22076805412;4102.446169767043;1197.3713800254761;1251.8497780266425;1270.9364531773374;1274;1286.1318609938255;825.8472182646229;843.6498852976069;843.7131375332293;858.0218550852034;897.8877640294963;5619.971900140473;5738.68437235956;5759.481646651738;5820.126980952807;5902.6458412495385;1042.5048102151568;1043.446973104256;1043.874735031801;1086.5110700184948;1119.0152665654173;4053.959460405358;4096;4167.729097608646;4171.144915292358;4233.915321693549;11078.833817492745;11195.888041119648;11253.212275140662;11292.604758833566;11301.26541774782;11022.669319920415;11214.327140371604;11239.775204495865;11252.606158784403;11325.943370283261;8348.33213342931;8555.401121921406;8561.657533698582;8562.700305489278;8567.657293708307;5792.913106303325;5823.505002074701;5842.269716285465;5910.586258961831;6020.729067192075;9892.356996795474;10140.087392134743;10184.490775461049;10271.691849244535;10285.228607854291;8900.510471924106;9182.494962777111;10572.154227661615;10653.307535010199;10701.518431670438;7869.0950540688555;8124.471909325875;8194.795130121556;8202.38482113832;8340.833183336177;8435.198656127657;8465.66137354499;8671.34964877624;8678.305735541267;8687.39188256816;7501.5874126923545;7529.322360987538;7585.62071896414;7619.771406857803;7731.497452665559;7449.81375465596;7509.324160825552;7562.432817538596;7652.579108149105;7685.11621163551;7049.506534542533;7064.540804847668;7145.17830449505;7145.678444469907;7147.53541019832;4974.104661161025;4991.450940396481;5018.323943451794;5088.643794934319;5241.344831896013;4988.176950803222;5051.722155281348;5085.949140508696;5110.054639891632;5267 06:35:31 INFO - PROCESS | 6872 | |4;prototype.html;335.12532290721214;335.2875140326806;338.41961036821846;342.1548774526918;343.4779135713715;5396.325459317585;5417.674939503632;5433.375161856387;5438.374586922505;5447.972760136204;5280.049591073605;5302.496262855023;5342.198670199472;5348.090824559825;5365.409804921455;3895.6883449324127;3933.6656384207377;3997.240524300381;4124.401961715549;4137.648299894513;4142.964258935266;4181.247375472413;4185.225733239346;4185.707000509966;4202.495700515927;4136.937945930814;4157.127003329305;4161.83352665893;4178.164367126572;4181.372794080882;4045.1707399982934;4195.769232692201;4205.488417171665;4213.515445723735;4223.21870453967;3663.4871118043493;3702.4631428442726;3722.2555488902326;3730.570984336809;3755.4930084438524;5186.392218412267;5187.533122019036;5192.870178245536;5197.350331208599;5207.401148867891;4602.4477062752685;4776.4268287805335;4783.952160478386;4791.688540244908;4798.5441383068555;5486.753096110685;5523.226748255248;5539.14143307788;5548.472895075001;5556.666600004012;4086.7956602169775;4092.9795351023354;4103.097318589906;4113.4858142732155;4137.40007698882;5361.273914629334;5517.310336207974;5797.391273916221;5803.593748437569;5808.215890854765;4137.834486620562;4158.625723684883;4165.854390042762;4171.270027745132;4174.248635245624;4234.788260586958;4238.491381034296;4244.702870799015;4247.23549761046;4255.978720106442;4602.677812553089;4787.234042553175;4790.0419916016235;4794.328793968847;4804.42346918372;5560.470870510642;5592.0921121016845;5594.1888426177975;5594.300712410949;5604.523615492729;1411.7741161414124;1412.865777751112;1418.191630770451;1422.9146251224959;1434.1323499282992;965.7778710896533;1000.7540611938183;1006.5671761142632;1013.1843865688191;1019.7100667655421;5202.323697919322;5205.750619851208;5218.373795144607;5261.73718307611;5269.841904742864;5530.446955304518;5538.280023596906;5541.672497550958;5541.695206763667;5557.610967232255;4941.308216849644;5159.535641792257;5197.194434862602;5209;5211.817586384458;2922.2840404100707;2935.515639919432;2937.3537821679197;2942.6763056063814;2953.1288269960414;5733.222700962715;5749.482546570829;5753.568482363839;5756.913646295309;5772;5346.518813306821;5547.833564992976;5590.413006634245;5591.440855914458;5616.831495055155;5697.544196464356;5706.229658996065;5708.002199230236;5712.428757124338;5724.341700704389;5257.369115706139;5498.718032016668;5518.475744804237;5525.668459892419;5544.61187716856;5439.3200849893765;5449.23710680513;5451.454854514675;5462.726863656721;5465.305755215896;5636.971815140898;5685.317761868437;5781.335146458211;5799.3040835100055;5884.558283220638;4175.123224122846;4184.979075104605;4210.389493523361;4210.7473551587;4215.283401821759;5626.35296940857;5766.826995190151;5778.248827652546;5794.768209271582;5833.358330583547;5605.5515558756015;5611.186377975252;5644.52021578154;5645.943540564542;5651;5634.267545219095;5634.802781902614;5644.181593668813;5653.773849045992;5665.3201615806365;5279.47205279469;5530.834074977757;5539.9169012464035;5576.522221611195;5613.410591887956;5624.550035997192;5629.8592535186945;5643.181738647955;5644.745986430538;5674.375818659862;5523.226748255328;5528.308961379827;5572.3034620672415;5579.832605021856;5589.832305030855 06:35:31 INFO - PROCESS | 6872 | |5;yui.html;826.7354446577094;827.2141465607674;843.4180415513296;862.3790870573189;878.0648609231164;14813.963022588423;15571.532854014384;15708.214589270548;15725.528234152966;15825.366985320588;13669.93165034176;13780;13804.792928106086;13817.170969741823;14262.286885655702;706.5725236232082;817.264461984216;837.7235512280932;839.9626461320295;840.9579521023954;711.4912837321315;799.9520028798262;826.2109685250572;833.7748807821885;835.8286551256978;883.152173913041;883.3728053082319;883.377219060564;889.4307643108416;889.9065598112202;734.6143274780729;868.9608967596473;869.8956125264946;870.5603670146567;871.0636066228798;559.0970582509259;620.407510827159;636.6848410037061;641.1056576076347;643.0707627478296;15281.694366112726;15298.847011529853;15316.387344506207;15316.923415382851;15321.616959575987;14287.285635718172;14548.272586370638;14674.633134171625;14681.77977330341;14705.191214483199;13365.66585835352;13406.93296533511;13432.731345373135;13622.523211687643;14228.288585570783;4403.031333106712;4414.911701765979;4585.426821647294;4607.723536587815;4655.333011222386;64438.3556164437;64712.352876471574;67401;67443.66278168578;68035;11948.522059117538;12019.218750781347;12044.277343359252;12075.698107547381;12153.756924861631;21272.680909786366;21332.573348533253;21491;21554.353369398945;21868.343949681534;7987.480813747088;8256.174382561696;8713.085126061798;8723.651053957898;8807.163319484638;4753.35829662998;4773.64197685175;4816.759162041884;4819.855404337875;4921;3563.3407819553468;3665.3585622516484;3679.2089700714473;3683.6684698377276;3684.410494320896;609.975600975956;630.700417301778;640.5516138702926;656.5732274021924;659.0476761080289;614.2690198663576;649.6654223075026;659.4691273524762;660.2077506991533;669.8924411988795;8876.689315873913;8900.955495222483;8940.8658870117;9010.63957441695;9267.985862902142;612.4120843989731;642.4121928435522;659.535027805396;665.9733610655519;687.5908834243617;4171.249175148502;4198.832046718158;4212.262854000538;4279.2083464559155;4405.163019026375;92507;94811;95242.52378738062;95971.52014239885;99507;80914;81973;82649;83302;86822.13177868267;75714;75839;76642.23357766462;76907.61546192234;77146.2285377139;8345.165483451607;8414.663413463393;8500.31997440191;8596.527191004554;8597.398182127192;50617;51535.742321288155;52554.73722631362;53089;53296.4670353307;61918.380816193065;62527.37472625398;72064;72432;73614.63192684003;11775.175737698279;12306.50773969067;12571;12814.807777883525;13127.606171814861;13636.250006249751;13694.726105477635;13706;13710.17738935667;14805.259737013323;12589.93705031469;13041.413136408695;13088.411021504246;13575.592732218049;13615.863841361459;13308.534201302908;13630.591082267549;13702.794458083335;13902.721945561234;14617.780733289223;13705.588832335046;13740.519081832088;13804.516841910485;14010.78983815264;14313.64215894611;11176.329420234812;11422.200445968703;11790.351530665896;11972.461239244081;12267.141300108906;10743.892561074603;10749.731256718645;10778.08386287143;10796;11168 06:35:31 INFO - PROCESS | 6872 | __end_tp_report 06:35:31 INFO - PROCESS | 6872 | __start_cc_report 06:35:31 INFO - PROCESS | 6872 | _x_x_mozilla_cycle_collect,1047 06:35:31 INFO - PROCESS | 6872 | __end_cc_report 06:35:31 INFO - PROCESS | 6872 | __startTimestamp1482158131184__endTimestamp 06:35:31 INFO - PROCESS | 6872 | 06:35:31 INFO - PROCESS | 6872 | ------- Summary: start ------- 06:35:31 INFO - PROCESS | 6872 | Number of tests: 6 06:35:31 INFO - PROCESS | 6872 | 06:35:31 INFO - PROCESS | 6872 | [#0] dojo.html Cycles:165 Average:5562.33 Median:5758.25 stddev:629.39 (10.9%) stddev-sans-first:602.79 06:35:31 INFO - PROCESS | 6872 | Values: 3174.0 3251.2 3253.7 3260.4 3283.4 5524.9 5590.6 5593.6 5603.7 5608.0 5569.7 5615.6 5629.1 5636.4 5668.0 5106.6 5127.2 5147.1 5194.1 5206.9 5006.8 5032.5 5044.2 5149.2 5210.5 5026.7 5092.1 5116.6 5124.6 5130.4 5120.0 5200.9 5209.5 5211.9 5229.9 4914.0 4921.2 5078.9 5092.3 5158.9 5429.1 5440.6 5458.9 5476.3 5504.3 5860.9 5884.2 5930.0 5940.4 5941.0 5728.9 5955.5 5982.4 5982.8 5982.9 5413.1 5522.9 5554.4 5569.3 5615.5 6092.9 6094.8 6097.3 6099.7 6111.2 5700.7 5881.8 5892.5 5892.7 5894.4 5831.6 5884.9 5912.6 5937.7 5944.9 5953.1 6014.5 6030.7 6041.0 6042.7 5986.2 6031.1 6031.5 6039.9 6059.6 4464.5 4498.2 4603.5 4656.9 4664.4 4083.4 4102.6 4108.1 4133.3 4181.8 5637.0 5646.9 5648.6 5653.7 5686.3 5716.4 6007.8 6011.7 6011.9 6025.2 5447.8 5551.4 5594.9 5595.7 5699.1 5167.1 5193.4 5207.7 5214.2 5216.9 6262.1 6265.7 6275.8 6282.7 6283.6 5744.5 5807.3 5957.6 5981.4 6008.7 6271.7 6277.1 6281.8 6283.4 6290.8 5920.2 5950.0 5954.9 5957.7 5960.0 5713.0 5758.3 5902.9 5946.2 6071.5 5831.7 5882.5 5882.6 5900.6 5915.2 5858.4 5866.2 5876.4 5876.5 5884.3 5578.1 5606.9 5791.2 5885.3 5941.6 6000.4 6028.6 6047.4 6056.5 6071.2 5840.4 5876.6 5879.6 5887.7 5890.0 06:35:31 INFO - PROCESS | 6872 | 06:35:31 INFO - PROCESS | 6872 | [#1] ext.html Cycles:180 Average:60494.33 Median:190783.57 stddev:118843.05 (62.3%) stddev-sans-first:119091.26 06:35:31 INFO - PROCESS | 6872 | Values: 565.8 620.9 643.6 659.5 680.7 34443.8 44954.8 45809.3 45897.5 45987.5 48207.0 48610.8 48664.1 48791.0 48848.8 8264.1 8719.4 8845.2 8860.4 8862.9 8495.9 10503.4 10787.0 10799.9 11100.6 10850.3 10859.4 10900.2 10921.9 10922.9 10693.5 10709.7 10730.8 10775.8 10784.5 10683.0 10709.6 10726.2 10748.0 10749.4 43884.6 44150.3 44235.8 44260.0 44275.0 3862.4 3897.2 3961.5 3998.0 4019.8 33713.4 33777.7 33871.5 34193.0 34625.3 3590.1 3664.1 3769.3 3778.1 3851.7 371794.0 376435.0 377502.0 377789.0 379052.0 38161.4 65503.3 65887.0 66128.3 66212.7 39192.0 41212.6 41477.2 41495.6 41535.2 15842.7 15959.5 15961.8 15978.3 15980.8 11994.7 12203.9 12988.2 13082.5 13186.2 9267.8 9324.9 9330.3 9369.0 9458.4 3506.9 3511.2 3567.5 3575.6 3591.2 956.8 1038.2 1043.7 1051.5 1163.9 29080.4 29312.1 29690.9 29712.4 30126.5 1114.5 1121.2 1136.5 1200.4 1207.5 15471.2 16503.3 16666.8 16719.6 16820.7 545411.0 550427.0 550581.0 550648.0 551485.0 62043.1 62594.4 62602.7 62610.7 62829.7 1308.7 1322.6 1335.2 1397.7 1404.2 32346.2 34483.0 34737.0 34770.1 35146.6 54239.5 54829.5 54852.5 54921.0 55036.4 396914.0 397101.0 398242.0 398772.0 401025.0 30412.5 31067.0 32401.7 32614.8 32660.2 51450.5 51541.7 51746.5 51755.7 52159.7 42986.6 43727.8 43797.8 43944.0 45311.8 43501.6 44537.6 44593.3 45375.3 45663.1 43250.1 43397.0 43614.3 43928.1 44108.8 31655.5 33749.3 34131.7 34188.7 34560.8 29069.6 29505.0 29517.7 29619.3 30053.7 06:35:31 INFO - PROCESS | 6872 | 06:35:31 INFO - PROCESS | 6872 | [#2] jquery.html Cycles:180 Average:32029.12 Median:2833.33 stddev:85743.89 (3026.3%) stddev-sans-first:85951.51 06:35:31 INFO - PROCESS | 6872 | Values: 387.6 404.7 424.0 424.8 426.5 14900.6 16616.0 20280.4 20540.9 21014.0 19729.8 20151.5 20347.3 20781.9 21000.9 5590.7 5657.1 5794.6 5839.3 5849.6 3974.4 5803.3 5862.4 5862.6 5868.9 4150.3 4293.9 4528.2 6484.6 6568.6 5583.8 6504.4 6544.3 6552.6 6563.1 5643.9 5723.1 5732.2 5733.6 5737.2 24119.9 26086.2 26926.3 27549.7 28515.3 2543.7 2617.4 2705.9 2825.0 2841.7 16359.3 16669.4 16759.7 16806.4 16820.7 2024.0 2125.0 2127.2 2127.8 2170.4 84399.6 87582.6 96642.0 96711.0 97663.0 18629.5 18819.2 19209.7 19372.8 19631.2 34679.7 34850.3 35064.5 35065.5 35088.0 10326.7 10369.0 10464.7 10493.1 10891.7 8778.5 8826.8 8856.1 9035.8 9038.5 9188.5 9455.1 9511.4 9542.3 9624.9 3395.2 3421.7 3452.6 3481.7 3594.5 882.6 926.1 945.4 945.6 995.4 18372.8 19311.9 19410.3 19414.5 20037.0 980.7 994.9 1006.8 1017.7 1019.2 10187.0 10631.6 11058.4 11098.2 11196.7 508729.0 514343.0 514415.0 525163.0 532627.0 101289.0 101882.5 102910.5 103122.5 103454.5 1031.6 1033.9 1059.5 1066.6 1066.8 17537.8 17804.8 17962.6 17967.2 18095.4 42631.4 43140.0 43740.1 44161.1 45153.3 62983.0 63609.0 63893.0 64276.7 65291.0 8678.3 8709.8 8750.9 8868.1 8880.8 12683.7 12823.2 13636.0 14082.9 14143.1 11435.7 11440.3 11800.8 11965.4 11998.7 10941.5 11395.1 11477.2 11487.8 11547.5 11159.5 11595.8 11814.5 12024.0 12121.6 8394.6 8670.3 8757.7 8780.9 8891.0 11130.1 11552.8 11724.8 12057.5 12189.5 06:35:31 INFO - PROCESS | 6872 | 06:35:31 INFO - PROCESS | 6872 | [#3] mootools.html Cycles:180 Average:5865.86 Median:4981.14 stddev:3278.88 (65.8%) stddev-sans-first:3270.34 06:35:31 INFO - PROCESS | 6872 | Values: 1328.5 1484.3 1524.2 1686.9 1848.2 7506.6 8553.3 8909.5 8921.5 9219.4 8941.0 9021.2 9028.0 9031.4 9043.5 2501.2 2527.9 2530.5 2530.7 2533.5 2457.4 2537.9 2544.7 2546.0 2547.2 2446.4 2476.4 2500.2 2500.8 2504.0 2382.7 2408.0 2437.0 2452.5 2453.1 2374.7 2381.1 2401.6 2403.0 2468.1 8682.7 8863.9 8943.2 9042.8 9045.4 5479.3 5642.3 5642.4 5647.1 5649.6 3505.6 3628.2 3692.6 3774.1 3777.4 1080.7 1092.2 1106.7 1109.3 1131.3 11887.1 11934.9 11957.3 12004.9 12010.2 4638.0 4731.8 4799.0 4817.3 4879.2 9939.8 9947.7 9959.1 9959.1 9968.2 5602.3 5610.5 5614.8 5616.1 5619.7 4283.7 4489.8 4508.4 4998.0 5146.8 3956.5 3984.6 4095.5 4101.2 4102.4 1197.4 1251.8 1270.9 1274.0 1286.1 825.8 843.6 843.7 858.0 897.9 5620.0 5738.7 5759.5 5820.1 5902.6 1042.5 1043.4 1043.9 1086.5 1119.0 4054.0 4096.0 4167.7 4171.1 4233.9 11078.8 11195.9 11253.2 11292.6 11301.3 11022.7 11214.3 11239.8 11252.6 11325.9 8348.3 8555.4 8561.7 8562.7 8567.7 5792.9 5823.5 5842.3 5910.6 6020.7 9892.4 10140.1 10184.5 10271.7 10285.2 8900.5 9182.5 10572.2 10653.3 10701.5 7869.1 8124.5 8194.8 8202.4 8340.8 8435.2 8465.7 8671.3 8678.3 8687.4 7501.6 7529.3 7585.6 7619.8 7731.5 7449.8 7509.3 7562.4 7652.6 7685.1 7049.5 7064.5 7145.2 7145.7 7147.5 4974.1 4991.5 5018.3 5088.6 5241.3 4988.2 5051.7 5085.9 5110.1 5267.0 06:35:31 INFO - PROCESS | 6872 | 06:35:31 INFO - PROCESS | 6872 | [#4] prototype.html Cycles:180 Average:4673.37 Median:5279.76 stddev:1348.16 (25.5%) stddev-sans-first:1312.03 06:35:31 INFO - PROCESS | 6872 | Values: 335.1 335.3 338.4 342.2 343.5 5396.3 5417.7 5433.4 5438.4 5448.0 5280.0 5302.5 5342.2 5348.1 5365.4 3895.7 3933.7 3997.2 4124.4 4137.6 4143.0 4181.2 4185.2 4185.7 4202.5 4136.9 4157.1 4161.8 4178.2 4181.4 4045.2 4195.8 4205.5 4213.5 4223.2 3663.5 3702.5 3722.3 3730.6 3755.5 5186.4 5187.5 5192.9 5197.4 5207.4 4602.4 4776.4 4784.0 4791.7 4798.5 5486.8 5523.2 5539.1 5548.5 5556.7 4086.8 4093.0 4103.1 4113.5 4137.4 5361.3 5517.3 5797.4 5803.6 5808.2 4137.8 4158.6 4165.9 4171.3 4174.2 4234.8 4238.5 4244.7 4247.2 4256.0 4602.7 4787.2 4790.0 4794.3 4804.4 5560.5 5592.1 5594.2 5594.3 5604.5 1411.8 1412.9 1418.2 1422.9 1434.1 965.8 1000.8 1006.6 1013.2 1019.7 5202.3 5205.8 5218.4 5261.7 5269.8 5530.4 5538.3 5541.7 5541.7 5557.6 4941.3 5159.5 5197.2 5209.0 5211.8 2922.3 2935.5 2937.4 2942.7 2953.1 5733.2 5749.5 5753.6 5756.9 5772.0 5346.5 5547.8 5590.4 5591.4 5616.8 5697.5 5706.2 5708.0 5712.4 5724.3 5257.4 5498.7 5518.5 5525.7 5544.6 5439.3 5449.2 5451.5 5462.7 5465.3 5637.0 5685.3 5781.3 5799.3 5884.6 4175.1 4185.0 4210.4 4210.7 4215.3 5626.4 5766.8 5778.2 5794.8 5833.4 5605.6 5611.2 5644.5 5645.9 5651.0 5634.3 5634.8 5644.2 5653.8 5665.3 5279.5 5530.8 5539.9 5576.5 5613.4 5624.6 5629.9 5643.2 5644.7 5674.4 5523.2 5528.3 5572.3 5579.8 5589.8 06:35:31 INFO - PROCESS | 6872 | 06:35:31 INFO - PROCESS | 6872 | [#5] yui.html Cycles:180 Average:19130.55 Median:51076.37 stddev:25748.77 (50.4%) stddev-sans-first:25784.32 06:35:31 INFO - PROCESS | 6872 | Values: 826.7 827.2 843.4 862.4 878.1 14814.0 15571.5 15708.2 15725.5 15825.4 13669.9 13780.0 13804.8 13817.2 14262.3 706.6 817.3 837.7 840.0 841.0 711.5 800.0 826.2 833.8 835.8 883.2 883.4 883.4 889.4 889.9 734.6 869.0 869.9 870.6 871.1 559.1 620.4 636.7 641.1 643.1 15281.7 15298.8 15316.4 15316.9 15321.6 14287.3 14548.3 14674.6 14681.8 14705.2 13365.7 13406.9 13432.7 13622.5 14228.3 4403.0 4414.9 4585.4 4607.7 4655.3 64438.4 64712.4 67401.0 67443.7 68035.0 11948.5 12019.2 12044.3 12075.7 12153.8 21272.7 21332.6 21491.0 21554.4 21868.3 7987.5 8256.2 8713.1 8723.7 8807.2 4753.4 4773.6 4816.8 4819.9 4921.0 3563.3 3665.4 3679.2 3683.7 3684.4 610.0 630.7 640.6 656.6 659.0 614.3 649.7 659.5 660.2 669.9 8876.7 8901.0 8940.9 9010.6 9268.0 612.4 642.4 659.5 666.0 687.6 4171.2 4198.8 4212.3 4279.2 4405.2 92507.0 94811.0 95242.5 95971.5 99507.0 80914.0 81973.0 82649.0 83302.0 86822.1 75714.0 75839.0 76642.2 76907.6 77146.2 8345.2 8414.7 8500.3 8596.5 8597.4 50617.0 51535.7 52554.7 53089.0 53296.5 61918.4 62527.4 72064.0 72432.0 73614.6 11775.2 12306.5 12571.0 12814.8 13127.6 13636.3 13694.7 13706.0 13710.2 14805.3 12589.9 13041.4 13088.4 13575.6 13615.9 13308.5 13630.6 13702.8 13902.7 14617.8 13705.6 13740.5 13804.5 14010.8 14313.6 11176.3 11422.2 11790.4 11972.5 12267.1 10743.9 10749.7 10778.1 10796.0 11168.0 06:35:31 INFO - PROCESS | 6872 | -------- Summary: end -------- 06:35:31 INFO - PROCESS | 6872 | 06:35:32 INFO - TEST-INFO | 6872: exit 0 06:35:32 INFO - TEST-OK | dromaeo_css | took 1115303ms 06:35:32 INFO - TEST-START | kraken 06:35:32 INFO - operating with platform_type : linux_ 06:35:32 INFO - Initialising browser for kraken test... 06:35:32 INFO - TEST-INFO | started process 7192 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpCCgnx4/profile http://localhost:59645/getInfo.html) 06:35:35 INFO - PROCESS | 7192 | __metrics Screen width/height:1600/1200 06:35:35 INFO - PROCESS | 7192 | colorDepth:24 06:35:35 INFO - PROCESS | 7192 | Browser inner width/height: 1024/697 06:35:35 INFO - PROCESS | 7192 | __metrics 06:35:36 INFO - PROCESS | 7192 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 06:35:36 INFO - PROCESS | 7192 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 06:35:36 INFO - PROCESS | 7192 | console.error: PushService: 06:35:36 INFO - PROCESS | 7192 | stateChangeProcessEnqueue: Error transitioning state 06:35:36 INFO - PROCESS | 7192 | UnknownError 06:35:37 INFO - TEST-INFO | 7192: exit 0 06:35:37 INFO - Browser initialized. 06:35:37 INFO - Running cycle 1/1 for kraken test... 06:35:37 INFO - TEST-INFO | started process 7284 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpCCgnx4/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:35:49 INFO - PROCESS | 7284 | RSS: Main: 144666624 06:35:49 INFO - PROCESS | 7284 | 06:35:51 INFO - PROCESS | 7284 | Cycle 1(1): loaded http://localhost:59645/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:59645/tests/kraken/driver.html?testName=audio-beat-detection) 06:35:52 INFO - PROCESS | 7284 | RSS: Main: 186298368 06:35:52 INFO - PROCESS | 7284 | 06:35:55 INFO - PROCESS | 7284 | Cycle 1(1): loaded http://localhost:59645/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:59645/tests/kraken/driver.html?testName=audio-dft) 06:35:55 INFO - PROCESS | 7284 | RSS: Main: 174252032 06:35:55 INFO - PROCESS | 7284 | 06:35:58 INFO - PROCESS | 7284 | Cycle 1(1): loaded http://localhost:59645/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:59645/tests/kraken/driver.html?testName=audio-fft) 06:35:59 INFO - PROCESS | 7284 | RSS: Main: 265953280 06:35:59 INFO - PROCESS | 7284 | 06:36:01 INFO - PROCESS | 7284 | Cycle 1(1): loaded http://localhost:59645/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:59645/tests/kraken/driver.html?testName=audio-oscillator) 06:36:01 INFO - PROCESS | 7284 | RSS: Main: 172478464 06:36:01 INFO - PROCESS | 7284 | 06:36:03 INFO - PROCESS | 7284 | Cycle 1(1): loaded http://localhost:59645/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:59645/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:36:04 INFO - PROCESS | 7284 | RSS: Main: 175431680 06:36:04 INFO - PROCESS | 7284 | 06:36:07 INFO - PROCESS | 7284 | Cycle 1(1): loaded http://localhost:59645/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:59645/tests/kraken/driver.html?testName=imaging-darkroom) 06:36:08 INFO - PROCESS | 7284 | RSS: Main: 214417408 06:36:08 INFO - PROCESS | 7284 | 06:36:11 INFO - PROCESS | 7284 | Cycle 1(1): loaded http://localhost:59645/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:59645/tests/kraken/driver.html?testName=imaging-desaturate) 06:36:11 INFO - PROCESS | 7284 | RSS: Main: 212910080 06:36:11 INFO - PROCESS | 7284 | 06:36:14 INFO - PROCESS | 7284 | Cycle 1(1): loaded http://localhost:59645/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:59645/tests/kraken/driver.html?testName=json-parse-financial) 06:36:15 INFO - PROCESS | 7284 | RSS: Main: 211509248 06:36:15 INFO - PROCESS | 7284 | 06:36:16 INFO - PROCESS | 7284 | Cycle 1(1): loaded http://localhost:59645/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:59645/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:36:17 INFO - PROCESS | 7284 | RSS: Main: 173371392 06:36:17 INFO - PROCESS | 7284 | 06:36:18 INFO - PROCESS | 7284 | Cycle 1(1): loaded http://localhost:59645/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:59645/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:36:19 INFO - PROCESS | 7284 | RSS: Main: 180232192 06:36:19 INFO - PROCESS | 7284 | 06:36:21 INFO - PROCESS | 7284 | Cycle 1(1): loaded http://localhost:59645/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:59645/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:36:22 INFO - PROCESS | 7284 | RSS: Main: 189071360 06:36:22 INFO - PROCESS | 7284 | 06:36:24 INFO - PROCESS | 7284 | Cycle 1(1): loaded http://localhost:59645/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:59645/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:36:25 INFO - PROCESS | 7284 | RSS: Main: 198144000 06:36:25 INFO - PROCESS | 7284 | 06:36:28 INFO - PROCESS | 7284 | Cycle 1(1): loaded http://localhost:59645/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:59645/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:36:28 INFO - PROCESS | 7284 | RSS: Main: 194146304 06:36:28 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | Cycle 1(1): loaded http://localhost:59645/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:59645/tests/kraken/driver.html?testName=ai-astar) 06:36:30 INFO - PROCESS | 7284 | RSS: Main: 245968896 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | __start_tp_report 06:36:30 INFO - PROCESS | 7284 | _x_x_mozilla_page_load 06:36:30 INFO - PROCESS | 7284 | _x_x_mozilla_page_load_details 06:36:30 INFO - PROCESS | 7284 | |i|pagename|runs| 06:36:30 INFO - PROCESS | 7284 | |0;ai-astar;105;110;112;111;111;110;110;111;109;110 06:36:30 INFO - PROCESS | 7284 | |1;audio-beat-detection;142;117;116;153;117;120;118;118;150;119 06:36:30 INFO - PROCESS | 7284 | |2;audio-dft;161;161;160;162;161;163;160;161;161;160 06:36:30 INFO - PROCESS | 7284 | |3;audio-fft;74;76;74;109;74;75;75;75;102;75 06:36:30 INFO - PROCESS | 7284 | |4;audio-oscillator;81;81;110;82;81;82;98;83;82;117 06:36:30 INFO - PROCESS | 7284 | |5;imaging-gaussian-blur;116;117;117;117;117;117;117;117;117;117 06:36:30 INFO - PROCESS | 7284 | |6;imaging-darkroom;146;145;145;147;146;146;146;147;146;147 06:36:30 INFO - PROCESS | 7284 | |7;imaging-desaturate;85;84;85;84;84;84;86;85;85;85 06:36:30 INFO - PROCESS | 7284 | |8;json-parse-financial;49;49;48;51;49;50;51;50;50;48 06:36:30 INFO - PROCESS | 7284 | |9;json-stringify-tinderbox;59;59;58;59;59;61;59;59;59;59 06:36:30 INFO - PROCESS | 7284 | |10;stanford-crypto-aes;83;78;75;74;81;76;80;78;74;76 06:36:30 INFO - PROCESS | 7284 | |11;stanford-crypto-ccm;144;124;132;126;131;127;130;119;160;124 06:36:30 INFO - PROCESS | 7284 | |12;stanford-crypto-pbkdf2;156;153;154;151;152;151;150;149;150;151 06:36:30 INFO - PROCESS | 7284 | |13;stanford-crypto-sha256-iterative;62;64;61;62;63;61;61;61;60;60 06:36:30 INFO - PROCESS | 7284 | __end_tp_report 06:36:30 INFO - PROCESS | 7284 | __start_cc_report 06:36:30 INFO - PROCESS | 7284 | _x_x_mozilla_cycle_collect,1609 06:36:30 INFO - PROCESS | 7284 | __end_cc_report 06:36:30 INFO - PROCESS | 7284 | __startTimestamp1482158190503__endTimestamp 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | ------- Summary: start ------- 06:36:30 INFO - PROCESS | 7284 | Number of tests: 14 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | [#0] ai-astar Cycles:10 Average:109.90 Median:110.50 stddev:1.91 (1.7%) stddev-sans-first:0.88 06:36:30 INFO - PROCESS | 7284 | Values: 105.0 110.0 112.0 111.0 111.0 110.0 110.0 111.0 109.0 110.0 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | [#1] audio-beat-detection Cycles:10 Average:127.00 Median:119.50 stddev:15.00 (12.6%) stddev-sans-first:14.90 06:36:30 INFO - PROCESS | 7284 | Values: 142.0 117.0 116.0 153.0 117.0 120.0 118.0 118.0 150.0 119.0 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | [#2] audio-dft Cycles:10 Average:161.00 Median:161.00 stddev:0.94 (0.6%) stddev-sans-first:1.00 06:36:30 INFO - PROCESS | 7284 | Values: 161.0 161.0 160.0 162.0 161.0 163.0 160.0 161.0 161.0 160.0 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | [#3] audio-fft Cycles:10 Average:80.90 Median:75.00 stddev:13.08 (17.4%) stddev-sans-first:13.64 06:36:30 INFO - PROCESS | 7284 | Values: 74.0 76.0 74.0 109.0 74.0 75.0 75.0 75.0 102.0 75.0 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | [#4] audio-oscillator Cycles:10 Average:89.70 Median:82.00 stddev:13.65 (16.6%) stddev-sans-first:14.11 06:36:30 INFO - PROCESS | 7284 | Values: 81.0 81.0 110.0 82.0 81.0 82.0 98.0 83.0 82.0 117.0 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | [#5] imaging-gaussian-blur Cycles:10 Average:116.90 Median:117.00 stddev:0.32 (0.3%) stddev-sans-first:0.00 06:36:30 INFO - PROCESS | 7284 | Values: 116.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | [#6] imaging-darkroom Cycles:10 Average:146.10 Median:146.00 stddev:0.74 (0.5%) stddev-sans-first:0.78 06:36:30 INFO - PROCESS | 7284 | Values: 146.0 145.0 145.0 147.0 146.0 146.0 146.0 147.0 146.0 147.0 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | [#7] imaging-desaturate Cycles:10 Average:84.70 Median:85.00 stddev:0.67 (0.8%) stddev-sans-first:0.71 06:36:30 INFO - PROCESS | 7284 | Values: 85.0 84.0 85.0 84.0 84.0 84.0 86.0 85.0 85.0 85.0 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | [#8] json-parse-financial Cycles:10 Average:49.50 Median:50.00 stddev:1.08 (2.2%) stddev-sans-first:1.13 06:36:30 INFO - PROCESS | 7284 | Values: 49.0 49.0 48.0 51.0 49.0 50.0 51.0 50.0 50.0 48.0 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | [#9] json-stringify-tinderbox Cycles:10 Average:59.10 Median:59.00 stddev:0.74 (1.3%) stddev-sans-first:0.78 06:36:30 INFO - PROCESS | 7284 | Values: 59.0 59.0 58.0 59.0 59.0 61.0 59.0 59.0 59.0 59.0 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | [#10] stanford-crypto-aes Cycles:10 Average:77.50 Median:78.00 stddev:3.06 (3.9%) stddev-sans-first:2.52 06:36:30 INFO - PROCESS | 7284 | Values: 83.0 78.0 75.0 74.0 81.0 76.0 80.0 78.0 74.0 76.0 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | [#11] stanford-crypto-ccm Cycles:10 Average:131.70 Median:130.50 stddev:11.97 (9.2%) stddev-sans-first:11.84 06:36:30 INFO - PROCESS | 7284 | Values: 144.0 124.0 132.0 126.0 131.0 127.0 130.0 119.0 160.0 124.0 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:151.70 Median:151.50 stddev:2.11 (1.4%) stddev-sans-first:1.56 06:36:30 INFO - PROCESS | 7284 | Values: 156.0 153.0 154.0 151.0 152.0 151.0 150.0 149.0 150.0 151.0 06:36:30 INFO - PROCESS | 7284 | 06:36:30 INFO - PROCESS | 7284 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:61.50 Median:61.50 stddev:1.27 (2.1%) stddev-sans-first:1.33 06:36:30 INFO - PROCESS | 7284 | Values: 62.0 64.0 61.0 62.0 63.0 61.0 61.0 61.0 60.0 60.0 06:36:30 INFO - PROCESS | 7284 | -------- Summary: end -------- 06:36:30 INFO - PROCESS | 7284 | 06:36:31 INFO - TEST-INFO | 7284: exit 0 06:36:31 INFO - TEST-OK | kraken | took 59555ms 06:36:31 INFO - SUITE-END | took 1174s 06:36:31 INFO - Completed test suite (00:19:34) 06:36:31 INFO - javascript benchmark 06:36:31 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3173.968260317397, 3251.1872031992, 3253.707166355028, 3260.3642289753507, 3283.3597448497553, 5524.944750552493, 5590.608657393984, 5593.608447408683, 5603.7478313475885, 5607.971960140204, 5569.721513924308, 5615.578831587627, 5629.127485239795, 5636.379998200205, 5667.979763642543, 5106.642535022541, 5127.179651255799, 5147.099257629919, 5194.065068287726, 5206.921896171561, 5006.799728010893, 5032.5470707636305, 5044.243363495469, 5149.17613181891, 5210.505002024802, 5026.673266237683, 5092.134337162691, 5116.616253780962, 5124.5644120249635, 5130.4356520782685, 5119.974400128012, 5200.869978250536, 5209.505097015796, 5211.895762084737, 5229.947700522984, 4913.950860491421, 4921.188003979375, 5078.873028174288, 5092.28707980883, 5158.896822063538, 5429.077056900336, 5440.619156659035, 5458.863528411782, 5476.342838859323, 5504.311961004874, 5860.882782344329, 5884.205632239636, 5929.9703501482645, 5940.37626049263, 5941.019731744257, 5728.914066289009, 5955.464008239279, 5982.4316689914385, 5982.760689572412, 5982.910256346158, 5413.052715774724, 5522.861928451781, 5554.416786237427, 5569.27599412082, 5615.522680572197, 6092.878142437126, 6094.8171554853425, 6097.298810636745, 6099.664518451527, 6111.236095488064, 5700.714964251771, 5881.794137205177, 5892.469677729025, 5892.6759028253855, 5894.38108998549, 5831.591788574844, 5884.941150588439, 5912.556558258062, 5937.732802023919, 5944.881102377928, 5953.107033944856, 6014.51883849291, 6030.698465076729, 6040.9730345840435, 6042.667653279024, 5986.235231653981, 6031.125486804389, 6031.517478601701, 6039.909401358983, 6059.575829691879, 4464.531224221475, 4498.167838949739, 4603.49361570227, 4656.906861862743, 4664.370310008173, 4083.3670781028986, 4102.630763231324, 4108.096218831853, 4133.297339452301, 4181.811818468176, 5636.971815140898, 5646.858828529237, 5648.576356773258, 5653.717314134276, 5686.289213848269, 5716.371199168088, 6007.8197654070445, 6011.729472173763, 6011.909821352683, 6025.246844144482, 5447.836564903059, 5551.444855514416, 5594.860128496739, 5595.748191331319, 5699.116636921284, 5167.121589329823, 5193.428722840485, 5207.71357575337, 5214.217867319857, 5216.947830521646, 6262.091996660459, 6265.686715664289, 6275.843103922256, 6282.717277722422, 6283.59156654816, 5744.511716504144, 5807.332156801853, 5957.582969192115, 5981.3719559445635, 6008.699565021819, 6271.717772700148, 6277.121203031488, 6281.780137695341, 6283.434490895841, 6290.779822706183, 5920.200772895776, 5949.970250148722, 5954.940450595612, 5957.702114894151, 5959.970200148971, 5713.0, 5758.2514273144225, 5902.881942361215, 5946.167536544801, 6071.483923866521, 5831.70841457917, 5882.49998750111, 5882.617629854046, 5900.64596124234, 5915.201447804491, 5858.414158584278, 5866.208061911588, 5876.44173803488, 5876.500497457764, 5884.264466941632, 5578.107502799533, 5606.887862242651, 5791.160281759206, 5885.264341957255, 5941.58408911372, 6000.369961154191, 6028.57799953999, 6047.425494578008, 6056.545759068175, 6071.150038994632, 5840.415958404295, 5876.559258055578, 5879.559033072451, 5887.7056147193325, 5890.028145356139], "value": 5520.206646988718, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [565.8132816170664, 620.8758248350331, 643.584887747403, 659.4691273524813, 680.6902859199065, 34443.827780861095, 44954.775226123864, 45809.31286030712, 45897.541024589744, 45987.54012459879, 48207.03585928279, 48610.75694621522, 48664.05343786244, 48791.0, 48848.75575622126, 8264.132266112061, 8719.433236839617, 8845.159709827589, 8860.424072435304, 8862.911370886273, 8495.915040849604, 10503.422311772849, 10787.0, 10799.892001079967, 11100.61147859825, 10850.29473084247, 10859.40273284973, 10900.236983411165, 10921.890781092206, 10922.890771092267, 10693.518791654395, 10709.732256693605, 10730.785384292349, 10775.784484310348, 10784.46077696116, 10683.0, 10709.571617135305, 10726.19553533488, 10748.032677059024, 10749.355038697704, 43884.561154388364, 44150.33774493385, 44235.77882110569, 44260.0, 44275.0, 3862.439946207784, 3897.1815918657117, 3961.4652021976954, 3997.960020399788, 4019.7588144711117, 33713.42299211351, 33777.685101059025, 33871.49192762111, 34193.0, 34625.30749385023, 3590.0845284452557, 3664.1022949377307, 3769.321522126016, 3778.1310298631192, 3851.6726078283377, 371794.0, 376435.0, 377502.0, 377789.0, 379052.0, 38161.42757858634, 65503.34496655068, 65887.0, 66128.33871661319, 66212.66893665597, 39192.0, 41212.58787412087, 41477.1704565907, 41495.58504414917, 41535.1692966139, 15842.68314633724, 15959.521214363587, 15961.760573591173, 15978.280977356048, 15980.76028859568, 11994.700132496757, 12203.938980305042, 12988.220706757626, 13082.476700932046, 13186.208827470191, 9267.814643707223, 9324.8601270981, 9330.300227482965, 9369.016253293443, 9458.43249405038, 3506.859725610947, 3511.17487390463, 3567.500549923013, 3575.5530558680166, 3591.2099338145567, 956.7560272130562, 1038.2213339995003, 1043.7077618266896, 1051.5163025008583, 1163.9243449175947, 29080.418391632473, 29312.120636380943, 29690.851545742134, 29712.405751884842, 30126.54810177849, 1114.4706264524448, 1121.220751577662, 1136.494260054268, 1200.3878022208562, 1207.4807832632052, 15471.22643867802, 16503.33986640521, 16666.83333166677, 16719.582010449834, 16820.74768878468, 545411.0, 550427.0, 550581.0, 550648.0, 551485.0, 62043.06935395973, 62594.37405625977, 62602.686986564775, 62610.68694656497, 62829.68585157136, 1308.6662900960193, 1322.5966080345586, 1335.2389138191331, 1397.699494608664, 1404.1785555450176, 32346.191345216557, 34483.0, 34737.0, 34770.130746731535, 35146.64853351536, 54239.45760542502, 54829.45170548243, 54852.451475486334, 54921.0, 55036.44963550313, 396914.0, 397101.0, 398242.0, 398772.0, 401025.0, 30412.5438118424, 31067.0, 32401.675983239867, 32614.83692581617, 32660.223880970385, 51450.48549514457, 51541.742291288305, 51746.48253517417, 51755.741221293654, 52159.73920130527, 42986.57013429826, 43727.78136109426, 43797.78101109474, 43944.0, 45311.77344113258, 43501.56498435102, 44537.55462445334, 44593.331100032876, 45375.319370210134, 45663.086738264385, 43250.134997300505, 43397.0, 43614.34578481262, 43928.12143757171, 44108.779456102515, 31655.52516712297, 33749.325013500085, 34131.65868341285, 34188.65811341855, 34560.82719586386, 29069.563956541093, 29505.0, 29517.704822951495, 29619.259518512208, 30053.69946300509], "value": 19932.55602044435, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [387.55624809593, 404.6843462099562, 423.9830406783729, 424.8215749385257, 426.5393375154833, 14900.552983410502, 16616.0, 20280.391588252376, 20540.89729551354, 21014.0, 19729.80270197301, 20151.496212594655, 20347.287844925395, 20781.896090519564, 21000.89499552504, 5590.720463976795, 5657.066584013633, 5794.623349482291, 5839.270091238595, 5849.590528662995, 3974.3839704845795, 5803.303603567578, 5862.384449632791, 5862.648241105548, 5868.9413105868825, 4150.273702102135, 4293.935590966138, 4528.20756367636, 6484.578502397329, 6568.573042752206, 5583.776648934037, 6504.382083702065, 6544.345565443417, 6552.639604821733, 6563.146790917174, 5643.943560564383, 5723.141528770676, 5732.197492351074, 5733.598648094635, 5737.196792449061, 24119.87940060306, 26086.217413477625, 26926.326841828915, 27549.724502754918, 28515.287117822012, 2543.7201907790127, 2617.437250991046, 2705.8647067646734, 2824.985875070632, 2841.6732075811337, 16359.345626174938, 16669.416570420097, 16759.74860377083, 16806.411775587796, 16820.66358672832, 2024.004473379392, 2124.968125478119, 2127.181035301405, 2127.8084972352563, 2170.3597438755605, 84399.57800211021, 87582.56208718916, 96642.033579664, 96711.0, 97663.0, 18629.534261643566, 18819.153138108817, 19209.711854322195, 19372.80627193738, 19631.21475141007, 34679.65320346764, 34850.30299394049, 35064.47403288953, 35065.474017889755, 35088.0, 10326.741831454123, 10369.0, 10464.738381540523, 10493.108085812639, 10891.67324980252, 8778.517181555077, 8826.77933051666, 8856.114388561222, 9035.819283614292, 9038.502882341403, 9188.540572971458, 9455.101765332283, 9511.429314241168, 9542.328148118539, 9624.855627165598, 3395.185155562647, 3421.6920477157178, 3452.5684289463816, 3481.7040551552896, 3594.514740509998, 882.580774132282, 926.1107341024235, 945.4327403557947, 945.5603144537823, 995.437577768573, 18372.81627183738, 19311.903440482707, 19410.320638777575, 19414.514637133903, 20037.0, 980.6616717232544, 994.9303548751518, 1006.8137394582026, 1017.699778565325, 1019.1541020952592, 10187.0, 10631.574737010433, 11058.391788451552, 11098.223124381217, 11196.66410007701, 508729.0, 514343.0, 514415.0, 525163.0, 532627.0, 101289.0, 101882.49058754808, 102910.48544757228, 103122.48438757758, 103454.48272758738, 1031.6028329093353, 1033.89661033896, 1059.4861492176442, 1066.6213494209444, 1066.802641511323, 17537.82462175413, 17804.821951780315, 17962.5509362267, 17967.191476383334, 18095.431552558406, 42631.360529592705, 43140.0, 43740.12519749523, 44161.11677766491, 45153.322700160184, 62983.0, 63609.0, 63893.0, 64276.678616606616, 65291.0, 8678.349123815613, 8709.782255443664, 8750.868736968823, 8868.068852770366, 8880.822383552422, 12683.682907927376, 12823.230606163661, 13636.045476816527, 14082.929585352007, 14143.080699754482, 11435.714107147054, 11440.313581185155, 11800.76398472043, 11965.401729913296, 11998.700032499257, 10941.507632156412, 11395.08839292838, 11477.196596238184, 11487.770244594894, 11547.4803633835, 11159.497822598165, 11595.768084638428, 11814.468348924147, 12024.0, 12121.575744848888, 8394.622241999246, 8670.306375490072, 8757.74911794609, 8780.868286975572, 8891.0, 11130.109591232844, 11552.768944621228, 11724.824127637921, 12057.457414416547, 12189.512419503475], "value": 10442.801374592886, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1328.4818920620964, 1484.2504535209719, 1524.154094477565, 1686.8650507959364, 1848.2329833119256, 7506.587137707424, 8553.272971797396, 8909.509976951273, 8921.464712117278, 9219.446833190013, 8940.955295223532, 9021.233195178402, 9028.006919238895, 9031.412958157714, 9043.457392556451, 2501.16211069292, 2527.9241622751347, 2530.5065512225124, 2530.6963164420204, 2533.4553071089713, 2457.447074408262, 2537.8984840606445, 2544.6564713763682, 2546.045233037611, 2547.2358292512263, 2446.425090103833, 2476.3561474016706, 2500.237427584586, 2500.8374455660323, 2503.987480062597, 2382.7259865115475, 2407.9999999999914, 2436.9756302437013, 2452.5340185364903, 2453.116877923946, 2374.655674927126, 2381.142788596104, 2401.6277476991095, 2402.9639555406684, 2468.0868078810777, 8682.739517814476, 8863.867041994376, 8943.239824614915, 9042.819143617156, 9045.412048216846, 5479.260299859548, 5642.322921249476, 5642.407547207526, 5647.068233741427, 5649.576281778883, 3505.6494350564994, 3628.2199327144526, 3692.630736926286, 3774.1319496515957, 3777.4145007523603, 1080.6595922284534, 1092.20814909191, 1106.7288514314046, 1109.3177695717156, 1131.2759833706434, 11887.10846686502, 11934.880651193464, 11957.342346170957, 12004.879951200464, 12010.219335743148, 4638.0, 4731.7634118293945, 4799.0401919616215, 4817.301491283744, 4879.243717223836, 9939.751506212258, 9947.701568952943, 9959.05388988045, 9959.05388988045, 9968.202543796478, 5602.299712535933, 5610.523105535994, 5614.803481878114, 5616.1014237721765, 5619.662820230799, 4283.700140990163, 4489.775511224426, 4508.391367165456, 4997.950020499821, 5146.790504231502, 3956.4658771066115, 3984.561698213194, 4095.488063992001, 4101.22076805412, 4102.446169767043, 1197.3713800254761, 1251.8497780266425, 1270.9364531773374, 1274.0, 1286.1318609938255, 825.8472182646229, 843.6498852976069, 843.7131375332293, 858.0218550852034, 897.8877640294963, 5619.971900140473, 5738.68437235956, 5759.481646651738, 5820.126980952807, 5902.6458412495385, 1042.5048102151568, 1043.446973104256, 1043.874735031801, 1086.5110700184948, 1119.0152665654173, 4053.959460405358, 4096.0, 4167.729097608646, 4171.144915292358, 4233.915321693549, 11078.833817492745, 11195.888041119648, 11253.212275140662, 11292.604758833566, 11301.26541774782, 11022.669319920415, 11214.327140371604, 11239.775204495865, 11252.606158784403, 11325.943370283261, 8348.33213342931, 8555.401121921406, 8561.657533698582, 8562.700305489278, 8567.657293708307, 5792.913106303325, 5823.505002074701, 5842.269716285465, 5910.586258961831, 6020.729067192075, 9892.356996795474, 10140.087392134743, 10184.490775461049, 10271.691849244535, 10285.228607854291, 8900.510471924106, 9182.494962777111, 10572.154227661615, 10653.307535010199, 10701.518431670438, 7869.0950540688555, 8124.471909325875, 8194.795130121556, 8202.38482113832, 8340.833183336177, 8435.198656127657, 8465.66137354499, 8671.34964877624, 8678.305735541267, 8687.39188256816, 7501.5874126923545, 7529.322360987538, 7585.62071896414, 7619.771406857803, 7731.497452665559, 7449.81375465596, 7509.324160825552, 7562.432817538596, 7652.579108149105, 7685.11621163551, 7049.506534542533, 7064.540804847668, 7145.17830449505, 7145.678444469907, 7147.53541019832, 4974.104661161025, 4991.450940396481, 5018.323943451794, 5088.643794934319, 5241.344831896013, 4988.176950803222, 5051.722155281348, 5085.949140508696, 5110.054639891632, 5267.0], "value": 4718.2675033898495, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [335.12532290721214, 335.2875140326806, 338.41961036821846, 342.1548774526918, 343.4779135713715, 5396.325459317585, 5417.674939503632, 5433.375161856387, 5438.374586922505, 5447.972760136204, 5280.049591073605, 5302.496262855023, 5342.198670199472, 5348.090824559825, 5365.409804921455, 3895.6883449324127, 3933.6656384207377, 3997.240524300381, 4124.401961715549, 4137.648299894513, 4142.964258935266, 4181.247375472413, 4185.225733239346, 4185.707000509966, 4202.495700515927, 4136.937945930814, 4157.127003329305, 4161.83352665893, 4178.164367126572, 4181.372794080882, 4045.1707399982934, 4195.769232692201, 4205.488417171665, 4213.515445723735, 4223.21870453967, 3663.4871118043493, 3702.4631428442726, 3722.2555488902326, 3730.570984336809, 3755.4930084438524, 5186.392218412267, 5187.533122019036, 5192.870178245536, 5197.350331208599, 5207.401148867891, 4602.4477062752685, 4776.4268287805335, 4783.952160478386, 4791.688540244908, 4798.5441383068555, 5486.753096110685, 5523.226748255248, 5539.14143307788, 5548.472895075001, 5556.666600004012, 4086.7956602169775, 4092.9795351023354, 4103.097318589906, 4113.4858142732155, 4137.40007698882, 5361.273914629334, 5517.310336207974, 5797.391273916221, 5803.593748437569, 5808.215890854765, 4137.834486620562, 4158.625723684883, 4165.854390042762, 4171.270027745132, 4174.248635245624, 4234.788260586958, 4238.491381034296, 4244.702870799015, 4247.23549761046, 4255.978720106442, 4602.677812553089, 4787.234042553175, 4790.0419916016235, 4794.328793968847, 4804.42346918372, 5560.470870510642, 5592.0921121016845, 5594.1888426177975, 5594.300712410949, 5604.523615492729, 1411.7741161414124, 1412.865777751112, 1418.191630770451, 1422.9146251224959, 1434.1323499282992, 965.7778710896533, 1000.7540611938183, 1006.5671761142632, 1013.1843865688191, 1019.7100667655421, 5202.323697919322, 5205.750619851208, 5218.373795144607, 5261.73718307611, 5269.841904742864, 5530.446955304518, 5538.280023596906, 5541.672497550958, 5541.695206763667, 5557.610967232255, 4941.308216849644, 5159.535641792257, 5197.194434862602, 5209.0, 5211.817586384458, 2922.2840404100707, 2935.515639919432, 2937.3537821679197, 2942.6763056063814, 2953.1288269960414, 5733.222700962715, 5749.482546570829, 5753.568482363839, 5756.913646295309, 5772.0, 5346.518813306821, 5547.833564992976, 5590.413006634245, 5591.440855914458, 5616.831495055155, 5697.544196464356, 5706.229658996065, 5708.002199230236, 5712.428757124338, 5724.341700704389, 5257.369115706139, 5498.718032016668, 5518.475744804237, 5525.668459892419, 5544.61187716856, 5439.3200849893765, 5449.23710680513, 5451.454854514675, 5462.726863656721, 5465.305755215896, 5636.971815140898, 5685.317761868437, 5781.335146458211, 5799.3040835100055, 5884.558283220638, 4175.123224122846, 4184.979075104605, 4210.389493523361, 4210.7473551587, 4215.283401821759, 5626.35296940857, 5766.826995190151, 5778.248827652546, 5794.768209271582, 5833.358330583547, 5605.5515558756015, 5611.186377975252, 5644.52021578154, 5645.943540564542, 5651.0, 5634.267545219095, 5634.802781902614, 5644.181593668813, 5653.773849045992, 5665.3201615806365, 5279.47205279469, 5530.834074977757, 5539.9169012464035, 5576.522221611195, 5613.410591887956, 5624.550035997192, 5629.8592535186945, 5643.181738647955, 5644.745986430538, 5674.375818659862, 5523.226748255328, 5528.308961379827, 5572.3034620672415, 5579.832605021856, 5589.832305030855], "value": 4247.614499475413, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [826.7354446577094, 827.2141465607674, 843.4180415513296, 862.3790870573189, 878.0648609231164, 14813.963022588423, 15571.532854014384, 15708.214589270548, 15725.528234152966, 15825.366985320588, 13669.93165034176, 13780.0, 13804.792928106086, 13817.170969741823, 14262.286885655702, 706.5725236232082, 817.264461984216, 837.7235512280932, 839.9626461320295, 840.9579521023954, 711.4912837321315, 799.9520028798262, 826.2109685250572, 833.7748807821885, 835.8286551256978, 883.152173913041, 883.3728053082319, 883.377219060564, 889.4307643108416, 889.9065598112202, 734.6143274780729, 868.9608967596473, 869.8956125264946, 870.5603670146567, 871.0636066228798, 559.0970582509259, 620.407510827159, 636.6848410037061, 641.1056576076347, 643.0707627478296, 15281.694366112726, 15298.847011529853, 15316.387344506207, 15316.923415382851, 15321.616959575987, 14287.285635718172, 14548.272586370638, 14674.633134171625, 14681.77977330341, 14705.191214483199, 13365.66585835352, 13406.93296533511, 13432.731345373135, 13622.523211687643, 14228.288585570783, 4403.031333106712, 4414.911701765979, 4585.426821647294, 4607.723536587815, 4655.333011222386, 64438.3556164437, 64712.352876471574, 67401.0, 67443.66278168578, 68035.0, 11948.522059117538, 12019.218750781347, 12044.277343359252, 12075.698107547381, 12153.756924861631, 21272.680909786366, 21332.573348533253, 21491.0, 21554.353369398945, 21868.343949681534, 7987.480813747088, 8256.174382561696, 8713.085126061798, 8723.651053957898, 8807.163319484638, 4753.35829662998, 4773.64197685175, 4816.759162041884, 4819.855404337875, 4921.0, 3563.3407819553468, 3665.3585622516484, 3679.2089700714473, 3683.6684698377276, 3684.410494320896, 609.975600975956, 630.700417301778, 640.5516138702926, 656.5732274021924, 659.0476761080289, 614.2690198663576, 649.6654223075026, 659.4691273524762, 660.2077506991533, 669.8924411988795, 8876.689315873913, 8900.955495222483, 8940.8658870117, 9010.63957441695, 9267.985862902142, 612.4120843989731, 642.4121928435522, 659.535027805396, 665.9733610655519, 687.5908834243617, 4171.249175148502, 4198.832046718158, 4212.262854000538, 4279.2083464559155, 4405.163019026375, 92507.0, 94811.0, 95242.52378738062, 95971.52014239885, 99507.0, 80914.0, 81973.0, 82649.0, 83302.0, 86822.13177868267, 75714.0, 75839.0, 76642.23357766462, 76907.61546192234, 77146.2285377139, 8345.165483451607, 8414.663413463393, 8500.31997440191, 8596.527191004554, 8597.398182127192, 50617.0, 51535.742321288155, 52554.73722631362, 53089.0, 53296.4670353307, 61918.380816193065, 62527.37472625398, 72064.0, 72432.0, 73614.63192684003, 11775.175737698279, 12306.50773969067, 12571.0, 12814.807777883525, 13127.606171814861, 13636.250006249751, 13694.726105477635, 13706.0, 13710.17738935667, 14805.259737013323, 12589.93705031469, 13041.413136408695, 13088.411021504246, 13575.592732218049, 13615.863841361459, 13308.534201302908, 13630.591082267549, 13702.794458083335, 13902.721945561234, 14617.780733289223, 13705.588832335046, 13740.519081832088, 13804.516841910485, 14010.78983815264, 14313.64215894611, 11176.329420234812, 11422.200445968703, 11790.351530665896, 11972.461239244081, 12267.141300108906, 10743.892561074603, 10749.731256718645, 10778.08386287143, 10796.0, 11168.0], "value": 7415.748155121365, "unit": "score"}], "name": "dromaeo_css", "value": 7448.643213404923, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 110.0, 112.0, 111.0, 111.0, 110.0, 110.0, 111.0, 109.0, 110.0], "value": 109.9, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [142.0, 117.0, 116.0, 153.0, 117.0, 120.0, 118.0, 118.0, 150.0, 119.0], "value": 127.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 161.0, 160.0, 162.0, 161.0, 163.0, 160.0, 161.0, 161.0, 160.0], "value": 161.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 76.0, 74.0, 109.0, 74.0, 75.0, 75.0, 75.0, 102.0, 75.0], "value": 80.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 81.0, 110.0, 82.0, 81.0, 82.0, 98.0, 83.0, 82.0, 117.0], "value": 89.7, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0], "value": 116.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 145.0, 145.0, 147.0, 146.0, 146.0, 146.0, 147.0, 146.0, 147.0], "value": 146.1, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 84.0, 85.0, 84.0, 84.0, 84.0, 86.0, 85.0, 85.0, 85.0], "value": 84.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [49.0, 49.0, 48.0, 51.0, 49.0, 50.0, 51.0, 50.0, 50.0, 48.0], "value": 49.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [59.0, 59.0, 58.0, 59.0, 59.0, 61.0, 59.0, 59.0, 59.0, 59.0], "value": 59.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 78.0, 75.0, 74.0, 81.0, 76.0, 80.0, 78.0, 74.0, 76.0], "value": 77.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [144.0, 124.0, 132.0, 126.0, 131.0, 127.0, 130.0, 119.0, 160.0, 124.0], "value": 131.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [156.0, 153.0, 154.0, 151.0, 152.0, 151.0, 150.0, 149.0, 150.0, 151.0], "value": 151.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 64.0, 61.0, 62.0, 63.0, 61.0, 61.0, 61.0, 60.0, 60.0], "value": 61.5, "unit": "score"}], "name": "kraken", "value": 1447.2, "alertThreshold": 2.0}]} 06:36:31 INFO - Return code: 0 06:36:31 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 06:36:31 INFO - # TBPL SUCCESS # 06:36:31 INFO - Running post-action listener: _resource_record_post_action 06:36:31 INFO - [mozharness: 2016-12-19 14:36:31.798954Z] Finished run-tests step (success) 06:36:31 INFO - Running post-run listener: _resource_record_post_run 06:36:31 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 8192; Write bytes: 372916224; Read time: 168; Write time: 211428 06:36:31 INFO - TinderboxPrint: CPU usage
13.0% 06:36:31 INFO - TinderboxPrint: I/O read bytes / time
8,192 / 168 06:36:31 INFO - TinderboxPrint: I/O write bytes / time
372,916,224 / 211,428 06:36:31 INFO - TinderboxPrint: CPU idle
8,269.3 (87.0%) 06:36:31 INFO - TinderboxPrint: CPU user
1,191.0 (12.5%) 06:36:31 INFO - TinderboxPrint: Swap in / out
0 / 0 06:36:31 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 123994112; Read time: 0; Write time: 67220 06:36:31 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 4096; Write bytes: 247664640; Read time: 152; Write time: 144176 06:36:32 INFO - Running post-run listener: _upload_blobber_files 06:36:32 INFO - Blob upload gear active. 06:36:32 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 06:36:32 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 06:36:32 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', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 06:36:32 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 Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 06:36:32 INFO - (blobuploader) - INFO - Open directory for files ... 06:36:32 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 06:36:32 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:36:32 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:36:33 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 06:36:33 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:36:33 INFO - (blobuploader) - INFO - Done attempting. 06:36:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 06:36:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:36:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:36:34 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 06:36:34 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:36:34 INFO - (blobuploader) - INFO - Done attempting. 06:36:34 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 06:36:34 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:36:34 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:36:38 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 06:36:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:36:38 INFO - (blobuploader) - INFO - Done attempting. 06:36:38 INFO - (blobuploader) - INFO - Iteration through files over. 06:36:38 INFO - Return code: 0 06:36:38 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 06:36:38 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 06:36:38 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a715eae5637585e2c405c49d40abf1337c24a732a8f16960cc4e88dc0fd3b36385d4cb26379a3ff511b371474c993567aaa6d89a8e514dcfaf70ac2b4e77a988", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d5bd2c31be93925e1625b28dd1f22999e3429966f12a2acfc91b825bd5f68eec1ae35cef7fb8b571af7b2c233d81b52d64986c8d5c39a384307e2cce7dcca7ca", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/355737912ebc1d50118d99798da590a7c6325dc047792e48b4633eceff6a726edc3925c91560012acbea6bbe9014c5f12d15f1fd167182f8b08ddb475e8ea30e"} 06:36:38 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 06:36:38 INFO - Writing to file /builds/slave/test/properties/blobber_files 06:36:38 INFO - Contents: 06:36:38 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a715eae5637585e2c405c49d40abf1337c24a732a8f16960cc4e88dc0fd3b36385d4cb26379a3ff511b371474c993567aaa6d89a8e514dcfaf70ac2b4e77a988", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d5bd2c31be93925e1625b28dd1f22999e3429966f12a2acfc91b825bd5f68eec1ae35cef7fb8b571af7b2c233d81b52d64986c8d5c39a384307e2cce7dcca7ca", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/355737912ebc1d50118d99798da590a7c6325dc047792e48b4633eceff6a726edc3925c91560012acbea6bbe9014c5f12d15f1fd167182f8b08ddb475e8ea30e"} 06:36:38 INFO - Running post-run listener: copy_logs_to_upload_dir 06:36:38 INFO - Copying logs to upload dir... 06:36:38 INFO - mkdir: /builds/slave/test/build/upload/logs 06:36:38 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1235.813469 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-12-19 06:36:37.543367) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-12-19 06:36:37.546896) ========= 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=337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a715eae5637585e2c405c49d40abf1337c24a732a8f16960cc4e88dc0fd3b36385d4cb26379a3ff511b371474c993567aaa6d89a8e514dcfaf70ac2b4e77a988", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d5bd2c31be93925e1625b28dd1f22999e3429966f12a2acfc91b825bd5f68eec1ae35cef7fb8b571af7b2c233d81b52d64986c8d5c39a384307e2cce7dcca7ca", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/355737912ebc1d50118d99798da590a7c6325dc047792e48b4633eceff6a726edc3925c91560012acbea6bbe9014c5f12d15f1fd167182f8b08ddb475e8ea30e"} build_url:https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011743 build_url: 'https://queue.taskcluster.net/v1/task/ZhifyXi3Q9WWlReey6RVrw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/a715eae5637585e2c405c49d40abf1337c24a732a8f16960cc4e88dc0fd3b36385d4cb26379a3ff511b371474c993567aaa6d89a8e514dcfaf70ac2b4e77a988", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d5bd2c31be93925e1625b28dd1f22999e3429966f12a2acfc91b825bd5f68eec1ae35cef7fb8b571af7b2c233d81b52d64986c8d5c39a384307e2cce7dcca7ca", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/355737912ebc1d50118d99798da590a7c6325dc047792e48b4633eceff6a726edc3925c91560012acbea6bbe9014c5f12d15f1fd167182f8b08ddb475e8ea30e"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-12-19 06:36:37.571942) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-12-19 06:36:37.572265) ========= 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=337fe3f4b1febe37b85fccc40000019e-1482155944.965370-1323057408 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004502 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-12-19 06:36:37.657168) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-12-19 06:36:37.657466) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-12-19 06:36:37.657742) ========= ========= Total master_lag: 0.17 =========