builder: autoland_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-066 starttime: 1476474263.38 results: success (0) buildid: 20161014123601 builduid: f5d3d38a18da4a6ba5452be6b9c4016d revision: c5b1bfd47d15f4e2c475d18e1987b7284cea9084 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-14 12:44:23.376778) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-14 12:44:23.377381) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-14 12:44:23.377713) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-14 12:44:23.392654) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 12:44:23.392939) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-10-14 12:44:23-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 223M=0s 2016-10-14 12:44:23 (223 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.083060 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 12:44:23.491504) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 12:44:23.491815) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019178 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 12:44:23.542359) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-14 12:44:23.542942) ========= bash -c 'python archiver_client.py mozharness --repo integration/autoland --rev c5b1bfd47d15f4e2c475d18e1987b7284cea9084 --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 c5b1bfd47d15f4e2c475d18e1987b7284cea9084 --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=82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-10-14 12:44:23,738 truncating revision to first 12 chars 2016-10-14 12:44:23,738 Setting DEBUG logging. 2016-10-14 12:44:23,738 attempt 1/10 2016-10-14 12:44:23,738 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/c5b1bfd47d15?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-14 12:44:24,584 unpacking tar archive at: autoland-c5b1bfd47d15/testing/mozharness/ program finished with exit code 0 elapsedTime=1.154688 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-14 12:44:24.711465) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-14 12:44:24.711811) ========= script_repo_revision: c5b1bfd47d15f4e2c475d18e1987b7284cea9084 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-14 12:44:24.712288) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-14 12:44:24.712589) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-14 12:44:24.724005) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-10-14 12:44:24.724566) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Autoland --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Autoland', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Autoland'] 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=82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 12:44:25 INFO - MultiFileLogger online at 20161014 12:44:25 in /builds/slave/test 12:44:25 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Autoland --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland 12:44:25 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 12:44:25 INFO - {'append_to_log': False, 12:44:25 INFO - 'base_work_dir': '/builds/slave/test', 12:44:25 INFO - 'blob_upload_branch': 'Autoland', 12:44:25 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 12:44:25 INFO - 'branch': 'Autoland', 12:44:25 INFO - 'buildbot_json_path': 'buildprops.json', 12:44:25 INFO - 'config_files': ('talos/linux_config.py',), 12:44:25 INFO - 'default_actions': ('clobber', 12:44:25 INFO - 'read-buildbot-config', 12:44:25 INFO - 'download-and-extract', 12:44:25 INFO - 'populate-webroot', 12:44:25 INFO - 'create-virtualenv', 12:44:25 INFO - 'install', 12:44:25 INFO - 'run-tests'), 12:44:25 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 12:44:25 INFO - 'download_minidump_stackwalk': True, 12:44:25 INFO - 'download_symbols': 'ondemand', 12:44:25 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 12:44:25 INFO - 'tooltool.py': '/tools/tooltool.py', 12:44:25 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 12:44:25 INFO - '/tools/misc-python/virtualenv.py')}, 12:44:25 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 12:44:25 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 12:44:25 INFO - 'installer_path': 'installer.exe', 12:44:25 INFO - 'log_level': 'info', 12:44:25 INFO - 'log_name': 'talos', 12:44:25 INFO - 'log_to_console': True, 12:44:25 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 12:44:25 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 12:44:25 INFO - 'opt_config_files': (), 12:44:25 INFO - 'pip_index': False, 12:44:25 INFO - 'sps_profile': False, 12:44:25 INFO - 'sps_profile_interval': 0, 12:44:25 INFO - 'suite': 'dromaeojs-e10s', 12:44:25 INFO - 'system_bits': '32', 12:44:25 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 12:44:25 INFO - 'title': 'talos-linux64-ix-066', 12:44:25 INFO - 'tooltool_cache': '/builds/tooltool_cache', 12:44:25 INFO - 'use_talos_json': True, 12:44:25 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 12:44:25 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 12:44:25 INFO - 'work_dir': 'build'} 12:44:25 INFO - [mozharness: 2016-10-14 19:44:25.025274Z] Running clobber step. 12:44:25 INFO - Running pre-action listener: _resource_record_pre_action 12:44:25 INFO - Running main action method: clobber 12:44:25 INFO - rmtree: /builds/slave/test/build 12:44:25 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 12:44:25 INFO - Running post-action listener: _resource_record_post_action 12:44:25 INFO - [mozharness: 2016-10-14 19:44:25.473489Z] Finished clobber step (success) 12:44:25 INFO - [mozharness: 2016-10-14 19:44:25.473590Z] Running read-buildbot-config step. 12:44:25 INFO - Running pre-action listener: _resource_record_pre_action 12:44:25 INFO - Running main action method: read_buildbot_config 12:44:25 INFO - Using buildbot properties: 12:44:25 INFO - { 12:44:25 INFO - "project": "", 12:44:25 INFO - "product": "firefox", 12:44:25 INFO - "script_repo_revision": "production", 12:44:25 INFO - "builddir": "autoland_ubuntu64_hw_test-dromaeojs-e10s", 12:44:25 INFO - "repository": "", 12:44:25 INFO - "buildername": "Ubuntu HW 12.04 x64 autoland pgo talos dromaeojs-e10s", 12:44:25 INFO - "buildid": "20161014123601", 12:44:25 INFO - "stage_platform": "linux64-pgo", 12:44:25 INFO - "basedir": "/builds/slave/test", 12:44:25 INFO - "buildnumber": 348, 12:44:25 INFO - "platform": "ubuntu64_hw", 12:44:25 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 12:44:25 INFO - "slavebuilddir": "test", 12:44:25 INFO - "branch": "autoland", 12:44:25 INFO - "revision": "c5b1bfd47d15f4e2c475d18e1987b7284cea9084", 12:44:25 INFO - "slavename": "talos-linux64-ix-066", 12:44:25 INFO - "builduid": "f5d3d38a18da4a6ba5452be6b9c4016d", 12:44:25 INFO - "repo_path": "integration/autoland" 12:44:25 INFO - } 12:44:25 INFO - Found installer url https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 12:44:25 INFO - Found a test packages url https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.test_packages.json. 12:44:25 INFO - Running post-action listener: _resource_record_post_action 12:44:25 INFO - [mozharness: 2016-10-14 19:44:25.475956Z] Finished read-buildbot-config step (success) 12:44:25 INFO - [mozharness: 2016-10-14 19:44:25.476045Z] Running download-and-extract step. 12:44:25 INFO - Running pre-action listener: _resource_record_pre_action 12:44:25 INFO - Running main action method: download_and_extract 12:44:25 INFO - mkdir: /builds/slave/test/build/tests 12:44:25 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:44:25 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 12:44:25 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/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:44:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/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:44:25 INFO - Downloaded 1361 bytes. 12:44:25 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 12:44:25 INFO - Using the following test package requirements: 12:44:25 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 12:44:25 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:44:25 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 12:44:25 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:44:25 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 12:44:25 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:44:25 INFO - u'jsshell-linux-x86_64.zip'], 12:44:25 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:44:25 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 12:44:25 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 12:44:25 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:44:25 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 12:44:25 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:44:25 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 12:44:25 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:44:25 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 12:44:25 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 12:44:25 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 12:44:25 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 12:44:25 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 12:44:25 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:44:25 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 12:44:25 INFO - Http code: 200 12:44:25 INFO - via: 1.1 5ed093c37d643652e278a198e0556a40.cloudfront.net (CloudFront) 12:44:25 INFO - x-amz-cf-id: R611UATvSdsfC6E8sUrBrhM9lXifwT9IzUpvlyNQeZKMWgtnSDEQlg== 12:44:25 INFO - x-amz-replication-status: COMPLETED 12:44:25 INFO - x-amz-version-id: oVlgW30hceVJ0Ll4FuUaEBHpwWt2oATS 12:44:25 INFO - Expected file size: 22122806 12:44:25 INFO - Obtained file size: 22122806 12:44:29 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:44:29 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 12:44:29 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:44:29 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 12:44:29 INFO - Http code: 200 12:44:29 INFO - via: 1.1 11dd60d1f68e8258294f92935b53a91f.cloudfront.net (CloudFront) 12:44:29 INFO - x-amz-cf-id: uk0QJoF6Nps8U2_nrwsglPZQ3V3Me3q1tzVJHivjfa4hG-IrQmyN8w== 12:44:29 INFO - x-amz-replication-status: COMPLETED 12:44:29 INFO - x-amz-version-id: oVlgW30hceVJ0Ll4FuUaEBHpwWt2oATS 12:44:30 INFO - Expected file size: 22122806 12:44:30 INFO - Obtained file size: 22122806 12:44:34 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 12:44:34 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 12:44:34 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 12:44:34 INFO - Http code: 200 12:44:34 INFO - via: 1.1 032d42677fbf05c24a4bb71369581429.cloudfront.net (CloudFront) 12:44:34 INFO - x-amz-cf-id: uR90ob0E3MkFM_qxBJS-IU27ZwkpUUmFtyglEKfUJVmWO5ZeoYoj8Q== 12:44:34 INFO - x-amz-replication-status: COMPLETED 12:44:34 INFO - x-amz-version-id: D_pknVBa9IR6sgEPlsLJv2yB9Gx7seOx 12:44:34 INFO - Expected file size: 14409006 12:44:34 INFO - Obtained file size: 14409006 12:44:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:44:34 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 12:44:34 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/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:44:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/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:44:35 INFO - Downloaded 59606947 bytes. 12:44:35 INFO - Setting buildbot property build_url to https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 12:44:35 INFO - mkdir: /builds/slave/test/properties 12:44:35 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 12:44:35 INFO - Writing to file /builds/slave/test/properties/build_url 12:44:35 INFO - Contents: 12:44:35 INFO - build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 12:44:35 INFO - Running post-action listener: _resource_record_post_action 12:44:35 INFO - Running post-action listener: set_extra_try_arguments 12:44:35 INFO - [mozharness: 2016-10-14 19:44:35.898067Z] Finished download-and-extract step (success) 12:44:35 INFO - [mozharness: 2016-10-14 19:44:35.898294Z] Running populate-webroot step. 12:44:35 INFO - Running pre-action listener: _resource_record_pre_action 12:44:35 INFO - Running main action method: populate_webroot 12:44:35 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 12:44:35 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 12:44:35 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 12:44:35 INFO - '--tppagecycles', 12:44:35 INFO - '7'], 12:44:35 INFO - 'tests': ['tsvgm']}}, 12:44:35 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 12:44:35 INFO - 'tests': ['tresize', 'tcanvasmark']}, 12:44:35 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 12:44:35 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 12:44:35 INFO - 'tests': ['dromaeo_css', 'kraken']}, 12:44:35 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 12:44:35 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:44:35 INFO - 'talos_options': ['--disable-e10s'], 12:44:35 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:44:35 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:44:35 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:44:35 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:44:35 INFO - 'talos_options': ['--disable-e10s'], 12:44:35 INFO - 'tests': ['damp', 'tps']}, 12:44:35 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:44:35 INFO - 'tests': ['damp', 'tps']}, 12:44:35 INFO - 'g3': {'talos_options': ['--disable-e10s'], 12:44:35 INFO - 'tests': ['dromaeo_dom']}, 12:44:35 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 12:44:35 INFO - 'g4': {'talos_options': ['--disable-e10s'], 12:44:35 INFO - 'tests': ['basic_compositor_video']}, 12:44:35 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 12:44:35 INFO - 'other': {'talos_options': ['--disable-e10s'], 12:44:35 INFO - 'tests': ['a11yr', 12:44:35 INFO - 'ts_paint', 12:44:35 INFO - 'tpaint', 12:44:35 INFO - 'sessionrestore', 12:44:35 INFO - 'sessionrestore_no_auto_restore', 12:44:35 INFO - 'tabpaint']}, 12:44:35 INFO - 'other-e10s': {'tests': ['a11yr', 12:44:35 INFO - 'ts_paint', 12:44:35 INFO - 'tpaint', 12:44:35 INFO - 'sessionrestore', 12:44:35 INFO - 'sessionrestore_no_auto_restore', 12:44:35 INFO - 'tabpaint']}, 12:44:35 INFO - 'other-e10s_l64': {'tests': ['a11yr', 12:44:35 INFO - 'ts_paint', 12:44:35 INFO - 'tpaint', 12:44:35 INFO - 'sessionrestore', 12:44:35 INFO - 'sessionrestore_no_auto_restore', 12:44:35 INFO - 'tabpaint']}, 12:44:35 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 12:44:35 INFO - 'ts_paint', 12:44:35 INFO - 'tpaint', 12:44:35 INFO - 'sessionrestore', 12:44:35 INFO - 'sessionrestore_no_auto_restore', 12:44:35 INFO - 'tabpaint']}, 12:44:35 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 12:44:35 INFO - 'tests': ['a11yr', 12:44:35 INFO - 'ts_paint', 12:44:35 INFO - 'tpaint', 12:44:35 INFO - 'sessionrestore', 12:44:35 INFO - 'sessionrestore_no_auto_restore', 12:44:35 INFO - 'tabpaint']}, 12:44:35 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 12:44:35 INFO - 'tests': ['a11yr', 12:44:35 INFO - 'ts_paint', 12:44:35 INFO - 'tpaint', 12:44:35 INFO - 'sessionrestore', 12:44:35 INFO - 'sessionrestore_no_auto_restore', 12:44:35 INFO - 'tabpaint']}, 12:44:35 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 12:44:35 INFO - 'tests': ['tsvgx', 12:44:35 INFO - 'tsvgr_opacity', 12:44:35 INFO - 'tart', 12:44:35 INFO - 'tscrollx', 12:44:35 INFO - 'cart']}, 12:44:35 INFO - 'svgr-e10s': {'tests': ['tsvgx', 12:44:35 INFO - 'tsvgr_opacity', 12:44:35 INFO - 'tart', 12:44:35 INFO - 'tscrollx', 12:44:35 INFO - 'cart']}, 12:44:35 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:44:35 INFO - 'talos_options': ['--disable-e10s'], 12:44:35 INFO - 'tests': ['tp5o']}, 12:44:35 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:44:35 INFO - 'tests': ['tp5o']}, 12:44:35 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:44:35 INFO - 'talos_options': ['--disable-e10s', 12:44:35 INFO - '--xperf_path', 12:44:35 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:44:35 INFO - 'tests': ['tp5n']}, 12:44:35 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:44:35 INFO - 'talos_options': ['--xperf_path', 12:44:35 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:44:35 INFO - 'tests': ['tp5n']}}, 12:44:35 INFO - 'talos.zip': {'path': '', 12:44:35 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 12:44:35 INFO - Running post-action listener: _resource_record_post_action 12:44:35 INFO - [mozharness: 2016-10-14 19:44:35.918362Z] Finished populate-webroot step (success) 12:44:35 INFO - [mozharness: 2016-10-14 19:44:35.918450Z] Running create-virtualenv step. 12:44:35 INFO - Running pre-action listener: _resource_record_pre_action 12:44:35 INFO - Running main action method: create_virtualenv 12:44:35 INFO - Creating virtualenv /builds/slave/test/build/venv 12:44:35 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:44:35 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 12:44:36 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 12:44:36 INFO - Using real prefix '/usr' 12:44:36 INFO - New python executable in /builds/slave/test/build/venv/bin/python 12:44:36 INFO - Installing distribute.............................................................................................................................................................................................done. 12:44:38 INFO - Installing pip.................done. 12:44:38 INFO - Return code: 0 12:44:38 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 12:44:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 12:44:38 INFO - Reading from file tmpfile_stdout 12:44:38 INFO - Output received: 12:44:38 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:44:38 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 12:44: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:44:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:44:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44: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:44:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:44:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:38 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 0x7f8204fa7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2be98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cb57b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d44790>, '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 0x2d45690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d45b20>, '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': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', '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:44:38 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:44:38 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:44:38 INFO - Using env: {'DISPLAY': ':0', 12:44:38 INFO - 'HOME': '/home/cltbld', 12:44:38 INFO - 'LANG': 'en_US.UTF-8', 12:44:38 INFO - 'LANGUAGE': 'en_US:en', 12:44:38 INFO - 'LOGNAME': 'cltbld', 12:44:38 INFO - 'MAIL': '/var/mail/cltbld', 12:44:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:44:38 INFO - 'MOZ_NO_REMOTE': '1', 12:44:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:44:38 INFO - 'NO_EM_RESTART': '1', 12:44:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:44:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:44:38 INFO - 'PWD': '/builds/slave/test', 12:44:38 INFO - 'SHELL': '/bin/bash', 12:44:38 INFO - 'SHLVL': '1', 12:44:38 INFO - 'TERM': 'linux', 12:44:38 INFO - 'TMOUT': '86400', 12:44:38 INFO - 'USER': 'cltbld', 12:44:38 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', 12:44:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:44:38 INFO - '_': '/tools/buildbot/bin/python'} 12:44:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:44:38 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:44:38 INFO - Cleaning up... 12:44:38 INFO - Return code: 0 12:44:38 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 12:44: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:44:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:44:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44: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:44:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:44:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:38 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 0x7f8204fa7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2be98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cb57b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d44790>, '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 0x2d45690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d45b20>, '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': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', '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:44:38 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:44:38 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:44:38 INFO - Using env: {'DISPLAY': ':0', 12:44:38 INFO - 'HOME': '/home/cltbld', 12:44:38 INFO - 'LANG': 'en_US.UTF-8', 12:44:38 INFO - 'LANGUAGE': 'en_US:en', 12:44:38 INFO - 'LOGNAME': 'cltbld', 12:44:38 INFO - 'MAIL': '/var/mail/cltbld', 12:44:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:44:38 INFO - 'MOZ_NO_REMOTE': '1', 12:44:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:44:38 INFO - 'NO_EM_RESTART': '1', 12:44:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:44:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:44:38 INFO - 'PWD': '/builds/slave/test', 12:44:38 INFO - 'SHELL': '/bin/bash', 12:44:38 INFO - 'SHLVL': '1', 12:44:38 INFO - 'TERM': 'linux', 12:44:38 INFO - 'TMOUT': '86400', 12:44:38 INFO - 'USER': 'cltbld', 12:44:38 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', 12:44:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:44:38 INFO - '_': '/tools/buildbot/bin/python'} 12:44:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:44:39 INFO - Downloading/unpacking psutil>=3.1.1 12:44:39 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:44:39 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:44:39 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:44:39 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:44:39 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:44:39 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:44:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 12:44:41 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:44:41 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:44:41 INFO - Installing collected packages: psutil 12:44:41 INFO - Running setup.py install for psutil 12:44:41 INFO - building 'psutil._psutil_linux' extension 12:44:41 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:44:41 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:44:41 INFO - building 'psutil._psutil_posix' extension 12:44:41 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:44:41 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:44:41 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:44:41 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:44:41 INFO - Successfully installed psutil 12:44:41 INFO - Cleaning up... 12:44:41 INFO - Return code: 0 12:44:41 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 12:44:41 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:44:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:44:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:41 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:44:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:44:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:41 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 0x7f8204fa7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2be98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cb57b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d44790>, '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 0x2d45690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d45b20>, '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': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', '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:44:41 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:44:41 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:44:41 INFO - Using env: {'DISPLAY': ':0', 12:44:41 INFO - 'HOME': '/home/cltbld', 12:44:41 INFO - 'LANG': 'en_US.UTF-8', 12:44:41 INFO - 'LANGUAGE': 'en_US:en', 12:44:41 INFO - 'LOGNAME': 'cltbld', 12:44:41 INFO - 'MAIL': '/var/mail/cltbld', 12:44:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:44:41 INFO - 'MOZ_NO_REMOTE': '1', 12:44:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:44:41 INFO - 'NO_EM_RESTART': '1', 12:44:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:44:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:44:41 INFO - 'PWD': '/builds/slave/test', 12:44:41 INFO - 'SHELL': '/bin/bash', 12:44:41 INFO - 'SHLVL': '1', 12:44:41 INFO - 'TERM': 'linux', 12:44:41 INFO - 'TMOUT': '86400', 12:44:41 INFO - 'USER': 'cltbld', 12:44:41 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', 12:44:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:44:41 INFO - '_': '/tools/buildbot/bin/python'} 12:44:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:44:42 INFO - Downloading/unpacking mozsystemmonitor==0.3 12:44:42 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:44:42 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:44:42 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:44:42 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:44:42 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:44:42 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:44:43 INFO - Downloading mozsystemmonitor-0.3.tar.gz 12:44:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 12:44:44 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 12:44:44 INFO - Installing collected packages: mozsystemmonitor 12:44:44 INFO - Running setup.py install for mozsystemmonitor 12:44:44 INFO - Successfully installed mozsystemmonitor 12:44:44 INFO - Cleaning up... 12:44:44 INFO - Return code: 0 12:44:44 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 12:44:44 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:44:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:44:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:44 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:44:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:44:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:44 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 0x7f8204fa7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2be98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cb57b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d44790>, '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 0x2d45690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d45b20>, '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': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', '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:44:44 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:44:44 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:44:44 INFO - Using env: {'DISPLAY': ':0', 12:44:44 INFO - 'HOME': '/home/cltbld', 12:44:44 INFO - 'LANG': 'en_US.UTF-8', 12:44:44 INFO - 'LANGUAGE': 'en_US:en', 12:44:44 INFO - 'LOGNAME': 'cltbld', 12:44:44 INFO - 'MAIL': '/var/mail/cltbld', 12:44:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:44:44 INFO - 'MOZ_NO_REMOTE': '1', 12:44:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:44:44 INFO - 'NO_EM_RESTART': '1', 12:44:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:44:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:44:44 INFO - 'PWD': '/builds/slave/test', 12:44:44 INFO - 'SHELL': '/bin/bash', 12:44:44 INFO - 'SHLVL': '1', 12:44:44 INFO - 'TERM': 'linux', 12:44:44 INFO - 'TMOUT': '86400', 12:44:44 INFO - 'USER': 'cltbld', 12:44:44 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', 12:44:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:44:44 INFO - '_': '/tools/buildbot/bin/python'} 12:44:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:44:44 INFO - Downloading/unpacking jsonschema==2.5.1 12:44:44 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:44:44 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:44:44 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:44:44 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:44:44 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:44:44 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:44:46 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:44:46 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 12:44:46 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:44:46 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:44:46 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:44:46 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:44:46 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:44:46 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:44:46 INFO - Downloading functools32-3.2.3-2.tar.gz 12:44:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 12:44:46 INFO - warning: no files found matching '*.txt' 12:44:46 INFO - no previously-included directories found matching 'build' 12:44:46 INFO - no previously-included directories found matching 'dist' 12:44:46 INFO - no previously-included directories found matching '.git*' 12:44:46 INFO - Installing collected packages: jsonschema, functools32 12:44:46 INFO - Running setup.py install for functools32 12:44:46 INFO - warning: no files found matching '*.txt' 12:44:46 INFO - no previously-included directories found matching 'build' 12:44:46 INFO - no previously-included directories found matching 'dist' 12:44:46 INFO - no previously-included directories found matching '.git*' 12:44:46 INFO - Successfully installed jsonschema functools32 12:44:46 INFO - Cleaning up... 12:44:46 INFO - Return code: 0 12:44:46 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 12:44: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:44:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:44:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44: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:44:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:44:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44: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', '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 0x7f8204fa7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2be98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cb57b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d44790>, '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 0x2d45690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d45b20>, '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': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', '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:44: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', 'functools32==3.2.3-2'] in /builds/slave/test/build 12:44: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 functools32==3.2.3-2 12:44:46 INFO - Using env: {'DISPLAY': ':0', 12:44:46 INFO - 'HOME': '/home/cltbld', 12:44:46 INFO - 'LANG': 'en_US.UTF-8', 12:44:46 INFO - 'LANGUAGE': 'en_US:en', 12:44:46 INFO - 'LOGNAME': 'cltbld', 12:44:46 INFO - 'MAIL': '/var/mail/cltbld', 12:44:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:44:46 INFO - 'MOZ_NO_REMOTE': '1', 12:44:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:44:46 INFO - 'NO_EM_RESTART': '1', 12:44:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:44:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:44:46 INFO - 'PWD': '/builds/slave/test', 12:44:46 INFO - 'SHELL': '/bin/bash', 12:44:46 INFO - 'SHLVL': '1', 12:44:46 INFO - 'TERM': 'linux', 12:44:46 INFO - 'TMOUT': '86400', 12:44:46 INFO - 'USER': 'cltbld', 12:44:46 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', 12:44:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:44:46 INFO - '_': '/tools/buildbot/bin/python'} 12:44:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:44:46 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 12:44:46 INFO - Cleaning up... 12:44:46 INFO - Return code: 0 12:44:46 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 12:44: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:44:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:44:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44: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:44:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:44:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:47 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 0x7f8204fa7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2be98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cb57b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d44790>, '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 0x2d45690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d45b20>, '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': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', '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:44:47 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:44:47 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:44:47 INFO - Using env: {'DISPLAY': ':0', 12:44:47 INFO - 'HOME': '/home/cltbld', 12:44:47 INFO - 'LANG': 'en_US.UTF-8', 12:44:47 INFO - 'LANGUAGE': 'en_US:en', 12:44:47 INFO - 'LOGNAME': 'cltbld', 12:44:47 INFO - 'MAIL': '/var/mail/cltbld', 12:44:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:44:47 INFO - 'MOZ_NO_REMOTE': '1', 12:44:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:44:47 INFO - 'NO_EM_RESTART': '1', 12:44:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:44:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:44:47 INFO - 'PWD': '/builds/slave/test', 12:44:47 INFO - 'SHELL': '/bin/bash', 12:44:47 INFO - 'SHLVL': '1', 12:44:47 INFO - 'TERM': 'linux', 12:44:47 INFO - 'TMOUT': '86400', 12:44:47 INFO - 'USER': 'cltbld', 12:44:47 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', 12:44:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:44:47 INFO - '_': '/tools/buildbot/bin/python'} 12:44:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:44:47 INFO - Downloading/unpacking blobuploader==1.2.4 12:44:47 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:44:47 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:44:47 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:44:47 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:44:47 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:44:47 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:44:49 INFO - Downloading blobuploader-1.2.4.tar.gz 12:44:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 12:44:49 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:44:49 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:44:49 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:44:49 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:44:49 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:44:49 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:44:49 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:44:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 12:44:49 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:44:49 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:44:49 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:44:49 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:44:49 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:44:49 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:44:49 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:44:49 INFO - Downloading docopt-0.6.1.tar.gz 12:44:49 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 12:44:49 INFO - Installing collected packages: blobuploader, requests, docopt 12:44:49 INFO - Running setup.py install for blobuploader 12:44:49 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 12:44:49 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 12:44:49 INFO - Running setup.py install for requests 12:44:50 INFO - Running setup.py install for docopt 12:44:50 INFO - Successfully installed blobuploader requests docopt 12:44:50 INFO - Cleaning up... 12:44:50 INFO - Return code: 0 12:44:50 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:44:50 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:44:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:44:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:50 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:44:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:44:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:50 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 0x7f8204fa7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2be98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cb57b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d44790>, '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 0x2d45690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d45b20>, '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': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', '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:44:50 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:44:50 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:44:50 INFO - Using env: {'DISPLAY': ':0', 12:44:50 INFO - 'HOME': '/home/cltbld', 12:44:50 INFO - 'LANG': 'en_US.UTF-8', 12:44:50 INFO - 'LANGUAGE': 'en_US:en', 12:44:50 INFO - 'LOGNAME': 'cltbld', 12:44:50 INFO - 'MAIL': '/var/mail/cltbld', 12:44:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:44:50 INFO - 'MOZ_NO_REMOTE': '1', 12:44:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:44:50 INFO - 'NO_EM_RESTART': '1', 12:44:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:44:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:44:50 INFO - 'PWD': '/builds/slave/test', 12:44:50 INFO - 'SHELL': '/bin/bash', 12:44:50 INFO - 'SHLVL': '1', 12:44:50 INFO - 'TERM': 'linux', 12:44:50 INFO - 'TMOUT': '86400', 12:44:50 INFO - 'USER': 'cltbld', 12:44:50 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', 12:44:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:44:50 INFO - '_': '/tools/buildbot/bin/python'} 12:44:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:44:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:44:50 INFO - Running setup.py (path:/tmp/pip-KsK82y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:44:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:44:50 INFO - Running setup.py (path:/tmp/pip-8ztiAj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:44:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:44:50 INFO - Running setup.py (path:/tmp/pip-svlbmH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:44:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:44:50 INFO - Running setup.py (path:/tmp/pip-a2pc_l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:44:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:44:51 INFO - Running setup.py (path:/tmp/pip-Ml0cC5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:44:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:44:51 INFO - Running setup.py (path:/tmp/pip-4nMTu3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:44:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:44:51 INFO - Running setup.py (path:/tmp/pip-RTMcMp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:44:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:44:51 INFO - Running setup.py (path:/tmp/pip-h7lqs9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:44:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:44:51 INFO - Running setup.py (path:/tmp/pip-IT0gBa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:44:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:44:51 INFO - Running setup.py (path:/tmp/pip-hGA7nn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:44:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:44:51 INFO - Running setup.py (path:/tmp/pip-XpVBog-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:44:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:44:51 INFO - Running setup.py (path:/tmp/pip-D6bJo5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:44:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:44:51 INFO - Running setup.py (path:/tmp/pip-iTwtkN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:44:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:44:51 INFO - Running setup.py (path:/tmp/pip-NMgz9h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:44:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:44:51 INFO - Running setup.py (path:/tmp/pip-tleUHS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:44:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:44:51 INFO - Running setup.py (path:/tmp/pip-B7bG7v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:44:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:44:51 INFO - Running setup.py (path:/tmp/pip-bHRDzg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:44:51 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:44:51 INFO - Running setup.py install for manifestparser 12:44:52 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 12:44:52 INFO - Running setup.py install for mozcrash 12:44:52 INFO - Running setup.py install for mozdebug 12:44:52 INFO - Running setup.py install for mozdevice 12:44:52 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 12:44:52 INFO - Installing dm script to /builds/slave/test/build/venv/bin 12:44:52 INFO - Running setup.py install for mozfile 12:44:52 INFO - Running setup.py install for mozhttpd 12:44:52 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 12:44:52 INFO - Running setup.py install for mozinfo 12:44:52 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 12:44:52 INFO - Running setup.py install for mozInstall 12:44:52 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 12:44:52 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 12:44:52 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 12:44:52 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 12:44:52 INFO - Running setup.py install for mozleak 12:44:52 INFO - Running setup.py install for mozlog 12:44:52 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 12:44:52 INFO - Running setup.py install for moznetwork 12:44:53 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 12:44:53 INFO - Running setup.py install for mozprocess 12:44:53 INFO - Running setup.py install for mozprofile 12:44:53 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 12:44:53 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 12:44:53 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 12:44:53 INFO - Running setup.py install for mozrunner 12:44:53 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 12:44:53 INFO - Running setup.py install for mozscreenshot 12:44:53 INFO - Running setup.py install for moztest 12:44:53 INFO - Running setup.py install for mozversion 12:44:53 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 12:44:53 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:44:53 INFO - Cleaning up... 12:44:53 INFO - Return code: 0 12:44:53 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:44:53 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:44:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:44:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:53 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:44:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:44:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:53 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 0x7f8204fa7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2be98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cb57b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d44790>, '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 0x2d45690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d45b20>, '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': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', '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:44:53 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:44:53 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:44:53 INFO - Using env: {'DISPLAY': ':0', 12:44:53 INFO - 'HOME': '/home/cltbld', 12:44:53 INFO - 'LANG': 'en_US.UTF-8', 12:44:53 INFO - 'LANGUAGE': 'en_US:en', 12:44:53 INFO - 'LOGNAME': 'cltbld', 12:44:53 INFO - 'MAIL': '/var/mail/cltbld', 12:44:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:44:53 INFO - 'MOZ_NO_REMOTE': '1', 12:44:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:44:53 INFO - 'NO_EM_RESTART': '1', 12:44:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:44:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:44:53 INFO - 'PWD': '/builds/slave/test', 12:44:53 INFO - 'SHELL': '/bin/bash', 12:44:53 INFO - 'SHLVL': '1', 12:44:53 INFO - 'TERM': 'linux', 12:44:53 INFO - 'TMOUT': '86400', 12:44:53 INFO - 'USER': 'cltbld', 12:44:53 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', 12:44:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:44:53 INFO - '_': '/tools/buildbot/bin/python'} 12:44:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:44:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:44:53 INFO - Running setup.py (path:/tmp/pip-zSNYwb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:44:54 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:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:44:54 INFO - Running setup.py (path:/tmp/pip-iVAzlC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:44:54 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:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:44:54 INFO - Running setup.py (path:/tmp/pip-xoFNpa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:44:54 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:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:44:54 INFO - Running setup.py (path:/tmp/pip-qOdBwp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:44:54 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:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:44:54 INFO - Running setup.py (path:/tmp/pip-mwA9NJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:44:54 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:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:44:54 INFO - Running setup.py (path:/tmp/pip-wzEwNu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:44:54 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:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:44:54 INFO - Running setup.py (path:/tmp/pip-JkEMy3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:44:54 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:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:44:54 INFO - Running setup.py (path:/tmp/pip-YpaSz7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:44:54 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:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:44:54 INFO - Running setup.py (path:/tmp/pip-VraUAj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:44:54 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:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:44:54 INFO - Running setup.py (path:/tmp/pip-9cn0vh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:44:54 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:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:44:54 INFO - Running setup.py (path:/tmp/pip-wAnPnw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:44:54 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:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:44:54 INFO - Running setup.py (path:/tmp/pip-cTEY6C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:44:54 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:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:44:54 INFO - Running setup.py (path:/tmp/pip-pviV0X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:44:54 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:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:44:54 INFO - Running setup.py (path:/tmp/pip-1yRfzO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:44:54 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:44:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:44:54 INFO - Running setup.py (path:/tmp/pip-BNgKjx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:44:55 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:44:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:44:55 INFO - Running setup.py (path:/tmp/pip-m1mZPQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:44:55 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:44:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:44:55 INFO - Running setup.py (path:/tmp/pip-YbcdHg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:44:55 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:44:55 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:44:55 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:44:55 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:44:55 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:44:55 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:44:55 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:44:55 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:44:55 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:44:55 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:44:55 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:44:55 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:44:55 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:44:57 INFO - Downloading blessings-1.6.tar.gz 12:44:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 12:44:57 INFO - Installing collected packages: blessings 12:44:57 INFO - Running setup.py install for blessings 12:44:57 INFO - Successfully installed blessings 12:44:57 INFO - Cleaning up... 12:44:57 INFO - Return code: 0 12:44:57 INFO - Done creating virtualenv /builds/slave/test/build/venv. 12:44:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:44:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:44:57 INFO - Reading from file tmpfile_stdout 12:44:57 INFO - Current package versions: 12:44:57 INFO - argparse == 1.2.1 12:44:57 INFO - blessings == 1.6 12:44:57 INFO - blobuploader == 1.2.4 12:44:57 INFO - docopt == 0.6.1 12:44:57 INFO - functools32 == 3.2.3-2 12:44:57 INFO - jsonschema == 2.5.1 12:44:57 INFO - manifestparser == 1.1 12:44:57 INFO - mozInstall == 1.12 12:44:57 INFO - mozcrash == 0.17 12:44:57 INFO - mozdebug == 0.1 12:44:57 INFO - mozdevice == 0.48 12:44:57 INFO - mozfile == 1.2 12:44:57 INFO - mozhttpd == 0.7 12:44:57 INFO - mozinfo == 0.9 12:44:57 INFO - mozleak == 0.1 12:44:57 INFO - mozlog == 3.4 12:44:57 INFO - moznetwork == 0.27 12:44:57 INFO - mozprocess == 0.23 12:44:57 INFO - mozprofile == 0.28 12:44:57 INFO - mozrunner == 6.12 12:44:57 INFO - mozscreenshot == 0.1 12:44:57 INFO - mozsystemmonitor == 0.3 12:44:57 INFO - moztest == 0.7 12:44:57 INFO - mozversion == 1.4 12:44:57 INFO - psutil == 3.1.1 12:44:57 INFO - requests == 1.2.3 12:44:57 INFO - wsgiref == 0.1.2 12:44:57 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:44:57 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:44:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:44:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:57 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:44:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:44:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:57 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 0x7f8204fa7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2be98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cb57b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d44790>, '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 0x2d45690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d45b20>, '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': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', '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:44:57 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:44:57 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:44:57 INFO - Using env: {'DISPLAY': ':0', 12:44:57 INFO - 'HOME': '/home/cltbld', 12:44:57 INFO - 'LANG': 'en_US.UTF-8', 12:44:57 INFO - 'LANGUAGE': 'en_US:en', 12:44:57 INFO - 'LOGNAME': 'cltbld', 12:44:57 INFO - 'MAIL': '/var/mail/cltbld', 12:44:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:44:57 INFO - 'MOZ_NO_REMOTE': '1', 12:44:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:44:57 INFO - 'NO_EM_RESTART': '1', 12:44:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:44:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:44:57 INFO - 'PWD': '/builds/slave/test', 12:44:57 INFO - 'SHELL': '/bin/bash', 12:44:57 INFO - 'SHLVL': '1', 12:44:57 INFO - 'TERM': 'linux', 12:44:57 INFO - 'TMOUT': '86400', 12:44:57 INFO - 'USER': 'cltbld', 12:44:57 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', 12:44:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:44:57 INFO - '_': '/tools/buildbot/bin/python'} 12:44:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:44:58 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:44:58 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:44:58 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:44:58 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:44:58 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:44:58 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:44:58 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:44:58 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:44:58 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:44:58 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:44:58 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:44:58 INFO - Cleaning up... 12:44:58 INFO - Return code: 0 12:44:58 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 12:44:58 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:44:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:44:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:58 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:44:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:44:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:44:58 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 0x7f8204fa7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2be98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2cb57b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2d44790>, '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 0x2d45690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d45b20>, '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': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', '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:44:58 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:44:58 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:44:58 INFO - Using env: {'DISPLAY': ':0', 12:44:58 INFO - 'HOME': '/home/cltbld', 12:44:58 INFO - 'LANG': 'en_US.UTF-8', 12:44:58 INFO - 'LANGUAGE': 'en_US:en', 12:44:58 INFO - 'LOGNAME': 'cltbld', 12:44:58 INFO - 'MAIL': '/var/mail/cltbld', 12:44:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:44:58 INFO - 'MOZ_NO_REMOTE': '1', 12:44:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:44:58 INFO - 'NO_EM_RESTART': '1', 12:44:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:44:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:44:58 INFO - 'PWD': '/builds/slave/test', 12:44:58 INFO - 'SHELL': '/bin/bash', 12:44:58 INFO - 'SHLVL': '1', 12:44:58 INFO - 'TERM': 'linux', 12:44:58 INFO - 'TMOUT': '86400', 12:44:58 INFO - 'USER': 'cltbld', 12:44:58 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', 12:44:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:44:58 INFO - '_': '/tools/buildbot/bin/python'} 12:44:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:44:58 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 12:44:58 INFO - Cleaning up... 12:44:58 INFO - Return code: 0 12:44:58 INFO - Running post-action listener: _resource_record_post_action 12:44:58 INFO - Running post-action listener: _start_resource_monitoring 12:44:58 INFO - Starting resource monitoring. 12:44:58 INFO - [mozharness: 2016-10-14 19:44:58.328365Z] Finished create-virtualenv step (success) 12:44:58 INFO - [mozharness: 2016-10-14 19:44:58.328827Z] Running install step. 12:44:58 INFO - Running pre-action listener: _resource_record_pre_action 12:44:58 INFO - Running main action method: install 12:44:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:44:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:44:58 INFO - Reading from file tmpfile_stdout 12:44:58 INFO - Detecting whether we're running mozinstall >=1.0... 12:44:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 12:44:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 12:44:58 INFO - Reading from file tmpfile_stdout 12:44:58 INFO - Output received: 12:44:58 INFO - Usage: mozinstall [options] installer 12:44:58 INFO - Options: 12:44:58 INFO - -h, --help show this help message and exit 12:44:58 INFO - -d DEST, --destination=DEST 12:44:58 INFO - Directory to install application into. [default: 12:44:58 INFO - "/builds/slave/test"] 12:44:58 INFO - --app=APP Application being installed. [default: firefox] 12:44:58 INFO - mkdir: /builds/slave/test/build/application 12:44:58 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:44:58 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:45:15 INFO - Reading from file tmpfile_stdout 12:45:15 INFO - Output received: 12:45:15 INFO - /builds/slave/test/build/application/firefox/firefox 12:45:15 INFO - Running post-action listener: _resource_record_post_action 12:45:15 INFO - [mozharness: 2016-10-14 19:45:15.591394Z] Finished install step (success) 12:45:15 INFO - [mozharness: 2016-10-14 19:45:15.591732Z] Running run-tests step. 12:45:15 INFO - Running pre-action listener: _resource_record_pre_action 12:45:15 INFO - Running main action method: run_tests 12:45:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 12:45:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 12:45:15 INFO - Python 2.7.3 12:45:15 INFO - Return code: 0 12:45:15 INFO - grabbing minidump binary from tooltool 12:45:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:45:15 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 0x2d44790>, '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 0x2d45690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2d45b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 12:45:15 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:45:15 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:45:15 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:45:15 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 12:45:15 INFO - Return code: 0 12:45:15 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 12:45:15 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 12:45:15 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 12:45:15 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 12:45:15 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 12:45:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-066', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 12:45:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Autoland --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-066 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 12:45:15 INFO - Using env: {'DISPLAY': ':0', 12:45:15 INFO - 'HOME': '/home/cltbld', 12:45:15 INFO - 'LANG': 'en_US.UTF-8', 12:45:15 INFO - 'LANGUAGE': 'en_US:en', 12:45:15 INFO - 'LOGNAME': 'cltbld', 12:45:15 INFO - 'MAIL': '/var/mail/cltbld', 12:45:15 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:45:15 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 12:45:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:45:15 INFO - 'MOZ_NO_REMOTE': '1', 12:45:15 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:45:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:45:15 INFO - 'NO_EM_RESTART': '1', 12:45:15 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:45:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:45:15 INFO - 'PWD': '/builds/slave/test', 12:45:15 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:45:15 INFO - 'SHELL': '/bin/bash', 12:45:15 INFO - 'SHLVL': '1', 12:45:15 INFO - 'TERM': 'linux', 12:45:15 INFO - 'TMOUT': '86400', 12:45:15 INFO - 'USER': 'cltbld', 12:45:15 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525', 12:45:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:45:15 INFO - '_': '/tools/buildbot/bin/python'} 12:45:15 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-066', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 12:45:15 INFO - mozversion application_buildid: 20161014093007 12:45:15 INFO - mozversion application_changeset: c5b1bfd47d15f4e2c475d18e1987b7284cea9084 12:45:15 INFO - mozversion application_display_name: Nightly 12:45:15 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:45:15 INFO - mozversion application_name: Firefox 12:45:15 INFO - mozversion application_remotingname: firefox 12:45:15 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland 12:45:15 INFO - mozversion application_vendor: Mozilla 12:45:15 INFO - mozversion application_version: 52.0a1 12:45:15 INFO - mozversion platform_buildid: 20161014093007 12:45:15 INFO - mozversion platform_changeset: c5b1bfd47d15f4e2c475d18e1987b7284cea9084 12:45:15 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland 12:45:15 INFO - mozversion platform_version: 52.0a1 12:45:15 INFO - using testdate: 1476474315 12:45:15 INFO - actual date: 1476474315 12:45:15 INFO - starting webserver on 'localhost:35381' 12:45:15 INFO - SUITE-START | Running 2 tests 12:45:15 INFO - TEST-START | dromaeo_css 12:45:15 INFO - operating with platform_type : linux_ 12:45:15 INFO - Initialising browser for dromaeo_css test... 12:45:15 INFO - TEST-INFO | started process 5535 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpJyYheV/profile http://localhost:35381/getInfo.html) 12:45:21 INFO - PROCESS | 5535 | __metrics Screen width/height:1600/1200 12:45:21 INFO - PROCESS | 5535 | colorDepth:24 12:45:21 INFO - PROCESS | 5535 | Browser inner width/height: 1024/697 12:45:21 INFO - PROCESS | 5535 | __metrics 12:45:21 ERROR - PROCESS | 5535 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3083: TypeError: this.tabs is undefined 12:45:22 INFO - TEST-INFO | 5535: exit 0 12:45:22 INFO - Browser initialized. 12:45:22 INFO - Running cycle 1/1 for dromaeo_css test... 12:45:22 INFO - TEST-INFO | started process 5656 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpJyYheV/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:45:34 INFO - PROCESS | 5656 | RSS: Main: 182382592 12:45:34 INFO - PROCESS | 5656 | 12:46:24 INFO - PROCESS | 5656 | 1476474384515 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:48:35 INFO - PROCESS | 5656 | Cycle 1(1): loaded http://localhost:35381/tests/dromaeo/cssquery-dojo.html (next: http://localhost:35381/tests/dromaeo/cssquery-ext.html) 12:48:36 INFO - PROCESS | 5656 | RSS: Main: 196702208 12:48:36 INFO - PROCESS | 5656 | 12:51:39 INFO - PROCESS | 5656 | Cycle 1(1): loaded http://localhost:35381/tests/dromaeo/cssquery-ext.html (next: http://localhost:35381/tests/dromaeo/cssquery-jquery.html) 12:51:39 INFO - PROCESS | 5656 | RSS: Main: 194576384 12:51:39 INFO - PROCESS | 5656 | 12:54:41 INFO - PROCESS | 5656 | Cycle 1(1): loaded http://localhost:35381/tests/dromaeo/cssquery-jquery.html (next: http://localhost:35381/tests/dromaeo/cssquery-mootools.html) 12:54:42 INFO - PROCESS | 5656 | RSS: Main: 197120000 12:54:42 INFO - PROCESS | 5656 | 12:57:44 INFO - PROCESS | 5656 | Cycle 1(1): loaded http://localhost:35381/tests/dromaeo/cssquery-mootools.html (next: http://localhost:35381/tests/dromaeo/cssquery-prototype.html) 12:57:44 INFO - PROCESS | 5656 | RSS: Main: 193769472 12:57:44 INFO - PROCESS | 5656 | 13:00:47 INFO - PROCESS | 5656 | Cycle 1(1): loaded http://localhost:35381/tests/dromaeo/cssquery-prototype.html (next: http://localhost:35381/tests/dromaeo/cssquery-yui.html) 13:00:47 INFO - PROCESS | 5656 | RSS: Main: 197337088 13:00:47 INFO - PROCESS | 5656 | 13:03:50 INFO - PROCESS | 5656 | Cycle 1(1): loaded http://localhost:35381/tests/dromaeo/cssquery-yui.html (next: http://localhost:35381/tests/dromaeo/cssquery-dojo.html) 13:03:50 INFO - PROCESS | 5656 | RSS: Main: 196083712 13:03:50 INFO - PROCESS | 5656 | 13:03:50 INFO - PROCESS | 5656 | __start_tp_report 13:03:50 INFO - PROCESS | 5656 | _x_x_mozilla_page_load 13:03:50 INFO - PROCESS | 5656 | _x_x_mozilla_page_load_details 13:03:50 INFO - PROCESS | 5656 | |i|pagename|runs| 13:03:50 INFO - PROCESS | 5656 | |0;dojo.html;3095.040537433396;3115.766317526186;3125.140586338757;3150.2281940924477;3160.2099475131217;5134.2812006319145;5310.256564081032;5337.01265265926;5367.087595108831;5367.302250707407;5202.8699282517955;5299.2581038654525;5357.7589008494615;5367.704776237305;5388.43421440749;4863.246196839478;4891.926621100686;4936.605071594264;4968.080905032581;4983.8504844854715;4805.543473370041;4904.288878112689;4965.478624744404;4984.900301993958;5001.424836143854;4675.766211689436;4718.740469274188;4880.731559764212;4905.901881962359;4929.6795708279205;4821.638377121695;4836.298736683197;4885.8778530536665;4907.901841963141;4976.626752993504;4840.370751802278;4857.611391088704;4872.269159626049;4885.413750349981;4926.9014619707405;5155.458676838953;5298.682079075268;5320.813771517978;5322.893542129174;5326.307580014612;5495.395506494282;5555.666660000373;5566.387697353288;5576.1356989666665;5591.7483713233005;5607.831765047055;5654.886902261932;5675.177099320616;5676.233708449389;5778.133280007991;5316.680999140064;5321.068812957717;5336.946630533723;5339.919901201485;5360.490753378423;5739.71301434935;5782.508486778671;5798.625231855749;5806.129080637854;5827.825165245049;5351.652142610717;5424.728763561806;5454.072807622713;5529.060059789765;5541.196526503634;5687.090065589568;5691.03252447085;5702.401247868997;5703.971480142573;5715.199872017921;5375.220593014069;5452.618316717871;5466.262054622654;5534.501894829485;5537.944620553823;5693.800716974886;5721.5708821838525;5724.79963201286;5786.42135786418;5787.565932555075;4294.227039132924;4324.35134729793;4342.240107981091;4414.602685758297;4421.115776844644;3896.7077469189926;3896.7077469189926;3906.824192911326;3924.117073658404;3934.488516492838;5421.918671219935;5520.861978450571;5527.668339899619;5550.361708403505;5552;5767.826965191051;5791.160281759121;5793.362730099686;5796.768129274782;5799.855003624859;5239.947600524022;5285.180796976475;5359;5411.540019098342;5449.01917654826;4883.536064073907;4909.705417674951;4938;4951.876203094879;4975.10448119342;5948.137520059568;5948.315943666534;5951.315598706205;5952.987992041277;5997.70011499432;5512.173174023928;5562.193481945176;5656.773729050957;5673.74468148926;5734.139879018014;5930.911036334544;5956.940430595639;5960.195373624505;6001.7299221536005;6090.208272924491;5621.775128994795;5622.24099746529;5622.9156562652415;5627.577931655061;5648.943510564842;5527.2538207343105;5732.5413966881715;5744.798932037359;5750.223719797774;5751.913721294268;5453.345598528202;5515.393306736336;5520.972395137998;5546.833594992157;5637.2107904894165;5519.530839878656;5553.222548843246;5572.749226284908;5578.888422231614;5584.218209450599;5323.893522129459;5374.4625537445945;5458.1266997280245;5516.834494965157;5521.641093328921;5483.533899618577;5533.059379905345;5535.6955367455175;5572.944270557243;5633.6619802811965;5332.33345831771;5372.167314066326;5420.647657902224;5430.619856609999;5439.755211015435 13:03:50 INFO - PROCESS | 5656 | |1;ext.html;555.911054231323;593.9643621382718;597.2206270816588;597.2355385107062;601.8615718384772;40811.79594102029;42938.78530607346;43061.35407968883;47106;47138;36409.81795091021;36892.44661330075;36911.44632830509;37094.629053709454;37098.629013709855;8863.379563430546;8968.417052891573;9006.414583052081;9042.819143617124;9051.27589792815;8525.95737021314;8587.699430519933;8599.312055035614;8607.139286071406;8614.483131012159;8852.291816654651;8919.420237684562;8931.598078086468;8958.32812539059;8992.77518062047;8896.510691911943;8904.376693631448;8911.420757650765;8955;9007.504587247699;8803.119688031209;8861.689840855604;8895.688650897253;8904.243139333164;8966.237869781076;42499.57500424987;42515.7874210627;42917.35623965643;43113.56886431159;43183;3056.419280336729;3391.9152021199666;3720.8651361334782;3724.422714479233;3813.8474461021524;30944.226394340098;31306.37387252265;31682;31692.841535792402;31773.52339714906;4337.696361254713;4346.543612920629;4357.215701173787;4399.472063352387;4500.887477813081;350313;352815;354886;355855;357054;61251.6937415319;62714.37285627086;62772.35048845626;63084;63112.36887631065;65234;65345.346546533925;65633.34366656368;65901.34098659048;66391.33608663948;16522.83477165237;16712.74930876038;16719.331226751037;16736;16748.665026699397;12705.555305564261;12787.488500460064;12805.295708736108;12824.551140710217;12839.55061572859;14365.856341436662;15239.923800380928;15300.540983770505;15475.84524154744;15536.84463155354;7084.689332473509;7407.777666699969;7410.96294518524;7426.435311050618;7587.772366829004;930.9534523273809;965.8309795785709;970.3935040599625;1072.5763323487179;1074.6937122920087;32392.83803580967;32452.188695282333;32469.18827029343;32569.185770355456;32632.673673263438;1075.2903083964702;1077.9137668986461;1085.4518468173521;1147.5639257082255;1164.2839653613137;16324.428644997368;16387.42644007454;17555.56111097233;17836.3757268495;18785.530361741065;478901;482597;483979;484150;485796;56355.71822140863;56939.14591281134;57097.429025710044;57217;57488.42511574831;1306.9477220911247;1326.8739469750358;1349.817774600436;1363.4682473835212;1372.8078069070539;30868.691313086583;32108.357832843678;32637.18407039748;32783.67216327806;33212.833935831135;49771.751141244065;50891;51006.23490647569;51033;51301;442778.7221277846;443767;443997;446020;446932;24299.271021869372;24879;27486.17541473759;27870.86064569664;27949.860250698617;42532.362014570426;43245;44252.114957700025;45658.54341456543;47057;38086.23827523489;38645.420318694676;39420.34201620621;39821.40267896042;41218.58781412148;38801.223975520894;38867.39641125583;40029.19941601093;40255.798721006206;40999.1800164001;37316.813415932746;38127;38345.80827095846;40656.39015414831;40963.7951810239;29215.123546293646;31189.376212476076;32284.677153228167;32320.83839580787;32510.67489325171;27412;28125.437491250468;28182.718172818008;28404.289892752848;28553.571696424155 13:03:50 INFO - PROCESS | 5656 | |2;jquery.html;370.05338069488886;379.8613506070283;387.70340689372637;390.0619011277878;396.78970145822706;17178.3128674853;19456.12447439865;19835.60328793423;20000.499987500283;20145.29491467799;18811;18907.338243161492;19213.23147074119;19425.805741942575;19491.122899469523;1754.9912250438795;1757.7714897063363;1758.0857953863983;1758.3669878843607;1960.8920959657783;5246.842594722164;5596.888062238752;5633.070543360341;5633.549316054706;5716.971415142919;5681.11942648888;5700.087985922253;5726.885462290752;5732.512736417389;5733.942660573382;5456.48163424474;5620.325560932673;5631.0708733059;5645.040343141634;5695.316562012565;5482.671039737588;5510.476504732044;5532.972335138298;5549.417311182348;5575.944240557624;12011.57959471423;12117.575884844076;12295.754084918251;12384.876151238463;12432.12975091744;1990.1342915831515;1999.1303782854504;2083.229205194088;2207.117153138757;2540.6824146981626;9020.503872287087;9106.81786364269;9237.953810230905;9547.331686781929;9656.227501799909;1771.2295151608962;1851.527860395604;1887.9710557746062;1906.304198967367;1934.220517124235;78521.60739196325;79182;82893;83177;83908.58045709794;10614.628488002883;10773.784524309627;10780.730481738019;11036.448177591088;11186.105111591054;14938;14945.701085978437;15076.924615377073;15088.849111508744;15105.79153667704;7336.889946650805;7771.533707977539;7838.8432231355055;8103.4732742372735;8120.3503719702285;7333.74331898381;7342.743003994835;7422.517536360119;7546.9245307546225;7622.618869056525;4534.251848445036;4538.455385353779;4586.151561961048;4643.094596553639;4758.452777930513;1774.4676597020841;1829.3505805439145;1863.993443540473;1915.7317975483165;1975.170428420067;842.5029232752705;972.2465089555651;990.5839547389969;999.8150342186718;1046.0062940206833;18212.180451879696;20723.58552828935;20754.40569928759;20935;21052;990.4107056301489;993.7018894331671;998.9400635961865;1003.3578509753618;1021.2748948246827;10200.591976321013;10335.689929302132;10355.275130740927;10373.585056597802;10396.324238924597;451267;454425;455391;467573;470682;91734;92314.53842730743;93036.53481732548;93372.53313733524;93878;976.5166242710046;1003.5835128421769;1039.880413752413;1043.410473082706;1048.2033654422694;16867.156642168087;17064.744028839825;17516.649667006845;17998.730019049464;18253.54366140857;42325.36511952385;42841.1431771369;43004;43119.35320970125;43252.56747432485;54869.72565137149;56978;58170.70914645569;58410.707946459996;58652.4134758647;6730.125083739083;7732.690692372242;7948.483348582324;8204.958975205085;8653.697120601;8723.781905452415;11891.821622675494;12896.548620798603;13096;13259.403326850123;10701.892981070401;11304.773904521699;11751.76496470083;11861.466234019317;11872.990795782454;10637.14902807789;11108.50011749457;11210.215284929976;11280.2667826591;11418.771624567627;11480.94259528697;11627.244229125079;11722.765544688888;11784.646460606196;12003.999000249938;8011.759647210593;8044.672629016147;8146.389020823581;8157.388195885451;8358.289545388467;11390.601328953448;11736.237144585575;11893.643190704293;11997.340146291688;12000.63998080059 13:03:50 INFO - PROCESS | 5656 | |3;mootools.html;1359.9592012239634;1439.8632129947655;1503.4211828446053;1604.6630207656392;1608.7586861970697;7147.428205743541;7313.122425308957;7997.560134192617;8507.489550626959;8583.570821458925;8004.91995080049;8302.418830681854;8329.91670083299;8466.619002144902;8583.570821458934;2238.0935721032965;2280.703508543895;2287.8512896661746;2294.300238427279;2295.494991101963;2230.4423894026495;2256.8420210585264;2319.211468100845;2320.269115228706;2323.3262353917344;2220.578090162872;2249.325202439262;2266.1275408967504;2273.818094552432;2276.338273060667;2240;2246.4047027537554;2249.347689170139;2255.4925141843037;2257.9096836126537;2208.436848603612;2221.1781640792847;2224.343818573525;2234.0058673890126;2235.8434909556336;8145.959270203671;8164.550949697764;8196.83606327876;8216.26053655174;8227.42408031438;5029.949700503022;5238.92141617876;5247.711375874325;5249.527542521191;5249.737513124367;3262.4127657021727;3322.900312990614;3370.9157271068175;3534.7525673202886;3540.6105328413855;1043.5669197283119;1090.8254679251281;1096.6216655253925;1108.84476173335;1116.13499537858;11847.822282665767;11849.881501185051;11919.761604767942;11952.999999999913;12053.6383908482;4272.188284225987;4295.098029413858;4552;4583.2666773316105;4614.538546145359;9879.209663226924;10039.04629060238;10050.09549140581;10088.243381746399;10106.090451859369;5127.2052831811125;5175.094358487249;5189.42916279209;5192.81825136126;5195.688258704414;4178.603032711888;4235.364695295731;4718.4809670936165;4786.928196076992;4792.544708252711;3797.3354662933875;3836.9232615347537;3975.1652153048185;3994.2211268802885;4001.3597824347967;1236.5486597392066;1241.4413513918773;1242.7203879127123;1256.2901960392348;1266.480223731526;654.8297442664941;775.1357236681173;791.1732239809413;791.2483141016057;834.3283656656329;5598.3282006159525;5704.857378565569;5774.855628609318;5876.118582212703;6002.519798416116;888.4092078767676;891.1133422244908;898.7169041751828;899.5457294066455;919.5494207838245;3762.473253744478;3940.7044471664167;3967.3652215645357;3983.541892682321;3994.5206575210577;10566.788664226673;10732;10781.784364312669;10853.294535855144;10930.289531180448;10647.14822814173;10650.520726567323;10667.466626668636;10702.89297107019;10797.946010270056;7005.50961432705;7370.557766533918;7496.7001319947685;7601.46789724725;7657.846843063107;5690.573207009574;5781.306243250837;5810.941890581209;5856.4143585641095;5940.198073260054;9374.343795934219;9503.239740820856;9549.713508594754;9664.516774161404;9733.9026609733;9753.366031207948;9943.850842237516;9991.450470224207;10048.648297309559;10124.190064794651;7184.389326907271;7492.70029198826;7498.512596681198;7638.427117966064;7656.157822639394;8015.238552337519;8046.798830029296;8107.14874938123;8108.270255676782;8146.918530814616;7269.527480713737;7482;7491.288327609086;7519.097708275042;7665.118511371041;7434.702611895464;7448.441366897613;7461.552306861606;7589.6205189739185;7681.654325555475;6734.326567343226;6866.588004719732;6882.208546017272;6887.965560172167;6889.311068893271;4874.220909368126;4972.229304457815;5028.170351891897;5031.823886163967;5089.236614507706;4759.833405830779;4887.951120488892;4916.164252077084;5046;5063.594912406925 13:03:50 INFO - PROCESS | 5656 | |4;prototype.html;315.26228625017467;322.6434789557539;332.16129273584187;336.32734530938126;337.50218427818953;5378.973105134469;5402.459754024596;5436.972815135919;5495.505404513593;5589.469000444957;5351.973240133803;5385.3268341457315;5406.432324605918;5406.972965135169;5417.349918009844;4249.150169966004;4258.744475331475;4259.616634502894;4260.72305300156;4289;4144.21259960608;4252.957470425303;4272.807723652428;4300.247456695081;4323.351497275418;4220.113776107021;4225.260579398609;4228.39321057999;4250.447441832557;4266.12544428393;4199.530164442421;4209.91580168398;4221.957780422187;4237.605752749687;4255.680823938186;3705.6850167735774;3769.2838360711376;3769.5288088988877;3777.452269420946;3792.867249646249;5303.655262407931;5310;5310.575153987672;5315.176147697113;5344.7862085516535;4867.610591152699;4868.756562171877;4880.414350277953;4895.755212239374;4903.239997800347;5403.243545903577;5630.71846407678;5648.915266271009;5651.350094739117;5757.359152641519;4056.9654738041904;4087.97956010221;4091.5499295077516;4092.4475195848777;4104.281750693616;5716.857078573027;5832.329282132567;5865.35481097079;5923.881522369528;5946.583739138262;4074.9388759168637;4092.120194158211;4093.63157315843;4097.037196258877;4122.752634841919;4135.421041054255;4155.688323375759;4173.520045194841;4178.558397352908;4180.540140584533;4618.376519169936;4802.903941921142;4805.3512775775525;4816.95183048165;4822.469528351879;5652.604317697722;5711.686312148229;5728.169415434739;5732.05421105513;5768.163616275617;1479.5931118942376;1491.7543850884633;1495.678429137719;1495.835458099608;1498.220925118932;917.5320586500799;956.3544607389983;966.5264020629841;969.8787651543557;986.8174387738292;4829.879253018632;4851.636127290467;4863.732494712754;4936.210206367035;4967.279744437036;5126.6923984561045;5139.946311006235;5161.741912904415;5164.3802743671;5180.419971908604;4639.058610545393;4766.428028636586;4895.853124406273;4897.7795999180125;4901.387326584177;2751.477219328321;2751.7110703376256;2755.1596762987483;2755.2836262571473;2776.2232171410315;5419.268398766195;5439.755211015514;5443.965646527147;5464.606525336093;5480.369757477941;5140.871478213075;5214.108057894555;5529.225908372831;5891.23413956183;5972.223610930638;6173.475254603409;6195.845103872439;6211.919007132571;6217.756448710276;6243;5562.332520097452;5903.321118071305;5914.260717410324;5962.940370596239;5965.343812180743;5789.247397838254;5868.911966320594;5873.353931067664;5887.1757953885635;5906.497947674324;6046.27444706638;6113.449789518964;6177.598456100339;6203.968980155251;6277.403646653561;4038.8384464621085;4072.6538244249573;4097.037196258817;4098.590140985878;4107.521292334817;5616.971915140398;5888.234529511136;5943.970280148572;5984.862876053536;6009.939900600938;5726.198332233574;5728.367415286623;5728.828135155952;5729.4843464088435;5760.769569217352;5703.600747947769;5710.685912274865;5736.42635736423;5743.62666426681;5759.798407055733;5406.864828379322;5591.748371323381;5624.072028115315;5673.461021202979;5686.147077938343;5726.284214473191;5738.799142030009;5768.682722450306;5826.184334193301;5830.18377427169;5555.416681248411;5587.385387607279;5617.8033768817895;5624.521915637217;5668.51817595509 13:03:50 INFO - PROCESS | 5656 | |5;yui.html;705.1115594351116;743.5315751076822;764.4877931785707;765.1468612497067;856.5973992223654;14951.850481495181;15308.923455382735;16267.755983660254;16435.917820410898;16527.586810329733;14825.703485930275;14921.477748278812;15009.62475938102;15009.849901500982;15024.849751502481;781.1758594682608;799.5722288575598;809.6761295481796;813.7762115418249;815.282551354807;823.9093699693059;824.2828738997081;824.3981893217955;826.5867066466767;828.8715249136394;859.0764927702744;865.3899001204136;867.8307729992654;867.9305655547541;869.4956924983494;857.6012154348196;857.8927634045745;858.2876212743439;858.5578427109981;860.5009094725044;625.8185126313364;627.2911609880852;628.2366924187089;629.9244090709144;633.9049142628596;15117.47088851896;15164.469243576532;15197.316120774592;15214.847851521565;15259.694806103817;15040.849591504055;15085;15088.321025553767;15213.695726085527;15235.771463428058;12260.0804939629;12262.386880655931;12308.454261799865;12375.504979800797;12787;3723.2925744108534;3737.663610275088;3767.077066118791;3796.5633952095586;3843.423486477023;79703.6014819928;82633;82812.58593706993;83229.16770832274;84041.57979210126;10771.084457821016;10780.622678206226;10885.782284354269;10973.3964631946;11177.944110279559;21156.78843211579;21167.364979050653;21239.150433982777;21278.574428511343;21301;7810.648520816463;7835.764927052198;7855.057393112749;8055.959720201478;8160.591970401456;4418.469783625986;4447.332900064951;4483.08096840147;4527.479339875957;4578.221702310549;3379.2396710740377;3524.7356448266482;3529.8941031769086;3540.592831824322;3548.503209550665;632.6141053957083;646.0857886091222;646.7897933171644;667.2293501006345;692.6121372031679;678.8268991407258;686.5160062156168;691.4261163234503;700.2087640965779;702.6276073680957;9125.954370228106;9142.634294628273;9556.655121227115;9578.521073946275;9678.012879484904;615.8737458821021;662.774656616743;666.3103687683224;692.1659400422479;703.261575345895;4495.348174514677;4630.675852690347;4635.397398338262;4782.665213435026;4849.830255941025;102199.489002556;125656;128925.35537322253;129084;129703;70887.64556177186;109192;110373;111942.44028779805;114793;92117.5394123025;95448;98105.5094724536;99232.5038374818;102174;8644.740657780276;8950.283977281932;9112.134347237003;9185.862212066691;9275.62897484093;54429;55292.72353638206;56023;56275;56566;72377;79404.20595794199;79526;81290;82226;11621.709457263636;11680.883191167979;11948.581799636971;12016.63950081499;12593.307368094842;12983.805242921553;13028.41372138237;13097.934510327388;13294.40175192138;13414.865851341752;11930.343831089373;11963;12309.507619695112;12313.938430307791;12669.619911402673;11551.249168804;12893.41979610901;12982.091253612534;13052.673683157996;13469.730605388033;10208.54061567246;10911.127109831354;10997.395143266876;11239.60661376848;11769.705757356134;10854.45727713627;11180.552777888794;11332.206745527734;11425.542978280775;11615;10373.222008349554;10552.577896884039;11751.823722644338;12003.339816310187;12257.754844903231 13:03:50 INFO - PROCESS | 5656 | __end_tp_report 13:03:50 INFO - PROCESS | 5656 | __start_cc_report 13:03:50 INFO - PROCESS | 5656 | _x_x_mozilla_cycle_collect,332 13:03:50 INFO - PROCESS | 5656 | __end_cc_report 13:03:50 INFO - PROCESS | 5656 | __startTimestamp1476475430767__endTimestamp 13:03:50 INFO - PROCESS | 5656 | 13:03:50 INFO - PROCESS | 5656 | ------- Summary: start ------- 13:03:50 INFO - PROCESS | 5656 | Number of tests: 6 13:03:50 INFO - PROCESS | 5656 | 13:03:50 INFO - PROCESS | 5656 | [#0] dojo.html Cycles:165 Average:5287.02 Median:5453.35 stddev:585.88 (10.7%) stddev-sans-first:561.87 13:03:50 INFO - PROCESS | 5656 | Values: 3095.0 3115.8 3125.1 3150.2 3160.2 5134.3 5310.3 5337.0 5367.1 5367.3 5202.9 5299.3 5357.8 5367.7 5388.4 4863.2 4891.9 4936.6 4968.1 4983.9 4805.5 4904.3 4965.5 4984.9 5001.4 4675.8 4718.7 4880.7 4905.9 4929.7 4821.6 4836.3 4885.9 4907.9 4976.6 4840.4 4857.6 4872.3 4885.4 4926.9 5155.5 5298.7 5320.8 5322.9 5326.3 5495.4 5555.7 5566.4 5576.1 5591.7 5607.8 5654.9 5675.2 5676.2 5778.1 5316.7 5321.1 5336.9 5339.9 5360.5 5739.7 5782.5 5798.6 5806.1 5827.8 5351.7 5424.7 5454.1 5529.1 5541.2 5687.1 5691.0 5702.4 5704.0 5715.2 5375.2 5452.6 5466.3 5534.5 5537.9 5693.8 5721.6 5724.8 5786.4 5787.6 4294.2 4324.4 4342.2 4414.6 4421.1 3896.7 3896.7 3906.8 3924.1 3934.5 5421.9 5520.9 5527.7 5550.4 5552.0 5767.8 5791.2 5793.4 5796.8 5799.9 5239.9 5285.2 5359.0 5411.5 5449.0 4883.5 4909.7 4938.0 4951.9 4975.1 5948.1 5948.3 5951.3 5953.0 5997.7 5512.2 5562.2 5656.8 5673.7 5734.1 5930.9 5956.9 5960.2 6001.7 6090.2 5621.8 5622.2 5622.9 5627.6 5648.9 5527.3 5732.5 5744.8 5750.2 5751.9 5453.3 5515.4 5521.0 5546.8 5637.2 5519.5 5553.2 5572.7 5578.9 5584.2 5323.9 5374.5 5458.1 5516.8 5521.6 5483.5 5533.1 5535.7 5572.9 5633.7 5332.3 5372.2 5420.6 5430.6 5439.8 13:03:50 INFO - PROCESS | 5656 | 13:03:50 INFO - PROCESS | 5656 | [#1] ext.html Cycles:180 Average:58695.66 Median:40981.49 stddev:114028.03 (278.2%) stddev-sans-first:114264.36 13:03:50 INFO - PROCESS | 5656 | Values: 555.9 594.0 597.2 597.2 601.9 40811.8 42938.8 43061.4 47106.0 47138.0 36409.8 36892.4 36911.4 37094.6 37098.6 8863.4 8968.4 9006.4 9042.8 9051.3 8526.0 8587.7 8599.3 8607.1 8614.5 8852.3 8919.4 8931.6 8958.3 8992.8 8896.5 8904.4 8911.4 8955.0 9007.5 8803.1 8861.7 8895.7 8904.2 8966.2 42499.6 42515.8 42917.4 43113.6 43183.0 3056.4 3391.9 3720.9 3724.4 3813.8 30944.2 31306.4 31682.0 31692.8 31773.5 4337.7 4346.5 4357.2 4399.5 4500.9 350313.0 352815.0 354886.0 355855.0 357054.0 61251.7 62714.4 62772.4 63084.0 63112.4 65234.0 65345.3 65633.3 65901.3 66391.3 16522.8 16712.7 16719.3 16736.0 16748.7 12705.6 12787.5 12805.3 12824.6 12839.6 14365.9 15239.9 15300.5 15475.8 15536.8 7084.7 7407.8 7411.0 7426.4 7587.8 931.0 965.8 970.4 1072.6 1074.7 32392.8 32452.2 32469.2 32569.2 32632.7 1075.3 1077.9 1085.5 1147.6 1164.3 16324.4 16387.4 17555.6 17836.4 18785.5 478901.0 482597.0 483979.0 484150.0 485796.0 56355.7 56939.1 57097.4 57217.0 57488.4 1306.9 1326.9 1349.8 1363.5 1372.8 30868.7 32108.4 32637.2 32783.7 33212.8 49771.8 50891.0 51006.2 51033.0 51301.0 442778.7 443767.0 443997.0 446020.0 446932.0 24299.3 24879.0 27486.2 27870.9 27949.9 42532.4 43245.0 44252.1 45658.5 47057.0 38086.2 38645.4 39420.3 39821.4 41218.6 38801.2 38867.4 40029.2 40255.8 40999.2 37316.8 38127.0 38345.8 40656.4 40963.8 29215.1 31189.4 32284.7 32320.8 32510.7 27412.0 28125.4 28182.7 28404.3 28553.6 13:03:50 INFO - PROCESS | 5656 | 13:03:50 INFO - PROCESS | 5656 | [#2] jquery.html Cycles:180 Average:27675.00 Median:1455.37 stddev:76155.20 (5232.7%) stddev-sans-first:76341.24 13:03:50 INFO - PROCESS | 5656 | Values: 370.1 379.9 387.7 390.1 396.8 17178.3 19456.1 19835.6 20000.5 20145.3 18811.0 18907.3 19213.2 19425.8 19491.1 1755.0 1757.8 1758.1 1758.4 1960.9 5246.8 5596.9 5633.1 5633.5 5717.0 5681.1 5700.1 5726.9 5732.5 5733.9 5456.5 5620.3 5631.1 5645.0 5695.3 5482.7 5510.5 5533.0 5549.4 5575.9 12011.6 12117.6 12295.8 12384.9 12432.1 1990.1 1999.1 2083.2 2207.1 2540.7 9020.5 9106.8 9238.0 9547.3 9656.2 1771.2 1851.5 1888.0 1906.3 1934.2 78521.6 79182.0 82893.0 83177.0 83908.6 10614.6 10773.8 10780.7 11036.4 11186.1 14938.0 14945.7 15076.9 15088.8 15105.8 7336.9 7771.5 7838.8 8103.5 8120.4 7333.7 7342.7 7422.5 7546.9 7622.6 4534.3 4538.5 4586.2 4643.1 4758.5 1774.5 1829.4 1864.0 1915.7 1975.2 842.5 972.2 990.6 999.8 1046.0 18212.2 20723.6 20754.4 20935.0 21052.0 990.4 993.7 998.9 1003.4 1021.3 10200.6 10335.7 10355.3 10373.6 10396.3 451267.0 454425.0 455391.0 467573.0 470682.0 91734.0 92314.5 93036.5 93372.5 93878.0 976.5 1003.6 1039.9 1043.4 1048.2 16867.2 17064.7 17516.6 17998.7 18253.5 42325.4 42841.1 43004.0 43119.4 43252.6 54869.7 56978.0 58170.7 58410.7 58652.4 6730.1 7732.7 7948.5 8205.0 8653.7 8723.8 11891.8 12896.5 13096.0 13259.4 10701.9 11304.8 11751.8 11861.5 11873.0 10637.1 11108.5 11210.2 11280.3 11418.8 11480.9 11627.2 11722.8 11784.6 12004.0 8011.8 8044.7 8146.4 8157.4 8358.3 11390.6 11736.2 11893.6 11997.3 12000.6 13:03:50 INFO - PROCESS | 5656 | 13:03:50 INFO - PROCESS | 5656 | [#3] mootools.html Cycles:180 Average:5590.57 Median:5000.20 stddev:3174.21 (63.5%) stddev-sans-first:3167.19 13:03:50 INFO - PROCESS | 5656 | Values: 1360.0 1439.9 1503.4 1604.7 1608.8 7147.4 7313.1 7997.6 8507.5 8583.6 8004.9 8302.4 8329.9 8466.6 8583.6 2238.1 2280.7 2287.9 2294.3 2295.5 2230.4 2256.8 2319.2 2320.3 2323.3 2220.6 2249.3 2266.1 2273.8 2276.3 2240.0 2246.4 2249.3 2255.5 2257.9 2208.4 2221.2 2224.3 2234.0 2235.8 8146.0 8164.6 8196.8 8216.3 8227.4 5029.9 5238.9 5247.7 5249.5 5249.7 3262.4 3322.9 3370.9 3534.8 3540.6 1043.6 1090.8 1096.6 1108.8 1116.1 11847.8 11849.9 11919.8 11953.0 12053.6 4272.2 4295.1 4552.0 4583.3 4614.5 9879.2 10039.0 10050.1 10088.2 10106.1 5127.2 5175.1 5189.4 5192.8 5195.7 4178.6 4235.4 4718.5 4786.9 4792.5 3797.3 3836.9 3975.2 3994.2 4001.4 1236.5 1241.4 1242.7 1256.3 1266.5 654.8 775.1 791.2 791.2 834.3 5598.3 5704.9 5774.9 5876.1 6002.5 888.4 891.1 898.7 899.5 919.5 3762.5 3940.7 3967.4 3983.5 3994.5 10566.8 10732.0 10781.8 10853.3 10930.3 10647.1 10650.5 10667.5 10702.9 10797.9 7005.5 7370.6 7496.7 7601.5 7657.8 5690.6 5781.3 5810.9 5856.4 5940.2 9374.3 9503.2 9549.7 9664.5 9733.9 9753.4 9943.9 9991.5 10048.6 10124.2 7184.4 7492.7 7498.5 7638.4 7656.2 8015.2 8046.8 8107.1 8108.3 8146.9 7269.5 7482.0 7491.3 7519.1 7665.1 7434.7 7448.4 7461.6 7589.6 7681.7 6734.3 6866.6 6882.2 6888.0 6889.3 4874.2 4972.2 5028.2 5031.8 5089.2 4759.8 4888.0 4916.2 5046.0 5063.6 13:03:50 INFO - PROCESS | 5656 | 13:03:50 INFO - PROCESS | 5656 | [#4] prototype.html Cycles:180 Average:4723.34 Median:5329.98 stddev:1400.26 (26.3%) stddev-sans-first:1364.54 13:03:50 INFO - PROCESS | 5656 | Values: 315.3 322.6 332.2 336.3 337.5 5379.0 5402.5 5437.0 5495.5 5589.5 5352.0 5385.3 5406.4 5407.0 5417.3 4249.2 4258.7 4259.6 4260.7 4289.0 4144.2 4253.0 4272.8 4300.2 4323.4 4220.1 4225.3 4228.4 4250.4 4266.1 4199.5 4209.9 4222.0 4237.6 4255.7 3705.7 3769.3 3769.5 3777.5 3792.9 5303.7 5310.0 5310.6 5315.2 5344.8 4867.6 4868.8 4880.4 4895.8 4903.2 5403.2 5630.7 5648.9 5651.4 5757.4 4057.0 4088.0 4091.5 4092.4 4104.3 5716.9 5832.3 5865.4 5923.9 5946.6 4074.9 4092.1 4093.6 4097.0 4122.8 4135.4 4155.7 4173.5 4178.6 4180.5 4618.4 4802.9 4805.4 4817.0 4822.5 5652.6 5711.7 5728.2 5732.1 5768.2 1479.6 1491.8 1495.7 1495.8 1498.2 917.5 956.4 966.5 969.9 986.8 4829.9 4851.6 4863.7 4936.2 4967.3 5126.7 5139.9 5161.7 5164.4 5180.4 4639.1 4766.4 4895.9 4897.8 4901.4 2751.5 2751.7 2755.2 2755.3 2776.2 5419.3 5439.8 5444.0 5464.6 5480.4 5140.9 5214.1 5529.2 5891.2 5972.2 6173.5 6195.8 6211.9 6217.8 6243.0 5562.3 5903.3 5914.3 5962.9 5965.3 5789.2 5868.9 5873.4 5887.2 5906.5 6046.3 6113.4 6177.6 6204.0 6277.4 4038.8 4072.7 4097.0 4098.6 4107.5 5617.0 5888.2 5944.0 5984.9 6009.9 5726.2 5728.4 5728.8 5729.5 5760.8 5703.6 5710.7 5736.4 5743.6 5759.8 5406.9 5591.7 5624.1 5673.5 5686.1 5726.3 5738.8 5768.7 5826.2 5830.2 5555.4 5587.4 5617.8 5624.5 5668.5 13:03:50 INFO - PROCESS | 5656 | 13:03:50 INFO - PROCESS | 5656 | [#5] yui.html Cycles:180 Average:21675.67 Median:4432.90 stddev:32562.46 (734.6%) stddev-sans-first:32615.74 13:03:50 INFO - PROCESS | 5656 | Values: 705.1 743.5 764.5 765.1 856.6 14951.9 15308.9 16267.8 16435.9 16527.6 14825.7 14921.5 15009.6 15009.8 15024.8 781.2 799.6 809.7 813.8 815.3 823.9 824.3 824.4 826.6 828.9 859.1 865.4 867.8 867.9 869.5 857.6 857.9 858.3 858.6 860.5 625.8 627.3 628.2 629.9 633.9 15117.5 15164.5 15197.3 15214.8 15259.7 15040.8 15085.0 15088.3 15213.7 15235.8 12260.1 12262.4 12308.5 12375.5 12787.0 3723.3 3737.7 3767.1 3796.6 3843.4 79703.6 82633.0 82812.6 83229.2 84041.6 10771.1 10780.6 10885.8 10973.4 11177.9 21156.8 21167.4 21239.2 21278.6 21301.0 7810.6 7835.8 7855.1 8056.0 8160.6 4418.5 4447.3 4483.1 4527.5 4578.2 3379.2 3524.7 3529.9 3540.6 3548.5 632.6 646.1 646.8 667.2 692.6 678.8 686.5 691.4 700.2 702.6 9126.0 9142.6 9556.7 9578.5 9678.0 615.9 662.8 666.3 692.2 703.3 4495.3 4630.7 4635.4 4782.7 4849.8 102199.5 125656.0 128925.4 129084.0 129703.0 70887.6 109192.0 110373.0 111942.4 114793.0 92117.5 95448.0 98105.5 99232.5 102174.0 8644.7 8950.3 9112.1 9185.9 9275.6 54429.0 55292.7 56023.0 56275.0 56566.0 72377.0 79404.2 79526.0 81290.0 82226.0 11621.7 11680.9 11948.6 12016.6 12593.3 12983.8 13028.4 13097.9 13294.4 13414.9 11930.3 11963.0 12309.5 12313.9 12669.6 11551.2 12893.4 12982.1 13052.7 13469.7 10208.5 10911.1 10997.4 11239.6 11769.7 10854.5 11180.6 11332.2 11425.5 11615.0 10373.2 10552.6 11751.8 12003.3 12257.8 13:03:50 INFO - PROCESS | 5656 | -------- Summary: end -------- 13:03:50 INFO - PROCESS | 5656 | 13:03:51 INFO - TEST-INFO | 5656: exit 0 13:03:51 INFO - TEST-OK | dromaeo_css | took 1115958ms 13:03:51 INFO - TEST-START | kraken 13:03:51 INFO - operating with platform_type : linux_ 13:03:51 INFO - Initialising browser for kraken test... 13:03:51 INFO - TEST-INFO | started process 6013 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpqmGPuk/profile http://localhost:35381/getInfo.html) 13:03:56 INFO - PROCESS | 6013 | __metrics Screen width/height:1600/1200 13:03:56 INFO - PROCESS | 6013 | colorDepth:24 13:03:56 INFO - PROCESS | 6013 | Browser inner width/height: 1024/697 13:03:56 INFO - PROCESS | 6013 | __metrics 13:03:56 ERROR - PROCESS | 6013 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3083: TypeError: this.tabs is undefined 13:03:57 INFO - TEST-INFO | 6013: exit 0 13:03:57 INFO - Browser initialized. 13:03:57 INFO - Running cycle 1/1 for kraken test... 13:03:57 INFO - TEST-INFO | started process 6135 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpqmGPuk/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:04:10 INFO - PROCESS | 6135 | RSS: Main: 182841344 13:04:10 INFO - PROCESS | 6135 | 13:04:13 INFO - PROCESS | 6135 | Cycle 1(1): loaded http://localhost:35381/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:35381/tests/kraken/driver.html?testName=audio-beat-detection) 13:04:13 INFO - PROCESS | 6135 | RSS: Main: 197017600 13:04:13 INFO - PROCESS | 6135 | 13:04:16 INFO - PROCESS | 6135 | Cycle 1(1): loaded http://localhost:35381/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:35381/tests/kraken/driver.html?testName=audio-dft) 13:04:17 INFO - PROCESS | 6135 | RSS: Main: 194625536 13:04:17 INFO - PROCESS | 6135 | 13:04:20 INFO - PROCESS | 6135 | Cycle 1(1): loaded http://localhost:35381/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:35381/tests/kraken/driver.html?testName=audio-fft) 13:04:20 INFO - PROCESS | 6135 | RSS: Main: 191410176 13:04:20 INFO - PROCESS | 6135 | 13:04:22 INFO - PROCESS | 6135 | Cycle 1(1): loaded http://localhost:35381/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:35381/tests/kraken/driver.html?testName=audio-oscillator) 13:04:23 INFO - PROCESS | 6135 | RSS: Main: 191979520 13:04:23 INFO - PROCESS | 6135 | 13:04:25 INFO - PROCESS | 6135 | Cycle 1(1): loaded http://localhost:35381/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:35381/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:04:26 INFO - PROCESS | 6135 | RSS: Main: 191950848 13:04:26 INFO - PROCESS | 6135 | 13:04:29 INFO - PROCESS | 6135 | Cycle 1(1): loaded http://localhost:35381/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:35381/tests/kraken/driver.html?testName=imaging-darkroom) 13:04:29 INFO - PROCESS | 6135 | RSS: Main: 192704512 13:04:29 INFO - PROCESS | 6135 | 13:04:33 INFO - PROCESS | 6135 | Cycle 1(1): loaded http://localhost:35381/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:35381/tests/kraken/driver.html?testName=imaging-desaturate) 13:04:34 INFO - PROCESS | 6135 | RSS: Main: 190349312 13:04:34 INFO - PROCESS | 6135 | 13:04:36 INFO - PROCESS | 6135 | Cycle 1(1): loaded http://localhost:35381/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:35381/tests/kraken/driver.html?testName=json-parse-financial) 13:04:37 INFO - PROCESS | 6135 | RSS: Main: 191344640 13:04:37 INFO - PROCESS | 6135 | 13:04:38 INFO - PROCESS | 6135 | Cycle 1(1): loaded http://localhost:35381/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:35381/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:04:39 INFO - PROCESS | 6135 | RSS: Main: 191447040 13:04:39 INFO - PROCESS | 6135 | 13:04:41 INFO - PROCESS | 6135 | Cycle 1(1): loaded http://localhost:35381/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:35381/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:04:42 INFO - PROCESS | 6135 | RSS: Main: 191356928 13:04:42 INFO - PROCESS | 6135 | 13:04:44 INFO - PROCESS | 6135 | Cycle 1(1): loaded http://localhost:35381/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:35381/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:04:44 INFO - PROCESS | 6135 | RSS: Main: 191885312 13:04:44 INFO - PROCESS | 6135 | 13:04:47 INFO - PROCESS | 6135 | Cycle 1(1): loaded http://localhost:35381/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:35381/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:04:48 INFO - PROCESS | 6135 | RSS: Main: 192290816 13:04:48 INFO - PROCESS | 6135 | 13:04:51 INFO - PROCESS | 6135 | Cycle 1(1): loaded http://localhost:35381/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:35381/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:04:51 INFO - PROCESS | 6135 | RSS: Main: 192540672 13:04:51 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | Cycle 1(1): loaded http://localhost:35381/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:35381/tests/kraken/driver.html?testName=ai-astar) 13:04:53 INFO - PROCESS | 6135 | RSS: Main: 194097152 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | __start_tp_report 13:04:53 INFO - PROCESS | 6135 | _x_x_mozilla_page_load 13:04:53 INFO - PROCESS | 6135 | _x_x_mozilla_page_load_details 13:04:53 INFO - PROCESS | 6135 | |i|pagename|runs| 13:04:53 INFO - PROCESS | 6135 | |0;ai-astar;106;115;113;112;113;113;112;111;112;111 13:04:53 INFO - PROCESS | 6135 | |1;audio-beat-detection;157;124;126;176;128;125;126;126;154;127 13:04:53 INFO - PROCESS | 6135 | |2;audio-dft;160;165;164;174;162;162;161;160;165;165 13:04:53 INFO - PROCESS | 6135 | |3;audio-fft;76;76;75;116;78;76;78;77;101;79 13:04:53 INFO - PROCESS | 6135 | |4;audio-oscillator;83;82;123;82;82;82;105;83;83;126 13:04:53 INFO - PROCESS | 6135 | |5;imaging-gaussian-blur;118;117;117;118;118;120;118;117;121;119 13:04:53 INFO - PROCESS | 6135 | |6;imaging-darkroom;147;147;147;146;146;148;148;147;146;149 13:04:53 INFO - PROCESS | 6135 | |7;imaging-desaturate;86;85;85;86;85;86;86;85;86;85 13:04:53 INFO - PROCESS | 6135 | |8;json-parse-financial;55;56;54;56;56;59;56;56;56;57 13:04:53 INFO - PROCESS | 6135 | |9;json-stringify-tinderbox;62;60;60;59;59;59;59;61;59;59 13:04:53 INFO - PROCESS | 6135 | |10;stanford-crypto-aes;83;81;82;81;82;85;81;80;83;80 13:04:53 INFO - PROCESS | 6135 | |11;stanford-crypto-ccm;153;147;131;132;130;135;136;140;171;142 13:04:53 INFO - PROCESS | 6135 | |12;stanford-crypto-pbkdf2;170;168;167;172;168;167;173;172;171;169 13:04:53 INFO - PROCESS | 6135 | |13;stanford-crypto-sha256-iterative;68;66;67;68;66;67;66;66;65;68 13:04:53 INFO - PROCESS | 6135 | __end_tp_report 13:04:53 INFO - PROCESS | 6135 | __start_cc_report 13:04:53 INFO - PROCESS | 6135 | _x_x_mozilla_cycle_collect,809 13:04:53 INFO - PROCESS | 6135 | __end_cc_report 13:04:53 INFO - PROCESS | 6135 | __startTimestamp1476475493683__endTimestamp 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | ------- Summary: start ------- 13:04:53 INFO - PROCESS | 6135 | Number of tests: 14 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | [#0] ai-astar Cycles:10 Average:111.80 Median:112.50 stddev:2.35 (2.1%) stddev-sans-first:1.24 13:04:53 INFO - PROCESS | 6135 | Values: 106.0 115.0 113.0 112.0 113.0 113.0 112.0 111.0 112.0 111.0 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | [#1] audio-beat-detection Cycles:10 Average:136.90 Median:127.50 stddev:18.46 (14.5%) stddev-sans-first:18.09 13:04:53 INFO - PROCESS | 6135 | Values: 157.0 124.0 126.0 176.0 128.0 125.0 126.0 126.0 154.0 127.0 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | [#2] audio-dft Cycles:10 Average:163.80 Median:164.50 stddev:4.10 (2.5%) stddev-sans-first:4.12 13:04:53 INFO - PROCESS | 6135 | Values: 160.0 165.0 164.0 174.0 162.0 162.0 161.0 160.0 165.0 165.0 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | [#3] audio-fft Cycles:10 Average:83.20 Median:76.50 stddev:13.85 (18.1%) stddev-sans-first:14.44 13:04:53 INFO - PROCESS | 6135 | Values: 76.0 76.0 75.0 116.0 78.0 76.0 78.0 77.0 101.0 79.0 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | [#4] audio-oscillator Cycles:10 Average:93.10 Median:82.00 stddev:18.00 (22.0%) stddev-sans-first:18.72 13:04:53 INFO - PROCESS | 6135 | Values: 83.0 82.0 123.0 82.0 82.0 82.0 105.0 83.0 83.0 126.0 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | [#5] imaging-gaussian-blur Cycles:10 Average:118.30 Median:118.00 stddev:1.34 (1.1%) stddev-sans-first:1.41 13:04:53 INFO - PROCESS | 6135 | Values: 118.0 117.0 117.0 118.0 118.0 120.0 118.0 117.0 121.0 119.0 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | [#6] imaging-darkroom Cycles:10 Average:147.10 Median:147.00 stddev:0.99 (0.7%) stddev-sans-first:1.05 13:04:53 INFO - PROCESS | 6135 | Values: 147.0 147.0 147.0 146.0 146.0 148.0 148.0 147.0 146.0 149.0 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | [#7] imaging-desaturate Cycles:10 Average:85.50 Median:86.00 stddev:0.53 (0.6%) stddev-sans-first:0.53 13:04:53 INFO - PROCESS | 6135 | Values: 86.0 85.0 85.0 86.0 85.0 86.0 86.0 85.0 86.0 85.0 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | [#8] json-parse-financial Cycles:10 Average:56.10 Median:56.00 stddev:1.29 (2.3%) stddev-sans-first:1.30 13:04:53 INFO - PROCESS | 6135 | Values: 55.0 56.0 54.0 56.0 56.0 59.0 56.0 56.0 56.0 57.0 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | [#9] json-stringify-tinderbox Cycles:10 Average:59.70 Median:59.50 stddev:1.06 (1.8%) stddev-sans-first:0.73 13:04:53 INFO - PROCESS | 6135 | Values: 62.0 60.0 60.0 59.0 59.0 59.0 59.0 61.0 59.0 59.0 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | [#10] stanford-crypto-aes Cycles:10 Average:81.80 Median:82.00 stddev:1.55 (1.9%) stddev-sans-first:1.58 13:04:53 INFO - PROCESS | 6135 | Values: 83.0 81.0 82.0 81.0 82.0 85.0 81.0 80.0 83.0 80.0 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | [#11] stanford-crypto-ccm Cycles:10 Average:141.70 Median:141.00 stddev:12.65 (9.0%) stddev-sans-first:12.74 13:04:53 INFO - PROCESS | 6135 | Values: 153.0 147.0 131.0 132.0 130.0 135.0 136.0 140.0 171.0 142.0 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:169.70 Median:170.50 stddev:2.21 (1.3%) stddev-sans-first:2.35 13:04:53 INFO - PROCESS | 6135 | Values: 170.0 168.0 167.0 172.0 168.0 167.0 173.0 172.0 171.0 169.0 13:04:53 INFO - PROCESS | 6135 | 13:04:53 INFO - PROCESS | 6135 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.70 Median:67.00 stddev:1.06 (1.6%) stddev-sans-first:1.01 13:04:53 INFO - PROCESS | 6135 | Values: 68.0 66.0 67.0 68.0 66.0 67.0 66.0 66.0 65.0 68.0 13:04:53 INFO - PROCESS | 6135 | -------- Summary: end -------- 13:04:53 INFO - PROCESS | 6135 | 13:04:54 INFO - TEST-INFO | 6135: exit 0 13:04:54 INFO - TEST-OK | kraken | took 63001ms 13:04:54 INFO - SUITE-END | took 1178s 13:04:54 INFO - Completed test suite (00:19:38) 13:04:54 INFO - javascript benchmark 13:04:54 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7095.130792943037, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3095.040537433396, 3115.766317526186, 3125.140586338757, 3150.2281940924477, 3160.2099475131217, 5134.2812006319145, 5310.256564081032, 5337.01265265926, 5367.087595108831, 5367.302250707407, 5202.8699282517955, 5299.2581038654525, 5357.7589008494615, 5367.704776237305, 5388.43421440749, 4863.246196839478, 4891.926621100686, 4936.605071594264, 4968.080905032581, 4983.8504844854715, 4805.543473370041, 4904.288878112689, 4965.478624744404, 4984.900301993958, 5001.424836143854, 4675.766211689436, 4718.740469274188, 4880.731559764212, 4905.901881962359, 4929.6795708279205, 4821.638377121695, 4836.298736683197, 4885.8778530536665, 4907.901841963141, 4976.626752993504, 4840.370751802278, 4857.611391088704, 4872.269159626049, 4885.413750349981, 4926.9014619707405, 5155.458676838953, 5298.682079075268, 5320.813771517978, 5322.893542129174, 5326.307580014612, 5495.395506494282, 5555.666660000373, 5566.387697353288, 5576.1356989666665, 5591.7483713233005, 5607.831765047055, 5654.886902261932, 5675.177099320616, 5676.233708449389, 5778.133280007991, 5316.680999140064, 5321.068812957717, 5336.946630533723, 5339.919901201485, 5360.490753378423, 5739.71301434935, 5782.508486778671, 5798.625231855749, 5806.129080637854, 5827.825165245049, 5351.652142610717, 5424.728763561806, 5454.072807622713, 5529.060059789765, 5541.196526503634, 5687.090065589568, 5691.03252447085, 5702.401247868997, 5703.971480142573, 5715.199872017921, 5375.220593014069, 5452.618316717871, 5466.262054622654, 5534.501894829485, 5537.944620553823, 5693.800716974886, 5721.5708821838525, 5724.79963201286, 5786.42135786418, 5787.565932555075, 4294.227039132924, 4324.35134729793, 4342.240107981091, 4414.602685758297, 4421.115776844644, 3896.7077469189926, 3896.7077469189926, 3906.824192911326, 3924.117073658404, 3934.488516492838, 5421.918671219935, 5520.861978450571, 5527.668339899619, 5550.361708403505, 5552.0, 5767.826965191051, 5791.160281759121, 5793.362730099686, 5796.768129274782, 5799.855003624859, 5239.947600524022, 5285.180796976475, 5359.0, 5411.540019098342, 5449.01917654826, 4883.536064073907, 4909.705417674951, 4938.0, 4951.876203094879, 4975.10448119342, 5948.137520059568, 5948.315943666534, 5951.315598706205, 5952.987992041277, 5997.70011499432, 5512.173174023928, 5562.193481945176, 5656.773729050957, 5673.74468148926, 5734.139879018014, 5930.911036334544, 5956.940430595639, 5960.195373624505, 6001.7299221536005, 6090.208272924491, 5621.775128994795, 5622.24099746529, 5622.9156562652415, 5627.577931655061, 5648.943510564842, 5527.2538207343105, 5732.5413966881715, 5744.798932037359, 5750.223719797774, 5751.913721294268, 5453.345598528202, 5515.393306736336, 5520.972395137998, 5546.833594992157, 5637.2107904894165, 5519.530839878656, 5553.222548843246, 5572.749226284908, 5578.888422231614, 5584.218209450599, 5323.893522129459, 5374.4625537445945, 5458.1266997280245, 5516.834494965157, 5521.641093328921, 5483.533899618577, 5533.059379905345, 5535.6955367455175, 5572.944270557243, 5633.6619802811965, 5332.33345831771, 5372.167314066326, 5420.647657902224, 5430.619856609999, 5439.755211015435], "value": 5248.704053787914, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [555.911054231323, 593.9643621382718, 597.2206270816588, 597.2355385107062, 601.8615718384772, 40811.79594102029, 42938.78530607346, 43061.35407968883, 47106.0, 47138.0, 36409.81795091021, 36892.44661330075, 36911.44632830509, 37094.629053709454, 37098.629013709855, 8863.379563430546, 8968.417052891573, 9006.414583052081, 9042.819143617124, 9051.27589792815, 8525.95737021314, 8587.699430519933, 8599.312055035614, 8607.139286071406, 8614.483131012159, 8852.291816654651, 8919.420237684562, 8931.598078086468, 8958.32812539059, 8992.77518062047, 8896.510691911943, 8904.376693631448, 8911.420757650765, 8955.0, 9007.504587247699, 8803.119688031209, 8861.689840855604, 8895.688650897253, 8904.243139333164, 8966.237869781076, 42499.57500424987, 42515.7874210627, 42917.35623965643, 43113.56886431159, 43183.0, 3056.419280336729, 3391.9152021199666, 3720.8651361334782, 3724.422714479233, 3813.8474461021524, 30944.226394340098, 31306.37387252265, 31682.0, 31692.841535792402, 31773.52339714906, 4337.696361254713, 4346.543612920629, 4357.215701173787, 4399.472063352387, 4500.887477813081, 350313.0, 352815.0, 354886.0, 355855.0, 357054.0, 61251.6937415319, 62714.37285627086, 62772.35048845626, 63084.0, 63112.36887631065, 65234.0, 65345.346546533925, 65633.34366656368, 65901.34098659048, 66391.33608663948, 16522.83477165237, 16712.74930876038, 16719.331226751037, 16736.0, 16748.665026699397, 12705.555305564261, 12787.488500460064, 12805.295708736108, 12824.551140710217, 12839.55061572859, 14365.856341436662, 15239.923800380928, 15300.540983770505, 15475.84524154744, 15536.84463155354, 7084.689332473509, 7407.777666699969, 7410.96294518524, 7426.435311050618, 7587.772366829004, 930.9534523273809, 965.8309795785709, 970.3935040599625, 1072.5763323487179, 1074.6937122920087, 32392.83803580967, 32452.188695282333, 32469.18827029343, 32569.185770355456, 32632.673673263438, 1075.2903083964702, 1077.9137668986461, 1085.4518468173521, 1147.5639257082255, 1164.2839653613137, 16324.428644997368, 16387.42644007454, 17555.56111097233, 17836.3757268495, 18785.530361741065, 478901.0, 482597.0, 483979.0, 484150.0, 485796.0, 56355.71822140863, 56939.14591281134, 57097.429025710044, 57217.0, 57488.42511574831, 1306.9477220911247, 1326.8739469750358, 1349.817774600436, 1363.4682473835212, 1372.8078069070539, 30868.691313086583, 32108.357832843678, 32637.18407039748, 32783.67216327806, 33212.833935831135, 49771.751141244065, 50891.0, 51006.23490647569, 51033.0, 51301.0, 442778.7221277846, 443767.0, 443997.0, 446020.0, 446932.0, 24299.271021869372, 24879.0, 27486.17541473759, 27870.86064569664, 27949.860250698617, 42532.362014570426, 43245.0, 44252.114957700025, 45658.54341456543, 47057.0, 38086.23827523489, 38645.420318694676, 39420.34201620621, 39821.40267896042, 41218.58781412148, 38801.223975520894, 38867.39641125583, 40029.19941601093, 40255.798721006206, 40999.1800164001, 37316.813415932746, 38127.0, 38345.80827095846, 40656.39015414831, 40963.7951810239, 29215.123546293646, 31189.376212476076, 32284.677153228167, 32320.83839580787, 32510.67489325171, 27412.0, 28125.437491250468, 28182.718172818008, 28404.289892752848, 28553.571696424155], "value": 19729.46270876076, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [370.05338069488886, 379.8613506070283, 387.70340689372637, 390.0619011277878, 396.78970145822706, 17178.3128674853, 19456.12447439865, 19835.60328793423, 20000.499987500283, 20145.29491467799, 18811.0, 18907.338243161492, 19213.23147074119, 19425.805741942575, 19491.122899469523, 1754.9912250438795, 1757.7714897063363, 1758.0857953863983, 1758.3669878843607, 1960.8920959657783, 5246.842594722164, 5596.888062238752, 5633.070543360341, 5633.549316054706, 5716.971415142919, 5681.11942648888, 5700.087985922253, 5726.885462290752, 5732.512736417389, 5733.942660573382, 5456.48163424474, 5620.325560932673, 5631.0708733059, 5645.040343141634, 5695.316562012565, 5482.671039737588, 5510.476504732044, 5532.972335138298, 5549.417311182348, 5575.944240557624, 12011.57959471423, 12117.575884844076, 12295.754084918251, 12384.876151238463, 12432.12975091744, 1990.1342915831515, 1999.1303782854504, 2083.229205194088, 2207.117153138757, 2540.6824146981626, 9020.503872287087, 9106.81786364269, 9237.953810230905, 9547.331686781929, 9656.227501799909, 1771.2295151608962, 1851.527860395604, 1887.9710557746062, 1906.304198967367, 1934.220517124235, 78521.60739196325, 79182.0, 82893.0, 83177.0, 83908.58045709794, 10614.628488002883, 10773.784524309627, 10780.730481738019, 11036.448177591088, 11186.105111591054, 14938.0, 14945.701085978437, 15076.924615377073, 15088.849111508744, 15105.79153667704, 7336.889946650805, 7771.533707977539, 7838.8432231355055, 8103.4732742372735, 8120.3503719702285, 7333.74331898381, 7342.743003994835, 7422.517536360119, 7546.9245307546225, 7622.618869056525, 4534.251848445036, 4538.455385353779, 4586.151561961048, 4643.094596553639, 4758.452777930513, 1774.4676597020841, 1829.3505805439145, 1863.993443540473, 1915.7317975483165, 1975.170428420067, 842.5029232752705, 972.2465089555651, 990.5839547389969, 999.8150342186718, 1046.0062940206833, 18212.180451879696, 20723.58552828935, 20754.40569928759, 20935.0, 21052.0, 990.4107056301489, 993.7018894331671, 998.9400635961865, 1003.3578509753618, 1021.2748948246827, 10200.591976321013, 10335.689929302132, 10355.275130740927, 10373.585056597802, 10396.324238924597, 451267.0, 454425.0, 455391.0, 467573.0, 470682.0, 91734.0, 92314.53842730743, 93036.53481732548, 93372.53313733524, 93878.0, 976.5166242710046, 1003.5835128421769, 1039.880413752413, 1043.410473082706, 1048.2033654422694, 16867.156642168087, 17064.744028839825, 17516.649667006845, 17998.730019049464, 18253.54366140857, 42325.36511952385, 42841.1431771369, 43004.0, 43119.35320970125, 43252.56747432485, 54869.72565137149, 56978.0, 58170.70914645569, 58410.707946459996, 58652.4134758647, 6730.125083739083, 7732.690692372242, 7948.483348582324, 8204.958975205085, 8653.697120601, 8723.781905452415, 11891.821622675494, 12896.548620798603, 13096.0, 13259.403326850123, 10701.892981070401, 11304.773904521699, 11751.76496470083, 11861.466234019317, 11872.990795782454, 10637.14902807789, 11108.50011749457, 11210.215284929976, 11280.2667826591, 11418.771624567627, 11480.94259528697, 11627.244229125079, 11722.765544688888, 11784.646460606196, 12003.999000249938, 8011.759647210593, 8044.672629016147, 8146.389020823581, 8157.388195885451, 8358.289545388467, 11390.601328953448, 11736.237144585575, 11893.643190704293, 11997.340146291688, 12000.63998080059], "value": 8585.49022195781, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1359.9592012239634, 1439.8632129947655, 1503.4211828446053, 1604.6630207656392, 1608.7586861970697, 7147.428205743541, 7313.122425308957, 7997.560134192617, 8507.489550626959, 8583.570821458925, 8004.91995080049, 8302.418830681854, 8329.91670083299, 8466.619002144902, 8583.570821458934, 2238.0935721032965, 2280.703508543895, 2287.8512896661746, 2294.300238427279, 2295.494991101963, 2230.4423894026495, 2256.8420210585264, 2319.211468100845, 2320.269115228706, 2323.3262353917344, 2220.578090162872, 2249.325202439262, 2266.1275408967504, 2273.818094552432, 2276.338273060667, 2240.0, 2246.4047027537554, 2249.347689170139, 2255.4925141843037, 2257.9096836126537, 2208.436848603612, 2221.1781640792847, 2224.343818573525, 2234.0058673890126, 2235.8434909556336, 8145.959270203671, 8164.550949697764, 8196.83606327876, 8216.26053655174, 8227.42408031438, 5029.949700503022, 5238.92141617876, 5247.711375874325, 5249.527542521191, 5249.737513124367, 3262.4127657021727, 3322.900312990614, 3370.9157271068175, 3534.7525673202886, 3540.6105328413855, 1043.5669197283119, 1090.8254679251281, 1096.6216655253925, 1108.84476173335, 1116.13499537858, 11847.822282665767, 11849.881501185051, 11919.761604767942, 11952.999999999913, 12053.6383908482, 4272.188284225987, 4295.098029413858, 4552.0, 4583.2666773316105, 4614.538546145359, 9879.209663226924, 10039.04629060238, 10050.09549140581, 10088.243381746399, 10106.090451859369, 5127.2052831811125, 5175.094358487249, 5189.42916279209, 5192.81825136126, 5195.688258704414, 4178.603032711888, 4235.364695295731, 4718.4809670936165, 4786.928196076992, 4792.544708252711, 3797.3354662933875, 3836.9232615347537, 3975.1652153048185, 3994.2211268802885, 4001.3597824347967, 1236.5486597392066, 1241.4413513918773, 1242.7203879127123, 1256.2901960392348, 1266.480223731526, 654.8297442664941, 775.1357236681173, 791.1732239809413, 791.2483141016057, 834.3283656656329, 5598.3282006159525, 5704.857378565569, 5774.855628609318, 5876.118582212703, 6002.519798416116, 888.4092078767676, 891.1133422244908, 898.7169041751828, 899.5457294066455, 919.5494207838245, 3762.473253744478, 3940.7044471664167, 3967.3652215645357, 3983.541892682321, 3994.5206575210577, 10566.788664226673, 10732.0, 10781.784364312669, 10853.294535855144, 10930.289531180448, 10647.14822814173, 10650.520726567323, 10667.466626668636, 10702.89297107019, 10797.946010270056, 7005.50961432705, 7370.557766533918, 7496.7001319947685, 7601.46789724725, 7657.846843063107, 5690.573207009574, 5781.306243250837, 5810.941890581209, 5856.4143585641095, 5940.198073260054, 9374.343795934219, 9503.239740820856, 9549.713508594754, 9664.516774161404, 9733.9026609733, 9753.366031207948, 9943.850842237516, 9991.450470224207, 10048.648297309559, 10124.190064794651, 7184.389326907271, 7492.70029198826, 7498.512596681198, 7638.427117966064, 7656.157822639394, 8015.238552337519, 8046.798830029296, 8107.14874938123, 8108.270255676782, 8146.918530814616, 7269.527480713737, 7482.0, 7491.288327609086, 7519.097708275042, 7665.118511371041, 7434.702611895464, 7448.441366897613, 7461.552306861606, 7589.6205189739185, 7681.654325555475, 6734.326567343226, 6866.588004719732, 6882.208546017272, 6887.965560172167, 6889.311068893271, 4874.220909368126, 4972.229304457815, 5028.170351891897, 5031.823886163967, 5089.236614507706, 4759.833405830779, 4887.951120488892, 4916.164252077084, 5046.0, 5063.594912406925], "value": 4464.324687424019, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [315.26228625017467, 322.6434789557539, 332.16129273584187, 336.32734530938126, 337.50218427818953, 5378.973105134469, 5402.459754024596, 5436.972815135919, 5495.505404513593, 5589.469000444957, 5351.973240133803, 5385.3268341457315, 5406.432324605918, 5406.972965135169, 5417.349918009844, 4249.150169966004, 4258.744475331475, 4259.616634502894, 4260.72305300156, 4289.0, 4144.21259960608, 4252.957470425303, 4272.807723652428, 4300.247456695081, 4323.351497275418, 4220.113776107021, 4225.260579398609, 4228.39321057999, 4250.447441832557, 4266.12544428393, 4199.530164442421, 4209.91580168398, 4221.957780422187, 4237.605752749687, 4255.680823938186, 3705.6850167735774, 3769.2838360711376, 3769.5288088988877, 3777.452269420946, 3792.867249646249, 5303.655262407931, 5310.0, 5310.575153987672, 5315.176147697113, 5344.7862085516535, 4867.610591152699, 4868.756562171877, 4880.414350277953, 4895.755212239374, 4903.239997800347, 5403.243545903577, 5630.71846407678, 5648.915266271009, 5651.350094739117, 5757.359152641519, 4056.9654738041904, 4087.97956010221, 4091.5499295077516, 4092.4475195848777, 4104.281750693616, 5716.857078573027, 5832.329282132567, 5865.35481097079, 5923.881522369528, 5946.583739138262, 4074.9388759168637, 4092.120194158211, 4093.63157315843, 4097.037196258877, 4122.752634841919, 4135.421041054255, 4155.688323375759, 4173.520045194841, 4178.558397352908, 4180.540140584533, 4618.376519169936, 4802.903941921142, 4805.3512775775525, 4816.95183048165, 4822.469528351879, 5652.604317697722, 5711.686312148229, 5728.169415434739, 5732.05421105513, 5768.163616275617, 1479.5931118942376, 1491.7543850884633, 1495.678429137719, 1495.835458099608, 1498.220925118932, 917.5320586500799, 956.3544607389983, 966.5264020629841, 969.8787651543557, 986.8174387738292, 4829.879253018632, 4851.636127290467, 4863.732494712754, 4936.210206367035, 4967.279744437036, 5126.6923984561045, 5139.946311006235, 5161.741912904415, 5164.3802743671, 5180.419971908604, 4639.058610545393, 4766.428028636586, 4895.853124406273, 4897.7795999180125, 4901.387326584177, 2751.477219328321, 2751.7110703376256, 2755.1596762987483, 2755.2836262571473, 2776.2232171410315, 5419.268398766195, 5439.755211015514, 5443.965646527147, 5464.606525336093, 5480.369757477941, 5140.871478213075, 5214.108057894555, 5529.225908372831, 5891.23413956183, 5972.223610930638, 6173.475254603409, 6195.845103872439, 6211.919007132571, 6217.756448710276, 6243.0, 5562.332520097452, 5903.321118071305, 5914.260717410324, 5962.940370596239, 5965.343812180743, 5789.247397838254, 5868.911966320594, 5873.353931067664, 5887.1757953885635, 5906.497947674324, 6046.27444706638, 6113.449789518964, 6177.598456100339, 6203.968980155251, 6277.403646653561, 4038.8384464621085, 4072.6538244249573, 4097.037196258817, 4098.590140985878, 4107.521292334817, 5616.971915140398, 5888.234529511136, 5943.970280148572, 5984.862876053536, 6009.939900600938, 5726.198332233574, 5728.367415286623, 5728.828135155952, 5729.4843464088435, 5760.769569217352, 5703.600747947769, 5710.685912274865, 5736.42635736423, 5743.62666426681, 5759.798407055733, 5406.864828379322, 5591.748371323381, 5624.072028115315, 5673.461021202979, 5686.147077938343, 5726.284214473191, 5738.799142030009, 5768.682722450306, 5826.184334193301, 5830.18377427169, 5555.416681248411, 5587.385387607279, 5617.8033768817895, 5624.521915637217, 5668.51817595509], "value": 4277.575875400493, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [705.1115594351116, 743.5315751076822, 764.4877931785707, 765.1468612497067, 856.5973992223654, 14951.850481495181, 15308.923455382735, 16267.755983660254, 16435.917820410898, 16527.586810329733, 14825.703485930275, 14921.477748278812, 15009.62475938102, 15009.849901500982, 15024.849751502481, 781.1758594682608, 799.5722288575598, 809.6761295481796, 813.7762115418249, 815.282551354807, 823.9093699693059, 824.2828738997081, 824.3981893217955, 826.5867066466767, 828.8715249136394, 859.0764927702744, 865.3899001204136, 867.8307729992654, 867.9305655547541, 869.4956924983494, 857.6012154348196, 857.8927634045745, 858.2876212743439, 858.5578427109981, 860.5009094725044, 625.8185126313364, 627.2911609880852, 628.2366924187089, 629.9244090709144, 633.9049142628596, 15117.47088851896, 15164.469243576532, 15197.316120774592, 15214.847851521565, 15259.694806103817, 15040.849591504055, 15085.0, 15088.321025553767, 15213.695726085527, 15235.771463428058, 12260.0804939629, 12262.386880655931, 12308.454261799865, 12375.504979800797, 12787.0, 3723.2925744108534, 3737.663610275088, 3767.077066118791, 3796.5633952095586, 3843.423486477023, 79703.6014819928, 82633.0, 82812.58593706993, 83229.16770832274, 84041.57979210126, 10771.084457821016, 10780.622678206226, 10885.782284354269, 10973.3964631946, 11177.944110279559, 21156.78843211579, 21167.364979050653, 21239.150433982777, 21278.574428511343, 21301.0, 7810.648520816463, 7835.764927052198, 7855.057393112749, 8055.959720201478, 8160.591970401456, 4418.469783625986, 4447.332900064951, 4483.08096840147, 4527.479339875957, 4578.221702310549, 3379.2396710740377, 3524.7356448266482, 3529.8941031769086, 3540.592831824322, 3548.503209550665, 632.6141053957083, 646.0857886091222, 646.7897933171644, 667.2293501006345, 692.6121372031679, 678.8268991407258, 686.5160062156168, 691.4261163234503, 700.2087640965779, 702.6276073680957, 9125.954370228106, 9142.634294628273, 9556.655121227115, 9578.521073946275, 9678.012879484904, 615.8737458821021, 662.774656616743, 666.3103687683224, 692.1659400422479, 703.261575345895, 4495.348174514677, 4630.675852690347, 4635.397398338262, 4782.665213435026, 4849.830255941025, 102199.489002556, 125656.0, 128925.35537322253, 129084.0, 129703.0, 70887.64556177186, 109192.0, 110373.0, 111942.44028779805, 114793.0, 92117.5394123025, 95448.0, 98105.5094724536, 99232.5038374818, 102174.0, 8644.740657780276, 8950.283977281932, 9112.134347237003, 9185.862212066691, 9275.62897484093, 54429.0, 55292.72353638206, 56023.0, 56275.0, 56566.0, 72377.0, 79404.20595794199, 79526.0, 81290.0, 82226.0, 11621.709457263636, 11680.883191167979, 11948.581799636971, 12016.63950081499, 12593.307368094842, 12983.805242921553, 13028.41372138237, 13097.934510327388, 13294.40175192138, 13414.865851341752, 11930.343831089373, 11963.0, 12309.507619695112, 12313.938430307791, 12669.619911402673, 11551.249168804, 12893.41979610901, 12982.091253612534, 13052.673683157996, 13469.730605388033, 10208.54061567246, 10911.127109831354, 10997.395143266876, 11239.60661376848, 11769.705757356134, 10854.45727713627, 11180.552777888794, 11332.206745527734, 11425.542978280775, 11615.0, 10373.222008349554, 10552.577896884039, 11751.823722644338, 12003.339816310187, 12257.754844903231], "value": 7513.318816631004, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1515.4, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [106.0, 115.0, 113.0, 112.0, 113.0, 113.0, 112.0, 111.0, 112.0, 111.0], "value": 111.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [157.0, 124.0, 126.0, 176.0, 128.0, 125.0, 126.0, 126.0, 154.0, 127.0], "value": 136.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 165.0, 164.0, 174.0, 162.0, 162.0, 161.0, 160.0, 165.0, 165.0], "value": 163.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 76.0, 75.0, 116.0, 78.0, 76.0, 78.0, 77.0, 101.0, 79.0], "value": 83.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 82.0, 123.0, 82.0, 82.0, 82.0, 105.0, 83.0, 83.0, 126.0], "value": 93.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 117.0, 118.0, 118.0, 120.0, 118.0, 117.0, 121.0, 119.0], "value": 118.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 147.0, 146.0, 146.0, 148.0, 148.0, 147.0, 146.0, 149.0], "value": 147.1, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 85.0, 85.0, 86.0, 85.0, 86.0, 86.0, 85.0, 86.0, 85.0], "value": 85.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 56.0, 54.0, 56.0, 56.0, 59.0, 56.0, 56.0, 56.0, 57.0], "value": 56.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 60.0, 60.0, 59.0, 59.0, 59.0, 59.0, 61.0, 59.0, 59.0], "value": 59.7, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 81.0, 82.0, 81.0, 82.0, 85.0, 81.0, 80.0, 83.0, 80.0], "value": 81.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [153.0, 147.0, 131.0, 132.0, 130.0, 135.0, 136.0, 140.0, 171.0, 142.0], "value": 141.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [170.0, 168.0, 167.0, 172.0, 168.0, 167.0, 173.0, 172.0, 171.0, 169.0], "value": 169.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 66.0, 67.0, 68.0, 66.0, 67.0, 66.0, 66.0, 65.0, 68.0], "value": 66.7, "unit": "score"}]}]} 13:04:54 INFO - Return code: 0 13:04:54 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 13:04:54 ERROR - # TBPL SUCCESS # 13:04:54 INFO - Running post-action listener: _resource_record_post_action 13:04:54 INFO - [mozharness: 2016-10-14 20:04:54.990618Z] Finished run-tests step (success) 13:04:54 INFO - Running post-run listener: _resource_record_post_run 13:04:55 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 491520; Write bytes: 392863744; Read time: 32; Write time: 343180 13:04:55 INFO - TinderboxPrint: CPU usage
13.5% 13:04:55 INFO - TinderboxPrint: I/O read bytes / time
491,520 / 32 13:04:55 INFO - TinderboxPrint: I/O write bytes / time
392,863,744 / 343,180 13:04:55 INFO - TinderboxPrint: CPU idle
8,254.2 (86.5%) 13:04:55 INFO - TinderboxPrint: CPU user
1,219.6 (12.8%) 13:04:55 INFO - TinderboxPrint: Swap in / out
0 / 0 13:04:55 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 103854080; Read time: 0; Write time: 120256 13:04:55 INFO - run-tests - Wall time: 1179s; CPU: 13.0%; Read bytes: 491520; Write bytes: 289009664; Read time: 32; Write time: 222924 13:04:55 INFO - Running post-run listener: _upload_blobber_files 13:04:55 INFO - Blob upload gear active. 13:04:55 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 13:04:55 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 13:04:55 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', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 13:04:55 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 -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 13:04:56 INFO - (blobuploader) - INFO - Open directory for files ... 13:04:56 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 13:04:56 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:04:56 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:04:56 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 13:04:56 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:04:56 INFO - (blobuploader) - INFO - Done attempting. 13:04:56 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 13:04:56 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:04:56 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:05:00 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 13:05:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:05:00 INFO - (blobuploader) - INFO - Done attempting. 13:05:00 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 13:05:00 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:05:00 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:05:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 13:05:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:05:01 INFO - (blobuploader) - INFO - Done attempting. 13:05:01 INFO - (blobuploader) - INFO - Iteration through files over. 13:05:01 INFO - Return code: 0 13:05:01 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 13:05:01 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 13:05:01 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/8d4bf90efedb349c78359f9400a8811c2d9df0f685a2de6c996ebe9246e70344ed7ac9f69eae1e93bbecbd095599aa4d496d3e1c811aa8f871904820f525a224", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/1fcd2e88469b490bce526bedddb640e52d16132dccb8618b1ed93dbd2f606d24f71f6c749f5ba6327eaa4ec274edbd2f676b792d107c0dbbd8befc5fe9d860aa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/946db36ca0dd8439d816c3bfdaaa3eb3d975caf16b5b60637105be1a9ee82c680cbb4f50c29fc11656bf100cd65bb2993a4ba12dba30a43770675d29d8cc7b61"} 13:05:01 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 13:05:01 INFO - Writing to file /builds/slave/test/properties/blobber_files 13:05:01 INFO - Contents: 13:05:01 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/8d4bf90efedb349c78359f9400a8811c2d9df0f685a2de6c996ebe9246e70344ed7ac9f69eae1e93bbecbd095599aa4d496d3e1c811aa8f871904820f525a224", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/1fcd2e88469b490bce526bedddb640e52d16132dccb8618b1ed93dbd2f606d24f71f6c749f5ba6327eaa4ec274edbd2f676b792d107c0dbbd8befc5fe9d860aa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/946db36ca0dd8439d816c3bfdaaa3eb3d975caf16b5b60637105be1a9ee82c680cbb4f50c29fc11656bf100cd65bb2993a4ba12dba30a43770675d29d8cc7b61"} 13:05:01 INFO - Running post-run listener: copy_logs_to_upload_dir 13:05:01 INFO - Copying logs to upload dir... 13:05:01 INFO - mkdir: /builds/slave/test/build/upload/logs 13:05:01 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1236.684439 ========= master_lag: -0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-10-14 13:05:01.402405) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-14 13:05:01.405607) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/8d4bf90efedb349c78359f9400a8811c2d9df0f685a2de6c996ebe9246e70344ed7ac9f69eae1e93bbecbd095599aa4d496d3e1c811aa8f871904820f525a224", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/1fcd2e88469b490bce526bedddb640e52d16132dccb8618b1ed93dbd2f606d24f71f6c749f5ba6327eaa4ec274edbd2f676b792d107c0dbbd8befc5fe9d860aa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/946db36ca0dd8439d816c3bfdaaa3eb3d975caf16b5b60637105be1a9ee82c680cbb4f50c29fc11656bf100cd65bb2993a4ba12dba30a43770675d29d8cc7b61"} build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011353 build_url: 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/autoland-linux64-pgo/1476462607/firefox-52.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/8d4bf90efedb349c78359f9400a8811c2d9df0f685a2de6c996ebe9246e70344ed7ac9f69eae1e93bbecbd095599aa4d496d3e1c811aa8f871904820f525a224", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/1fcd2e88469b490bce526bedddb640e52d16132dccb8618b1ed93dbd2f606d24f71f6c749f5ba6327eaa4ec274edbd2f676b792d107c0dbbd8befc5fe9d860aa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/946db36ca0dd8439d816c3bfdaaa3eb3d975caf16b5b60637105be1a9ee82c680cbb4f50c29fc11656bf100cd65bb2993a4ba12dba30a43770675d29d8cc7b61"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-14 13:05:01.431741) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 13:05:01.432063) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1476474262.888105-1141416525 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004403 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 13:05:01.515217) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-14 13:05:01.515519) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-14 13:05:01.515827) ========= ========= Total master_lag: 0.15 =========