builder: autoland_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-062 starttime: 1475695688.01 results: success (0) buildid: 20161005120900 builduid: a958bcba410d42df947e87bfa76d4919 revision: 8450da83e7bc128faddb9007b79b0a67e62cdf90 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-05 12:28:08.010525) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-05 12:28:08.011071) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-05 12:28:08.011426) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-05 12:28:08.048073) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-05 12:28:08.048394) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-10-05 12:28:08-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 103M=0s 2016-10-05 12:28:08 (103 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.151975 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-05 12:28:08.219003) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-05 12:28:08.219325) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019807 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-05 12:28:08.271994) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-05 12:28:08.272397) ========= bash -c 'python archiver_client.py mozharness --repo integration/autoland --rev 8450da83e7bc128faddb9007b79b0a67e62cdf90 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/autoland --rev 8450da83e7bc128faddb9007b79b0a67e62cdf90 --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=a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-10-05 12:28:08,877 truncating revision to first 12 chars 2016-10-05 12:28:08,877 Setting DEBUG logging. 2016-10-05 12:28:08,877 attempt 1/10 2016-10-05 12:28:08,877 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/8450da83e7bc?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-05 12:28:09,169 unpacking tar archive at: autoland-8450da83e7bc/testing/mozharness/ program finished with exit code 0 elapsedTime=0.616939 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-05 12:28:08.903408) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-05 12:28:08.903768) ========= script_repo_revision: 8450da83e7bc128faddb9007b79b0a67e62cdf90 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-05 12:28:08.904285) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-05 12:28:08.904590) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-05 12:28:08.914389) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 45 secs) (at 2016-10-05 12:28:08.914804) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Autoland-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland-Non-PGO 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', 'Autoland-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Autoland-Non-PGO'] 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=a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 12:28:09 INFO - MultiFileLogger online at 20161005 12:28:09 in /builds/slave/test 12:28:09 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Autoland-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland-Non-PGO 12:28:09 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 12:28:09 INFO - {'append_to_log': False, 12:28:09 INFO - 'base_work_dir': '/builds/slave/test', 12:28:09 INFO - 'blob_upload_branch': 'Autoland-Non-PGO', 12:28:09 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 12:28:09 INFO - 'branch': 'Autoland-Non-PGO', 12:28:09 INFO - 'buildbot_json_path': 'buildprops.json', 12:28:09 INFO - 'config_files': ('talos/linux_config.py',), 12:28:09 INFO - 'default_actions': ('clobber', 12:28:09 INFO - 'read-buildbot-config', 12:28:09 INFO - 'download-and-extract', 12:28:09 INFO - 'populate-webroot', 12:28:09 INFO - 'create-virtualenv', 12:28:09 INFO - 'install', 12:28:09 INFO - 'run-tests'), 12:28:09 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 12:28:09 INFO - 'download_minidump_stackwalk': True, 12:28:09 INFO - 'download_symbols': 'ondemand', 12:28:09 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 12:28:09 INFO - 'tooltool.py': '/tools/tooltool.py', 12:28:09 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 12:28:09 INFO - '/tools/misc-python/virtualenv.py')}, 12:28:09 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 12:28:09 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 12:28:09 INFO - 'installer_path': 'installer.exe', 12:28:09 INFO - 'log_level': 'info', 12:28:09 INFO - 'log_name': 'talos', 12:28:09 INFO - 'log_to_console': True, 12:28:09 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 12:28:09 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 12:28:09 INFO - 'opt_config_files': (), 12:28:09 INFO - 'pip_index': False, 12:28:09 INFO - 'sps_profile': False, 12:28:09 INFO - 'sps_profile_interval': 0, 12:28:09 INFO - 'suite': 'dromaeojs', 12:28:09 INFO - 'system_bits': '32', 12:28:09 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 12:28:09 INFO - 'title': 'talos-linux64-ix-062', 12:28:09 INFO - 'tooltool_cache': '/builds/tooltool_cache', 12:28:09 INFO - 'use_talos_json': True, 12:28:09 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 12:28:09 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 12:28:09 INFO - 'work_dir': 'build'} 12:28:09 INFO - [mozharness: 2016-10-05 19:28:09.619408Z] Running clobber step. 12:28:09 INFO - Running pre-action listener: _resource_record_pre_action 12:28:09 INFO - Running main action method: clobber 12:28:09 INFO - rmtree: /builds/slave/test/build 12:28:09 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 12:28:10 INFO - Running post-action listener: _resource_record_post_action 12:28:10 INFO - [mozharness: 2016-10-05 19:28:10.594072Z] Finished clobber step (success) 12:28:10 INFO - [mozharness: 2016-10-05 19:28:10.594222Z] Running read-buildbot-config step. 12:28:10 INFO - Running pre-action listener: _resource_record_pre_action 12:28:10 INFO - Running main action method: read_buildbot_config 12:28:10 INFO - Using buildbot properties: 12:28:10 INFO - { 12:28:10 INFO - "project": "", 12:28:10 INFO - "product": "firefox", 12:28:10 INFO - "script_repo_revision": "production", 12:28:10 INFO - "builddir": "autoland_ubuntu64_hw_test-dromaeojs", 12:28:10 INFO - "repository": "", 12:28:10 INFO - "buildername": "Ubuntu HW 12.04 x64 autoland talos dromaeojs", 12:28:10 INFO - "buildid": "20161005120900", 12:28:10 INFO - "pgo_build": "False", 12:28:10 INFO - "basedir": "/builds/slave/test", 12:28:10 INFO - "buildnumber": 793, 12:28:10 INFO - "slavename": "talos-linux64-ix-062", 12:28:10 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 12:28:10 INFO - "platform": "ubuntu64_hw", 12:28:10 INFO - "scheduler": "tests-autoland-linux64-talos", 12:28:10 INFO - "branch": "autoland", 12:28:10 INFO - "repo_path": "integration/autoland", 12:28:10 INFO - "revision": "8450da83e7bc128faddb9007b79b0a67e62cdf90", 12:28:10 INFO - "stage_platform": "linux64", 12:28:10 INFO - "builduid": "a958bcba410d42df947e87bfa76d4919", 12:28:10 INFO - "slavebuilddir": "test" 12:28:10 INFO - } 12:28:10 INFO - Found installer url https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 12:28:10 INFO - Running post-action listener: _resource_record_post_action 12:28:10 INFO - [mozharness: 2016-10-05 19:28:10.596761Z] Finished read-buildbot-config step (success) 12:28:10 INFO - [mozharness: 2016-10-05 19:28:10.596849Z] Running download-and-extract step. 12:28:10 INFO - Running pre-action listener: _resource_record_pre_action 12:28:10 INFO - Running main action method: download_and_extract 12:28:10 INFO - mkdir: /builds/slave/test/build/tests 12:28:10 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')]} 12:28:10 INFO - trying https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 12:28:10 INFO - Downloading https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 12:28:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 12:28:11 INFO - Downloaded 1361 bytes. 12:28:11 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 12:28:11 INFO - Using the following test package requirements: 12:28:11 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 12:28:11 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:28:11 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 12:28:11 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:28:11 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 12:28:11 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:28:11 INFO - u'jsshell-linux-x86_64.zip'], 12:28:11 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:28:11 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 12:28:11 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 12:28:11 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:28:11 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 12:28:11 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:28:11 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 12:28:11 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:28:11 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 12:28:11 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:28:11 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 12:28:11 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 12:28:11 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 12:28:11 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:28:11 INFO - Fetch https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 12:28:11 INFO - Http code: 200 12:28:11 INFO - via: 1.1 441811a054e8d055b893175754efd0c3.cloudfront.net (CloudFront) 12:28:11 INFO - x-amz-cf-id: UbsGZNneyVgJ_cg7c7duN48l1pZGW1CNcw3xHLOBW47SOd6rcvIpxA== 12:28:11 INFO - x-amz-version-id: dDybf.ArT4TE3PffvwLF8ENZmKyZfIl8 12:28:11 INFO - Expected file size: 20421485 12:28:11 INFO - Obtained file size: 20421485 12:28:15 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 12:28:15 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 12:28:15 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:28:15 INFO - Fetch https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 12:28:16 INFO - Http code: 200 12:28:16 INFO - via: 1.1 93ab344e1a3fa44edbf3f1bc5729427a.cloudfront.net (CloudFront) 12:28:16 INFO - x-amz-cf-id: b3TQSINqKbYQGqv96FWHuwTty5HyZ2kpx3GA2UOOl2CdXSPu5GYJdg== 12:28:16 INFO - x-amz-version-id: dDybf.ArT4TE3PffvwLF8ENZmKyZfIl8 12:28:16 INFO - Expected file size: 20421485 12:28:16 INFO - Obtained file size: 20421485 12:28:21 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 12:28:21 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 12:28:21 INFO - Fetch https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 12:28:21 INFO - Http code: 200 12:28:21 INFO - via: 1.1 c0740de9f16cf32ffedfd2f9806b8483.cloudfront.net (CloudFront) 12:28:21 INFO - x-amz-cf-id: JZdg0YQDChd9r8BH0qCU1WhCgXOuFUKpTc9Q2KqZYXhhAEwFdiVtSA== 12:28:21 INFO - x-amz-version-id: .ISGhcUrSRI7eZcgdVjtBWzEusM9v9ZZ 12:28:22 INFO - Expected file size: 14409006 12:28:22 INFO - Obtained file size: 14409006 12:28:22 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')]} 12:28:22 INFO - trying https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 12:28:22 INFO - Downloading https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 12:28:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 12:28:23 INFO - Downloaded 55808111 bytes. 12:28:23 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 12:28:23 INFO - mkdir: /builds/slave/test/properties 12:28:23 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 12:28:23 INFO - Writing to file /builds/slave/test/properties/build_url 12:28:23 INFO - Contents: 12:28:23 INFO - build_url:https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 12:28:24 INFO - Running post-action listener: _resource_record_post_action 12:28:24 INFO - Running post-action listener: set_extra_try_arguments 12:28:24 INFO - [mozharness: 2016-10-05 19:28:24.357796Z] Finished download-and-extract step (success) 12:28:24 INFO - [mozharness: 2016-10-05 19:28:24.358021Z] Running populate-webroot step. 12:28:24 INFO - Running pre-action listener: _resource_record_pre_action 12:28:24 INFO - Running main action method: populate_webroot 12:28:24 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 12:28:24 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 12:28:24 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 12:28:24 INFO - '--tppagecycles', 12:28:24 INFO - '7'], 12:28:24 INFO - 'tests': ['tsvgm']}}, 12:28:24 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 12:28:24 INFO - 'tests': ['tresize', 'tcanvasmark']}, 12:28:24 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 12:28:24 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 12:28:24 INFO - 'tests': ['dromaeo_css', 'kraken']}, 12:28:24 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 12:28:24 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:24 INFO - 'talos_options': ['--disable-e10s'], 12:28:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:28:24 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:28:24 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:24 INFO - 'talos_options': ['--disable-e10s'], 12:28:24 INFO - 'tests': ['damp', 'tps']}, 12:28:24 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:24 INFO - 'tests': ['damp', 'tps']}, 12:28:24 INFO - 'g3': {'talos_options': ['--disable-e10s'], 12:28:24 INFO - 'tests': ['dromaeo_dom']}, 12:28:24 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 12:28:24 INFO - 'g4': {'talos_options': ['--disable-e10s'], 12:28:24 INFO - 'tests': ['basic_compositor_video']}, 12:28:24 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 12:28:24 INFO - 'other': {'talos_options': ['--disable-e10s'], 12:28:24 INFO - 'tests': ['a11yr', 12:28:24 INFO - 'ts_paint', 12:28:24 INFO - 'tpaint', 12:28:24 INFO - 'sessionrestore', 12:28:24 INFO - 'sessionrestore_no_auto_restore', 12:28:24 INFO - 'tabpaint']}, 12:28:24 INFO - 'other-e10s': {'tests': ['a11yr', 12:28:24 INFO - 'ts_paint', 12:28:24 INFO - 'tpaint', 12:28:24 INFO - 'sessionrestore', 12:28:24 INFO - 'sessionrestore_no_auto_restore', 12:28:24 INFO - 'tabpaint']}, 12:28:24 INFO - 'other-e10s_l64': {'tests': ['a11yr', 12:28:24 INFO - 'ts_paint', 12:28:24 INFO - 'tpaint', 12:28:24 INFO - 'sessionrestore', 12:28:24 INFO - 'sessionrestore_no_auto_restore', 12:28:24 INFO - 'tabpaint']}, 12:28:24 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 12:28:24 INFO - 'ts_paint', 12:28:24 INFO - 'tpaint', 12:28:24 INFO - 'sessionrestore', 12:28:24 INFO - 'sessionrestore_no_auto_restore', 12:28:24 INFO - 'tabpaint']}, 12:28:24 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 12:28:24 INFO - 'tests': ['a11yr', 12:28:24 INFO - 'ts_paint', 12:28:24 INFO - 'tpaint', 12:28:24 INFO - 'sessionrestore', 12:28:24 INFO - 'sessionrestore_no_auto_restore', 12:28:24 INFO - 'tabpaint']}, 12:28:24 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 12:28:24 INFO - 'tests': ['a11yr', 12:28:24 INFO - 'ts_paint', 12:28:24 INFO - 'tpaint', 12:28:24 INFO - 'sessionrestore', 12:28:24 INFO - 'sessionrestore_no_auto_restore', 12:28:24 INFO - 'tabpaint']}, 12:28:24 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 12:28:24 INFO - 'tests': ['tsvgx', 12:28:24 INFO - 'tsvgr_opacity', 12:28:24 INFO - 'tart', 12:28:24 INFO - 'tscrollx', 12:28:24 INFO - 'cart']}, 12:28:24 INFO - 'svgr-e10s': {'tests': ['tsvgx', 12:28:24 INFO - 'tsvgr_opacity', 12:28:24 INFO - 'tart', 12:28:24 INFO - 'tscrollx', 12:28:24 INFO - 'cart']}, 12:28:24 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:24 INFO - 'talos_options': ['--disable-e10s'], 12:28:24 INFO - 'tests': ['tp5o']}, 12:28:24 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:24 INFO - 'tests': ['tp5o']}, 12:28:24 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:24 INFO - 'talos_options': ['--disable-e10s', 12:28:24 INFO - '--xperf_path', 12:28:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:28:24 INFO - 'tests': ['tp5n']}, 12:28:24 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:28:24 INFO - 'talos_options': ['--xperf_path', 12:28:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:28:24 INFO - 'tests': ['tp5n']}}, 12:28:24 INFO - 'talos.zip': {'path': '', 12:28:24 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 12:28:24 INFO - Running post-action listener: _resource_record_post_action 12:28:24 INFO - [mozharness: 2016-10-05 19:28:24.374919Z] Finished populate-webroot step (success) 12:28:24 INFO - [mozharness: 2016-10-05 19:28:24.375007Z] Running create-virtualenv step. 12:28:24 INFO - Running pre-action listener: _resource_record_pre_action 12:28:24 INFO - Running main action method: create_virtualenv 12:28:24 INFO - Creating virtualenv /builds/slave/test/build/venv 12:28:24 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 12:28:24 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 12:28:24 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 12:28:24 INFO - Using real prefix '/usr' 12:28:24 INFO - New python executable in /builds/slave/test/build/venv/bin/python 12:28:24 INFO - Installing distribute.............................................................................................................................................................................................done. 12:28:26 INFO - Installing pip.................done. 12:28:26 INFO - Return code: 0 12:28:26 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 12:28:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 12:28:27 INFO - Reading from file tmpfile_stdout 12:28:27 INFO - Output received: 12:28:27 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) 12:28:27 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 12:28:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:27 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 0x7f0151c1af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bed8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cbaca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cb7f60>, '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 0x2cb8d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cb91d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', '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 12:28:27 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 12:28:27 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 12:28:27 INFO - Using env: {'DISPLAY': ':0', 12:28:27 INFO - 'HOME': '/home/cltbld', 12:28:27 INFO - 'LANG': 'en_US.UTF-8', 12:28:27 INFO - 'LANGUAGE': 'en_US:en', 12:28:27 INFO - 'LOGNAME': 'cltbld', 12:28:27 INFO - 'MAIL': '/var/mail/cltbld', 12:28:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:27 INFO - 'MOZ_NO_REMOTE': '1', 12:28:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:27 INFO - 'NO_EM_RESTART': '1', 12:28:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:27 INFO - 'PWD': '/builds/slave/test', 12:28:27 INFO - 'SHELL': '/bin/bash', 12:28:27 INFO - 'SHLVL': '1', 12:28:27 INFO - 'TERM': 'linux', 12:28:27 INFO - 'TMOUT': '86400', 12:28:27 INFO - 'USER': 'cltbld', 12:28:27 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', 12:28:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:27 INFO - '_': '/tools/buildbot/bin/python'} 12:28:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:27 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 12:28:27 INFO - Cleaning up... 12:28:27 INFO - Return code: 0 12:28:27 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 12:28:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:27 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 0x7f0151c1af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bed8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cbaca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cb7f60>, '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 0x2cb8d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cb91d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', '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 12:28:27 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 12:28:27 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 12:28:27 INFO - Using env: {'DISPLAY': ':0', 12:28:27 INFO - 'HOME': '/home/cltbld', 12:28:27 INFO - 'LANG': 'en_US.UTF-8', 12:28:27 INFO - 'LANGUAGE': 'en_US:en', 12:28:27 INFO - 'LOGNAME': 'cltbld', 12:28:27 INFO - 'MAIL': '/var/mail/cltbld', 12:28:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:27 INFO - 'MOZ_NO_REMOTE': '1', 12:28:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:27 INFO - 'NO_EM_RESTART': '1', 12:28:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:27 INFO - 'PWD': '/builds/slave/test', 12:28:27 INFO - 'SHELL': '/bin/bash', 12:28:27 INFO - 'SHLVL': '1', 12:28:27 INFO - 'TERM': 'linux', 12:28:27 INFO - 'TMOUT': '86400', 12:28:27 INFO - 'USER': 'cltbld', 12:28:27 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', 12:28:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:27 INFO - '_': '/tools/buildbot/bin/python'} 12:28:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:27 INFO - Downloading/unpacking psutil>=3.1.1 12:28:27 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 12:28:27 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 12:28:27 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 12:28:27 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 12:28:27 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 12:28:27 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 12:28:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 12:28:29 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:28:29 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:28:29 INFO - Installing collected packages: psutil 12:28:29 INFO - Running setup.py install for psutil 12:28:29 INFO - building 'psutil._psutil_linux' extension 12:28:29 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 12:28:29 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 12:28:29 INFO - building 'psutil._psutil_posix' extension 12:28:29 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 12:28:30 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 12:28:30 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:28:30 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:28:30 INFO - Successfully installed psutil 12:28:30 INFO - Cleaning up... 12:28:30 INFO - Return code: 0 12:28:30 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 12:28:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:28:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:30 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 0x7f0151c1af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bed8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cbaca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cb7f60>, '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 0x2cb8d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cb91d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', '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 12:28:30 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 12:28:30 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 12:28:30 INFO - Using env: {'DISPLAY': ':0', 12:28:30 INFO - 'HOME': '/home/cltbld', 12:28:30 INFO - 'LANG': 'en_US.UTF-8', 12:28:30 INFO - 'LANGUAGE': 'en_US:en', 12:28:30 INFO - 'LOGNAME': 'cltbld', 12:28:30 INFO - 'MAIL': '/var/mail/cltbld', 12:28:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:30 INFO - 'MOZ_NO_REMOTE': '1', 12:28:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:30 INFO - 'NO_EM_RESTART': '1', 12:28:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:30 INFO - 'PWD': '/builds/slave/test', 12:28:30 INFO - 'SHELL': '/bin/bash', 12:28:30 INFO - 'SHLVL': '1', 12:28:30 INFO - 'TERM': 'linux', 12:28:30 INFO - 'TMOUT': '86400', 12:28:30 INFO - 'USER': 'cltbld', 12:28:30 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', 12:28:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:30 INFO - '_': '/tools/buildbot/bin/python'} 12:28:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:30 INFO - Downloading/unpacking mozsystemmonitor==0.3 12:28:30 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 12:28:30 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 12:28:30 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 12:28:30 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 12:28:30 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 12:28:30 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 12:28:32 INFO - Downloading mozsystemmonitor-0.3.tar.gz 12:28:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 12:28:32 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 12:28:32 INFO - Installing collected packages: mozsystemmonitor 12:28:32 INFO - Running setup.py install for mozsystemmonitor 12:28:32 INFO - Successfully installed mozsystemmonitor 12:28:32 INFO - Cleaning up... 12:28:32 INFO - Return code: 0 12:28:32 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 12:28: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')]} 12:28:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28: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')]} 12:28:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:32 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 0x7f0151c1af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bed8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cbaca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cb7f60>, '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 0x2cb8d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cb91d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', '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 12:28:32 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 12:28:32 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 12:28:32 INFO - Using env: {'DISPLAY': ':0', 12:28:32 INFO - 'HOME': '/home/cltbld', 12:28:32 INFO - 'LANG': 'en_US.UTF-8', 12:28:32 INFO - 'LANGUAGE': 'en_US:en', 12:28:32 INFO - 'LOGNAME': 'cltbld', 12:28:32 INFO - 'MAIL': '/var/mail/cltbld', 12:28:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:32 INFO - 'MOZ_NO_REMOTE': '1', 12:28:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:32 INFO - 'NO_EM_RESTART': '1', 12:28:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:32 INFO - 'PWD': '/builds/slave/test', 12:28:32 INFO - 'SHELL': '/bin/bash', 12:28:32 INFO - 'SHLVL': '1', 12:28:32 INFO - 'TERM': 'linux', 12:28:32 INFO - 'TMOUT': '86400', 12:28:32 INFO - 'USER': 'cltbld', 12:28:32 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', 12:28:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:32 INFO - '_': '/tools/buildbot/bin/python'} 12:28:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:32 INFO - Downloading/unpacking jsonschema==2.5.1 12:28:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:28:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:28:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:28:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:28:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:28:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:28:34 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:28:34 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 12:28:34 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 12:28:34 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 12:28:34 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 12:28:34 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 12:28:34 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 12:28:34 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 12:28:34 INFO - Downloading functools32-3.2.3-2.tar.gz 12:28:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 12:28:34 INFO - warning: no files found matching '*.txt' 12:28:34 INFO - no previously-included directories found matching 'build' 12:28:34 INFO - no previously-included directories found matching 'dist' 12:28:34 INFO - no previously-included directories found matching '.git*' 12:28:34 INFO - Installing collected packages: jsonschema, functools32 12:28:34 INFO - Running setup.py install for functools32 12:28:35 INFO - warning: no files found matching '*.txt' 12:28:35 INFO - no previously-included directories found matching 'build' 12:28:35 INFO - no previously-included directories found matching 'dist' 12:28:35 INFO - no previously-included directories found matching '.git*' 12:28:35 INFO - Successfully installed jsonschema functools32 12:28:35 INFO - Cleaning up... 12:28:35 INFO - Return code: 0 12:28:35 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 12:28: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')]} 12:28:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28: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')]} 12:28:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:35 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f0151c1af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bed8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cbaca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cb7f60>, '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 0x2cb8d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cb91d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', '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 12:28:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 12:28:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 12:28:35 INFO - Using env: {'DISPLAY': ':0', 12:28:35 INFO - 'HOME': '/home/cltbld', 12:28:35 INFO - 'LANG': 'en_US.UTF-8', 12:28:35 INFO - 'LANGUAGE': 'en_US:en', 12:28:35 INFO - 'LOGNAME': 'cltbld', 12:28:35 INFO - 'MAIL': '/var/mail/cltbld', 12:28:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:35 INFO - 'MOZ_NO_REMOTE': '1', 12:28:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:35 INFO - 'NO_EM_RESTART': '1', 12:28:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:35 INFO - 'PWD': '/builds/slave/test', 12:28:35 INFO - 'SHELL': '/bin/bash', 12:28:35 INFO - 'SHLVL': '1', 12:28:35 INFO - 'TERM': 'linux', 12:28:35 INFO - 'TMOUT': '86400', 12:28:35 INFO - 'USER': 'cltbld', 12:28:35 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', 12:28:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:35 INFO - '_': '/tools/buildbot/bin/python'} 12:28:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:35 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 12:28:35 INFO - Cleaning up... 12:28:35 INFO - Return code: 0 12:28:35 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 12:28: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')]} 12:28:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28: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')]} 12:28:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:35 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f0151c1af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bed8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cbaca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cb7f60>, '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 0x2cb8d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cb91d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', '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 12:28:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 12:28:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 12:28:35 INFO - Using env: {'DISPLAY': ':0', 12:28:35 INFO - 'HOME': '/home/cltbld', 12:28:35 INFO - 'LANG': 'en_US.UTF-8', 12:28:35 INFO - 'LANGUAGE': 'en_US:en', 12:28:35 INFO - 'LOGNAME': 'cltbld', 12:28:35 INFO - 'MAIL': '/var/mail/cltbld', 12:28:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:35 INFO - 'MOZ_NO_REMOTE': '1', 12:28:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:35 INFO - 'NO_EM_RESTART': '1', 12:28:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:35 INFO - 'PWD': '/builds/slave/test', 12:28:35 INFO - 'SHELL': '/bin/bash', 12:28:35 INFO - 'SHLVL': '1', 12:28:35 INFO - 'TERM': 'linux', 12:28:35 INFO - 'TMOUT': '86400', 12:28:35 INFO - 'USER': 'cltbld', 12:28:35 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', 12:28:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:35 INFO - '_': '/tools/buildbot/bin/python'} 12:28:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:35 INFO - Downloading/unpacking blobuploader==1.2.4 12:28:35 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 12:28:35 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 12:28:35 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 12:28:35 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 12:28:35 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 12:28:35 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 12:28:37 INFO - Downloading blobuploader-1.2.4.tar.gz 12:28:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 12:28:37 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:28: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 12:28: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 12:28: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 12:28: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 12:28: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 12:28: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 12:28:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 12:28:37 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:28: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 12:28: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 12:28: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 12:28: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 12:28: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 12:28: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 12:28:38 INFO - Downloading docopt-0.6.1.tar.gz 12:28:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 12:28:38 INFO - Installing collected packages: blobuploader, requests, docopt 12:28:38 INFO - Running setup.py install for blobuploader 12:28:38 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 12:28:38 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 12:28:38 INFO - Running setup.py install for requests 12:28:38 INFO - Running setup.py install for docopt 12:28:38 INFO - Successfully installed blobuploader requests docopt 12:28:38 INFO - Cleaning up... 12:28:38 INFO - Return code: 0 12:28:38 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:28:38 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')]} 12:28:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:38 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')]} 12:28:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:38 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 0x7f0151c1af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bed8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cbaca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cb7f60>, '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 0x2cb8d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cb91d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', '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 12:28:38 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 12:28:38 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 12:28:38 INFO - Using env: {'DISPLAY': ':0', 12:28:38 INFO - 'HOME': '/home/cltbld', 12:28:38 INFO - 'LANG': 'en_US.UTF-8', 12:28:38 INFO - 'LANGUAGE': 'en_US:en', 12:28:38 INFO - 'LOGNAME': 'cltbld', 12:28:38 INFO - 'MAIL': '/var/mail/cltbld', 12:28:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:38 INFO - 'MOZ_NO_REMOTE': '1', 12:28:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:38 INFO - 'NO_EM_RESTART': '1', 12:28:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:38 INFO - 'PWD': '/builds/slave/test', 12:28:38 INFO - 'SHELL': '/bin/bash', 12:28:38 INFO - 'SHLVL': '1', 12:28:38 INFO - 'TERM': 'linux', 12:28:38 INFO - 'TMOUT': '86400', 12:28:38 INFO - 'USER': 'cltbld', 12:28:38 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', 12:28:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:38 INFO - '_': '/tools/buildbot/bin/python'} 12:28:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:28:39 INFO - Running setup.py (path:/tmp/pip-S6KMlA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:28:39 INFO - Running setup.py (path:/tmp/pip-InL12z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:28:39 INFO - Running setup.py (path:/tmp/pip-7tD1VB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:28:39 INFO - Running setup.py (path:/tmp/pip-7EQ3go-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:28:39 INFO - Running setup.py (path:/tmp/pip-mULAnp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:28:39 INFO - Running setup.py (path:/tmp/pip-5vFRPG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:28:39 INFO - Running setup.py (path:/tmp/pip-1YdFEn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:28:39 INFO - Running setup.py (path:/tmp/pip-GueyLr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:28:39 INFO - Running setup.py (path:/tmp/pip-p0A74U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:28:39 INFO - Running setup.py (path:/tmp/pip-V_6GNN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:28:39 INFO - Running setup.py (path:/tmp/pip-SeyAtR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:28:39 INFO - Running setup.py (path:/tmp/pip-qftlQm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:28:39 INFO - Running setup.py (path:/tmp/pip-hxLe_I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:28:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:28:39 INFO - Running setup.py (path:/tmp/pip-F0rcbs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:28:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:28:40 INFO - Running setup.py (path:/tmp/pip-SUIk7D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:28:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:28:40 INFO - Running setup.py (path:/tmp/pip-mpX4ui-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:28:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:28:40 INFO - Running setup.py (path:/tmp/pip-pcrhNQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:28:40 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:28:40 INFO - Running setup.py install for manifestparser 12:28:40 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 12:28:40 INFO - Running setup.py install for mozcrash 12:28:40 INFO - Running setup.py install for mozdebug 12:28:40 INFO - Running setup.py install for mozdevice 12:28:40 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 12:28:40 INFO - Installing dm script to /builds/slave/test/build/venv/bin 12:28:40 INFO - Running setup.py install for mozfile 12:28:40 INFO - Running setup.py install for mozhttpd 12:28:40 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 12:28:40 INFO - Running setup.py install for mozinfo 12:28:40 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 12:28:40 INFO - Running setup.py install for mozInstall 12:28:41 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 12:28:41 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 12:28:41 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 12:28:41 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 12:28:41 INFO - Running setup.py install for mozleak 12:28:41 INFO - Running setup.py install for mozlog 12:28:41 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 12:28:41 INFO - Running setup.py install for moznetwork 12:28:41 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 12:28:41 INFO - Running setup.py install for mozprocess 12:28:41 INFO - Running setup.py install for mozprofile 12:28:41 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 12:28:41 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 12:28:41 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 12:28:41 INFO - Running setup.py install for mozrunner 12:28:41 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 12:28:41 INFO - Running setup.py install for mozscreenshot 12:28:41 INFO - Running setup.py install for moztest 12:28:41 INFO - Running setup.py install for mozversion 12:28:42 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 12:28:42 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:28:42 INFO - Cleaning up... 12:28:42 INFO - Return code: 0 12:28:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:28:42 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')]} 12:28:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:42 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')]} 12:28:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:42 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 0x7f0151c1af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bed8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cbaca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cb7f60>, '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 0x2cb8d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cb91d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', '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 12:28:42 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 12:28:42 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 12:28:42 INFO - Using env: {'DISPLAY': ':0', 12:28:42 INFO - 'HOME': '/home/cltbld', 12:28:42 INFO - 'LANG': 'en_US.UTF-8', 12:28:42 INFO - 'LANGUAGE': 'en_US:en', 12:28:42 INFO - 'LOGNAME': 'cltbld', 12:28:42 INFO - 'MAIL': '/var/mail/cltbld', 12:28:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:42 INFO - 'MOZ_NO_REMOTE': '1', 12:28:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:42 INFO - 'NO_EM_RESTART': '1', 12:28:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:42 INFO - 'PWD': '/builds/slave/test', 12:28:42 INFO - 'SHELL': '/bin/bash', 12:28:42 INFO - 'SHLVL': '1', 12:28:42 INFO - 'TERM': 'linux', 12:28:42 INFO - 'TMOUT': '86400', 12:28:42 INFO - 'USER': 'cltbld', 12:28:42 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', 12:28:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:42 INFO - '_': '/tools/buildbot/bin/python'} 12:28:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:28:42 INFO - Running setup.py (path:/tmp/pip-PWjVh4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:28:42 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)) 12:28:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:28:42 INFO - Running setup.py (path:/tmp/pip-rO5jdM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:28:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 12:28:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:28:42 INFO - Running setup.py (path:/tmp/pip-hxS9_B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:28:42 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)) 12:28:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:28:42 INFO - Running setup.py (path:/tmp/pip-bw0Ni4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:28:42 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)) 12:28:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:28:42 INFO - Running setup.py (path:/tmp/pip-rbgOkE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:28:42 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)) 12:28:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:28:42 INFO - Running setup.py (path:/tmp/pip-o1IPwL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:28:42 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)) 12:28:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:28:42 INFO - Running setup.py (path:/tmp/pip-xqskoX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:28:42 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)) 12:28:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:28:42 INFO - Running setup.py (path:/tmp/pip-DhJr5J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:28:42 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)) 12:28:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:28:42 INFO - Running setup.py (path:/tmp/pip-1uLnAq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:28:42 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)) 12:28:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:28:42 INFO - Running setup.py (path:/tmp/pip-I_9UEc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:28:43 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)) 12:28:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:28:43 INFO - Running setup.py (path:/tmp/pip-Tgqlbb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:28:43 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)) 12:28:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:28:43 INFO - Running setup.py (path:/tmp/pip-XgkE82-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:28:43 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)) 12:28:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:28:43 INFO - Running setup.py (path:/tmp/pip-_QGvbZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:28:43 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)) 12:28:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:28:43 INFO - Running setup.py (path:/tmp/pip-nKuTdz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:28:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 12:28:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:28:43 INFO - Running setup.py (path:/tmp/pip-8AAq18-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:28:43 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)) 12:28:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:28:43 INFO - Running setup.py (path:/tmp/pip-xxOXFu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:28:43 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)) 12:28:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:28:43 INFO - Running setup.py (path:/tmp/pip-EB2iST-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:28:43 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)) 12:28:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 12:28:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 12:28:43 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)) 12:28:43 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)) 12:28:43 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)) 12:28:43 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:28:43 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 12:28:43 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 12:28:43 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 12:28:43 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 12:28:43 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 12:28:43 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 12:28:45 INFO - Downloading blessings-1.6.tar.gz 12:28:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 12:28:45 INFO - Installing collected packages: blessings 12:28:45 INFO - Running setup.py install for blessings 12:28:45 INFO - Successfully installed blessings 12:28:45 INFO - Cleaning up... 12:28:45 INFO - Return code: 0 12:28:45 INFO - Done creating virtualenv /builds/slave/test/build/venv. 12:28:45 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:28:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:28:45 INFO - Reading from file tmpfile_stdout 12:28:45 INFO - Current package versions: 12:28:45 INFO - argparse == 1.2.1 12:28:45 INFO - blessings == 1.6 12:28:45 INFO - blobuploader == 1.2.4 12:28:45 INFO - docopt == 0.6.1 12:28:45 INFO - functools32 == 3.2.3-2 12:28:45 INFO - jsonschema == 2.5.1 12:28:45 INFO - manifestparser == 1.1 12:28:45 INFO - mozInstall == 1.12 12:28:45 INFO - mozcrash == 0.17 12:28:45 INFO - mozdebug == 0.1 12:28:45 INFO - mozdevice == 0.48 12:28:45 INFO - mozfile == 1.2 12:28:45 INFO - mozhttpd == 0.7 12:28:45 INFO - mozinfo == 0.9 12:28:45 INFO - mozleak == 0.1 12:28:45 INFO - mozlog == 3.4 12:28:45 INFO - moznetwork == 0.27 12:28:45 INFO - mozprocess == 0.23 12:28:45 INFO - mozprofile == 0.28 12:28:45 INFO - mozrunner == 6.12 12:28:45 INFO - mozscreenshot == 0.1 12:28:45 INFO - mozsystemmonitor == 0.3 12:28:45 INFO - moztest == 0.7 12:28:45 INFO - mozversion == 1.4 12:28:45 INFO - psutil == 3.1.1 12:28:45 INFO - requests == 1.2.3 12:28:45 INFO - wsgiref == 0.1.2 12:28:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:28:45 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')]} 12:28:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:45 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')]} 12:28:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:45 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 0x7f0151c1af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bed8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cbaca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cb7f60>, '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 0x2cb8d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cb91d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', '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 12:28:45 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 12:28:45 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 12:28:45 INFO - Using env: {'DISPLAY': ':0', 12:28:45 INFO - 'HOME': '/home/cltbld', 12:28:45 INFO - 'LANG': 'en_US.UTF-8', 12:28:45 INFO - 'LANGUAGE': 'en_US:en', 12:28:45 INFO - 'LOGNAME': 'cltbld', 12:28:45 INFO - 'MAIL': '/var/mail/cltbld', 12:28:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:45 INFO - 'MOZ_NO_REMOTE': '1', 12:28:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:45 INFO - 'NO_EM_RESTART': '1', 12:28:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:45 INFO - 'PWD': '/builds/slave/test', 12:28:45 INFO - 'SHELL': '/bin/bash', 12:28:45 INFO - 'SHLVL': '1', 12:28:45 INFO - 'TERM': 'linux', 12:28:45 INFO - 'TMOUT': '86400', 12:28:45 INFO - 'USER': 'cltbld', 12:28:45 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', 12:28:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:45 INFO - '_': '/tools/buildbot/bin/python'} 12:28:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:46 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)) 12:28:46 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)) 12:28:46 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)) 12:28:46 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)) 12:28:46 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)) 12:28:46 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)) 12:28:46 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)) 12:28:46 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)) 12:28:46 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)) 12:28:46 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)) 12:28:46 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)) 12:28:46 INFO - Cleaning up... 12:28:46 INFO - Return code: 0 12:28:46 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 12:28:46 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')]} 12:28:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:28:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:46 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')]} 12:28:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:28:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:28:46 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 0x7f0151c1af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bed8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cbaca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2cb7f60>, '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 0x2cb8d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cb91d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', '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 12:28:46 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 12:28:46 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 12:28:46 INFO - Using env: {'DISPLAY': ':0', 12:28:46 INFO - 'HOME': '/home/cltbld', 12:28:46 INFO - 'LANG': 'en_US.UTF-8', 12:28:46 INFO - 'LANGUAGE': 'en_US:en', 12:28:46 INFO - 'LOGNAME': 'cltbld', 12:28:46 INFO - 'MAIL': '/var/mail/cltbld', 12:28:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:28:46 INFO - 'MOZ_NO_REMOTE': '1', 12:28:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:28:46 INFO - 'NO_EM_RESTART': '1', 12:28:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:28:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:28:46 INFO - 'PWD': '/builds/slave/test', 12:28:46 INFO - 'SHELL': '/bin/bash', 12:28:46 INFO - 'SHLVL': '1', 12:28:46 INFO - 'TERM': 'linux', 12:28:46 INFO - 'TMOUT': '86400', 12:28:46 INFO - 'USER': 'cltbld', 12:28:46 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', 12:28:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:28:46 INFO - '_': '/tools/buildbot/bin/python'} 12:28:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:28:46 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 12:28:46 INFO - Cleaning up... 12:28:46 INFO - Return code: 0 12:28:46 INFO - Running post-action listener: _resource_record_post_action 12:28:46 INFO - Running post-action listener: _start_resource_monitoring 12:28:46 INFO - Starting resource monitoring. 12:28:46 INFO - [mozharness: 2016-10-05 19:28:46.436849Z] Finished create-virtualenv step (success) 12:28:46 INFO - [mozharness: 2016-10-05 19:28:46.437432Z] Running install step. 12:28:46 INFO - Running pre-action listener: _resource_record_pre_action 12:28:46 INFO - Running main action method: install 12:28:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:28:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:28:46 INFO - Reading from file tmpfile_stdout 12:28:46 INFO - Detecting whether we're running mozinstall >=1.0... 12:28:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 12:28:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 12:28:46 INFO - Reading from file tmpfile_stdout 12:28:46 INFO - Output received: 12:28:46 INFO - Usage: mozinstall [options] installer 12:28:46 INFO - Options: 12:28:46 INFO - -h, --help show this help message and exit 12:28:46 INFO - -d DEST, --destination=DEST 12:28:46 INFO - Directory to install application into. [default: 12:28:46 INFO - "/builds/slave/test"] 12:28:46 INFO - --app=APP Application being installed. [default: firefox] 12:28:46 INFO - mkdir: /builds/slave/test/build/application 12:28:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 12:28:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 12:29:02 INFO - Reading from file tmpfile_stdout 12:29:02 INFO - Output received: 12:29:02 INFO - /builds/slave/test/build/application/firefox/firefox 12:29:02 INFO - Running post-action listener: _resource_record_post_action 12:29:02 INFO - [mozharness: 2016-10-05 19:29:02.913934Z] Finished install step (success) 12:29:02 INFO - [mozharness: 2016-10-05 19:29:02.914177Z] Running run-tests step. 12:29:02 INFO - Running pre-action listener: _resource_record_pre_action 12:29:02 INFO - Running main action method: run_tests 12:29:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 12:29:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 12:29:02 INFO - Python 2.7.3 12:29:02 INFO - Return code: 0 12:29:02 INFO - grabbing minidump binary from tooltool 12:29:02 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')]} 12:29:02 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 0x2cb7f60>, '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 0x2cb8d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2cb91d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 12:29:02 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 12:29:02 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 12:29:02 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 12:29:02 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 12:29:02 INFO - Return code: 0 12:29:02 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 12:29:02 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 12:29:02 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 12:29:02 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 12:29:02 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 12:29:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-062', '--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 12:29:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Autoland-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-062 --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 12:29:02 INFO - Using env: {'DISPLAY': ':0', 12:29:02 INFO - 'HOME': '/home/cltbld', 12:29:02 INFO - 'LANG': 'en_US.UTF-8', 12:29:02 INFO - 'LANGUAGE': 'en_US:en', 12:29:02 INFO - 'LOGNAME': 'cltbld', 12:29:02 INFO - 'MAIL': '/var/mail/cltbld', 12:29:02 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:29:02 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 12:29:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:29:02 INFO - 'MOZ_NO_REMOTE': '1', 12:29:02 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:29:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:29:02 INFO - 'NO_EM_RESTART': '1', 12:29:02 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:29:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:29:03 INFO - 'PWD': '/builds/slave/test', 12:29:03 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:29:03 INFO - 'SHELL': '/bin/bash', 12:29:03 INFO - 'SHLVL': '1', 12:29:03 INFO - 'TERM': 'linux', 12:29:03 INFO - 'TMOUT': '86400', 12:29:03 INFO - 'USER': 'cltbld', 12:29:03 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600', 12:29:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:29:03 INFO - '_': '/tools/buildbot/bin/python'} 12:29:03 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-062', '--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 12:29:03 INFO - mozversion application_buildid: 20161005120900 12:29:03 INFO - mozversion application_changeset: 8450da83e7bc128faddb9007b79b0a67e62cdf90 12:29:03 INFO - mozversion application_display_name: Nightly 12:29:03 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:29:03 INFO - mozversion application_name: Firefox 12:29:03 INFO - mozversion application_remotingname: firefox 12:29:03 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland 12:29:03 INFO - mozversion application_vendor: Mozilla 12:29:03 INFO - mozversion application_version: 52.0a1 12:29:03 INFO - mozversion platform_buildid: 20161005120900 12:29:03 INFO - mozversion platform_changeset: 8450da83e7bc128faddb9007b79b0a67e62cdf90 12:29:03 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland 12:29:03 INFO - mozversion platform_version: 52.0a1 12:29:03 INFO - using testdate: 1475695743 12:29:03 INFO - actual date: 1475695743 12:29:03 INFO - starting webserver on 'localhost:47990' 12:29:03 INFO - SUITE-START | Running 2 tests 12:29:03 INFO - TEST-START | dromaeo_css 12:29:03 INFO - operating with platform_type : linux_ 12:29:03 INFO - Initialising browser for dromaeo_css test... 12:29:03 INFO - TEST-INFO | started process 24874 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWcdGDC/profile http://localhost:47990/getInfo.html) 12:29:07 INFO - PROCESS | 24874 | __metrics Screen width/height:1600/1200 12:29:07 INFO - PROCESS | 24874 | colorDepth:24 12:29:07 INFO - PROCESS | 24874 | Browser inner width/height: 1024/697 12:29:07 INFO - PROCESS | 24874 | __metrics 12:29:07 INFO - PROCESS | 24874 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 12:29:07 INFO - PROCESS | 24874 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 12:29:08 INFO - PROCESS | 24874 | console.error: PushService: 12:29:08 INFO - PROCESS | 24874 | stateChangeProcessEnqueue: Error transitioning state 12:29:08 INFO - PROCESS | 24874 | UnknownError 12:29:09 INFO - TEST-INFO | 24874: exit 0 12:29:09 INFO - Browser initialized. 12:29:09 INFO - Running cycle 1/1 for dromaeo_css test... 12:29:09 INFO - TEST-INFO | started process 24955 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWcdGDC/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:29:21 INFO - PROCESS | 24955 | RSS: Main: 176353280 12:29:21 INFO - PROCESS | 24955 | 12:30:12 INFO - PROCESS | 24955 | 1475695812945 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] 12:32:25 INFO - PROCESS | 24955 | Cycle 1(1): loaded http://localhost:47990/tests/dromaeo/cssquery-dojo.html (next: http://localhost:47990/tests/dromaeo/cssquery-ext.html) 12:32:27 INFO - PROCESS | 24955 | RSS: Main: 357429248 12:32:27 INFO - PROCESS | 24955 | 12:35:30 INFO - PROCESS | 24955 | Cycle 1(1): loaded http://localhost:47990/tests/dromaeo/cssquery-ext.html (next: http://localhost:47990/tests/dromaeo/cssquery-jquery.html) 12:35:30 INFO - PROCESS | 24955 | RSS: Main: 281841664 12:35:30 INFO - PROCESS | 24955 | 12:38:32 INFO - PROCESS | 24955 | Cycle 1(1): loaded http://localhost:47990/tests/dromaeo/cssquery-jquery.html (next: http://localhost:47990/tests/dromaeo/cssquery-mootools.html) 12:38:33 INFO - PROCESS | 24955 | RSS: Main: 261885952 12:38:33 INFO - PROCESS | 24955 | 12:41:35 INFO - PROCESS | 24955 | Cycle 1(1): loaded http://localhost:47990/tests/dromaeo/cssquery-mootools.html (next: http://localhost:47990/tests/dromaeo/cssquery-prototype.html) 12:41:36 INFO - PROCESS | 24955 | RSS: Main: 220585984 12:41:36 INFO - PROCESS | 24955 | 12:44:39 INFO - PROCESS | 24955 | Cycle 1(1): loaded http://localhost:47990/tests/dromaeo/cssquery-prototype.html (next: http://localhost:47990/tests/dromaeo/cssquery-yui.html) 12:44:39 INFO - PROCESS | 24955 | RSS: Main: 224698368 12:44:39 INFO - PROCESS | 24955 | 12:47:42 INFO - PROCESS | 24955 | Cycle 1(1): loaded http://localhost:47990/tests/dromaeo/cssquery-yui.html (next: http://localhost:47990/tests/dromaeo/cssquery-dojo.html) 12:47:43 INFO - PROCESS | 24955 | RSS: Main: 307433472 12:47:43 INFO - PROCESS | 24955 | 12:47:43 INFO - PROCESS | 24955 | __start_tp_report 12:47:43 INFO - PROCESS | 24955 | _x_x_mozilla_page_load 12:47:43 INFO - PROCESS | 24955 | _x_x_mozilla_page_load_details 12:47:43 INFO - PROCESS | 24955 | |i|pagename|runs| 12:47:43 INFO - PROCESS | 24955 | |0;dojo.html;2556.143691863226;2589.6633437653104;2609.3346196719835;2629.513539995101;2638.6833579970394;4524.547545245474;4573.359729637845;4699.365585645936;4709.717416954981;4715.434147902252;4630.953690463094;4708.034852855165;4717.292406139072;4781.832635857746;4839.854804355866;4278.058827058042;4311.094670119279;4359.215341238576;4386.342048692705;4401.295792673157;4385.605295523403;4475.127350166719;4477.216487114758;4486.528914463983;4496.460424749034;4230.661547076257;4250.659947204216;4250.936235956463;4304.634106100985;4359.520452750211;4217.936730949038;4241.724287921275;4271.337942618899;4367.235733746614;4371.4098596689355;4278.101598664284;4290;4297.892552686177;4340.60934515895;4344.543822898613;4675.0883577702025;4683.484816670163;4684.531546845323;4689.88275293117;4705.600023997964;4809.687370320918;4858.878528036827;4991;5011.674241174312;5059.342285502861;5100.897982040376;5102.234664800272;5102.846914592568;5146.665466744687;5151.304573882516;4736.668433209677;4747.454042785055;4749.192637251606;4749.62003039756;4803.927941080851;4846.8788280292565;4899.853004409873;5119.232115182678;5177.689338639693;5246.554042906319;4969.527894850055;4990.451050384455;4992.350994370781;5045.31888195089;5058.064258112261;5066.06277838601;5077.771500282496;5078.847634570969;5081.9745901271;5134.435212126663;4808.519148085164;4850.660453768273;5021.59827213822;5030.874228144326;5034.597232221487;4868.02639472107;4906.656534042654;4909.165441874889;4915.680480768739;4926.556609905126;3845.0002999219846;3860.845566177378;3962.0094976255937;3962.366021436614;3965.7422267553093;3425.606055303672;3429.77706449085;3432.3135372925517;3482.077249528877;3493.2664140530774;4124.195781822576;4175.269327867611;4176.2691528982305;4220.894477638084;4237.343211802176;4877.829275975324;4992.201247800334;5000.799968001239;5042.747862606855;5063.87340316495;4282.35764635301;4291.0559676871035;4292.377605247284;4298.161858437575;4349.456317960255;4421.624161946271;4523.140603285366;4536.705114167635;4543.068670922453;4558.840440584564;4661.067786442657;4706.458757242961;4744.4069491313585;4751.263554148974;4827.637927155548;5046.722430266371;5077.492250775041;5085.7711402986215;5086.33877595925;5139.92290115656;4754.144254034169;4765.166095933128;4768.904621907612;4771.379720636295;4825.083234185494;4887.877803054952;4943.2585112233455;4947.282644016669;4950.356453661001;4951.777170027285;4964.156093464192;5011.774470148925;5018.397792264952;5023.246513023076;5025.899482010266;4879.170541007966;4888.755562221803;4894.755262236945;4913.459519452786;4990.3762029746285;4912.435069966857;4926.113299606105;4929.16204245272;4929.728864912464;4985;4810.062037902575;4830.130576496264;4853.451304661907;4865.489123641966;4927.408710954708;4746.5490778376;4792.976035119802;4832.081904438145;4844.2007068834655;4874.317595536557;4789.161896668;4798.568128868418;4808.519148085164;4837.661363704507;4850.1997170466475 12:47:43 INFO - PROCESS | 24955 | |1;ext.html;551.4402881075708;581.4069648958061;582.6911736779506;596.2517041113402;598.320905771949;35934.2813143737;37416.43875341869;37460.625393746086;41106.38340424889;41142.794286028526;38510.22979540408;38883;38894.61105388945;38921.61078389215;38973.61026389735;7607.125180604232;7738.148803631596;7743.574103424309;7744.341730952848;7744.341730952848;7523.059617547807;7608.201138880421;7610.391168706518;7614.086309642823;7617.771466856003;7649.579273139975;7673.462857599942;7684.269994350528;7694.153643099255;7702.345300649452;7582.886256706154;7595.354394876442;7603.201663825274;7607.505512141693;7619.923800761977;7606.543607383519;7686;7688.9231107688765;7690.15408305086;7699.5380277182985;36587.63412365896;36684;36718.632813671786;36794.26411471782;36796.264074718354;2928.3996780659913;2990.1029691092804;3027.712367325101;3043.071863081759;3165.5568220449154;24784.3803904902;25154;26918.730812691818;27619.171424857086;28431.147065588066;3439.2777516721517;3445.7243420526297;3448.758586898918;3478.3912815257227;3504.334176506481;238300;240246;241666;241929.29131338903;242193.78903105546;49386.259206111215;49652;49664.02015879059;49693;49704.50295497071;32225.838870805495;32965.83517082399;33011.504827427605;51277.23084153741;51484.74257628688;12207.450664720109;12363.567275145328;12378;12379.814302785466;12389.070819688559;10609.522571484302;10621.787564248672;10686.305390149615;10781;10785.083267922315;17061.317547297967;17170.141492925304;17248.913755431393;17392.3043078278;17437.65124697524;6472.223333200046;6613.537052406382;6627.86744265112;6690.698918548677;6900.723971041202;769.2845653542148;836.7949852286229;861.7759382560579;879.4415546128255;972.6595691507915;25239.62140567893;26523.73476265251;27509.17472475829;27555.31111722223;27704.168874933785;735.3933005270673;912.9589168487435;959.2134449751137;961.8893827209961;965.4496936746128;13711.520096796565;13990.72018559623;14254.287285635677;14371.353289101806;14373;360011;363562;363935;365614;366588;47615.52384476111;47972.7601361991;48022;48022.5197748025;48088.27867581989;1062.3041907550567;1092.781443711245;1138.345451365468;1146.2434793036555;1162.4013632979022;24636.630450542896;27809.582856257577;28212.294692632848;28907.710922890503;29014.41971160607;38651;39043;39052.2189556213;39053.2189356217;39108.2178356437;288844;289130;289680;290317;291093;24174.39564010914;25197.370065748502;25213.621795672712;26155.73844261533;26197.476050479265;39227.60772392354;40106.598934011454;40309.39535906905;40798.38802417907;41136.79431602823;34330.65669343275;34564.30871382508;34601.48097778485;34711.9586412408;34849;33607.83196084102;34451.310973780885;34651;34748.30503389968;34911.301773964886;33622.49566256557;34229.48655770116;34512.48231276483;34514;34678.30643387169;29292.707072929;32376;32391.67608323981;32414.189645259055;32566.348673025932;24178.87910560436;24514.754852451246;24928.133264674794;24971.75028249767;25072.74927250704 12:47:43 INFO - PROCESS | 24955 | |2;jquery.html;332.390064232134;344.63812996353823;350.9859605615775;356.8019749039282;376.1930658737009;11954.282743035414;12928.741425171504;16002.759958600616;16427.507174784747;17062.74405883913;16464.176791160455;16731.581710457245;16767.32930682774;16822.57943551412;17032.063236521986;4348.934765978513;4580.770961451931;4771.355866957951;5081.695098294114;5087.236914462842;4909.337239472679;5042.82350117746;5051.520105589963;5052.646314757969;5055.064813009605;4775.617950563964;5024.221245706921;5026.798928042874;5027.296178535008;5030.245463180534;4946;5011.498850114977;5020;5023.246513023039;5027.547520723134;4335.3063509838275;4490.932636010462;4491.955080449186;4495.303227999665;4496.190685676577;19428.708569371473;19620.117094730773;19991.100400482013;20384.694229586567;20391.898040509852;1734.4796561031767;1962.7154062660977;1964.4401345616573;1975.4468748750373;2055.8149766521083;8981.955090224572;9407.388519746195;9628.75928101803;11737.941310293394;13326.267055311953;1592.1243316176174;1637.598788296863;1655.9586010349717;1704.5056933489273;1719.5357253541474;63121.68439157775;69190;70225.2977470229;70539.29460705379;72023.27976720218;9682.370645907993;9885.961973992627;9908.35595686278;9916.603335866628;10028.849567256497;13591.660208494866;13601.727965440834;13652.658683532793;13718.24549649759;13781.104228225133;7102.28977102296;7247.927520724831;7290.234525374865;7335.88996165058;7407.925920740724;6830.692618832164;6872.278410766898;6933.514653974275;7031.613261270577;7141.678624461808;4269.4449721536;4293.463317085364;4302.913941721211;4304.354346847936;4407.118576284692;1715.62256303613;1820.126339357116;1833.294181740013;1838.6874231380698;1839.245909177231;771.6064806948384;786.838698066895;798.473007814851;819.9877001844977;837.5142417397894;15696.843031569766;16347.591310217102;16482.505524834272;16701.832981670028;17451.825481745273;783.2480818414272;788.8619491588948;842.8567143585606;853.910339414365;895.8700988356652;8946.239569636524;9518.714438566716;9546.904530954602;9631.855522167172;9632.518374081268;358005;367298;369639;370521;371165;69774;70859.58280834355;73070;73369.63315183496;73800;876.4828751036919;886.7827382291251;891.0376793063476;893.3701740273092;898.3756289378949;12980.675483112998;14064.859351406354;14171.078879872775;14364.066335688147;14478.27608619586;35107.29785404329;35334.29331413409;35488.822555887054;36173.638263617024;36243.63756362403;46642.766786165856;47058;47463.52536474729;47470;50648.49351506438;7157.212706602374;7596.924030759622;7673.808154796175;7753.1859154787935;7775.650095745818;10625.149988001096;11298.943505282421;11468.483918223867;11856.940715296369;11904.345261010381;9360.485173315534;9612.855807162758;9857.65498207588;10124.190064794946;10328.741781455523;10383.234850075354;10385.961403859554;10581.31221470602;10591.152707783205;10705.625303114353;10345.689629311133;10460.372377657364;10741.462926853783;11042.17183711241;11057.502412391623;7603.695852165852;7671.2712292332135;10597;10766.946165269124;10954.616588419367;10068.848967265643;10191.84712229332;10223.233257505568;10837.67486975392;11028.503717332578 12:47:43 INFO - PROCESS | 24955 | |3;mootools.html;1220.121512510993;1317.268915751758;1364.63154948164;1366.3168415792104;1638.8033435987684;6635.435987941025;7421;7729.072511298645;7734.071911370644;7957.403194760387;7857.292843644071;7860.096088949773;7927.524348539092;7945.205479452052;7945.523268603888;2106.7682554918983;2137.8717276963353;2140.946476338096;2141.5609799990966;2141.6573348264283;2111.3032699209225;2153.3001774423374;2161.492049368397;2170.4573856535867;2175.4887601413657;2101.086027578001;2133.8292936565117;2142.3037512808323;2145.6888751131078;2158.125958986613;2125.298651445027;2131.893405329743;2132.040581738224;2134.4557137929883;2136.113512892148;2055.486128467883;2091.0903756865814;2099.737532808399;2099.8740075595515;2108.599366120432;7665.195154508808;7783.766487005342;7800.960995195044;7846.921530784676;7885.921140788633;4473.261911784552;4632.513586073447;4634.050019745944;4641.907161856744;4650.4186976627925;2835.7164283571683;2960.8963686270877;3005.5191169412788;3007.383486385286;3027.2431892026993;862.3446180902497;868.0538213347481;876.5660997806064;886.3219636977717;889.226373055446;10519.631812886511;10574.841377379345;10597.258191926569;10676.893231067668;10709;3750.718696097804;3844.5386553613184;3950.0914789598555;3992;3999.480067591253;8410.02364444355;8413.789655258544;8414.789630259293;8422.368322375847;8426.325893928471;4516.096780643885;4532.750698711537;4551.158035763395;4557.111363284194;4557.863264102082;3657.908552286214;3780.8109594520165;4066.2477441673386;4214.199302132646;4216.7680777557525;3279.6064472263483;3334.299217633676;3412.2663627320244;3438.3123375325035;3456.4642480415578;967.205833179456;972.7957129002847;1000.0849222960909;1001.4942454060798;1008.4503945349655;784.1296161260996;802.6027116577214;805.8227190018187;805.9723852088517;806.2260230179094;5079.771410286546;5129.487051294841;5138.30632864566;5227.686338819683;5413;364.6080463501746;374.26083485116675;375.7125798763948;388.38053304978513;388.62109443292564;3463.809490478048;3532.7350448716447;3587.3901436755814;3630.727695422801;3696.131409118909;9297.512398016284;9754.463504507321;9759.804803904024;9778.608855645694;9783.804323913482;9683.273754468442;9703.02969703024;9714.757131071638;9715.0770676787;9742.902570974342;7169.641517924083;7221.53060051095;7347.26527347261;7347.55914645123;7360.2271761465345;5089.618278629044;5102.566281866083;5104.540591346648;5235.214717792362;5351.2508248844415;8831.91168088311;8862.113788621085;8912.153345432174;8965.148310910454;8979.910200897908;8781.692640757543;9053.279876823382;9067.727968160965;9072.682456114004;9155.176034156691;5711.457411545896;5944.791932282523;6284.528660350584;6318.968405157945;6350.079238510482;7420.406367490696;7638.847223055619;7682.654280557276;7689.077310722749;7695.615219239127;6519.511036672174;6534.738610455719;6685.364890335411;6734.292899245705;6822.727090916308;6301;6378.74485020594;6450.548461607643;6463.935360646334;6465.741370345134;5988.970055149696;6073.878522429615;6080.118382834553;6084;6086.482648974709;4260.467441569804;4296.334068219431;4373.650107991417;4376.627986621173;4518.856622342837;4480.798364073559;4513.75174365413;4529.139463501924;4567.406237189277;4640.512746161605 12:47:43 INFO - PROCESS | 24955 | |4;prototype.html;286.65744435399694;289.77687180870726;298.08190772420943;298.8192143753029;299.1727872432725;4718.952810471894;4762.666613337068;4785.688930219533;4790.952090479099;4822.107910036637;4740.620750339973;4741.976290118545;4745.620350371971;4760.809567617292;4775.522447755223;3788.981055094721;3807.200487897531;3807.352750032487;3811.7141214408894;3820.77075375477;3649.233660931208;3796.4495148203496;3797.468354430382;3797.525309336333;3821.7706937583694;3719.442083687455;3738.1962877981227;3761.755485893422;3778.565464971522;3800.429935509682;3746.7002639788752;3789.355809512362;3790.3556395412706;3792.6586607205486;3798.772073675588;3163.683631636841;3269.9019029429155;3379.915502112467;3384.2047118927035;3387.390989280097;4527.615152712024;4645.349651048856;4656.511066338054;4667.533246675339;4702.9294560581275;4306.246406878815;4306.569343065699;4313.482382114135;4321.762303073329;4321.870343889688;4708.858734237979;4785.306130611077;4992.800287988476;5048.570871475929;5056.924146137811;3345.3643807676463;3602.2435288589427;3608.0438683748825;3612.945805812915;3649.160693040589;5186.870328241824;5194.454582268883;5200.193969934666;5218.973905130488;5237.16205407133;3642.4900513928073;3738.8222709846855;3739.9439008414897;3743.2487121965332;3748.681362084199;3726.9068273293383;3765.7740535567955;3769.151940813295;3783.5838057813617;3785.545734511821;4240.49114106303;4241.575842415796;4246.596573325529;4248.447701798808;4280.694388211626;4951.257311403318;4972.825951091767;5001.424836143818;5006.199008158677;5012.619005972134;1207.93356365399;1271.434211775751;1276.3554405025402;1302.5701518498872;1327.9136856104321;789.1989630525022;808.6765293882494;817.5952903312898;825.5624519004937;827.8882350882674;3885.941710874339;3886.106195574977;3895.8441662333757;3921.745086569364;3928;4496.493674618974;4522.977385113053;4530.301137073598;4539.409876716006;4559.703619264737;3863.2080423513676;3884.4755957945317;3891.9805400972814;3893.182431689377;3922.881978636075;2403.795677367443;2409.445827459694;2514.585093459595;2696.191142657195;2713.3623598454346;4603.723776573416;4767.642426818003;4831.565159135695;4845.927311090337;4855.150348688965;5111.5655169310285;5290.444503327172;5307.548858347007;5314.73426328682;5319.494648008433;4840.443349014909;4875.146849301429;4893.681910675866;4894.0179227412955;4919.262110683426;4863.954249836303;5092.694438333712;5105.387353517453;5137.409197942285;5158.226266059971;5050.898982020412;5054.570361519312;5083.364579427572;5090.516400942052;5098.158803797481;4834.347363106076;4848.272759086024;4849.587785038311;4859.319695242598;4862.975685121552;3576.803275819855;3593.4070878304788;3623.1123374772296;3644.21649345392;3651.3427583034245;5104.846854594368;5110.616703747308;5130.153524668388;5137;5164.586833053271;5025.035229214781;5041.789970407002;5051.848444546669;5088.414832294334;5093.955739073407;4914.65597408178;4976.402831660224;4984.850454486371;5065.949340506548;5072.28987941681;4945.455999840086;4946.925796112989;4948.356713627206;4975.353204083446;4987.700737955734;5055;5091.516305950929;5098;5121.7695203715175;5139.306193663808;4765.974460854192;4956.628252880976;4960.23116416956;5003.899922001467;5006.874828129326 12:47:43 INFO - PROCESS | 24955 | |5;yui.html;608.3855306140798;690.4786885901141;721.5634541102636;733.9926600733991;744.9068866391701;12944.805827912576;13805.171689698625;13819.861801381996;13821.723565528697;13845.861541384584;12475.563355282567;12525.874741252584;12548.121631485777;12562.560310389139;12567.308798016105;607.696151924038;622.6202016769766;732.4689600039954;736.5617457612711;751.2187325181804;749.6176949755636;750.7672621487357;751.1549506804845;751.6767789850362;752.405599576334;791.4973991515401;791.8218400859818;792.029763539665;792.2988155482411;792.5403266105674;635.7774778827396;651.9217693876718;758.2834221660534;770.2374649097409;791.3194652598761;565.7143142712945;566.0801198053164;572.5076434266527;574.4887050525036;574.5604612471462;12507.874921250854;12531.874681253163;12534.874651253462;12563.93718031404;12574.748505029847;11732.472038758277;11837.289762614184;11851.94074029633;11955.581554645632;12499.437525311383;12004.579839705655;12023.57917472893;12089.21420107699;12396.75206495874;12787.168834025759;4123;4148.585141485857;4164.208800327928;4327.134573085364;4336.8265269389185;61273;62861.37138628647;63420.04869927001;63686;63749.362506374804;9952.651657191964;10101.292909496411;10165.695029149138;10167.440790756431;10250.487475626189;17336.479905602853;17422.65154696899;17620.91189544044;17632.471025869243;17882.374116906107;6488.643124628191;6492.967535162294;6522.967385163044;6568.146141001639;6568.86862262752;3452.9827350863084;3495.790252584853;3504.859805607747;3531.311394278091;3574.9285014299567;2625.8949642014486;2682.021062312242;2695.1375559820667;2697.7167397422986;2702.2703869955003;481.066730542746;487.28612582566;494.868859752166;495.4005653159645;496.86087895389346;546.907025805614;561.7977528089884;561.8623437257817;563.7350445290707;569.0354848531699;7843.607819609111;7916.960415197887;8152;8159.306458950937;8165.346772258205;478.6505850728987;530.6259087343414;530.9575233981273;541.1801121301232;566.8554518597814;3598.280343931172;3605.4952306677087;3662.047867554402;3798.6201379862346;3964.484616999829;55643;87686.56156719176;94577.05422945683;103921;105225;85031;86595.56702216448;87117;87357.33318668758;90044;74755;76525.2347476518;76887.61556192295;77015.61492192504;77092;6630.569013014138;6644.61041662534;6779.220389655253;7107.751228707178;7346.191918889025;45088.54911450844;45539.31691024571;46230.306545401174;46479.443630599286;47704.5229547714;61214.69392653008;62431;66631;68138.65930670315;69190;8634.827303454022;8917;8955.41789783662;9322.673706420243;9499.667511637059;9822.066903644429;10028.197744180303;10208.234382421497;10246;10383.896161038596;10289.3311934724;11381.048136838774;11560.132990025613;11623.418829058344;12313.938430307791;12042.819357709466;12206.023518118707;12488.875111249135;13187.80218296707;13361.53234636783;11700.173764957068;11940.2835829847;12174.939125304316;12218.327991960528;12295;10124.69625911224;10295.742606434898;10362.740931476472;10411.219158562986;10804.027637512661;9465.952670236606;9788.951055244963;10116.696499105039;10299.742506437398;10361.171106311327 12:47:43 INFO - PROCESS | 24955 | __end_tp_report 12:47:43 INFO - PROCESS | 24955 | __start_cc_report 12:47:43 INFO - PROCESS | 24955 | _x_x_mozilla_cycle_collect,1961 12:47:43 INFO - PROCESS | 24955 | __end_cc_report 12:47:43 INFO - PROCESS | 24955 | __startTimestamp1475696863151__endTimestamp 12:47:43 INFO - PROCESS | 24955 | 12:47:43 INFO - PROCESS | 24955 | ------- Summary: start ------- 12:47:43 INFO - PROCESS | 24955 | Number of tests: 6 12:47:43 INFO - PROCESS | 24955 | 12:47:43 INFO - PROCESS | 24955 | [#0] dojo.html Cycles:165 Average:4620.17 Median:4789.16 stddev:519.24 (10.8%) stddev-sans-first:494.95 12:47:43 INFO - PROCESS | 24955 | Values: 2556.1 2589.7 2609.3 2629.5 2638.7 4524.5 4573.4 4699.4 4709.7 4715.4 4631.0 4708.0 4717.3 4781.8 4839.9 4278.1 4311.1 4359.2 4386.3 4401.3 4385.6 4475.1 4477.2 4486.5 4496.5 4230.7 4250.7 4250.9 4304.6 4359.5 4217.9 4241.7 4271.3 4367.2 4371.4 4278.1 4290.0 4297.9 4340.6 4344.5 4675.1 4683.5 4684.5 4689.9 4705.6 4809.7 4858.9 4991.0 5011.7 5059.3 5100.9 5102.2 5102.8 5146.7 5151.3 4736.7 4747.5 4749.2 4749.6 4803.9 4846.9 4899.9 5119.2 5177.7 5246.6 4969.5 4990.5 4992.4 5045.3 5058.1 5066.1 5077.8 5078.8 5082.0 5134.4 4808.5 4850.7 5021.6 5030.9 5034.6 4868.0 4906.7 4909.2 4915.7 4926.6 3845.0 3860.8 3962.0 3962.4 3965.7 3425.6 3429.8 3432.3 3482.1 3493.3 4124.2 4175.3 4176.3 4220.9 4237.3 4877.8 4992.2 5000.8 5042.7 5063.9 4282.4 4291.1 4292.4 4298.2 4349.5 4421.6 4523.1 4536.7 4543.1 4558.8 4661.1 4706.5 4744.4 4751.3 4827.6 5046.7 5077.5 5085.8 5086.3 5139.9 4754.1 4765.2 4768.9 4771.4 4825.1 4887.9 4943.3 4947.3 4950.4 4951.8 4964.2 5011.8 5018.4 5023.2 5025.9 4879.2 4888.8 4894.8 4913.5 4990.4 4912.4 4926.1 4929.2 4929.7 4985.0 4810.1 4830.1 4853.5 4865.5 4927.4 4746.5 4793.0 4832.1 4844.2 4874.3 4789.2 4798.6 4808.5 4837.7 4850.2 12:47:43 INFO - PROCESS | 24955 | 12:47:43 INFO - PROCESS | 24955 | [#1] ext.html Cycles:180 Average:44491.93 Median:34880.15 stddev:79511.21 (228.0%) stddev-sans-first:79665.82 12:47:43 INFO - PROCESS | 24955 | Values: 551.4 581.4 582.7 596.3 598.3 35934.3 37416.4 37460.6 41106.4 41142.8 38510.2 38883.0 38894.6 38921.6 38973.6 7607.1 7738.1 7743.6 7744.3 7744.3 7523.1 7608.2 7610.4 7614.1 7617.8 7649.6 7673.5 7684.3 7694.2 7702.3 7582.9 7595.4 7603.2 7607.5 7619.9 7606.5 7686.0 7688.9 7690.2 7699.5 36587.6 36684.0 36718.6 36794.3 36796.3 2928.4 2990.1 3027.7 3043.1 3165.6 24784.4 25154.0 26918.7 27619.2 28431.1 3439.3 3445.7 3448.8 3478.4 3504.3 238300.0 240246.0 241666.0 241929.3 242193.8 49386.3 49652.0 49664.0 49693.0 49704.5 32225.8 32965.8 33011.5 51277.2 51484.7 12207.5 12363.6 12378.0 12379.8 12389.1 10609.5 10621.8 10686.3 10781.0 10785.1 17061.3 17170.1 17248.9 17392.3 17437.7 6472.2 6613.5 6627.9 6690.7 6900.7 769.3 836.8 861.8 879.4 972.7 25239.6 26523.7 27509.2 27555.3 27704.2 735.4 913.0 959.2 961.9 965.4 13711.5 13990.7 14254.3 14371.4 14373.0 360011.0 363562.0 363935.0 365614.0 366588.0 47615.5 47972.8 48022.0 48022.5 48088.3 1062.3 1092.8 1138.3 1146.2 1162.4 24636.6 27809.6 28212.3 28907.7 29014.4 38651.0 39043.0 39052.2 39053.2 39108.2 288844.0 289130.0 289680.0 290317.0 291093.0 24174.4 25197.4 25213.6 26155.7 26197.5 39227.6 40106.6 40309.4 40798.4 41136.8 34330.7 34564.3 34601.5 34712.0 34849.0 33607.8 34451.3 34651.0 34748.3 34911.3 33622.5 34229.5 34512.5 34514.0 34678.3 29292.7 32376.0 32391.7 32414.2 32566.3 24178.9 24514.8 24928.1 24971.8 25072.7 12:47:43 INFO - PROCESS | 24955 | 12:47:43 INFO - PROCESS | 24955 | [#2] jquery.html Cycles:180 Average:23306.39 Median:4303.63 stddev:60670.41 (1409.7%) stddev-sans-first:60816.09 12:47:43 INFO - PROCESS | 24955 | Values: 332.4 344.6 351.0 356.8 376.2 11954.3 12928.7 16002.8 16427.5 17062.7 16464.2 16731.6 16767.3 16822.6 17032.1 4348.9 4580.8 4771.4 5081.7 5087.2 4909.3 5042.8 5051.5 5052.6 5055.1 4775.6 5024.2 5026.8 5027.3 5030.2 4946.0 5011.5 5020.0 5023.2 5027.5 4335.3 4490.9 4492.0 4495.3 4496.2 19428.7 19620.1 19991.1 20384.7 20391.9 1734.5 1962.7 1964.4 1975.4 2055.8 8982.0 9407.4 9628.8 11737.9 13326.3 1592.1 1637.6 1656.0 1704.5 1719.5 63121.7 69190.0 70225.3 70539.3 72023.3 9682.4 9886.0 9908.4 9916.6 10028.8 13591.7 13601.7 13652.7 13718.2 13781.1 7102.3 7247.9 7290.2 7335.9 7407.9 6830.7 6872.3 6933.5 7031.6 7141.7 4269.4 4293.5 4302.9 4304.4 4407.1 1715.6 1820.1 1833.3 1838.7 1839.2 771.6 786.8 798.5 820.0 837.5 15696.8 16347.6 16482.5 16701.8 17451.8 783.2 788.9 842.9 853.9 895.9 8946.2 9518.7 9546.9 9631.9 9632.5 358005.0 367298.0 369639.0 370521.0 371165.0 69774.0 70859.6 73070.0 73369.6 73800.0 876.5 886.8 891.0 893.4 898.4 12980.7 14064.9 14171.1 14364.1 14478.3 35107.3 35334.3 35488.8 36173.6 36243.6 46642.8 47058.0 47463.5 47470.0 50648.5 7157.2 7596.9 7673.8 7753.2 7775.7 10625.1 11298.9 11468.5 11856.9 11904.3 9360.5 9612.9 9857.7 10124.2 10328.7 10383.2 10386.0 10581.3 10591.2 10705.6 10345.7 10460.4 10741.5 11042.2 11057.5 7603.7 7671.3 10597.0 10766.9 10954.6 10068.8 10191.8 10223.2 10837.7 11028.5 12:47:43 INFO - PROCESS | 24955 | 12:47:43 INFO - PROCESS | 24955 | [#3] mootools.html Cycles:180 Average:5029.54 Median:5103.55 stddev:2891.96 (56.7%) stddev-sans-first:2885.90 12:47:43 INFO - PROCESS | 24955 | Values: 1220.1 1317.3 1364.6 1366.3 1638.8 6635.4 7421.0 7729.1 7734.1 7957.4 7857.3 7860.1 7927.5 7945.2 7945.5 2106.8 2137.9 2140.9 2141.6 2141.7 2111.3 2153.3 2161.5 2170.5 2175.5 2101.1 2133.8 2142.3 2145.7 2158.1 2125.3 2131.9 2132.0 2134.5 2136.1 2055.5 2091.1 2099.7 2099.9 2108.6 7665.2 7783.8 7801.0 7846.9 7885.9 4473.3 4632.5 4634.1 4641.9 4650.4 2835.7 2960.9 3005.5 3007.4 3027.2 862.3 868.1 876.6 886.3 889.2 10519.6 10574.8 10597.3 10676.9 10709.0 3750.7 3844.5 3950.1 3992.0 3999.5 8410.0 8413.8 8414.8 8422.4 8426.3 4516.1 4532.8 4551.2 4557.1 4557.9 3657.9 3780.8 4066.2 4214.2 4216.8 3279.6 3334.3 3412.3 3438.3 3456.5 967.2 972.8 1000.1 1001.5 1008.5 784.1 802.6 805.8 806.0 806.2 5079.8 5129.5 5138.3 5227.7 5413.0 364.6 374.3 375.7 388.4 388.6 3463.8 3532.7 3587.4 3630.7 3696.1 9297.5 9754.5 9759.8 9778.6 9783.8 9683.3 9703.0 9714.8 9715.1 9742.9 7169.6 7221.5 7347.3 7347.6 7360.2 5089.6 5102.6 5104.5 5235.2 5351.3 8831.9 8862.1 8912.2 8965.1 8979.9 8781.7 9053.3 9067.7 9072.7 9155.2 5711.5 5944.8 6284.5 6319.0 6350.1 7420.4 7638.8 7682.7 7689.1 7695.6 6519.5 6534.7 6685.4 6734.3 6822.7 6301.0 6378.7 6450.5 6463.9 6465.7 5989.0 6073.9 6080.1 6084.0 6086.5 4260.5 4296.3 4373.7 4376.6 4518.9 4480.8 4513.8 4529.1 4567.4 4640.5 12:47:43 INFO - PROCESS | 24955 | 12:47:43 INFO - PROCESS | 24955 | [#4] prototype.html Cycles:180 Average:4120.61 Median:4705.89 stddev:1204.07 (25.6%) stddev-sans-first:1172.55 12:47:43 INFO - PROCESS | 24955 | Values: 286.7 289.8 298.1 298.8 299.2 4719.0 4762.7 4785.7 4791.0 4822.1 4740.6 4742.0 4745.6 4760.8 4775.5 3789.0 3807.2 3807.4 3811.7 3820.8 3649.2 3796.4 3797.5 3797.5 3821.8 3719.4 3738.2 3761.8 3778.6 3800.4 3746.7 3789.4 3790.4 3792.7 3798.8 3163.7 3269.9 3379.9 3384.2 3387.4 4527.6 4645.3 4656.5 4667.5 4702.9 4306.2 4306.6 4313.5 4321.8 4321.9 4708.9 4785.3 4992.8 5048.6 5056.9 3345.4 3602.2 3608.0 3612.9 3649.2 5186.9 5194.5 5200.2 5219.0 5237.2 3642.5 3738.8 3739.9 3743.2 3748.7 3726.9 3765.8 3769.2 3783.6 3785.5 4240.5 4241.6 4246.6 4248.4 4280.7 4951.3 4972.8 5001.4 5006.2 5012.6 1207.9 1271.4 1276.4 1302.6 1327.9 789.2 808.7 817.6 825.6 827.9 3885.9 3886.1 3895.8 3921.7 3928.0 4496.5 4523.0 4530.3 4539.4 4559.7 3863.2 3884.5 3892.0 3893.2 3922.9 2403.8 2409.4 2514.6 2696.2 2713.4 4603.7 4767.6 4831.6 4845.9 4855.2 5111.6 5290.4 5307.5 5314.7 5319.5 4840.4 4875.1 4893.7 4894.0 4919.3 4864.0 5092.7 5105.4 5137.4 5158.2 5050.9 5054.6 5083.4 5090.5 5098.2 4834.3 4848.3 4849.6 4859.3 4863.0 3576.8 3593.4 3623.1 3644.2 3651.3 5104.8 5110.6 5130.2 5137.0 5164.6 5025.0 5041.8 5051.8 5088.4 5094.0 4914.7 4976.4 4984.9 5065.9 5072.3 4945.5 4946.9 4948.4 4975.4 4987.7 5055.0 5091.5 5098.0 5121.8 5139.3 4766.0 4956.6 4960.2 5003.9 5006.9 12:47:43 INFO - PROCESS | 24955 | 12:47:43 INFO - PROCESS | 24955 | [#5] yui.html Cycles:180 Average:17657.75 Median:491.08 stddev:25461.82 (5184.9%) stddev-sans-first:25501.06 12:47:43 INFO - PROCESS | 24955 | Values: 608.4 690.5 721.6 734.0 744.9 12944.8 13805.2 13819.9 13821.7 13845.9 12475.6 12525.9 12548.1 12562.6 12567.3 607.7 622.6 732.5 736.6 751.2 749.6 750.8 751.2 751.7 752.4 791.5 791.8 792.0 792.3 792.5 635.8 651.9 758.3 770.2 791.3 565.7 566.1 572.5 574.5 574.6 12507.9 12531.9 12534.9 12563.9 12574.7 11732.5 11837.3 11851.9 11955.6 12499.4 12004.6 12023.6 12089.2 12396.8 12787.2 4123.0 4148.6 4164.2 4327.1 4336.8 61273.0 62861.4 63420.0 63686.0 63749.4 9952.7 10101.3 10165.7 10167.4 10250.5 17336.5 17422.7 17620.9 17632.5 17882.4 6488.6 6493.0 6523.0 6568.1 6568.9 3453.0 3495.8 3504.9 3531.3 3574.9 2625.9 2682.0 2695.1 2697.7 2702.3 481.1 487.3 494.9 495.4 496.9 546.9 561.8 561.9 563.7 569.0 7843.6 7917.0 8152.0 8159.3 8165.3 478.7 530.6 531.0 541.2 566.9 3598.3 3605.5 3662.0 3798.6 3964.5 55643.0 87686.6 94577.1 103921.0 105225.0 85031.0 86595.6 87117.0 87357.3 90044.0 74755.0 76525.2 76887.6 77015.6 77092.0 6630.6 6644.6 6779.2 7107.8 7346.2 45088.5 45539.3 46230.3 46479.4 47704.5 61214.7 62431.0 66631.0 68138.7 69190.0 8634.8 8917.0 8955.4 9322.7 9499.7 9822.1 10028.2 10208.2 10246.0 10383.9 10289.3 11381.0 11560.1 11623.4 12313.9 12042.8 12206.0 12488.9 13187.8 13361.5 11700.2 11940.3 12174.9 12218.3 12295.0 10124.7 10295.7 10362.7 10411.2 10804.0 9466.0 9789.0 10116.7 10299.7 10361.2 12:47:43 INFO - PROCESS | 24955 | -------- Summary: end -------- 12:47:43 INFO - PROCESS | 24955 | 12:47:44 INFO - TEST-INFO | 24955: exit 0 12:47:44 INFO - TEST-OK | dromaeo_css | took 1120900ms 12:47:44 INFO - TEST-START | kraken 12:47:44 INFO - operating with platform_type : linux_ 12:47:44 INFO - Initialising browser for kraken test... 12:47:44 INFO - TEST-INFO | started process 25258 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdWlPB8/profile http://localhost:47990/getInfo.html) 12:47:48 INFO - PROCESS | 25258 | __metrics Screen width/height:1600/1200 12:47:48 INFO - PROCESS | 25258 | colorDepth:24 12:47:48 INFO - PROCESS | 25258 | Browser inner width/height: 1024/697 12:47:48 INFO - PROCESS | 25258 | __metrics 12:47:48 INFO - PROCESS | 25258 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 12:47:48 INFO - PROCESS | 25258 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 12:47:49 INFO - PROCESS | 25258 | console.error: PushService: 12:47:49 INFO - PROCESS | 25258 | stateChangeProcessEnqueue: Error transitioning state 12:47:49 INFO - PROCESS | 25258 | UnknownError 12:47:49 INFO - TEST-INFO | 25258: exit 0 12:47:49 INFO - Browser initialized. 12:47:49 INFO - Running cycle 1/1 for kraken test... 12:47:49 INFO - TEST-INFO | started process 25337 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdWlPB8/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:48:02 INFO - PROCESS | 25337 | RSS: Main: 175398912 12:48:02 INFO - PROCESS | 25337 | 12:48:04 INFO - PROCESS | 25337 | Cycle 1(1): loaded http://localhost:47990/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:47990/tests/kraken/driver.html?testName=audio-beat-detection) 12:48:05 INFO - PROCESS | 25337 | RSS: Main: 238567424 12:48:05 INFO - PROCESS | 25337 | 12:48:08 INFO - PROCESS | 25337 | Cycle 1(1): loaded http://localhost:47990/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:47990/tests/kraken/driver.html?testName=audio-dft) 12:48:09 INFO - PROCESS | 25337 | RSS: Main: 218800128 12:48:09 INFO - PROCESS | 25337 | 12:48:12 INFO - PROCESS | 25337 | Cycle 1(1): loaded http://localhost:47990/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:47990/tests/kraken/driver.html?testName=audio-fft) 12:48:13 INFO - PROCESS | 25337 | RSS: Main: 301424640 12:48:13 INFO - PROCESS | 25337 | 12:48:15 INFO - PROCESS | 25337 | Cycle 1(1): loaded http://localhost:47990/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:47990/tests/kraken/driver.html?testName=audio-oscillator) 12:48:16 INFO - PROCESS | 25337 | RSS: Main: 212176896 12:48:16 INFO - PROCESS | 25337 | 12:48:18 INFO - PROCESS | 25337 | Cycle 1(1): loaded http://localhost:47990/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:47990/tests/kraken/driver.html?testName=imaging-gaussian-blur) 12:48:18 INFO - PROCESS | 25337 | RSS: Main: 214794240 12:48:18 INFO - PROCESS | 25337 | 12:48:22 INFO - PROCESS | 25337 | Cycle 1(1): loaded http://localhost:47990/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:47990/tests/kraken/driver.html?testName=imaging-darkroom) 12:48:22 INFO - PROCESS | 25337 | RSS: Main: 250507264 12:48:22 INFO - PROCESS | 25337 | 12:48:26 INFO - PROCESS | 25337 | Cycle 1(1): loaded http://localhost:47990/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:47990/tests/kraken/driver.html?testName=imaging-desaturate) 12:48:26 INFO - PROCESS | 25337 | RSS: Main: 244707328 12:48:26 INFO - PROCESS | 25337 | 12:48:29 INFO - PROCESS | 25337 | Cycle 1(1): loaded http://localhost:47990/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:47990/tests/kraken/driver.html?testName=json-parse-financial) 12:48:30 INFO - PROCESS | 25337 | RSS: Main: 247398400 12:48:30 INFO - PROCESS | 25337 | 12:48:32 INFO - PROCESS | 25337 | Cycle 1(1): loaded http://localhost:47990/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:47990/tests/kraken/driver.html?testName=json-stringify-tinderbox) 12:48:32 INFO - PROCESS | 25337 | RSS: Main: 211337216 12:48:32 INFO - PROCESS | 25337 | 12:48:34 INFO - PROCESS | 25337 | Cycle 1(1): loaded http://localhost:47990/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:47990/tests/kraken/driver.html?testName=stanford-crypto-aes) 12:48:35 INFO - PROCESS | 25337 | RSS: Main: 218300416 12:48:35 INFO - PROCESS | 25337 | 12:48:37 INFO - PROCESS | 25337 | Cycle 1(1): loaded http://localhost:47990/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:47990/tests/kraken/driver.html?testName=stanford-crypto-ccm) 12:48:38 INFO - PROCESS | 25337 | RSS: Main: 227524608 12:48:38 INFO - PROCESS | 25337 | 12:48:41 INFO - PROCESS | 25337 | Cycle 1(1): loaded http://localhost:47990/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:47990/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 12:48:41 INFO - PROCESS | 25337 | RSS: Main: 236138496 12:48:41 INFO - PROCESS | 25337 | 12:48:44 INFO - PROCESS | 25337 | Cycle 1(1): loaded http://localhost:47990/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:47990/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 12:48:45 INFO - PROCESS | 25337 | RSS: Main: 233254912 12:48:45 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | Cycle 1(1): loaded http://localhost:47990/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:47990/tests/kraken/driver.html?testName=ai-astar) 12:48:47 INFO - PROCESS | 25337 | RSS: Main: 284590080 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | __start_tp_report 12:48:47 INFO - PROCESS | 25337 | _x_x_mozilla_page_load 12:48:47 INFO - PROCESS | 25337 | _x_x_mozilla_page_load_details 12:48:47 INFO - PROCESS | 25337 | |i|pagename|runs| 12:48:47 INFO - PROCESS | 25337 | |0;ai-astar;113;115;115;116;113;115;113;114;115;115 12:48:47 INFO - PROCESS | 25337 | |1;audio-beat-detection;151;133;128;176;133;129;129;128;176;128 12:48:47 INFO - PROCESS | 25337 | |2;audio-dft;162;162;163;161;163;163;161;165;164;162 12:48:47 INFO - PROCESS | 25337 | |3;audio-fft;76;75;77;110;78;78;79;77;101;76 12:48:47 INFO - PROCESS | 25337 | |4;audio-oscillator;85;84;119;85;84;88;117;85;84;112 12:48:47 INFO - PROCESS | 25337 | |5;imaging-gaussian-blur;117;118;118;117;117;117;117;118;117;117 12:48:47 INFO - PROCESS | 25337 | |6;imaging-darkroom;147;146;147;147;147;147;146;148;148;147 12:48:47 INFO - PROCESS | 25337 | |7;imaging-desaturate;96;96;96;96;97;97;96;95;95;97 12:48:47 INFO - PROCESS | 25337 | |8;json-parse-financial;66;67;65;65;67;68;67;75;66;66 12:48:47 INFO - PROCESS | 25337 | |9;json-stringify-tinderbox;69;67;67;68;70;67;68;68;70;68 12:48:47 INFO - PROCESS | 25337 | |10;stanford-crypto-aes;92;84;84;85;84;83;84;84;87;87 12:48:47 INFO - PROCESS | 25337 | |11;stanford-crypto-ccm;149;145;143;146;140;144;150;143;178;143 12:48:47 INFO - PROCESS | 25337 | |12;stanford-crypto-pbkdf2;177;182;188;179;177;179;180;175;177;178 12:48:47 INFO - PROCESS | 25337 | |13;stanford-crypto-sha256-iterative;74;76;70;70;75;71;71;70;74;71 12:48:47 INFO - PROCESS | 25337 | __end_tp_report 12:48:47 INFO - PROCESS | 25337 | __start_cc_report 12:48:47 INFO - PROCESS | 25337 | _x_x_mozilla_cycle_collect,1960 12:48:47 INFO - PROCESS | 25337 | __end_cc_report 12:48:47 INFO - PROCESS | 25337 | __startTimestamp1475696927531__endTimestamp 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | ------- Summary: start ------- 12:48:47 INFO - PROCESS | 25337 | Number of tests: 14 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | [#0] ai-astar Cycles:10 Average:114.40 Median:115.00 stddev:1.07 (0.9%) stddev-sans-first:1.01 12:48:47 INFO - PROCESS | 25337 | Values: 113.0 115.0 115.0 116.0 113.0 115.0 113.0 114.0 115.0 115.0 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | [#1] audio-beat-detection Cycles:10 Average:141.10 Median:133.00 stddev:19.64 (14.8%) stddev-sans-first:20.51 12:48:47 INFO - PROCESS | 25337 | Values: 151.0 133.0 128.0 176.0 133.0 129.0 129.0 128.0 176.0 128.0 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | [#2] audio-dft Cycles:10 Average:162.60 Median:163.00 stddev:1.26 (0.8%) stddev-sans-first:1.32 12:48:47 INFO - PROCESS | 25337 | Values: 162.0 162.0 163.0 161.0 163.0 163.0 161.0 165.0 164.0 162.0 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | [#3] audio-fft Cycles:10 Average:82.70 Median:77.00 stddev:12.26 (15.9%) stddev-sans-first:12.76 12:48:47 INFO - PROCESS | 25337 | Values: 76.0 75.0 77.0 110.0 78.0 78.0 79.0 77.0 101.0 76.0 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | [#4] audio-oscillator Cycles:10 Average:94.30 Median:84.50 stddev:15.11 (17.9%) stddev-sans-first:15.65 12:48:47 INFO - PROCESS | 25337 | Values: 85.0 84.0 119.0 85.0 84.0 88.0 117.0 85.0 84.0 112.0 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | [#5] imaging-gaussian-blur Cycles:10 Average:117.30 Median:117.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 12:48:47 INFO - PROCESS | 25337 | Values: 117.0 118.0 118.0 117.0 117.0 117.0 117.0 118.0 117.0 117.0 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | [#6] imaging-darkroom Cycles:10 Average:147.00 Median:147.00 stddev:0.67 (0.5%) stddev-sans-first:0.71 12:48:47 INFO - PROCESS | 25337 | Values: 147.0 146.0 147.0 147.0 147.0 147.0 146.0 148.0 148.0 147.0 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | [#7] imaging-desaturate Cycles:10 Average:96.10 Median:96.00 stddev:0.74 (0.8%) stddev-sans-first:0.78 12:48:47 INFO - PROCESS | 25337 | Values: 96.0 96.0 96.0 96.0 97.0 97.0 96.0 95.0 95.0 97.0 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | [#8] json-parse-financial Cycles:10 Average:67.20 Median:67.00 stddev:2.90 (4.3%) stddev-sans-first:3.04 12:48:47 INFO - PROCESS | 25337 | Values: 66.0 67.0 65.0 65.0 67.0 68.0 67.0 75.0 66.0 66.0 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | [#9] json-stringify-tinderbox Cycles:10 Average:68.20 Median:68.00 stddev:1.14 (1.7%) stddev-sans-first:1.17 12:48:47 INFO - PROCESS | 25337 | Values: 69.0 67.0 67.0 68.0 70.0 67.0 68.0 68.0 70.0 68.0 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | [#10] stanford-crypto-aes Cycles:10 Average:85.40 Median:84.50 stddev:2.67 (3.2%) stddev-sans-first:1.41 12:48:47 INFO - PROCESS | 25337 | Values: 92.0 84.0 84.0 85.0 84.0 83.0 84.0 84.0 87.0 87.0 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | [#11] stanford-crypto-ccm Cycles:10 Average:148.10 Median:145.50 stddev:10.92 (7.5%) stddev-sans-first:11.58 12:48:47 INFO - PROCESS | 25337 | Values: 149.0 145.0 143.0 146.0 140.0 144.0 150.0 143.0 178.0 143.0 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:179.20 Median:179.00 stddev:3.65 (2.0%) stddev-sans-first:3.78 12:48:47 INFO - PROCESS | 25337 | Values: 177.0 182.0 188.0 179.0 177.0 179.0 180.0 175.0 177.0 178.0 12:48:47 INFO - PROCESS | 25337 | 12:48:47 INFO - PROCESS | 25337 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:72.20 Median:72.50 stddev:2.30 (3.2%) stddev-sans-first:2.35 12:48:47 INFO - PROCESS | 25337 | Values: 74.0 76.0 70.0 70.0 75.0 71.0 71.0 70.0 74.0 71.0 12:48:47 INFO - PROCESS | 25337 | -------- Summary: end -------- 12:48:47 INFO - PROCESS | 25337 | 12:48:48 INFO - TEST-INFO | 25337: exit 0 12:48:49 INFO - TEST-OK | kraken | took 64906ms 12:48:49 INFO - SUITE-END | took 1185s 12:48:49 INFO - Completed test suite (00:19:45) 12:48:49 INFO - javascript benchmark 12:48:49 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2556.143691863226, 2589.6633437653104, 2609.3346196719835, 2629.513539995101, 2638.6833579970394, 4524.547545245474, 4573.359729637845, 4699.365585645936, 4709.717416954981, 4715.434147902252, 4630.953690463094, 4708.034852855165, 4717.292406139072, 4781.832635857746, 4839.854804355866, 4278.058827058042, 4311.094670119279, 4359.215341238576, 4386.342048692705, 4401.295792673157, 4385.605295523403, 4475.127350166719, 4477.216487114758, 4486.528914463983, 4496.460424749034, 4230.661547076257, 4250.659947204216, 4250.936235956463, 4304.634106100985, 4359.520452750211, 4217.936730949038, 4241.724287921275, 4271.337942618899, 4367.235733746614, 4371.4098596689355, 4278.101598664284, 4290.0, 4297.892552686177, 4340.60934515895, 4344.543822898613, 4675.0883577702025, 4683.484816670163, 4684.531546845323, 4689.88275293117, 4705.600023997964, 4809.687370320918, 4858.878528036827, 4991.0, 5011.674241174312, 5059.342285502861, 5100.897982040376, 5102.234664800272, 5102.846914592568, 5146.665466744687, 5151.304573882516, 4736.668433209677, 4747.454042785055, 4749.192637251606, 4749.62003039756, 4803.927941080851, 4846.8788280292565, 4899.853004409873, 5119.232115182678, 5177.689338639693, 5246.554042906319, 4969.527894850055, 4990.451050384455, 4992.350994370781, 5045.31888195089, 5058.064258112261, 5066.06277838601, 5077.771500282496, 5078.847634570969, 5081.9745901271, 5134.435212126663, 4808.519148085164, 4850.660453768273, 5021.59827213822, 5030.874228144326, 5034.597232221487, 4868.02639472107, 4906.656534042654, 4909.165441874889, 4915.680480768739, 4926.556609905126, 3845.0002999219846, 3860.845566177378, 3962.0094976255937, 3962.366021436614, 3965.7422267553093, 3425.606055303672, 3429.77706449085, 3432.3135372925517, 3482.077249528877, 3493.2664140530774, 4124.195781822576, 4175.269327867611, 4176.2691528982305, 4220.894477638084, 4237.343211802176, 4877.829275975324, 4992.201247800334, 5000.799968001239, 5042.747862606855, 5063.87340316495, 4282.35764635301, 4291.0559676871035, 4292.377605247284, 4298.161858437575, 4349.456317960255, 4421.624161946271, 4523.140603285366, 4536.705114167635, 4543.068670922453, 4558.840440584564, 4661.067786442657, 4706.458757242961, 4744.4069491313585, 4751.263554148974, 4827.637927155548, 5046.722430266371, 5077.492250775041, 5085.7711402986215, 5086.33877595925, 5139.92290115656, 4754.144254034169, 4765.166095933128, 4768.904621907612, 4771.379720636295, 4825.083234185494, 4887.877803054952, 4943.2585112233455, 4947.282644016669, 4950.356453661001, 4951.777170027285, 4964.156093464192, 5011.774470148925, 5018.397792264952, 5023.246513023076, 5025.899482010266, 4879.170541007966, 4888.755562221803, 4894.755262236945, 4913.459519452786, 4990.3762029746285, 4912.435069966857, 4926.113299606105, 4929.16204245272, 4929.728864912464, 4985.0, 4810.062037902575, 4830.130576496264, 4853.451304661907, 4865.489123641966, 4927.408710954708, 4746.5490778376, 4792.976035119802, 4832.081904438145, 4844.2007068834655, 4874.317595536557, 4789.161896668, 4798.568128868418, 4808.519148085164, 4837.661363704507, 4850.1997170466475], "value": 4584.898982419758, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [551.4402881075708, 581.4069648958061, 582.6911736779506, 596.2517041113402, 598.320905771949, 35934.2813143737, 37416.43875341869, 37460.625393746086, 41106.38340424889, 41142.794286028526, 38510.22979540408, 38883.0, 38894.61105388945, 38921.61078389215, 38973.61026389735, 7607.125180604232, 7738.148803631596, 7743.574103424309, 7744.341730952848, 7744.341730952848, 7523.059617547807, 7608.201138880421, 7610.391168706518, 7614.086309642823, 7617.771466856003, 7649.579273139975, 7673.462857599942, 7684.269994350528, 7694.153643099255, 7702.345300649452, 7582.886256706154, 7595.354394876442, 7603.201663825274, 7607.505512141693, 7619.923800761977, 7606.543607383519, 7686.0, 7688.9231107688765, 7690.15408305086, 7699.5380277182985, 36587.63412365896, 36684.0, 36718.632813671786, 36794.26411471782, 36796.264074718354, 2928.3996780659913, 2990.1029691092804, 3027.712367325101, 3043.071863081759, 3165.5568220449154, 24784.3803904902, 25154.0, 26918.730812691818, 27619.171424857086, 28431.147065588066, 3439.2777516721517, 3445.7243420526297, 3448.758586898918, 3478.3912815257227, 3504.334176506481, 238300.0, 240246.0, 241666.0, 241929.29131338903, 242193.78903105546, 49386.259206111215, 49652.0, 49664.02015879059, 49693.0, 49704.50295497071, 32225.838870805495, 32965.83517082399, 33011.504827427605, 51277.23084153741, 51484.74257628688, 12207.450664720109, 12363.567275145328, 12378.0, 12379.814302785466, 12389.070819688559, 10609.522571484302, 10621.787564248672, 10686.305390149615, 10781.0, 10785.083267922315, 17061.317547297967, 17170.141492925304, 17248.913755431393, 17392.3043078278, 17437.65124697524, 6472.223333200046, 6613.537052406382, 6627.86744265112, 6690.698918548677, 6900.723971041202, 769.2845653542148, 836.7949852286229, 861.7759382560579, 879.4415546128255, 972.6595691507915, 25239.62140567893, 26523.73476265251, 27509.17472475829, 27555.31111722223, 27704.168874933785, 735.3933005270673, 912.9589168487435, 959.2134449751137, 961.8893827209961, 965.4496936746128, 13711.520096796565, 13990.72018559623, 14254.287285635677, 14371.353289101806, 14373.0, 360011.0, 363562.0, 363935.0, 365614.0, 366588.0, 47615.52384476111, 47972.7601361991, 48022.0, 48022.5197748025, 48088.27867581989, 1062.3041907550567, 1092.781443711245, 1138.345451365468, 1146.2434793036555, 1162.4013632979022, 24636.630450542896, 27809.582856257577, 28212.294692632848, 28907.710922890503, 29014.41971160607, 38651.0, 39043.0, 39052.2189556213, 39053.2189356217, 39108.2178356437, 288844.0, 289130.0, 289680.0, 290317.0, 291093.0, 24174.39564010914, 25197.370065748502, 25213.621795672712, 26155.73844261533, 26197.476050479265, 39227.60772392354, 40106.598934011454, 40309.39535906905, 40798.38802417907, 41136.79431602823, 34330.65669343275, 34564.30871382508, 34601.48097778485, 34711.9586412408, 34849.0, 33607.83196084102, 34451.310973780885, 34651.0, 34748.30503389968, 34911.301773964886, 33622.49566256557, 34229.48655770116, 34512.48231276483, 34514.0, 34678.30643387169, 29292.707072929, 32376.0, 32391.67608323981, 32414.189645259055, 32566.348673025932, 24178.87910560436, 24514.754852451246, 24928.133264674794, 24971.75028249767, 25072.74927250704], "value": 16697.06381254217, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [332.390064232134, 344.63812996353823, 350.9859605615775, 356.8019749039282, 376.1930658737009, 11954.282743035414, 12928.741425171504, 16002.759958600616, 16427.507174784747, 17062.74405883913, 16464.176791160455, 16731.581710457245, 16767.32930682774, 16822.57943551412, 17032.063236521986, 4348.934765978513, 4580.770961451931, 4771.355866957951, 5081.695098294114, 5087.236914462842, 4909.337239472679, 5042.82350117746, 5051.520105589963, 5052.646314757969, 5055.064813009605, 4775.617950563964, 5024.221245706921, 5026.798928042874, 5027.296178535008, 5030.245463180534, 4946.0, 5011.498850114977, 5020.0, 5023.246513023039, 5027.547520723134, 4335.3063509838275, 4490.932636010462, 4491.955080449186, 4495.303227999665, 4496.190685676577, 19428.708569371473, 19620.117094730773, 19991.100400482013, 20384.694229586567, 20391.898040509852, 1734.4796561031767, 1962.7154062660977, 1964.4401345616573, 1975.4468748750373, 2055.8149766521083, 8981.955090224572, 9407.388519746195, 9628.75928101803, 11737.941310293394, 13326.267055311953, 1592.1243316176174, 1637.598788296863, 1655.9586010349717, 1704.5056933489273, 1719.5357253541474, 63121.68439157775, 69190.0, 70225.2977470229, 70539.29460705379, 72023.27976720218, 9682.370645907993, 9885.961973992627, 9908.35595686278, 9916.603335866628, 10028.849567256497, 13591.660208494866, 13601.727965440834, 13652.658683532793, 13718.24549649759, 13781.104228225133, 7102.28977102296, 7247.927520724831, 7290.234525374865, 7335.88996165058, 7407.925920740724, 6830.692618832164, 6872.278410766898, 6933.514653974275, 7031.613261270577, 7141.678624461808, 4269.4449721536, 4293.463317085364, 4302.913941721211, 4304.354346847936, 4407.118576284692, 1715.62256303613, 1820.126339357116, 1833.294181740013, 1838.6874231380698, 1839.245909177231, 771.6064806948384, 786.838698066895, 798.473007814851, 819.9877001844977, 837.5142417397894, 15696.843031569766, 16347.591310217102, 16482.505524834272, 16701.832981670028, 17451.825481745273, 783.2480818414272, 788.8619491588948, 842.8567143585606, 853.910339414365, 895.8700988356652, 8946.239569636524, 9518.714438566716, 9546.904530954602, 9631.855522167172, 9632.518374081268, 358005.0, 367298.0, 369639.0, 370521.0, 371165.0, 69774.0, 70859.58280834355, 73070.0, 73369.63315183496, 73800.0, 876.4828751036919, 886.7827382291251, 891.0376793063476, 893.3701740273092, 898.3756289378949, 12980.675483112998, 14064.859351406354, 14171.078879872775, 14364.066335688147, 14478.27608619586, 35107.29785404329, 35334.29331413409, 35488.822555887054, 36173.638263617024, 36243.63756362403, 46642.766786165856, 47058.0, 47463.52536474729, 47470.0, 50648.49351506438, 7157.212706602374, 7596.924030759622, 7673.808154796175, 7753.1859154787935, 7775.650095745818, 10625.149988001096, 11298.943505282421, 11468.483918223867, 11856.940715296369, 11904.345261010381, 9360.485173315534, 9612.855807162758, 9857.65498207588, 10124.190064794946, 10328.741781455523, 10383.234850075354, 10385.961403859554, 10581.31221470602, 10591.152707783205, 10705.625303114353, 10345.689629311133, 10460.372377657364, 10741.462926853783, 11042.17183711241, 11057.502412391623, 7603.695852165852, 7671.2712292332135, 10597.0, 10766.946165269124, 10954.616588419367, 10068.848967265643, 10191.84712229332, 10223.233257505568, 10837.67486975392, 11028.503717332578], "value": 8008.380412640177, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1220.121512510993, 1317.268915751758, 1364.63154948164, 1366.3168415792104, 1638.8033435987684, 6635.435987941025, 7421.0, 7729.072511298645, 7734.071911370644, 7957.403194760387, 7857.292843644071, 7860.096088949773, 7927.524348539092, 7945.205479452052, 7945.523268603888, 2106.7682554918983, 2137.8717276963353, 2140.946476338096, 2141.5609799990966, 2141.6573348264283, 2111.3032699209225, 2153.3001774423374, 2161.492049368397, 2170.4573856535867, 2175.4887601413657, 2101.086027578001, 2133.8292936565117, 2142.3037512808323, 2145.6888751131078, 2158.125958986613, 2125.298651445027, 2131.893405329743, 2132.040581738224, 2134.4557137929883, 2136.113512892148, 2055.486128467883, 2091.0903756865814, 2099.737532808399, 2099.8740075595515, 2108.599366120432, 7665.195154508808, 7783.766487005342, 7800.960995195044, 7846.921530784676, 7885.921140788633, 4473.261911784552, 4632.513586073447, 4634.050019745944, 4641.907161856744, 4650.4186976627925, 2835.7164283571683, 2960.8963686270877, 3005.5191169412788, 3007.383486385286, 3027.2431892026993, 862.3446180902497, 868.0538213347481, 876.5660997806064, 886.3219636977717, 889.226373055446, 10519.631812886511, 10574.841377379345, 10597.258191926569, 10676.893231067668, 10709.0, 3750.718696097804, 3844.5386553613184, 3950.0914789598555, 3992.0, 3999.480067591253, 8410.02364444355, 8413.789655258544, 8414.789630259293, 8422.368322375847, 8426.325893928471, 4516.096780643885, 4532.750698711537, 4551.158035763395, 4557.111363284194, 4557.863264102082, 3657.908552286214, 3780.8109594520165, 4066.2477441673386, 4214.199302132646, 4216.7680777557525, 3279.6064472263483, 3334.299217633676, 3412.2663627320244, 3438.3123375325035, 3456.4642480415578, 967.205833179456, 972.7957129002847, 1000.0849222960909, 1001.4942454060798, 1008.4503945349655, 784.1296161260996, 802.6027116577214, 805.8227190018187, 805.9723852088517, 806.2260230179094, 5079.771410286546, 5129.487051294841, 5138.30632864566, 5227.686338819683, 5413.0, 364.6080463501746, 374.26083485116675, 375.7125798763948, 388.38053304978513, 388.62109443292564, 3463.809490478048, 3532.7350448716447, 3587.3901436755814, 3630.727695422801, 3696.131409118909, 9297.512398016284, 9754.463504507321, 9759.804803904024, 9778.608855645694, 9783.804323913482, 9683.273754468442, 9703.02969703024, 9714.757131071638, 9715.0770676787, 9742.902570974342, 7169.641517924083, 7221.53060051095, 7347.26527347261, 7347.55914645123, 7360.2271761465345, 5089.618278629044, 5102.566281866083, 5104.540591346648, 5235.214717792362, 5351.2508248844415, 8831.91168088311, 8862.113788621085, 8912.153345432174, 8965.148310910454, 8979.910200897908, 8781.692640757543, 9053.279876823382, 9067.727968160965, 9072.682456114004, 9155.176034156691, 5711.457411545896, 5944.791932282523, 6284.528660350584, 6318.968405157945, 6350.079238510482, 7420.406367490696, 7638.847223055619, 7682.654280557276, 7689.077310722749, 7695.615219239127, 6519.511036672174, 6534.738610455719, 6685.364890335411, 6734.292899245705, 6822.727090916308, 6301.0, 6378.74485020594, 6450.548461607643, 6463.935360646334, 6465.741370345134, 5988.970055149696, 6073.878522429615, 6080.118382834553, 6084.0, 6086.482648974709, 4260.467441569804, 4296.334068219431, 4373.650107991417, 4376.627986621173, 4518.856622342837, 4480.798364073559, 4513.75174365413, 4529.139463501924, 4567.406237189277, 4640.512746161605], "value": 3940.3506811157554, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [286.65744435399694, 289.77687180870726, 298.08190772420943, 298.8192143753029, 299.1727872432725, 4718.952810471894, 4762.666613337068, 4785.688930219533, 4790.952090479099, 4822.107910036637, 4740.620750339973, 4741.976290118545, 4745.620350371971, 4760.809567617292, 4775.522447755223, 3788.981055094721, 3807.200487897531, 3807.352750032487, 3811.7141214408894, 3820.77075375477, 3649.233660931208, 3796.4495148203496, 3797.468354430382, 3797.525309336333, 3821.7706937583694, 3719.442083687455, 3738.1962877981227, 3761.755485893422, 3778.565464971522, 3800.429935509682, 3746.7002639788752, 3789.355809512362, 3790.3556395412706, 3792.6586607205486, 3798.772073675588, 3163.683631636841, 3269.9019029429155, 3379.915502112467, 3384.2047118927035, 3387.390989280097, 4527.615152712024, 4645.349651048856, 4656.511066338054, 4667.533246675339, 4702.9294560581275, 4306.246406878815, 4306.569343065699, 4313.482382114135, 4321.762303073329, 4321.870343889688, 4708.858734237979, 4785.306130611077, 4992.800287988476, 5048.570871475929, 5056.924146137811, 3345.3643807676463, 3602.2435288589427, 3608.0438683748825, 3612.945805812915, 3649.160693040589, 5186.870328241824, 5194.454582268883, 5200.193969934666, 5218.973905130488, 5237.16205407133, 3642.4900513928073, 3738.8222709846855, 3739.9439008414897, 3743.2487121965332, 3748.681362084199, 3726.9068273293383, 3765.7740535567955, 3769.151940813295, 3783.5838057813617, 3785.545734511821, 4240.49114106303, 4241.575842415796, 4246.596573325529, 4248.447701798808, 4280.694388211626, 4951.257311403318, 4972.825951091767, 5001.424836143818, 5006.199008158677, 5012.619005972134, 1207.93356365399, 1271.434211775751, 1276.3554405025402, 1302.5701518498872, 1327.9136856104321, 789.1989630525022, 808.6765293882494, 817.5952903312898, 825.5624519004937, 827.8882350882674, 3885.941710874339, 3886.106195574977, 3895.8441662333757, 3921.745086569364, 3928.0, 4496.493674618974, 4522.977385113053, 4530.301137073598, 4539.409876716006, 4559.703619264737, 3863.2080423513676, 3884.4755957945317, 3891.9805400972814, 3893.182431689377, 3922.881978636075, 2403.795677367443, 2409.445827459694, 2514.585093459595, 2696.191142657195, 2713.3623598454346, 4603.723776573416, 4767.642426818003, 4831.565159135695, 4845.927311090337, 4855.150348688965, 5111.5655169310285, 5290.444503327172, 5307.548858347007, 5314.73426328682, 5319.494648008433, 4840.443349014909, 4875.146849301429, 4893.681910675866, 4894.0179227412955, 4919.262110683426, 4863.954249836303, 5092.694438333712, 5105.387353517453, 5137.409197942285, 5158.226266059971, 5050.898982020412, 5054.570361519312, 5083.364579427572, 5090.516400942052, 5098.158803797481, 4834.347363106076, 4848.272759086024, 4849.587785038311, 4859.319695242598, 4862.975685121552, 3576.803275819855, 3593.4070878304788, 3623.1123374772296, 3644.21649345392, 3651.3427583034245, 5104.846854594368, 5110.616703747308, 5130.153524668388, 5137.0, 5164.586833053271, 5025.035229214781, 5041.789970407002, 5051.848444546669, 5088.414832294334, 5093.955739073407, 4914.65597408178, 4976.402831660224, 4984.850454486371, 5065.949340506548, 5072.28987941681, 4945.455999840086, 4946.925796112989, 4948.356713627206, 4975.353204083446, 4987.700737955734, 5055.0, 5091.516305950929, 5098.0, 5121.7695203715175, 5139.306193663808, 4765.974460854192, 4956.628252880976, 4960.23116416956, 5003.899922001467, 5006.874828129326], "value": 3736.4165435527448, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [608.3855306140798, 690.4786885901141, 721.5634541102636, 733.9926600733991, 744.9068866391701, 12944.805827912576, 13805.171689698625, 13819.861801381996, 13821.723565528697, 13845.861541384584, 12475.563355282567, 12525.874741252584, 12548.121631485777, 12562.560310389139, 12567.308798016105, 607.696151924038, 622.6202016769766, 732.4689600039954, 736.5617457612711, 751.2187325181804, 749.6176949755636, 750.7672621487357, 751.1549506804845, 751.6767789850362, 752.405599576334, 791.4973991515401, 791.8218400859818, 792.029763539665, 792.2988155482411, 792.5403266105674, 635.7774778827396, 651.9217693876718, 758.2834221660534, 770.2374649097409, 791.3194652598761, 565.7143142712945, 566.0801198053164, 572.5076434266527, 574.4887050525036, 574.5604612471462, 12507.874921250854, 12531.874681253163, 12534.874651253462, 12563.93718031404, 12574.748505029847, 11732.472038758277, 11837.289762614184, 11851.94074029633, 11955.581554645632, 12499.437525311383, 12004.579839705655, 12023.57917472893, 12089.21420107699, 12396.75206495874, 12787.168834025759, 4123.0, 4148.585141485857, 4164.208800327928, 4327.134573085364, 4336.8265269389185, 61273.0, 62861.37138628647, 63420.04869927001, 63686.0, 63749.362506374804, 9952.651657191964, 10101.292909496411, 10165.695029149138, 10167.440790756431, 10250.487475626189, 17336.479905602853, 17422.65154696899, 17620.91189544044, 17632.471025869243, 17882.374116906107, 6488.643124628191, 6492.967535162294, 6522.967385163044, 6568.146141001639, 6568.86862262752, 3452.9827350863084, 3495.790252584853, 3504.859805607747, 3531.311394278091, 3574.9285014299567, 2625.8949642014486, 2682.021062312242, 2695.1375559820667, 2697.7167397422986, 2702.2703869955003, 481.066730542746, 487.28612582566, 494.868859752166, 495.4005653159645, 496.86087895389346, 546.907025805614, 561.7977528089884, 561.8623437257817, 563.7350445290707, 569.0354848531699, 7843.607819609111, 7916.960415197887, 8152.0, 8159.306458950937, 8165.346772258205, 478.6505850728987, 530.6259087343414, 530.9575233981273, 541.1801121301232, 566.8554518597814, 3598.280343931172, 3605.4952306677087, 3662.047867554402, 3798.6201379862346, 3964.484616999829, 55643.0, 87686.56156719176, 94577.05422945683, 103921.0, 105225.0, 85031.0, 86595.56702216448, 87117.0, 87357.33318668758, 90044.0, 74755.0, 76525.2347476518, 76887.61556192295, 77015.61492192504, 77092.0, 6630.569013014138, 6644.61041662534, 6779.220389655253, 7107.751228707178, 7346.191918889025, 45088.54911450844, 45539.31691024571, 46230.306545401174, 46479.443630599286, 47704.5229547714, 61214.69392653008, 62431.0, 66631.0, 68138.65930670315, 69190.0, 8634.827303454022, 8917.0, 8955.41789783662, 9322.673706420243, 9499.667511637059, 9822.066903644429, 10028.197744180303, 10208.234382421497, 10246.0, 10383.896161038596, 10289.3311934724, 11381.048136838774, 11560.132990025613, 11623.418829058344, 12313.938430307791, 12042.819357709466, 12206.023518118707, 12488.875111249135, 13187.80218296707, 13361.53234636783, 11700.173764957068, 11940.2835829847, 12174.939125304316, 12218.327991960528, 12295.0, 10124.69625911224, 10295.742606434898, 10362.740931476472, 10411.219158562986, 10804.027637512661, 9465.952670236606, 9788.951055244963, 10116.696499105039, 10299.742506437398, 10361.171106311327], "value": 6390.447125244175, "unit": "score"}], "name": "dromaeo_css", "value": 6216.0479547175055, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 115.0, 115.0, 116.0, 113.0, 115.0, 113.0, 114.0, 115.0, 115.0], "value": 114.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 133.0, 128.0, 176.0, 133.0, 129.0, 129.0, 128.0, 176.0, 128.0], "value": 141.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 162.0, 163.0, 161.0, 163.0, 163.0, 161.0, 165.0, 164.0, 162.0], "value": 162.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 77.0, 110.0, 78.0, 78.0, 79.0, 77.0, 101.0, 76.0], "value": 82.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 84.0, 119.0, 85.0, 84.0, 88.0, 117.0, 85.0, 84.0, 112.0], "value": 94.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 118.0, 118.0, 117.0, 117.0, 117.0, 117.0, 118.0, 117.0, 117.0], "value": 117.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 146.0, 147.0, 147.0, 147.0, 147.0, 146.0, 148.0, 148.0, 147.0], "value": 147.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 96.0, 96.0, 96.0, 97.0, 97.0, 96.0, 95.0, 95.0, 97.0], "value": 96.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 67.0, 65.0, 65.0, 67.0, 68.0, 67.0, 75.0, 66.0, 66.0], "value": 67.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 67.0, 67.0, 68.0, 70.0, 67.0, 68.0, 68.0, 70.0, 68.0], "value": 68.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [92.0, 84.0, 84.0, 85.0, 84.0, 83.0, 84.0, 84.0, 87.0, 87.0], "value": 85.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 145.0, 143.0, 146.0, 140.0, 144.0, 150.0, 143.0, 178.0, 143.0], "value": 148.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [177.0, 182.0, 188.0, 179.0, 177.0, 179.0, 180.0, 175.0, 177.0, 178.0], "value": 179.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 76.0, 70.0, 70.0, 75.0, 71.0, 71.0, 70.0, 74.0, 71.0], "value": 72.2, "unit": "score"}], "name": "kraken", "value": 1575.8000000000002, "alertThreshold": 2.0}]} 12:48:49 INFO - Return code: 0 12:48:49 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 12:48:49 INFO - # TBPL SUCCESS # 12:48:49 INFO - Running post-action listener: _resource_record_post_action 12:48:49 INFO - [mozharness: 2016-10-05 19:48:49.319416Z] Finished run-tests step (success) 12:48:49 INFO - Running post-run listener: _resource_record_post_run 12:48:49 INFO - Total resource usage - Wall time: 1202s; CPU: 13.0%; Read bytes: 4096; Write bytes: 410333184; Read time: 12; Write time: 264440 12:48:49 INFO - TinderboxPrint: CPU usage
13.1% 12:48:49 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 12:48:49 INFO - TinderboxPrint: I/O write bytes / time
410,333,184 / 264,440 12:48:49 INFO - TinderboxPrint: CPU idle
8,335.5 (86.9%) 12:48:49 INFO - TinderboxPrint: CPU user
1,206.2 (12.6%) 12:48:49 INFO - TinderboxPrint: Swap in / out
0 / 0 12:48:49 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 115900416; Read time: 0; Write time: 71324 12:48:49 INFO - run-tests - Wall time: 1186s; CPU: 13.0%; Read bytes: 0; Write bytes: 294432768; Read time: 0; Write time: 193116 12:48:49 INFO - Running post-run listener: _upload_blobber_files 12:48:49 INFO - Blob upload gear active. 12:48:49 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 12:48:49 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 12:48:49 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', 'Autoland-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 12:48:49 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 Autoland-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 12:48:50 INFO - (blobuploader) - INFO - Open directory for files ... 12:48:50 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 12:48:50 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:48:50 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:48:53 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 12:48:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:48:53 INFO - (blobuploader) - INFO - Done attempting. 12:48:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 12:48:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:48:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:48:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 12:48:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:48:54 INFO - (blobuploader) - INFO - Done attempting. 12:48:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 12:48:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:48:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:48:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 12:48:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:48:55 INFO - (blobuploader) - INFO - Done attempting. 12:48:55 INFO - (blobuploader) - INFO - Iteration through files over. 12:48:55 INFO - Return code: 0 12:48:55 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 12:48:55 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 12:48:55 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/e1d323cb86dc696324b31267f30382549bfe6477a3240d83c152d5cd38ab018fd1422554faf7fdb125e83a3855f06ecc2b1e1e288414e461f1c326d3220287e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/f1cfb0f10019bb7c196db9492462656229c8db6fd0f1d4caf4a481b758e478517e3807f9e8c3381c0335bcc234a8e542023e0c6e69b5722f0d014754ec8519b6", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/c64d6937e7c076d44aef92584a581ebfc0bff2e899c576140b1454bc62c6fd8f34440ecb86dc7ec507266e98b55adbef86b3b87089c9a6ccd645f7cf3ceda803"} 12:48:55 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 12:48:55 INFO - Writing to file /builds/slave/test/properties/blobber_files 12:48:55 INFO - Contents: 12:48:55 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/e1d323cb86dc696324b31267f30382549bfe6477a3240d83c152d5cd38ab018fd1422554faf7fdb125e83a3855f06ecc2b1e1e288414e461f1c326d3220287e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/f1cfb0f10019bb7c196db9492462656229c8db6fd0f1d4caf4a481b758e478517e3807f9e8c3381c0335bcc234a8e542023e0c6e69b5722f0d014754ec8519b6", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/c64d6937e7c076d44aef92584a581ebfc0bff2e899c576140b1454bc62c6fd8f34440ecb86dc7ec507266e98b55adbef86b3b87089c9a6ccd645f7cf3ceda803"} 12:48:55 INFO - Running post-run listener: copy_logs_to_upload_dir 12:48:55 INFO - Copying logs to upload dir... 12:48:55 INFO - mkdir: /builds/slave/test/build/upload/logs 12:48:55 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1245.574474 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 45 secs) (at 2016-10-05 12:48:54.500890) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-05 12:48:54.504211) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/e1d323cb86dc696324b31267f30382549bfe6477a3240d83c152d5cd38ab018fd1422554faf7fdb125e83a3855f06ecc2b1e1e288414e461f1c326d3220287e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/f1cfb0f10019bb7c196db9492462656229c8db6fd0f1d4caf4a481b758e478517e3807f9e8c3381c0335bcc234a8e542023e0c6e69b5722f0d014754ec8519b6", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/c64d6937e7c076d44aef92584a581ebfc0bff2e899c576140b1454bc62c6fd8f34440ecb86dc7ec507266e98b55adbef86b3b87089c9a6ccd645f7cf3ceda803"} build_url:https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011508 build_url: 'https://queue.taskcluster.net/v1/task/WpSjkN54Rg-g2QnGbjjAUg/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/e1d323cb86dc696324b31267f30382549bfe6477a3240d83c152d5cd38ab018fd1422554faf7fdb125e83a3855f06ecc2b1e1e288414e461f1c326d3220287e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/f1cfb0f10019bb7c196db9492462656229c8db6fd0f1d4caf4a481b758e478517e3807f9e8c3381c0335bcc234a8e542023e0c6e69b5722f0d014754ec8519b6", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/c64d6937e7c076d44aef92584a581ebfc0bff2e899c576140b1454bc62c6fd8f34440ecb86dc7ec507266e98b55adbef86b3b87089c9a6ccd645f7cf3ceda803"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-05 12:48:54.530175) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-05 12:48:54.530488) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1475692645.205714-918066600 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004524 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-05 12:48:54.612520) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-05 12:48:54.612848) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-05 12:48:54.613136) ========= ========= Total master_lag: 0.17 =========