builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-050 starttime: 1462388281.36 results: success (0) buildid: 20160504112038 builduid: 6cad1eaef6bb4aa1b789022806161b7b revision: 680574fb36ff4b2c2db6db577aba77d56b8f81d6 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-05-04 11:58:01.358434) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-05-04 11:58:01.358902) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-04 11:58:01.359191) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-05-04 11:58:01.372185) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-04 11:58:01.372476) ========= 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=6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-05-04 11:58:02-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 207M=0s 2016-05-04 11:58:02 (207 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.093766 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-04 11:58:01.478422) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-04 11:58:01.478755) ========= 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=6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020898 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-05-04 11:58:01.528570) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-04 11:58:01.528939) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 680574fb36ff4b2c2db6db577aba77d56b8f81d6 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 680574fb36ff4b2c2db6db577aba77d56b8f81d6 --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=6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-05-04 11:58:02,584 truncating revision to first 12 chars 2016-05-04 11:58:02,584 Setting DEBUG logging. 2016-05-04 11:58:02,584 attempt 1/10 2016-05-04 11:58:02,584 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/680574fb36ff?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-05-04 11:58:02,842 unpacking tar archive at: fx-team-680574fb36ff/testing/mozharness/ program finished with exit code 0 elapsedTime=0.543069 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-05-04 11:58:02.084781) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-04 11:58:02.085102) ========= script_repo_revision: 680574fb36ff4b2c2db6db577aba77d56b8f81d6 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-05-04 11:58:02.085516) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-04 11:58:02.085783) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-05-04 11:58:02.096353) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 35 mins, 35 secs) (at 2016-05-04 11:58:02.096766) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:58:03 INFO - MultiFileLogger online at 20160504 11:58:03 in /builds/slave/test 11:58:03 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 11:58:03 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 11:58:03 INFO - {'append_to_log': False, 11:58:03 INFO - 'base_work_dir': '/builds/slave/test', 11:58:03 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 11:58:03 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 11:58:03 INFO - 'branch': 'Fx-Team-Non-PGO', 11:58:03 INFO - 'buildbot_json_path': 'buildprops.json', 11:58:03 INFO - 'config_files': ('talos/linux_config.py',), 11:58:03 INFO - 'default_actions': ('clobber', 11:58:03 INFO - 'read-buildbot-config', 11:58:03 INFO - 'download-and-extract', 11:58:03 INFO - 'populate-webroot', 11:58:03 INFO - 'create-virtualenv', 11:58:03 INFO - 'install', 11:58:03 INFO - 'run-tests'), 11:58:03 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:58:03 INFO - 'download_minidump_stackwalk': True, 11:58:03 INFO - 'download_symbols': 'ondemand', 11:58:03 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:58:03 INFO - 'tooltool.py': '/tools/tooltool.py', 11:58:03 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:58:03 INFO - '/tools/misc-python/virtualenv.py')}, 11:58:03 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:58:03 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:58:03 INFO - 'installer_path': 'installer.exe', 11:58:03 INFO - 'log_level': 'info', 11:58:03 INFO - 'log_name': 'talos', 11:58:03 INFO - 'log_to_console': True, 11:58:03 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:58:03 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:58:03 INFO - 'opt_config_files': (), 11:58:03 INFO - 'pip_index': False, 11:58:03 INFO - 'sps_profile': False, 11:58:03 INFO - 'sps_profile_interval': 0, 11:58:03 INFO - 'suite': 'dromaeojs-e10s', 11:58:03 INFO - 'system_bits': '32', 11:58:03 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:58:03 INFO - 'title': 'talos-linux64-ix-050', 11:58:03 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:58:03 INFO - 'use_talos_json': True, 11:58:03 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 11:58:03 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:58:03 INFO - 'work_dir': 'build'} 11:58:03 INFO - ##### 11:58:03 INFO - ##### Running clobber step. 11:58:03 INFO - ##### 11:58:03 INFO - Running pre-action listener: _resource_record_pre_action 11:58:03 INFO - Running main action method: clobber 11:58:03 INFO - rmtree: /builds/slave/test/build 11:58:03 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 11:58:04 INFO - Running post-action listener: _resource_record_post_action 11:58:04 INFO - ##### 11:58:04 INFO - ##### Running read-buildbot-config step. 11:58:04 INFO - ##### 11:58:04 INFO - Running pre-action listener: _resource_record_pre_action 11:58:04 INFO - Running main action method: read_buildbot_config 11:58:04 INFO - Using buildbot properties: 11:58:04 INFO - { 11:58:04 INFO - "project": "", 11:58:04 INFO - "product": "firefox", 11:58:04 INFO - "script_repo_revision": "production", 11:58:04 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 11:58:04 INFO - "repository": "", 11:58:04 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 11:58:04 INFO - "buildid": "20160504112038", 11:58:04 INFO - "pgo_build": "False", 11:58:04 INFO - "basedir": "/builds/slave/test", 11:58:04 INFO - "buildnumber": 1241, 11:58:04 INFO - "slavename": "talos-linux64-ix-050", 11:58:04 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 11:58:04 INFO - "platform": "ubuntu64_hw", 11:58:04 INFO - "scheduler": "tests-fx-team-linux64-talos", 11:58:04 INFO - "branch": "fx-team", 11:58:04 INFO - "repo_path": "integration/fx-team", 11:58:04 INFO - "revision": "680574fb36ff4b2c2db6db577aba77d56b8f81d6", 11:58:04 INFO - "stage_platform": "linux64", 11:58:04 INFO - "builduid": "6cad1eaef6bb4aa1b789022806161b7b", 11:58:04 INFO - "slavebuilddir": "test" 11:58:04 INFO - } 11:58:04 INFO - Found installer url https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2. 11:58:04 INFO - Running post-action listener: _resource_record_post_action 11:58:04 INFO - ##### 11:58:04 INFO - ##### Running download-and-extract step. 11:58:04 INFO - ##### 11:58:04 INFO - Running pre-action listener: _resource_record_pre_action 11:58:04 INFO - Running main action method: download_and_extract 11:58:04 INFO - mkdir: /builds/slave/test/build/tests 11:58:04 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:58:04 INFO - https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 11:58:04 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 11:58:04 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 11:58:04 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 11:58:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 11:58:34 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json: timed out 11:58:34 INFO - retry: attempt #1 caught exception: timed out 11:58:34 INFO - retry: Failed, sleeping 30 seconds before retrying 11:59:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #2 11:59:34 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json: timed out 11:59:34 INFO - retry: attempt #2 caught exception: timed out 11:59:34 INFO - retry: Failed, sleeping 60 seconds before retrying 12:00:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #3 12:01:04 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json: timed out 12:01:04 INFO - retry: attempt #3 caught exception: timed out 12:01:04 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json! 12:01:04 INFO - Caught exception: timed out 12:01:04 INFO - Caught exception: timed out 12:01:04 INFO - Caught exception: timed out 12:01:04 INFO - trying https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 12:01:04 INFO - Downloading https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 12:01:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 12:01:06 INFO - Downloaded 1361 bytes. 12:01:06 INFO - Reading from file /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 12:01:06 INFO - Using the following test package requirements: 12:01:06 INFO - {u'common': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 12:01:06 INFO - u'cppunittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 12:01:06 INFO - u'firefox-49.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 12:01:06 INFO - u'gtest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 12:01:06 INFO - u'firefox-49.0a1.en-US.linux-x86_64.gtest.tests.zip'], 12:01:06 INFO - u'jittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 12:01:06 INFO - u'jsshell-linux-x86_64.zip'], 12:01:06 INFO - u'mochitest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 12:01:06 INFO - u'firefox-49.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 12:01:06 INFO - u'mozbase': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 12:01:06 INFO - u'reftest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 12:01:06 INFO - u'firefox-49.0a1.en-US.linux-x86_64.reftest.tests.zip'], 12:01:06 INFO - u'talos': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 12:01:06 INFO - u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'], 12:01:06 INFO - u'web-platform': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 12:01:06 INFO - u'firefox-49.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 12:01:06 INFO - u'xpcshell': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 12:01:06 INFO - u'firefox-49.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 12:01:06 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 12:01:06 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:01:06 INFO - https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 12:01:06 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 12:01:06 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 12:01:06 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 12:01:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:01:36 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip: timed out 12:01:36 INFO - retry: attempt #1 caught exception: timed out 12:01:36 INFO - retry: Failed, sleeping 30 seconds before retrying 12:02:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #2 12:02:36 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip: timed out 12:02:36 INFO - retry: attempt #2 caught exception: timed out 12:02:36 INFO - retry: Failed, sleeping 60 seconds before retrying 12:03:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #3 12:04:06 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip: timed out 12:04:06 INFO - retry: attempt #3 caught exception: timed out 12:04:06 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip! 12:04:06 INFO - Caught exception: timed out 12:04:06 INFO - Caught exception: timed out 12:04:06 INFO - Caught exception: timed out 12:04:06 INFO - trying https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 12:04:06 INFO - Downloading https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 12:04:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:04:07 INFO - Downloaded 22307347 bytes. 12:04:07 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 12:04:07 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 12:04:08 INFO - Return code: 0 12:04:08 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 12:04:08 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:04:08 INFO - https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 12:04:08 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 12:04:08 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 12:04:08 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 12:04:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:04:38 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip: timed out 12:04:38 INFO - retry: attempt #1 caught exception: timed out 12:04:38 INFO - retry: Failed, sleeping 30 seconds before retrying 12:05:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #2 12:05:38 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip: timed out 12:05:38 INFO - retry: attempt #2 caught exception: timed out 12:05:38 INFO - retry: Failed, sleeping 60 seconds before retrying 12:06:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #3 12:07:08 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip: timed out 12:07:08 INFO - retry: attempt #3 caught exception: timed out 12:07:08 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip! 12:07:08 INFO - Caught exception: timed out 12:07:08 INFO - Caught exception: timed out 12:07:08 INFO - Caught exception: timed out 12:07:08 INFO - trying https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 12:07:08 INFO - Downloading https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 12:07:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:07:09 INFO - Downloaded 22307347 bytes. 12:07:09 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 12:07:09 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 12:07:11 INFO - Return code: 0 12:07:11 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:07:11 INFO - https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 12:07:11 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 12:07:11 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 12:07:11 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 12:07:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 12:07:41 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip: timed out 12:07:41 INFO - retry: attempt #1 caught exception: timed out 12:07:41 INFO - retry: Failed, sleeping 30 seconds before retrying 12:08:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #2 12:08:41 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip: timed out 12:08:41 INFO - retry: attempt #2 caught exception: timed out 12:08:41 INFO - retry: Failed, sleeping 60 seconds before retrying 12:09:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #3 12:10:11 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip: timed out 12:10:11 INFO - retry: attempt #3 caught exception: timed out 12:10:11 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip! 12:10:11 INFO - Caught exception: timed out 12:10:11 INFO - Caught exception: timed out 12:10:11 INFO - Caught exception: timed out 12:10:11 INFO - trying https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 12:10:11 INFO - Downloading https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 12:10:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 12:10:12 INFO - Downloaded 10840152 bytes. 12:10:12 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 12:10:12 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 12:10:12 INFO - Return code: 0 12:10:12 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:10:12 INFO - https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 12:10:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 12:10:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 12:10:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 12:10:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 12:10:42 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2: timed out 12:10:42 INFO - retry: attempt #1 caught exception: timed out 12:10:42 INFO - retry: Failed, sleeping 30 seconds before retrying 12:11:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #2 12:11:42 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2: timed out 12:11:42 INFO - retry: attempt #2 caught exception: timed out 12:11:42 INFO - retry: Failed, sleeping 60 seconds before retrying 12:12:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #3 12:13:12 WARNING - Timed out accessing http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2: timed out 12:13:12 INFO - retry: attempt #3 caught exception: timed out 12:13:12 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2! 12:13:12 INFO - Caught exception: timed out 12:13:12 INFO - Caught exception: timed out 12:13:12 INFO - Caught exception: timed out 12:13:12 INFO - trying https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 12:13:12 INFO - Downloading https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 12:13:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 12:13:13 INFO - Downloaded 54870114 bytes. 12:13:13 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 12:13:13 INFO - mkdir: /builds/slave/test/properties 12:13:13 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 12:13:13 INFO - Writing to file /builds/slave/test/properties/build_url 12:13:13 INFO - Contents: 12:13:13 INFO - build_url:https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 12:13:14 INFO - Running post-action listener: _resource_record_post_action 12:13:14 INFO - Running post-action listener: set_extra_try_arguments 12:13:14 INFO - ##### 12:13:14 INFO - ##### Running populate-webroot step. 12:13:14 INFO - ##### 12:13:14 INFO - Running pre-action listener: _resource_record_pre_action 12:13:14 INFO - Running main action method: populate_webroot 12:13:14 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 12:13:14 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 12:13:14 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 12:13:14 INFO - '--tppagecycles', 12:13:14 INFO - '7'], 12:13:14 INFO - 'tests': ['tsvgm']}}, 12:13:14 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 12:13:14 INFO - 'tests': ['tresize', 'tcanvasmark']}, 12:13:14 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 12:13:14 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 12:13:14 INFO - 'tests': ['dromaeo_css', 'kraken']}, 12:13:14 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 12:13:14 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:14 INFO - 'talos_options': ['--disable-e10s'], 12:13:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:13:14 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:13:14 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:14 INFO - 'talos_options': ['--disable-e10s'], 12:13:14 INFO - 'tests': ['damp', 'tps']}, 12:13:14 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:14 INFO - 'tests': ['damp', 'tps']}, 12:13:14 INFO - 'g3': {'talos_options': ['--disable-e10s'], 12:13:14 INFO - 'tests': ['dromaeo_dom']}, 12:13:14 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 12:13:14 INFO - 'other': {'talos_options': ['--disable-e10s'], 12:13:14 INFO - 'tests': ['a11yr', 12:13:14 INFO - 'ts_paint', 12:13:14 INFO - 'tpaint', 12:13:14 INFO - 'sessionrestore', 12:13:14 INFO - 'sessionrestore_no_auto_restore', 12:13:14 INFO - 'tabpaint']}, 12:13:14 INFO - 'other-e10s': {'tests': ['a11yr', 12:13:14 INFO - 'ts_paint', 12:13:14 INFO - 'tpaint', 12:13:14 INFO - 'sessionrestore', 12:13:14 INFO - 'sessionrestore_no_auto_restore', 12:13:14 INFO - 'tabpaint']}, 12:13:14 INFO - 'other-e10s_l64': {'tests': ['a11yr', 12:13:14 INFO - 'ts_paint', 12:13:14 INFO - 'tpaint', 12:13:14 INFO - 'sessionrestore', 12:13:14 INFO - 'sessionrestore_no_auto_restore', 12:13:14 INFO - 'tabpaint']}, 12:13:14 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 12:13:14 INFO - 'ts_paint', 12:13:14 INFO - 'tpaint', 12:13:14 INFO - 'sessionrestore', 12:13:14 INFO - 'sessionrestore_no_auto_restore', 12:13:14 INFO - 'tabpaint']}, 12:13:14 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 12:13:14 INFO - 'tests': ['a11yr', 12:13:14 INFO - 'ts_paint', 12:13:14 INFO - 'tpaint', 12:13:14 INFO - 'sessionrestore', 12:13:14 INFO - 'sessionrestore_no_auto_restore', 12:13:14 INFO - 'tabpaint']}, 12:13:14 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 12:13:14 INFO - 'tests': ['a11yr', 12:13:14 INFO - 'ts_paint', 12:13:14 INFO - 'tpaint', 12:13:14 INFO - 'sessionrestore', 12:13:14 INFO - 'sessionrestore_no_auto_restore', 12:13:14 INFO - 'tabpaint']}, 12:13:14 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 12:13:14 INFO - 'tests': ['tsvgx', 12:13:14 INFO - 'tsvgr_opacity', 12:13:14 INFO - 'tart', 12:13:14 INFO - 'tscrollx', 12:13:14 INFO - 'cart']}, 12:13:14 INFO - 'svgr-e10s': {'tests': ['tsvgx', 12:13:14 INFO - 'tsvgr_opacity', 12:13:14 INFO - 'tart', 12:13:14 INFO - 'tscrollx', 12:13:14 INFO - 'cart']}, 12:13:14 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:14 INFO - 'talos_options': ['--disable-e10s'], 12:13:14 INFO - 'tests': ['tp5o']}, 12:13:14 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:14 INFO - 'tests': ['tp5o']}, 12:13:14 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:14 INFO - 'talos_options': ['--disable-e10s', 12:13:14 INFO - '--xperf_path', 12:13:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:13:14 INFO - 'tests': ['tp5n']}, 12:13:14 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:13:14 INFO - 'talos_options': ['--xperf_path', 12:13:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:13:14 INFO - 'tests': ['tp5n']}}, 12:13:14 INFO - 'talos.zip': {'path': '', 12:13:14 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 12:13:14 INFO - Running post-action listener: _resource_record_post_action 12:13:14 INFO - ##### 12:13:14 INFO - ##### Running create-virtualenv step. 12:13:14 INFO - ##### 12:13:14 INFO - Running pre-action listener: _resource_record_pre_action 12:13:14 INFO - Running main action method: create_virtualenv 12:13:14 INFO - Creating virtualenv /builds/slave/test/build/venv 12:13:14 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:13:14 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 12:13:14 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 12:13:14 INFO - Using real prefix '/usr' 12:13:14 INFO - New python executable in /builds/slave/test/build/venv/bin/python 12:13:15 INFO - Installing distribute.............................................................................................................................................................................................done. 12:13:17 INFO - Installing pip.................done. 12:13:17 INFO - Return code: 0 12:13:17 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 12:13:17 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:17 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:17 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 0x7fd180261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16418a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x170c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x179b410>, '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 0x179c310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x179c7a0>, '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': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', '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:13:17 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:13:17 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:13:17 INFO - Using env: {'DISPLAY': ':0', 12:13:17 INFO - 'HOME': '/home/cltbld', 12:13:17 INFO - 'LANG': 'en_US.UTF-8', 12:13:17 INFO - 'LANGUAGE': 'en_US:en', 12:13:17 INFO - 'LOGNAME': 'cltbld', 12:13:17 INFO - 'MAIL': '/var/mail/cltbld', 12:13:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:17 INFO - 'MOZ_NO_REMOTE': '1', 12:13:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:17 INFO - 'NO_EM_RESTART': '1', 12:13:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:17 INFO - 'PWD': '/builds/slave/test', 12:13:17 INFO - 'SHELL': '/bin/bash', 12:13:17 INFO - 'SHLVL': '1', 12:13:17 INFO - 'TERM': 'linux', 12:13:17 INFO - 'TMOUT': '86400', 12:13:17 INFO - 'USER': 'cltbld', 12:13:17 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', 12:13:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:17 INFO - '_': '/tools/buildbot/bin/python'} 12:13:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:17 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:13:17 INFO - Cleaning up... 12:13:17 INFO - Return code: 0 12:13:17 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 12:13:17 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:17 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:17 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>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd180261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16418a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x170c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x179b410>, '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 0x179c310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x179c7a0>, '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': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', '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:13:17 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>=0.7.1'] in /builds/slave/test/build 12:13:17 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>=0.7.1 12:13:17 INFO - Using env: {'DISPLAY': ':0', 12:13:17 INFO - 'HOME': '/home/cltbld', 12:13:17 INFO - 'LANG': 'en_US.UTF-8', 12:13:17 INFO - 'LANGUAGE': 'en_US:en', 12:13:17 INFO - 'LOGNAME': 'cltbld', 12:13:17 INFO - 'MAIL': '/var/mail/cltbld', 12:13:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:17 INFO - 'MOZ_NO_REMOTE': '1', 12:13:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:17 INFO - 'NO_EM_RESTART': '1', 12:13:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:17 INFO - 'PWD': '/builds/slave/test', 12:13:17 INFO - 'SHELL': '/bin/bash', 12:13:17 INFO - 'SHLVL': '1', 12:13:17 INFO - 'TERM': 'linux', 12:13:17 INFO - 'TMOUT': '86400', 12:13:17 INFO - 'USER': 'cltbld', 12:13:17 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', 12:13:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:17 INFO - '_': '/tools/buildbot/bin/python'} 12:13:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:17 INFO - Downloading/unpacking psutil>=0.7.1 12:13:17 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:13:17 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:13:17 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:13:17 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:13:17 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:13:17 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:13:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 12:13:19 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:13:19 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:13:19 INFO - Installing collected packages: psutil 12:13:19 INFO - Running setup.py install for psutil 12:13:19 INFO - building 'psutil._psutil_linux' extension 12:13:19 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:13:19 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:13:19 INFO - building 'psutil._psutil_posix' extension 12:13:19 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:13:19 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:13:20 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:13:20 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:13:20 INFO - Successfully installed psutil 12:13:20 INFO - Cleaning up... 12:13:20 INFO - Return code: 0 12:13:20 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 12:13:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:20 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd180261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16418a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x170c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x179b410>, '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 0x179c310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x179c7a0>, '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': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', '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:13:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 12:13:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 12:13:20 INFO - Using env: {'DISPLAY': ':0', 12:13:20 INFO - 'HOME': '/home/cltbld', 12:13:20 INFO - 'LANG': 'en_US.UTF-8', 12:13:20 INFO - 'LANGUAGE': 'en_US:en', 12:13:20 INFO - 'LOGNAME': 'cltbld', 12:13:20 INFO - 'MAIL': '/var/mail/cltbld', 12:13:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:20 INFO - 'MOZ_NO_REMOTE': '1', 12:13:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:20 INFO - 'NO_EM_RESTART': '1', 12:13:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:20 INFO - 'PWD': '/builds/slave/test', 12:13:20 INFO - 'SHELL': '/bin/bash', 12:13:20 INFO - 'SHLVL': '1', 12:13:20 INFO - 'TERM': 'linux', 12:13:20 INFO - 'TMOUT': '86400', 12:13:20 INFO - 'USER': 'cltbld', 12:13:20 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', 12:13:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:20 INFO - '_': '/tools/buildbot/bin/python'} 12:13:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:20 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 12:13:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:22 INFO - Downloading mozsystemmonitor-0.0.tar.gz 12:13:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 12:13:22 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 12:13:22 INFO - Installing collected packages: mozsystemmonitor 12:13:22 INFO - Running setup.py install for mozsystemmonitor 12:13:22 INFO - Successfully installed mozsystemmonitor 12:13:22 INFO - Cleaning up... 12:13:22 INFO - Return code: 0 12:13:22 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 12:13:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:22 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 0x7fd180261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16418a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x170c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x179b410>, '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 0x179c310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x179c7a0>, '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': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', '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:13:22 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:13:22 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:13:22 INFO - Using env: {'DISPLAY': ':0', 12:13:22 INFO - 'HOME': '/home/cltbld', 12:13:22 INFO - 'LANG': 'en_US.UTF-8', 12:13:22 INFO - 'LANGUAGE': 'en_US:en', 12:13:22 INFO - 'LOGNAME': 'cltbld', 12:13:22 INFO - 'MAIL': '/var/mail/cltbld', 12:13:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:22 INFO - 'MOZ_NO_REMOTE': '1', 12:13:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:22 INFO - 'NO_EM_RESTART': '1', 12:13:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:22 INFO - 'PWD': '/builds/slave/test', 12:13:22 INFO - 'SHELL': '/bin/bash', 12:13:22 INFO - 'SHLVL': '1', 12:13:22 INFO - 'TERM': 'linux', 12:13:22 INFO - 'TMOUT': '86400', 12:13:22 INFO - 'USER': 'cltbld', 12:13:22 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', 12:13:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:22 INFO - '_': '/tools/buildbot/bin/python'} 12:13:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:22 INFO - Downloading/unpacking blobuploader==1.2.4 12:13:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:22 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:13:22 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:13:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:24 INFO - Downloading blobuploader-1.2.4.tar.gz 12:13:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 12:13:24 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:13:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:24 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:24 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 12:13:24 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:13:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:24 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:24 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:25 INFO - Downloading docopt-0.6.1.tar.gz 12:13:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 12:13:25 INFO - Installing collected packages: blobuploader, requests, docopt 12:13:25 INFO - Running setup.py install for blobuploader 12:13:25 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 12:13:25 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 12:13:25 INFO - Running setup.py install for requests 12:13:25 INFO - Running setup.py install for docopt 12:13:25 INFO - Successfully installed blobuploader requests docopt 12:13:25 INFO - Cleaning up... 12:13:25 INFO - Return code: 0 12:13:25 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:13: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:25 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 0x7fd180261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16418a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x170c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x179b410>, '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 0x179c310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x179c7a0>, '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': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', '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:13:25 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:13:25 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:13:25 INFO - Using env: {'DISPLAY': ':0', 12:13:25 INFO - 'HOME': '/home/cltbld', 12:13:25 INFO - 'LANG': 'en_US.UTF-8', 12:13:25 INFO - 'LANGUAGE': 'en_US:en', 12:13:25 INFO - 'LOGNAME': 'cltbld', 12:13:25 INFO - 'MAIL': '/var/mail/cltbld', 12:13:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:25 INFO - 'MOZ_NO_REMOTE': '1', 12:13:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:25 INFO - 'NO_EM_RESTART': '1', 12:13:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:25 INFO - 'PWD': '/builds/slave/test', 12:13:25 INFO - 'SHELL': '/bin/bash', 12:13:25 INFO - 'SHLVL': '1', 12:13:25 INFO - 'TERM': 'linux', 12:13:25 INFO - 'TMOUT': '86400', 12:13:25 INFO - 'USER': 'cltbld', 12:13:25 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', 12:13:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:25 INFO - '_': '/tools/buildbot/bin/python'} 12:13:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:13:26 INFO - Running setup.py (path:/tmp/pip-vIZhnu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:13:26 INFO - Running setup.py (path:/tmp/pip-LBa73I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:13:26 INFO - Running setup.py (path:/tmp/pip-rIPfVZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:13:26 INFO - Running setup.py (path:/tmp/pip-iYfkMp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:13:26 INFO - Running setup.py (path:/tmp/pip-nqoDAh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:13:26 INFO - Running setup.py (path:/tmp/pip-VlyAYN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:13:26 INFO - Running setup.py (path:/tmp/pip-pY8f8q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:13:26 INFO - Running setup.py (path:/tmp/pip-ZerHRh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:13:26 INFO - Running setup.py (path:/tmp/pip-Wrtddh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:13:26 INFO - Running setup.py (path:/tmp/pip-OsrALf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:13:26 INFO - Running setup.py (path:/tmp/pip-8k70b8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:13:26 INFO - Running setup.py (path:/tmp/pip-D_eXe8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:13:26 INFO - Running setup.py (path:/tmp/pip-5MehQ8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:13:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:13:27 INFO - Running setup.py (path:/tmp/pip-KfBaJb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:13:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:13:27 INFO - Running setup.py (path:/tmp/pip-OuJeza-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:13:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:13:27 INFO - Running setup.py (path:/tmp/pip-OEJRa6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:13:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:13:27 INFO - Running setup.py (path:/tmp/pip-lUHV8U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:13:27 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:13:27 INFO - Running setup.py install for manifestparser 12:13:27 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 12:13:27 INFO - Running setup.py install for mozcrash 12:13:27 INFO - Running setup.py install for mozdebug 12:13:27 INFO - Running setup.py install for mozdevice 12:13:27 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 12:13:27 INFO - Installing dm script to /builds/slave/test/build/venv/bin 12:13:27 INFO - Running setup.py install for mozfile 12:13:27 INFO - Running setup.py install for mozhttpd 12:13:27 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 12:13:27 INFO - Running setup.py install for mozinfo 12:13:28 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 12:13:28 INFO - Running setup.py install for mozInstall 12:13:28 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 12:13:28 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 12:13:28 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 12:13:28 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 12:13:28 INFO - Running setup.py install for mozleak 12:13:28 INFO - Running setup.py install for mozlog 12:13:28 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 12:13:28 INFO - Running setup.py install for moznetwork 12:13:28 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 12:13:28 INFO - Running setup.py install for mozprocess 12:13:28 INFO - Running setup.py install for mozprofile 12:13:28 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 12:13:28 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 12:13:28 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 12:13:28 INFO - Running setup.py install for mozrunner 12:13:28 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 12:13:28 INFO - Running setup.py install for mozscreenshot 12:13:28 INFO - Running setup.py install for moztest 12:13:29 INFO - Running setup.py install for mozversion 12:13:29 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 12:13:29 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:13:29 INFO - Cleaning up... 12:13:29 INFO - Return code: 0 12:13:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:13:29 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:29 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:29 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 0x7fd180261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16418a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x170c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x179b410>, '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 0x179c310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x179c7a0>, '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': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', '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:13:29 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:13:29 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:13:29 INFO - Using env: {'DISPLAY': ':0', 12:13:29 INFO - 'HOME': '/home/cltbld', 12:13:29 INFO - 'LANG': 'en_US.UTF-8', 12:13:29 INFO - 'LANGUAGE': 'en_US:en', 12:13:29 INFO - 'LOGNAME': 'cltbld', 12:13:29 INFO - 'MAIL': '/var/mail/cltbld', 12:13:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:29 INFO - 'MOZ_NO_REMOTE': '1', 12:13:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:29 INFO - 'NO_EM_RESTART': '1', 12:13:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:29 INFO - 'PWD': '/builds/slave/test', 12:13:29 INFO - 'SHELL': '/bin/bash', 12:13:29 INFO - 'SHLVL': '1', 12:13:29 INFO - 'TERM': 'linux', 12:13:29 INFO - 'TMOUT': '86400', 12:13:29 INFO - 'USER': 'cltbld', 12:13:29 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', 12:13:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:29 INFO - '_': '/tools/buildbot/bin/python'} 12:13:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:13:29 INFO - Running setup.py (path:/tmp/pip-OwLes8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:13:29 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:13:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:13:29 INFO - Running setup.py (path:/tmp/pip-e51J2J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:13:29 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:13:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:13:29 INFO - Running setup.py (path:/tmp/pip-pnoYGY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:13:29 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:13:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:13:29 INFO - Running setup.py (path:/tmp/pip-FkXkC_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:13:29 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:13:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:13:29 INFO - Running setup.py (path:/tmp/pip-mIPA8R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:13:29 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:13:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:13:29 INFO - Running setup.py (path:/tmp/pip-q2izSF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:13:29 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:13:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:13:29 INFO - Running setup.py (path:/tmp/pip-LwMopt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:13:29 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:13:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:13:29 INFO - Running setup.py (path:/tmp/pip-hf1sJJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:13:29 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:13:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:13:29 INFO - Running setup.py (path:/tmp/pip-dLYPXb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:13:30 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:13:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:13:30 INFO - Running setup.py (path:/tmp/pip-a3cE80-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:13:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 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:13:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:13:30 INFO - Running setup.py (path:/tmp/pip-TxbuIW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:13:30 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:13:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:13:30 INFO - Running setup.py (path:/tmp/pip-zdEY2m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:13:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 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:13:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:13:30 INFO - Running setup.py (path:/tmp/pip-ZNkHWV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:13:30 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:13:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:13:30 INFO - Running setup.py (path:/tmp/pip-PkHt_o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:13:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 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:13:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:13:30 INFO - Running setup.py (path:/tmp/pip-Yl1Yh7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:13:30 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:13:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:13:30 INFO - Running setup.py (path:/tmp/pip-HdLwoB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:13:30 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:13:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:13:30 INFO - Running setup.py (path:/tmp/pip-LJpwwG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:13:30 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:13:30 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:13:30 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:13:30 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:13:30 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:13:30 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:13:30 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:13:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:32 INFO - Downloading blessings-1.6.tar.gz 12:13:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 12:13:32 INFO - Installing collected packages: blessings 12:13:32 INFO - Running setup.py install for blessings 12:13:32 INFO - Successfully installed blessings 12:13:32 INFO - Cleaning up... 12:13:32 INFO - Return code: 0 12:13:32 INFO - Done creating virtualenv /builds/slave/test/build/venv. 12:13:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:13:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:13:32 INFO - Reading from file tmpfile_stdout 12:13:32 INFO - Current package versions: 12:13:32 INFO - argparse == 1.2.1 12:13:32 INFO - blessings == 1.6 12:13:32 INFO - blobuploader == 1.2.4 12:13:32 INFO - docopt == 0.6.1 12:13:32 INFO - manifestparser == 1.1 12:13:32 INFO - mozInstall == 1.12 12:13:32 INFO - mozcrash == 0.17 12:13:32 INFO - mozdebug == 0.1 12:13:32 INFO - mozdevice == 0.48 12:13:32 INFO - mozfile == 1.2 12:13:32 INFO - mozhttpd == 0.7 12:13:32 INFO - mozinfo == 0.9 12:13:32 INFO - mozleak == 0.1 12:13:32 INFO - mozlog == 3.1 12:13:32 INFO - moznetwork == 0.27 12:13:32 INFO - mozprocess == 0.22 12:13:32 INFO - mozprofile == 0.28 12:13:32 INFO - mozrunner == 6.11 12:13:32 INFO - mozscreenshot == 0.1 12:13:32 INFO - mozsystemmonitor == 0.0 12:13:32 INFO - moztest == 0.7 12:13:32 INFO - mozversion == 1.4 12:13:32 INFO - psutil == 3.1.1 12:13:32 INFO - requests == 1.2.3 12:13:32 INFO - wsgiref == 0.1.2 12:13:32 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:13:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:32 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 0x7fd180261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16418a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x170c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x179b410>, '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 0x179c310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x179c7a0>, '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': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', '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:13:32 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:13:32 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:13:32 INFO - Using env: {'DISPLAY': ':0', 12:13:32 INFO - 'HOME': '/home/cltbld', 12:13:32 INFO - 'LANG': 'en_US.UTF-8', 12:13:32 INFO - 'LANGUAGE': 'en_US:en', 12:13:32 INFO - 'LOGNAME': 'cltbld', 12:13:32 INFO - 'MAIL': '/var/mail/cltbld', 12:13:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:32 INFO - 'MOZ_NO_REMOTE': '1', 12:13:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:32 INFO - 'NO_EM_RESTART': '1', 12:13:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:32 INFO - 'PWD': '/builds/slave/test', 12:13:32 INFO - 'SHELL': '/bin/bash', 12:13:32 INFO - 'SHLVL': '1', 12:13:32 INFO - 'TERM': 'linux', 12:13:32 INFO - 'TMOUT': '86400', 12:13:32 INFO - 'USER': 'cltbld', 12:13:32 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', 12:13:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:32 INFO - '_': '/tools/buildbot/bin/python'} 12:13:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:33 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:13:33 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:13:33 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:13:33 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:13:33 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:13:33 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:13:33 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:13:33 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:13:33 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:13:33 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:13:33 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:13:33 INFO - Cleaning up... 12:13:33 INFO - Return code: 0 12:13:33 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 12:13:33 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:33 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:33 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 0x7fd180261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16418a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x170c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x179b410>, '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 0x179c310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x179c7a0>, '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': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', '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:13:33 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:13:33 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:13:33 INFO - Using env: {'DISPLAY': ':0', 12:13:33 INFO - 'HOME': '/home/cltbld', 12:13:33 INFO - 'LANG': 'en_US.UTF-8', 12:13:33 INFO - 'LANGUAGE': 'en_US:en', 12:13:33 INFO - 'LOGNAME': 'cltbld', 12:13:33 INFO - 'MAIL': '/var/mail/cltbld', 12:13:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:33 INFO - 'MOZ_NO_REMOTE': '1', 12:13:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:33 INFO - 'NO_EM_RESTART': '1', 12:13:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:33 INFO - 'PWD': '/builds/slave/test', 12:13:33 INFO - 'SHELL': '/bin/bash', 12:13:33 INFO - 'SHLVL': '1', 12:13:33 INFO - 'TERM': 'linux', 12:13:33 INFO - 'TMOUT': '86400', 12:13:33 INFO - 'USER': 'cltbld', 12:13:33 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', 12:13:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:33 INFO - '_': '/tools/buildbot/bin/python'} 12:13:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:33 INFO - Downloading/unpacking jsonschema 12:13:33 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:13:33 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:13:33 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:13:33 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:13:33 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:13:33 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:13:35 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:13:35 INFO - Downloading/unpacking functools32 (from jsonschema) 12:13:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:35 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:35 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:35 INFO - Downloading functools32-3.2.3-2.tar.gz 12:13:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 12:13:35 INFO - warning: no files found matching '*.txt' 12:13:35 INFO - no previously-included directories found matching 'build' 12:13:35 INFO - no previously-included directories found matching 'dist' 12:13:35 INFO - no previously-included directories found matching '.git*' 12:13:35 INFO - Installing collected packages: jsonschema, functools32 12:13:35 INFO - Running setup.py install for functools32 12:13:35 INFO - warning: no files found matching '*.txt' 12:13:35 INFO - no previously-included directories found matching 'build' 12:13:35 INFO - no previously-included directories found matching 'dist' 12:13:35 INFO - no previously-included directories found matching '.git*' 12:13:35 INFO - Successfully installed jsonschema functools32 12:13:35 INFO - Cleaning up... 12:13:35 INFO - Return code: 0 12:13:35 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 12:13:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:13:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:13:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:13:35 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd180261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16418a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x170c5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x179b410>, '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 0x179c310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x179c7a0>, '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': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', '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:13:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 12:13:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 12:13:35 INFO - Using env: {'DISPLAY': ':0', 12:13:35 INFO - 'HOME': '/home/cltbld', 12:13:35 INFO - 'LANG': 'en_US.UTF-8', 12:13:35 INFO - 'LANGUAGE': 'en_US:en', 12:13:35 INFO - 'LOGNAME': 'cltbld', 12:13:35 INFO - 'MAIL': '/var/mail/cltbld', 12:13:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:35 INFO - 'MOZ_NO_REMOTE': '1', 12:13:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:35 INFO - 'NO_EM_RESTART': '1', 12:13:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:35 INFO - 'PWD': '/builds/slave/test', 12:13:35 INFO - 'SHELL': '/bin/bash', 12:13:35 INFO - 'SHLVL': '1', 12:13:35 INFO - 'TERM': 'linux', 12:13:35 INFO - 'TMOUT': '86400', 12:13:35 INFO - 'USER': 'cltbld', 12:13:35 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', 12:13:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:35 INFO - '_': '/tools/buildbot/bin/python'} 12:13:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:13:35 INFO - Downloading/unpacking flake8 12:13:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:35 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:35 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:37 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 12:13:37 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 12:13:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:13:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:13:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:13:38 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 12:13:38 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 12:13:38 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:13:38 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:13:38 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:13:38 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:13:38 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:13:38 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:13:38 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 12:13:38 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:13:38 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:13:38 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:13:38 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:13:38 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:13:38 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:13:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 12:13:38 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 12:13:38 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 12:13:38 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 12:13:38 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 12:13:38 INFO - no previously-included directories found matching 'docs/_build' 12:13:38 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 12:13:38 INFO - Running setup.py install for pep8 12:13:38 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 12:13:38 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 12:13:38 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 12:13:38 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 12:13:38 INFO - no previously-included directories found matching 'docs/_build' 12:13:38 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 12:13:38 INFO - Successfully installed flake8 mccabe pyflakes pep8 12:13:38 INFO - Cleaning up... 12:13:38 INFO - Return code: 0 12:13:38 INFO - Running post-action listener: _resource_record_post_action 12:13:38 INFO - Running post-action listener: _start_resource_monitoring 12:13:38 INFO - Starting resource monitoring. 12:13:38 INFO - ##### 12:13:38 INFO - ##### Running install step. 12:13:38 INFO - ##### 12:13:38 INFO - Running pre-action listener: _resource_record_pre_action 12:13:38 INFO - Running main action method: install 12:13:38 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:13:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:13:39 INFO - Reading from file tmpfile_stdout 12:13:39 INFO - Detecting whether we're running mozinstall >=1.0... 12:13:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 12:13:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 12:13:39 INFO - Reading from file tmpfile_stdout 12:13:39 INFO - Output received: 12:13:39 INFO - Usage: mozinstall [options] installer 12:13:39 INFO - Options: 12:13:39 INFO - -h, --help show this help message and exit 12:13:39 INFO - -d DEST, --destination=DEST 12:13:39 INFO - Directory to install application into. [default: 12:13:39 INFO - "/builds/slave/test"] 12:13:39 INFO - --app=APP Application being installed. [default: firefox] 12:13:39 INFO - mkdir: /builds/slave/test/build/application 12:13:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 12:13:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 12:13:54 INFO - Reading from file tmpfile_stdout 12:13:54 INFO - Output received: 12:13:54 INFO - /builds/slave/test/build/application/firefox/firefox 12:13:54 INFO - Running post-action listener: _resource_record_post_action 12:13:54 INFO - ##### 12:13:54 INFO - ##### Running run-tests step. 12:13:54 INFO - ##### 12:13:54 INFO - Running pre-action listener: _resource_record_pre_action 12:13:54 INFO - Running main action method: run_tests 12:13:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 12:13:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 12:13:54 INFO - Python 2.7.3 12:13:54 INFO - Return code: 0 12:13:54 INFO - grabbing minidump binary from tooltool 12:13:54 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:13:54 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: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x179b410>, '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 0x179c310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x179c7a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 12:13:54 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:13:54 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:13:54 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 12:13:54 INFO - Return code: 0 12:13:54 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 12:13:54 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 12:13:54 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 12:13:54 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 12:13:54 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 12:13:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 12:13:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 12:13:55 INFO - Return code: 0 12:13:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-050', '--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:13:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-050 --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:13:55 INFO - Using env: {'DISPLAY': ':0', 12:13:55 INFO - 'HOME': '/home/cltbld', 12:13:55 INFO - 'LANG': 'en_US.UTF-8', 12:13:55 INFO - 'LANGUAGE': 'en_US:en', 12:13:55 INFO - 'LOGNAME': 'cltbld', 12:13:55 INFO - 'MAIL': '/var/mail/cltbld', 12:13:55 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:13:55 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 12:13:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:13:55 INFO - 'MOZ_NO_REMOTE': '1', 12:13:55 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:13:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:13:55 INFO - 'NO_EM_RESTART': '1', 12:13:55 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:13:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:13:55 INFO - 'PWD': '/builds/slave/test', 12:13:55 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:13:55 INFO - 'SHELL': '/bin/bash', 12:13:55 INFO - 'SHLVL': '1', 12:13:55 INFO - 'TERM': 'linux', 12:13:55 INFO - 'TMOUT': '86400', 12:13:55 INFO - 'USER': 'cltbld', 12:13:55 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731', 12:13:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:13:55 INFO - '_': '/tools/buildbot/bin/python'} 12:13:55 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-050', '--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:13:56 INFO - mozversion application_buildid: 20160504112038 12:13:56 INFO - mozversion application_changeset: 680574fb36ff4b2c2db6db577aba77d56b8f81d6 12:13:56 INFO - mozversion application_display_name: Nightly 12:13:56 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:13:56 INFO - mozversion application_name: Firefox 12:13:56 INFO - mozversion application_remotingname: firefox 12:13:56 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 12:13:56 INFO - mozversion application_vendor: Mozilla 12:13:56 INFO - mozversion application_version: 49.0a1 12:13:56 INFO - mozversion platform_buildid: 20160504112038 12:13:56 INFO - mozversion platform_changeset: 680574fb36ff4b2c2db6db577aba77d56b8f81d6 12:13:56 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 12:13:56 INFO - mozversion platform_version: 49.0a1 12:13:56 INFO - using testdate: 1462389236 12:13:56 INFO - actual date: 1462389236 12:13:56 INFO - starting webserver on 'localhost:48869' 12:13:56 INFO - SUITE-START | Running 2 tests 12:13:56 INFO - TEST-START | dromaeo_css 12:13:56 INFO - operating with platform_type : linux_ 12:13:56 INFO - Initialising browser for dromaeo_css test... 12:13:56 INFO - TEST-INFO | started process 12630 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp_gijvB/profile http://localhost:48869/getInfo.html) 12:14:00 INFO - PROCESS | 12630 | 12:14:00 INFO - PROCESS | 12630 | (process:12699): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 12:14:01 INFO - PROCESS | 12630 | __metrics Screen width/height:1600/1200 12:14:01 INFO - PROCESS | 12630 | colorDepth:24 12:14:01 INFO - PROCESS | 12630 | Browser inner width/height: 1024/697 12:14:01 INFO - PROCESS | 12630 | __metrics 12:14:01 ERROR - PROCESS | 12630 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2936: TypeError: this.tabs is undefined 12:14:02 INFO - TEST-INFO | 12630: exit 0 12:14:02 INFO - Browser initialized. 12:14:02 INFO - Running cycle 1/1 for dromaeo_css test... 12:14:02 INFO - TEST-INFO | started process 12750 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp_gijvB/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:14:04 INFO - PROCESS | 12750 | 12:14:04 INFO - PROCESS | 12750 | (process:12812): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 12:14:14 INFO - PROCESS | 12750 | RSS: Main: 165072896 12:14:14 INFO - PROCESS | 12750 | 12:15:04 INFO - PROCESS | 12750 | 1462389304113 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:17:15 INFO - PROCESS | 12750 | Cycle 1(1): loaded http://localhost:48869/tests/dromaeo/cssquery-dojo.html (next: http://localhost:48869/tests/dromaeo/cssquery-ext.html) 12:17:16 INFO - PROCESS | 12750 | RSS: Main: 170651648 12:17:16 INFO - PROCESS | 12750 | 12:20:18 INFO - PROCESS | 12750 | Cycle 1(1): loaded http://localhost:48869/tests/dromaeo/cssquery-ext.html (next: http://localhost:48869/tests/dromaeo/cssquery-jquery.html) 12:20:19 INFO - PROCESS | 12750 | RSS: Main: 167194624 12:20:19 INFO - PROCESS | 12750 | 12:23:21 INFO - PROCESS | 12750 | Cycle 1(1): loaded http://localhost:48869/tests/dromaeo/cssquery-jquery.html (next: http://localhost:48869/tests/dromaeo/cssquery-mootools.html) 12:23:21 INFO - PROCESS | 12750 | RSS: Main: 168456192 12:23:21 INFO - PROCESS | 12750 | 12:26:23 INFO - PROCESS | 12750 | Cycle 1(1): loaded http://localhost:48869/tests/dromaeo/cssquery-mootools.html (next: http://localhost:48869/tests/dromaeo/cssquery-prototype.html) 12:26:24 INFO - PROCESS | 12750 | RSS: Main: 166207488 12:26:24 INFO - PROCESS | 12750 | 12:29:27 INFO - PROCESS | 12750 | Cycle 1(1): loaded http://localhost:48869/tests/dromaeo/cssquery-prototype.html (next: http://localhost:48869/tests/dromaeo/cssquery-yui.html) 12:29:27 INFO - PROCESS | 12750 | RSS: Main: 167854080 12:29:27 INFO - PROCESS | 12750 | 12:32:30 INFO - PROCESS | 12750 | Cycle 1(1): loaded http://localhost:48869/tests/dromaeo/cssquery-yui.html (next: http://localhost:48869/tests/dromaeo/cssquery-dojo.html) 12:32:30 INFO - PROCESS | 12750 | RSS: Main: 169578496 12:32:30 INFO - PROCESS | 12750 | 12:32:30 INFO - PROCESS | 12750 | __start_tp_report 12:32:30 INFO - PROCESS | 12750 | _x_x_mozilla_page_load 12:32:30 INFO - PROCESS | 12750 | _x_x_mozilla_page_load_details 12:32:30 INFO - PROCESS | 12750 | |i|pagename|runs| 12:32:30 INFO - PROCESS | 12750 | |0;dojo.html;2589.766920977112;2678.54464740994;2712.823666461681;2716.6468359113314;2725.7138000509945;4607.193741095311;4618.3303421003975;4646.51211622779;4670.579647831694;4684.765761711909;4613.515580864003;4698.694584851983;4719.07977944301;4789.497102804199;4811.783469743861;4329.26402511573;4374.825006999717;4383.3863259143745;4401.735895846244;4402.8679139625865;577.0361885892952;4295.548967358429;4364.912701745963;4418.491873434548;4440.8001639926115;4398.296272596369;4403.581659742319;4405.118976204756;4407.228734971367;4443.37792709021;4246.2356775780345;4447.066116115588;4465.553444655541;4472.642188624902;4515.322701594754;4323.935140972888;4375.278079116942;4390.538993405678;4431.224535706238;4434.977825110854;4626.074785043005;4633.7914793834025;4651.2557990721325;4689.695169813951;4743.407074115736;5096.745162741885;5110.8466745997675;5112.846614601568;5117.923231151536;5181.4300426953005;5189.040027594907;5194.37667479901;5197.922031169535;5207.218917162418;5208.114620514484;4810.542998415145;4817.7591120444185;4817.8313759018265;4834.444038935497;4853.684510506806;5151.845444636667;5196.58427325813;5246.31797866275;5249.632525723163;5274.683518988873;5082.491750824962;5094.821681241138;5119.206522988943;5121.4622464641425;5159.432462429129;4933.136701077297;5183.455737147545;5192.1952097424955;5196.68819870809;5200.219967004904;5013.573846223112;5063.620228482805;5065.696058236517;5095.87260318495;5116.820911268088;4914.90170196594;5036.7733451994745;5076.44159142494;5080.59355251579;5124.615653825978;4199.622034016953;4328.632066274402;4352.912941741148;4358.455193100863;4386;3757.1922036762226;3790.5451345838123;3803.0682482791894;3826.445165450994;3859.996400935777;4440.3561483585345;4458;4466.888327791767;4470.485894122217;4511.278195488706;5198;5210.583153347723;5211.296474975906;5215.765290561933;5223.738813059332;4356.847510337123;4423.51341352451;4444.177827101932;4498.572635599613;4502.932456013163;4592.2193227151465;4608.193566125915;4619.792109355087;4620.214563524209;4674.789634466457;4709.458412282632;4798.256270278112;4812.639052071108;4827.710337379698;4864.197407427735;5166.173412254021;5199.48005199477;5217.921731173959;5235.188545775411;5262.473752624707;4785.545373189541;4802.711837289774;4809.398825146856;4809.567138957511;4866.90266194667;4906.63200259989;5000.1749711297225;5038.067957427887;5063.746812659426;5108.642395032461;5125.205593133071;5156.793728250828;5196.168613021899;5214.217867319932;5237.790488380422;4925.1381008324115;4930.309756634146;4931.334269873521;4937.703737775745;4992.475790041994;4795.304680821331;4917.5328343808715;4921.557059864629;4947.18371468718;4970.602351811919;4773.284007398779;4844.491328410607;4907.067657145131;4912.066707325596;4931.9753401232765;5026;5058.317127187783;5060.721660308718;5063.088644044107;5079.390473143247;4639.5128511507155;4961.131801934719;4967.801287948586;4979.302897594413;5009.023240468074 12:32:30 INFO - PROCESS | 12750 | |1;ext.html;585.6749504025267;607.7143742441051;607.8146165419547;628.531743850831;643.7714611312983;28593.42813143736;29281.853590732044;34757.65242347579;35380.64619353806;35540.82229588855;38651;39424;39456.40815387772;39526.60473395265;39529.40705889414;7634.5037572557885;7832.451728379016;7846.489978151402;7863.921360786405;7866.488678235896;7728.304452599265;7852.882206766903;7856.567888766115;7858.449908506407;7866.842663146734;8014.078380986203;8026.398020148483;8036.27673509384;8077.071136819253;8082.515049097044;7909.209079092102;7966.163552826985;7989.360851131895;8012.839743205132;8040.994875640574;7862.095858976234;7997.280244777998;8008.719694810654;8009.799755006114;8033.076196237449;39398.80300598479;39671.8016409919;40266.194676106315;40275.194496109914;40304.79847600743;3336.8331583420972;3358.580177477815;3422.57217847769;3460.8442620082155;3674.4855720199193;29663.53856717798;29689;29992.55011174834;30179.69820301791;30921.8453907729;3374.6794054564775;3398.4732366483236;3409.641987591292;3440.6559344065645;3466.116140384211;245017;245889;246487;246498;247034.7648261765;30742.385152297276;31140.065798026095;53985;54565.454345456834;54657.72671136698;32767.18082047968;32774.67225327764;32791.50812737811;33014.17464563357;33066.504002439986;13812;13910.234937078558;13917.86082139186;13920.234387108603;13987.580372588838;11102.333859968428;11110.888891111146;11117.722056948642;11123.332600044023;11147.498362573704;8207.768834674727;8242.381821363422;8247.381446391544;8308.875366869503;8349.872767176475;3214.9839250804066;3219.259570298844;3245.0913744151676;3275.6724327567053;3279.2785587170783;926.5135803703109;948.6964171465065;949.924006079512;976.7069879036261;1010.9090181883665;29011.12966611005;29220.561691574643;29466.410671786445;29591.556126658117;29957.850210748806;973.6786860336072;1053.731298518888;1055.2244100586217;1078.191356482638;1079.185215162563;15555.45555905538;15823;15941.362345506283;16037.198140092949;16181.110038947736;336691;339692;341830;343701;344274;52240.47759522432;52795.736021319644;52801.2079818803;52804.73597631987;52921.2061819073;1226.9447874845653;1252.511520507003;1291.806229065629;1299.7270573179737;1303.0357535423907;27461.588076179272;28447.431051378444;28631.570526442538;28665.713342866304;28728;44722.3291650632;44756.32865506955;44835.32747008732;45062.77468612636;45173.77413112913;285596;289517;290957;291346;291449;25882.094126705473;26003.869980649975;26331.736682632927;26394.868025659747;26493.867530662996;44309;44346;44467;44530.3320450187;45584.77207613941;37719.434208486346;38265.773914249425;38754.2249155021;38797;39449.40825887671;37687;37784.43323350097;38389.232215354976;38742.6125738739;38877.61122388853;37405.62594374021;37982;38161;38259.04352391101;38436.80781596074;33131.83434082814;34089.147771305914;34632.480512792834;34646.82676586601;34719.305613888086;26154.86922565375;26289.73710262873;26451;26546.60180097339;26686.332841679112 12:32:30 INFO - PROCESS | 12750 | |2;jquery.html;382.6766382406866;384.9826757795899;386.1157948298397;399.01642451357435;399.3769719237989;15104.546863594096;16812.41156559521;17148.742768858476;17221.22504487298;17287;17240.655186896285;17632.294708211688;17849.10754462278;18157.546061348472;18239.361622343222;5095.082885080684;5287.127623942045;5298.09932311508;5310.548603368718;5318.893622127555;3677.8896633100917;5769.5672824538115;6034.818955431322;6087.969560152215;6100.847478813043;5231.529162375386;6011.699415029253;6020.367861374536;6021.307549631782;6033.185519954794;5562.7774889004395;5566.332040155166;5601.971990140044;5604.047311956957;5604.635698679573;5213.087709650796;5415.512603865671;5443.700596467193;5583.832485025456;5593.664380137164;12591.118621696485;12708.682282942907;12760;12829.61511154667;17234;1926.5857840564206;1958.6964020576834;1983.2562788954142;2001.9299324523718;2131.955341882482;9544.141027307507;9865.914749377564;10063.086323697784;11014.229003969645;13025.218486890817;1754.1843042984945;1755.2715623016434;1756.332593614431;1790.1586254460383;1843.3087592152942;71406.64296678535;73091.63454182749;73540.63229683817;74020;75161;9771.21830253578;10067.798644027078;10333.431661258703;10377.221708371902;10456.895431045592;14184.290785460893;14281.14313141215;14282.285885705673;14305.64235894111;14322.427102915975;7479.626464541422;7555.395568354518;7588.354989825927;7626.275503827128;7712.383009359238;7191.568505889663;7317;7370.815729606803;7397.297256760599;7423.591702456417;4365.039691267916;4416.697074363071;4465.084657645175;4506.571875671806;4583.541645835457;1686.1822016322074;1824.6259516799025;1871.2982631513182;1898;1902.5053486093716;922.4926290540176;958.3770549143113;962.1725316228038;1013.8023085498257;1017.8982101789762;14646.414143434356;15784.842151578338;16033.839661603468;16197.433089842034;16323;877.6708734224666;888.9822203555892;889.0842432294746;904.1275169461501;932.3566738950238;8089.2315230053055;9330.206932410822;9419.529023548932;9424.293178011676;9639.566219520138;415104;417555;418301;419139;424735;74675.62662186654;75020;77535;79290.60354698305;79953.20046799458;981.8330883749637;985.2364417576435;991.2367477042781;994.8507723841482;1007.1741172238694;14502.709945801236;14635.34140963638;14907.55277341638;15082.472113475975;15691;32683.673163268064;33540.66459335375;34374.656253438145;35156.472652910736;35974.64025359713;42822.57177428186;44232;44476.33285500785;44672;44878.10243795171;5700.458456446631;7461.365783908429;7741.45809793309;7820.491668041559;8070.354371650371;11406.20156589064;12225.755484890431;12274.570390036306;12333.93833030829;12444.377781111089;4952.5295096967175;7568.470207085451;9202.38958182302;10062.748431288983;10427.582896684047;9978.550965206437;10124;10128.797424051625;10170.644027459004;10419.322744021918;10564.049235568837;10645.520951557044;10695.411752353695;10983.450827458755;11099.500522476346;7874.978868126968;7909.841803164019;7990.680372785256;8157.877631835646;8282.751517454486;8136.918630813616;10348.172146228435;10685.732856678645;10844.566217351534;10925.344479331265 12:32:30 INFO - PROCESS | 12750 | |3;mootools.html;1504.420797992773;1527.9915255931085;1684.83994020568;1779.4839496546003;1816.881902676326;6751.426128779048;7452.515586486875;7503.962480187605;7755.767326980193;7775.416843736722;7477.065366829146;7497.887531687015;7599.582022988733;7616;7621.771346859589;1872.5880306332585;1884.4629280655015;1899.1358931686118;1904.2192700992596;1905.9237630494763;2163.426691926633;2163.8809865457392;2183.11583808557;2206.9448263793374;2213.5904857601313;2154.5583155453173;2156.4716644422138;2158.212252527832;2161.3407910587266;2175.9564808703817;2123.140128248054;2133.25336132354;2138.882361470111;2140.6146893559153;2147.6563749799957;2134.237261178148;2143.389134096775;2174.282486779359;2179.1174574297434;2189.879556624385;7588.430867684946;7645.808854778619;7648.54108753471;7657.157712651604;7668.424868134856;4485.1254005468945;4631.4673812511655;4634.953650463486;4644.489106198315;4656.324832899245;2755.2836262571677;2871.3395918938554;2884.2887685575492;2893.3056066544086;2894.2619631993916;906.3610154840821;940.149165005671;977.4233202410541;1574.7559128335126;1624.7400415933394;9847.950760246225;9929.702108936743;9944.105030547213;9981.151602113756;9989.550470228785;4030.879073627796;4036.2734707752297;4104.220198162339;4107.096438783463;4107.486564179478;8032.518048917083;8037.7588672339925;8059.073206581201;8065.758027259191;8072.919270807334;4427.800748966304;4544.045750392388;4579.335996280521;4579.473360563511;4584.129015487047;3791.3554695701796;4183.079722461053;4239.745615263094;4263.126059157865;4309.181255561433;3331.1172539277113;3340.3987282288936;3440.4323286657423;3456.291460250693;3482.59950105736;1043.6034306963456;1064.0902028765295;1078.5524007536942;1086.4241951765578;1096.7751610919743;730.9049823522907;834.5034704350901;878.789090618247;879.384430898361;886.7650072730731;4946.332245146859;5050.3182070420025;5105.897882042338;5125.794968201305;5196.818111366084;419.53222157295005;432.9458817647794;453.28381157770644;454.56588957545466;458.92198326284614;3456.879009234715;3494.8602055917477;3500.072480792592;3519.683228509395;3536.2397084626928;9114.40756350835;9341.673041443517;9439.764005899908;9549.09283618055;9551.808963820684;9366.67216647414;9402.952985235166;9429.3399462037;9435.716928492157;9437.103475169848;7289.781306560812;7311.780646580611;7322.084739407681;7367.373773229336;7396.297351751575;5345.38528069277;5350.117230656898;5477.780888764405;5536.141898005815;5578.776848925998;8457.238848503664;8483.321334293118;8556.10160933093;8557;8596.226339629464;8361.289290410383;8580.184882436159;8583;8612;8773.254273386578;5852.678102704393;6363.331850155852;6488.351164883474;6495.285518593046;6871.862562748817;7150.713971441084;7264.927350726425;7279.4540409468445;7288;7294.489385742947;6361.968190159019;6621.470282377494;6630.801075967729;6637.933620663732;6719;6377.266614339411;6489.1888513935755;6506.089147519446;6612.636305003271;6641.867162656623;6027.909581356371;6110.877782444238;6142.201513803177;6157.599756015845;6177.19696439478;4199.045126750464;4271.914561708811;4356.390105385185;4406.030673251879;4513.638779737785;4443.911121777482;4474.731516109044;4479.260921947973;4505.43682039745;4525.773711314487 12:32:30 INFO - PROCESS | 12750 | |4;prototype.html;302.7169596427339;309.48470796124457;318.30609271787523;319.77296119754965;320.5848426287957;4727.314539391786;4817.325574419579;4924;4998.225275082359;5043.117454445471;4879.072556466119;4931.580815630676;4941.555260026596;4947.554720075193;4952.405711314647;3957.3272543667645;3958.287508248521;3969.563348031714;3969.5831937646562;3976.582458841823;3671.816409179544;3934.665553427962;3940.783256920868;3984.1434091670285;3986.70099742519;3819.8854034379015;3833.731638785272;3867.149227170018;3869.8839034829;3874.321993651114;3845.8846234612865;3849.2101172954713;3849.40334248192;3850.7689538627633;3867.2265546890453;3407.8296085195643;3415.84628691707;3416.760826742129;3419.7093247074026;3429.794212347267;4639.466461356953;4731.33761273422;4762.1903676603015;4781.258904869751;4801.375821143264;4321.956780432187;4345.869623911288;4382.8904277393;4393.165298593289;4413.713108647959;5156.355455568054;5156.793728250866;5183.559397451183;5187.870303242411;5190.506901844319;3611.1694310308776;3693;3697.1681371691425;3703.6481534254203;3714.628537146291;5393.487618676219;5430.321209848769;5440.4015558288165;5448.400675925645;5467.234587157801;3805.9048523786573;3814.237152569497;3818.427235914635;3820.312343778091;3822.636849499293;3850.614938506127;3853.807309634507;3861.1505468796818;3864.7294689371474;3870.2646497165447;4219.7046206765235;4382.824687012548;4402.977985110054;4407;4407.162639098561;5185.585153187736;5190.532852043334;5201.101597916809;5228.55557277628;5233.659812112201;1300.174389262825;1365.5766712319212;1392.997042129665;1398.1680899864564;1398.825146856643;893.1648908270788;923.7044145873256;926.545992463688;937.8686983822271;942.5946842857637;4712.952870471251;4752.477227504972;4753.619710423158;4761.5714585686765;4786.1863483207935;5587.357453892854;5618.91571626426;5624.184493248456;5634.746436410372;5649.915251271234;4666.230072038144;4708.835190768306;4768.427788665313;4769.42766867978;4776.617870570346;2979.478591246523;2997.1757766614355;3002.8048176868433;3007.203091180839;3010.5785190073407;5219;5290.391604965402;5292.708901010405;5295.788168473218;5296.788128474895;5224.50367215114;5559.805406810742;5575.916361254584;5753.942460575425;5798.5071268941765;5024.648274620815;5047.141985862486;5061.31672224245;5099.87250318745;5102.285680004802;5360.946390536201;5362.92741451719;5375.763574377836;5393.325834270716;5434.755436005468;5182.300389447376;5206.583473322201;5268.578513718817;5307.867303317448;5316.175992721134;5039.571636410946;5053.938672878589;5054.646174767731;5067.5185857343495;5078.949210507995;3696.4085746280466;3700.648438398348;3712.0163156762937;3712.461693054438;3713.628637136265;5044.924326135184;5058.571885495056;5337.492938170868;5374.328208973879;5392.406835248041;5072.467390924047;5136.871578210575;5161.200013997836;5170.508801663836;5190.247414125006;5130.896332503656;5193.636445448782;5194.402643695872;5206.271122042993;5233.188855727369;4843.789052736815;5113.386393632639;5143.768530416065;5148.43367229612;5173.767180476812;5182.300389447376;5196.818111366084;5247.2129180623215;5255.605829562722;5274.235235890697;5131.794728210979;5157.793688252428;5160.741962901765;5161.948380516147;5175.508326708957 12:32:30 INFO - PROCESS | 12750 | |5;yui.html;699.8775214337492;787.322902304018;789.7670187294751;803.009548766204;807.4670717326566;11518.942405287973;11533.711657208574;11908.22596531225;12059.216150950182;12067.21563098398;12442.066844986617;12489.68775780606;12545.059120565948;12601.117921745481;12625.684357891058;696.2550071423578;856.2850020233082;872.7818045488627;875.2385424680521;877.473515890467;863.1282404771164;865.926396256319;871.5772850167696;875.3653601139155;876.0494863073573;922.6171138977317;923.7829110159107;924.6347692661394;925.3661242049218;925.8287216864868;917.4724533393326;918.3571499950061;918.6646873891015;920.627146005862;921.4517362169532;675.9155105611799;676.9255381907986;677.0926957876469;680.0750978669006;680.3196803196803;11855.644330670008;11880.58417955376;11884;11942.701432464171;11949.462274197682;12612.621621351374;13019.804702929463;13112.213267203999;13164.86835131646;13341.19952802835;10315.948420257926;10490.108340791043;10549.630762923338;10608.886066962936;10632.096271816905;3463.428534291839;3490.4938783876196;3499.7550171488006;3523;3603.045193023851;46511.30233046507;46652.33476652342;46848.063038739376;47884;48018.5198148021;10589.788204235872;10592.788144237073;10636.255462117577;10636.41499717523;10844.620438284623;19056.71414928777;19219.903900480407;19238.903805481164;19299.421017369503;19303.034848257532;7210.174401301532;7229.89155162673;7283.344498995116;7411.592362420119;7464.104307483137;3829.0810205550465;3861.2470568239487;3863.285292220948;3865.1110244643887;3900.863469778544;3008.3832814273023;3082.784205105621;3089.4902341113466;3230.8869189578722;3394.35507253621;583.8160979291509;590.3240789296232;595.9303051023423;605.9636421814705;605.9727312270959;516.3007054454864;590.7489317040327;613.9386061393825;626.3266987987931;658.2474533865484;7234.891476627855;7431;7632;7998;8360.28937540316;542.0622323380495;602.6625089949642;605.276694350256;613.2303958532013;620.3672254300678;3595.388783906742;3850.1914597934747;3891.9416208756893;3904.6876249899938;4002.579729128458;49587.752061239466;50837.74581127071;51603.22595161076;51618;51632.22551661728;44790.77604611956;46774.29838552424;46886.76556617263;47114.5288547117;48753;41830.37254441186;42045.15909681789;42785;43099.353509698005;43188.784056079516;7276.345128938421;7434.479586428898;7489.700411983677;7608.695652173851;7618.314351708373;28774;29108.7089129106;29635.703642964156;29811.72071072137;29815.254618634706;35347.293054139285;37256.81371593125;37515.43726844045;37807.81096094502;37985.62014379821;9740;9827.11555959967;9938.204943604349;9943;10090.747731306776;10396.688099357032;10498.580056797642;10499.002594753487;10743.838842417214;10855.45722713877;9447;9477.952610236905;9577.904220957702;9864.753381165241;9973.60105595768;8883.466991980502;8917;9030.63877444895;9172.862407063765;9891.604335826487;9735.26985476078;10003.649872254437;10564.630237941636;11008.944955275172;11049.729281132773;9415.529223538659;9499.335046546676;9506.90493095088;9682.177014953808;9711.3202075854;9173.954130229573;9361.765955851159;9563.330566860253;9607.13535781783;9623.278254130828 12:32:30 INFO - PROCESS | 12750 | __end_tp_report 12:32:30 INFO - PROCESS | 12750 | __start_cc_report 12:32:30 INFO - PROCESS | 12750 | _x_x_mozilla_cycle_collect,378 12:32:30 INFO - PROCESS | 12750 | __end_cc_report 12:32:30 INFO - PROCESS | 12750 | __startTimestamp1462390350612__endTimestamp 12:32:30 INFO - PROCESS | 12750 | 12:32:30 INFO - PROCESS | 12750 | ------- Summary: start ------- 12:32:30 INFO - PROCESS | 12750 | Number of tests: 6 12:32:30 INFO - PROCESS | 12750 | 12:32:30 INFO - PROCESS | 12750 | [#0] dojo.html Cycles:165 Average:4706.83 Median:4827.71 stddev:594.67 (12.3%) stddev-sans-first:572.83 12:32:30 INFO - PROCESS | 12750 | Values: 2589.8 2678.5 2712.8 2716.6 2725.7 4607.2 4618.3 4646.5 4670.6 4684.8 4613.5 4698.7 4719.1 4789.5 4811.8 4329.3 4374.8 4383.4 4401.7 4402.9 577.0 4295.5 4364.9 4418.5 4440.8 4398.3 4403.6 4405.1 4407.2 4443.4 4246.2 4447.1 4465.6 4472.6 4515.3 4323.9 4375.3 4390.5 4431.2 4435.0 4626.1 4633.8 4651.3 4689.7 4743.4 5096.7 5110.8 5112.8 5117.9 5181.4 5189.0 5194.4 5197.9 5207.2 5208.1 4810.5 4817.8 4817.8 4834.4 4853.7 5151.8 5196.6 5246.3 5249.6 5274.7 5082.5 5094.8 5119.2 5121.5 5159.4 4933.1 5183.5 5192.2 5196.7 5200.2 5013.6 5063.6 5065.7 5095.9 5116.8 4914.9 5036.8 5076.4 5080.6 5124.6 4199.6 4328.6 4352.9 4358.5 4386.0 3757.2 3790.5 3803.1 3826.4 3860.0 4440.4 4458.0 4466.9 4470.5 4511.3 5198.0 5210.6 5211.3 5215.8 5223.7 4356.8 4423.5 4444.2 4498.6 4502.9 4592.2 4608.2 4619.8 4620.2 4674.8 4709.5 4798.3 4812.6 4827.7 4864.2 5166.2 5199.5 5217.9 5235.2 5262.5 4785.5 4802.7 4809.4 4809.6 4866.9 4906.6 5000.2 5038.1 5063.7 5108.6 5125.2 5156.8 5196.2 5214.2 5237.8 4925.1 4930.3 4931.3 4937.7 4992.5 4795.3 4917.5 4921.6 4947.2 4970.6 4773.3 4844.5 4907.1 4912.1 4932.0 5026.0 5058.3 5060.7 5063.1 5079.4 4639.5 4961.1 4967.8 4979.3 5009.0 12:32:30 INFO - PROCESS | 12750 | 12:32:30 INFO - PROCESS | 12750 | [#1] ext.html Cycles:180 Average:44500.45 Median:19056.47 stddev:77410.80 (406.2%) stddev-sans-first:77557.74 12:32:30 INFO - PROCESS | 12750 | Values: 585.7 607.7 607.8 628.5 643.8 28593.4 29281.9 34757.7 35380.6 35540.8 38651.0 39424.0 39456.4 39526.6 39529.4 7634.5 7832.5 7846.5 7863.9 7866.5 7728.3 7852.9 7856.6 7858.4 7866.8 8014.1 8026.4 8036.3 8077.1 8082.5 7909.2 7966.2 7989.4 8012.8 8041.0 7862.1 7997.3 8008.7 8009.8 8033.1 39398.8 39671.8 40266.2 40275.2 40304.8 3336.8 3358.6 3422.6 3460.8 3674.5 29663.5 29689.0 29992.6 30179.7 30921.8 3374.7 3398.5 3409.6 3440.7 3466.1 245017.0 245889.0 246487.0 246498.0 247034.8 30742.4 31140.1 53985.0 54565.5 54657.7 32767.2 32774.7 32791.5 33014.2 33066.5 13812.0 13910.2 13917.9 13920.2 13987.6 11102.3 11110.9 11117.7 11123.3 11147.5 8207.8 8242.4 8247.4 8308.9 8349.9 3215.0 3219.3 3245.1 3275.7 3279.3 926.5 948.7 949.9 976.7 1010.9 29011.1 29220.6 29466.4 29591.6 29957.9 973.7 1053.7 1055.2 1078.2 1079.2 15555.5 15823.0 15941.4 16037.2 16181.1 336691.0 339692.0 341830.0 343701.0 344274.0 52240.5 52795.7 52801.2 52804.7 52921.2 1226.9 1252.5 1291.8 1299.7 1303.0 27461.6 28447.4 28631.6 28665.7 28728.0 44722.3 44756.3 44835.3 45062.8 45173.8 285596.0 289517.0 290957.0 291346.0 291449.0 25882.1 26003.9 26331.7 26394.9 26493.9 44309.0 44346.0 44467.0 44530.3 45584.8 37719.4 38265.8 38754.2 38797.0 39449.4 37687.0 37784.4 38389.2 38742.6 38877.6 37405.6 37982.0 38161.0 38259.0 38436.8 33131.8 34089.1 34632.5 34646.8 34719.3 26154.9 26289.7 26451.0 26546.6 26686.3 12:32:30 INFO - PROCESS | 12750 | 12:32:30 INFO - PROCESS | 12750 | [#2] jquery.html Cycles:180 Average:24851.49 Median:233778.79 stddev:69022.96 (29.5%) stddev-sans-first:69192.14 12:32:30 INFO - PROCESS | 12750 | Values: 382.7 385.0 386.1 399.0 399.4 15104.5 16812.4 17148.7 17221.2 17287.0 17240.7 17632.3 17849.1 18157.5 18239.4 5095.1 5287.1 5298.1 5310.5 5318.9 3677.9 5769.6 6034.8 6088.0 6100.8 5231.5 6011.7 6020.4 6021.3 6033.2 5562.8 5566.3 5602.0 5604.0 5604.6 5213.1 5415.5 5443.7 5583.8 5593.7 12591.1 12708.7 12760.0 12829.6 17234.0 1926.6 1958.7 1983.3 2001.9 2132.0 9544.1 9865.9 10063.1 11014.2 13025.2 1754.2 1755.3 1756.3 1790.2 1843.3 71406.6 73091.6 73540.6 74020.0 75161.0 9771.2 10067.8 10333.4 10377.2 10456.9 14184.3 14281.1 14282.3 14305.6 14322.4 7479.6 7555.4 7588.4 7626.3 7712.4 7191.6 7317.0 7370.8 7397.3 7423.6 4365.0 4416.7 4465.1 4506.6 4583.5 1686.2 1824.6 1871.3 1898.0 1902.5 922.5 958.4 962.2 1013.8 1017.9 14646.4 15784.8 16033.8 16197.4 16323.0 877.7 889.0 889.1 904.1 932.4 8089.2 9330.2 9419.5 9424.3 9639.6 415104.0 417555.0 418301.0 419139.0 424735.0 74675.6 75020.0 77535.0 79290.6 79953.2 981.8 985.2 991.2 994.9 1007.2 14502.7 14635.3 14907.6 15082.5 15691.0 32683.7 33540.7 34374.7 35156.5 35974.6 42822.6 44232.0 44476.3 44672.0 44878.1 5700.5 7461.4 7741.5 7820.5 8070.4 11406.2 12225.8 12274.6 12333.9 12444.4 4952.5 7568.5 9202.4 10062.7 10427.6 9978.6 10124.0 10128.8 10170.6 10419.3 10564.0 10645.5 10695.4 10983.5 11099.5 7875.0 7909.8 7990.7 8157.9 8282.8 8136.9 10348.2 10685.7 10844.6 10925.3 12:32:30 INFO - PROCESS | 12750 | 12:32:30 INFO - PROCESS | 12750 | [#3] mootools.html Cycles:180 Average:4975.72 Median:5161.31 stddev:2744.37 (53.2%) stddev-sans-first:2739.67 12:32:30 INFO - PROCESS | 12750 | Values: 1504.4 1528.0 1684.8 1779.5 1816.9 6751.4 7452.5 7504.0 7755.8 7775.4 7477.1 7497.9 7599.6 7616.0 7621.8 1872.6 1884.5 1899.1 1904.2 1905.9 2163.4 2163.9 2183.1 2206.9 2213.6 2154.6 2156.5 2158.2 2161.3 2176.0 2123.1 2133.3 2138.9 2140.6 2147.7 2134.2 2143.4 2174.3 2179.1 2189.9 7588.4 7645.8 7648.5 7657.2 7668.4 4485.1 4631.5 4635.0 4644.5 4656.3 2755.3 2871.3 2884.3 2893.3 2894.3 906.4 940.1 977.4 1574.8 1624.7 9848.0 9929.7 9944.1 9981.2 9989.6 4030.9 4036.3 4104.2 4107.1 4107.5 8032.5 8037.8 8059.1 8065.8 8072.9 4427.8 4544.0 4579.3 4579.5 4584.1 3791.4 4183.1 4239.7 4263.1 4309.2 3331.1 3340.4 3440.4 3456.3 3482.6 1043.6 1064.1 1078.6 1086.4 1096.8 730.9 834.5 878.8 879.4 886.8 4946.3 5050.3 5105.9 5125.8 5196.8 419.5 432.9 453.3 454.6 458.9 3456.9 3494.9 3500.1 3519.7 3536.2 9114.4 9341.7 9439.8 9549.1 9551.8 9366.7 9403.0 9429.3 9435.7 9437.1 7289.8 7311.8 7322.1 7367.4 7396.3 5345.4 5350.1 5477.8 5536.1 5578.8 8457.2 8483.3 8556.1 8557.0 8596.2 8361.3 8580.2 8583.0 8612.0 8773.3 5852.7 6363.3 6488.4 6495.3 6871.9 7150.7 7264.9 7279.5 7288.0 7294.5 6362.0 6621.5 6630.8 6637.9 6719.0 6377.3 6489.2 6506.1 6612.6 6641.9 6027.9 6110.9 6142.2 6157.6 6177.2 4199.0 4271.9 4356.4 4406.0 4513.6 4443.9 4474.7 4479.3 4505.4 4525.8 12:32:30 INFO - PROCESS | 12750 | 12:32:30 INFO - PROCESS | 12750 | [#4] prototype.html Cycles:180 Average:4349.91 Median:4936.57 stddev:1258.15 (25.5%) stddev-sans-first:1224.46 12:32:30 INFO - PROCESS | 12750 | Values: 302.7 309.5 318.3 319.8 320.6 4727.3 4817.3 4924.0 4998.2 5043.1 4879.1 4931.6 4941.6 4947.6 4952.4 3957.3 3958.3 3969.6 3969.6 3976.6 3671.8 3934.7 3940.8 3984.1 3986.7 3819.9 3833.7 3867.1 3869.9 3874.3 3845.9 3849.2 3849.4 3850.8 3867.2 3407.8 3415.8 3416.8 3419.7 3429.8 4639.5 4731.3 4762.2 4781.3 4801.4 4322.0 4345.9 4382.9 4393.2 4413.7 5156.4 5156.8 5183.6 5187.9 5190.5 3611.2 3693.0 3697.2 3703.6 3714.6 5393.5 5430.3 5440.4 5448.4 5467.2 3805.9 3814.2 3818.4 3820.3 3822.6 3850.6 3853.8 3861.2 3864.7 3870.3 4219.7 4382.8 4403.0 4407.0 4407.2 5185.6 5190.5 5201.1 5228.6 5233.7 1300.2 1365.6 1393.0 1398.2 1398.8 893.2 923.7 926.5 937.9 942.6 4713.0 4752.5 4753.6 4761.6 4786.2 5587.4 5618.9 5624.2 5634.7 5649.9 4666.2 4708.8 4768.4 4769.4 4776.6 2979.5 2997.2 3002.8 3007.2 3010.6 5219.0 5290.4 5292.7 5295.8 5296.8 5224.5 5559.8 5575.9 5753.9 5798.5 5024.6 5047.1 5061.3 5099.9 5102.3 5360.9 5362.9 5375.8 5393.3 5434.8 5182.3 5206.6 5268.6 5307.9 5316.2 5039.6 5053.9 5054.6 5067.5 5078.9 3696.4 3700.6 3712.0 3712.5 3713.6 5044.9 5058.6 5337.5 5374.3 5392.4 5072.5 5136.9 5161.2 5170.5 5190.2 5130.9 5193.6 5194.4 5206.3 5233.2 4843.8 5113.4 5143.8 5148.4 5173.8 5182.3 5196.8 5247.2 5255.6 5274.2 5131.8 5157.8 5160.7 5161.9 5175.5 12:32:30 INFO - PROCESS | 12750 | 12:32:30 INFO - PROCESS | 12750 | [#5] yui.html Cycles:180 Average:12683.31 Median:50212.75 stddev:14390.67 (28.7%) stddev-sans-first:14402.90 12:32:30 INFO - PROCESS | 12750 | Values: 699.9 787.3 789.8 803.0 807.5 11518.9 11533.7 11908.2 12059.2 12067.2 12442.1 12489.7 12545.1 12601.1 12625.7 696.3 856.3 872.8 875.2 877.5 863.1 865.9 871.6 875.4 876.0 922.6 923.8 924.6 925.4 925.8 917.5 918.4 918.7 920.6 921.5 675.9 676.9 677.1 680.1 680.3 11855.6 11880.6 11884.0 11942.7 11949.5 12612.6 13019.8 13112.2 13164.9 13341.2 10315.9 10490.1 10549.6 10608.9 10632.1 3463.4 3490.5 3499.8 3523.0 3603.0 46511.3 46652.3 46848.1 47884.0 48018.5 10589.8 10592.8 10636.3 10636.4 10844.6 19056.7 19219.9 19238.9 19299.4 19303.0 7210.2 7229.9 7283.3 7411.6 7464.1 3829.1 3861.2 3863.3 3865.1 3900.9 3008.4 3082.8 3089.5 3230.9 3394.4 583.8 590.3 595.9 606.0 606.0 516.3 590.7 613.9 626.3 658.2 7234.9 7431.0 7632.0 7998.0 8360.3 542.1 602.7 605.3 613.2 620.4 3595.4 3850.2 3891.9 3904.7 4002.6 49587.8 50837.7 51603.2 51618.0 51632.2 44790.8 46774.3 46886.8 47114.5 48753.0 41830.4 42045.2 42785.0 43099.4 43188.8 7276.3 7434.5 7489.7 7608.7 7618.3 28774.0 29108.7 29635.7 29811.7 29815.3 35347.3 37256.8 37515.4 37807.8 37985.6 9740.0 9827.1 9938.2 9943.0 10090.7 10396.7 10498.6 10499.0 10743.8 10855.5 9447.0 9478.0 9577.9 9864.8 9973.6 8883.5 8917.0 9030.6 9172.9 9891.6 9735.3 10003.6 10564.6 11008.9 11049.7 9415.5 9499.3 9506.9 9682.2 9711.3 9174.0 9361.8 9563.3 9607.1 9623.3 12:32:30 INFO - PROCESS | 12750 | -------- Summary: end -------- 12:32:30 INFO - PROCESS | 12750 | 12:32:31 INFO - TEST-INFO | 12750: exit 0 12:32:31 INFO - TEST-OK | dromaeo_css | took 1115234ms 12:32:31 INFO - TEST-START | kraken 12:32:31 INFO - operating with platform_type : linux_ 12:32:31 INFO - Initialising browser for kraken test... 12:32:31 INFO - TEST-INFO | started process 12989 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpOMpO1x/profile http://localhost:48869/getInfo.html) 12:32:35 INFO - PROCESS | 12989 | 12:32:35 INFO - PROCESS | 12989 | (process:13057): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 12:32:35 INFO - PROCESS | 12989 | __metrics Screen width/height:1600/1200 12:32:35 INFO - PROCESS | 12989 | colorDepth:24 12:32:35 INFO - PROCESS | 12989 | Browser inner width/height: 1024/697 12:32:35 INFO - PROCESS | 12989 | __metrics 12:32:36 ERROR - PROCESS | 12989 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2936: TypeError: this.tabs is undefined 12:32:37 INFO - TEST-INFO | 12989: exit 0 12:32:37 INFO - Browser initialized. 12:32:37 INFO - Running cycle 1/1 for kraken test... 12:32:37 INFO - TEST-INFO | started process 13108 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpOMpO1x/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:32:39 INFO - PROCESS | 13108 | 12:32:39 INFO - PROCESS | 13108 | (process:13168): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 12:32:49 INFO - PROCESS | 13108 | RSS: Main: 166211584 12:32:49 INFO - PROCESS | 13108 | 12:32:52 INFO - PROCESS | 13108 | Cycle 1(1): loaded http://localhost:48869/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:48869/tests/kraken/driver.html?testName=audio-beat-detection) 12:32:53 INFO - PROCESS | 13108 | RSS: Main: 169488384 12:32:53 INFO - PROCESS | 13108 | 12:32:55 INFO - PROCESS | 13108 | Cycle 1(1): loaded http://localhost:48869/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:48869/tests/kraken/driver.html?testName=audio-dft) 12:32:56 INFO - PROCESS | 13108 | RSS: Main: 171491328 12:32:56 INFO - PROCESS | 13108 | 12:32:59 INFO - PROCESS | 13108 | Cycle 1(1): loaded http://localhost:48869/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:48869/tests/kraken/driver.html?testName=audio-fft) 12:33:00 INFO - PROCESS | 13108 | RSS: Main: 164569088 12:33:00 INFO - PROCESS | 13108 | 12:33:02 INFO - PROCESS | 13108 | Cycle 1(1): loaded http://localhost:48869/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:48869/tests/kraken/driver.html?testName=audio-oscillator) 12:33:02 INFO - PROCESS | 13108 | RSS: Main: 164515840 12:33:02 INFO - PROCESS | 13108 | 12:33:05 INFO - PROCESS | 13108 | Cycle 1(1): loaded http://localhost:48869/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:48869/tests/kraken/driver.html?testName=imaging-gaussian-blur) 12:33:05 INFO - PROCESS | 13108 | RSS: Main: 165949440 12:33:05 INFO - PROCESS | 13108 | 12:33:08 INFO - PROCESS | 13108 | Cycle 1(1): loaded http://localhost:48869/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:48869/tests/kraken/driver.html?testName=imaging-darkroom) 12:33:09 INFO - PROCESS | 13108 | RSS: Main: 166432768 12:33:09 INFO - PROCESS | 13108 | 12:33:12 INFO - PROCESS | 13108 | Cycle 1(1): loaded http://localhost:48869/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:48869/tests/kraken/driver.html?testName=imaging-desaturate) 12:33:13 INFO - PROCESS | 13108 | RSS: Main: 166113280 12:33:13 INFO - PROCESS | 13108 | 12:33:16 INFO - PROCESS | 13108 | Cycle 1(1): loaded http://localhost:48869/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:48869/tests/kraken/driver.html?testName=json-parse-financial) 12:33:17 INFO - PROCESS | 13108 | RSS: Main: 167010304 12:33:17 INFO - PROCESS | 13108 | 12:33:18 INFO - PROCESS | 13108 | Cycle 1(1): loaded http://localhost:48869/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:48869/tests/kraken/driver.html?testName=json-stringify-tinderbox) 12:33:19 INFO - PROCESS | 13108 | RSS: Main: 167264256 12:33:19 INFO - PROCESS | 13108 | 12:33:21 INFO - PROCESS | 13108 | Cycle 1(1): loaded http://localhost:48869/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:48869/tests/kraken/driver.html?testName=stanford-crypto-aes) 12:33:22 INFO - PROCESS | 13108 | RSS: Main: 167010304 12:33:22 INFO - PROCESS | 13108 | 12:33:24 INFO - PROCESS | 13108 | Cycle 1(1): loaded http://localhost:48869/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:48869/tests/kraken/driver.html?testName=stanford-crypto-ccm) 12:33:24 INFO - PROCESS | 13108 | RSS: Main: 167473152 12:33:24 INFO - PROCESS | 13108 | 12:33:27 INFO - PROCESS | 13108 | Cycle 1(1): loaded http://localhost:48869/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:48869/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 12:33:28 INFO - PROCESS | 13108 | RSS: Main: 167636992 12:33:28 INFO - PROCESS | 13108 | 12:33:31 INFO - PROCESS | 13108 | Cycle 1(1): loaded http://localhost:48869/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:48869/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 12:33:31 INFO - PROCESS | 13108 | RSS: Main: 167718912 12:33:31 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | Cycle 1(1): loaded http://localhost:48869/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:48869/tests/kraken/driver.html?testName=ai-astar) 12:33:33 INFO - PROCESS | 13108 | RSS: Main: 169385984 12:33:33 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | __start_tp_report 12:33:33 INFO - PROCESS | 13108 | _x_x_mozilla_page_load 12:33:33 INFO - PROCESS | 13108 | _x_x_mozilla_page_load_details 12:33:33 INFO - PROCESS | 13108 | |i|pagename|runs| 12:33:33 INFO - PROCESS | 13108 | |0;ai-astar;117;111;115;115;117;128;114;117;119;117 12:33:33 INFO - PROCESS | 13108 | |1;audio-beat-detection;161;133;151;183;132;158;163;135;199;135 12:33:33 INFO - PROCESS | 13108 | |2;audio-dft;165;165;166;170;176;163;163;164;167;163 12:33:33 INFO - PROCESS | 13108 | |3;audio-fft;74;74;74;151;74;75;73;77;173;74 12:33:33 INFO - PROCESS | 13108 | |4;audio-oscillator;94;94;149;95;95;94;150;94;93;144 12:33:33 INFO - PROCESS | 13108 | |5;imaging-gaussian-blur;117;118;117;118;118;118;118;117;118;117 12:33:33 INFO - PROCESS | 13108 | |6;imaging-darkroom;149;147;147;148;146;147;148;148;148;148 12:33:33 INFO - PROCESS | 13108 | |7;imaging-desaturate;95;96;95;95;95;96;96;95;96;95 12:33:33 INFO - PROCESS | 13108 | |8;json-parse-financial;69;66;67;70;67;68;68;83;66;66 12:33:33 INFO - PROCESS | 13108 | |9;json-stringify-tinderbox;65;64;66;65;64;65;64;64;65;66 12:33:33 INFO - PROCESS | 13108 | |10;stanford-crypto-aes;80;79;80;80;85;81;82;82;82;90 12:33:33 INFO - PROCESS | 13108 | |11;stanford-crypto-ccm;133;144;131;139;133;134;133;133;178;142 12:33:33 INFO - PROCESS | 13108 | |12;stanford-crypto-pbkdf2;182;181;182;186;181;188;178;180;182;177 12:33:33 INFO - PROCESS | 13108 | |13;stanford-crypto-sha256-iterative;75;77;77;76;75;74;76;74;76;73 12:33:33 INFO - PROCESS | 13108 | __end_tp_report 12:33:33 INFO - PROCESS | 13108 | __start_cc_report 12:33:33 INFO - PROCESS | 13108 | _x_x_mozilla_cycle_collect,921 12:33:33 INFO - PROCESS | 13108 | __end_cc_report 12:33:33 INFO - PROCESS | 13108 | __startTimestamp1462390413979__endTimestamp 12:33:33 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | ------- Summary: start ------- 12:33:33 INFO - PROCESS | 13108 | Number of tests: 14 12:33:33 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | [#0] ai-astar Cycles:10 Average:117.00 Median:117.00 stddev:4.45 (3.8%) stddev-sans-first:4.72 12:33:33 INFO - PROCESS | 13108 | Values: 117.0 111.0 115.0 115.0 117.0 128.0 114.0 117.0 119.0 117.0 12:33:33 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | [#1] audio-beat-detection Cycles:10 Average:155.00 Median:159.50 stddev:22.75 (14.3%) stddev-sans-first:24.03 12:33:33 INFO - PROCESS | 13108 | Values: 161.0 133.0 151.0 183.0 132.0 158.0 163.0 135.0 199.0 135.0 12:33:33 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | [#2] audio-dft Cycles:10 Average:166.20 Median:165.50 stddev:4.08 (2.5%) stddev-sans-first:4.30 12:33:33 INFO - PROCESS | 13108 | Values: 165.0 165.0 166.0 170.0 176.0 163.0 163.0 164.0 167.0 163.0 12:33:33 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | [#3] audio-fft Cycles:10 Average:91.90 Median:74.00 stddev:37.32 (50.4%) stddev-sans-first:39.02 12:33:33 INFO - PROCESS | 13108 | Values: 74.0 74.0 74.0 151.0 74.0 75.0 73.0 77.0 173.0 74.0 12:33:33 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | [#4] audio-oscillator Cycles:10 Average:110.20 Median:94.00 stddev:25.90 (27.6%) stddev-sans-first:26.80 12:33:33 INFO - PROCESS | 13108 | Values: 94.0 94.0 149.0 95.0 95.0 94.0 150.0 94.0 93.0 144.0 12:33:33 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | [#5] imaging-gaussian-blur Cycles:10 Average:117.60 Median:118.00 stddev:0.52 (0.4%) stddev-sans-first:0.50 12:33:33 INFO - PROCESS | 13108 | Values: 117.0 118.0 117.0 118.0 118.0 118.0 118.0 117.0 118.0 117.0 12:33:33 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | [#6] imaging-darkroom Cycles:10 Average:147.60 Median:148.00 stddev:0.84 (0.6%) stddev-sans-first:0.73 12:33:33 INFO - PROCESS | 13108 | Values: 149.0 147.0 147.0 148.0 146.0 147.0 148.0 148.0 148.0 148.0 12:33:33 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | [#7] imaging-desaturate Cycles:10 Average:95.40 Median:95.50 stddev:0.52 (0.5%) stddev-sans-first:0.53 12:33:33 INFO - PROCESS | 13108 | Values: 95.0 96.0 95.0 95.0 95.0 96.0 96.0 95.0 96.0 95.0 12:33:33 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | [#8] json-parse-financial Cycles:10 Average:69.00 Median:68.00 stddev:5.10 (7.5%) stddev-sans-first:5.41 12:33:33 INFO - PROCESS | 13108 | Values: 69.0 66.0 67.0 70.0 67.0 68.0 68.0 83.0 66.0 66.0 12:33:33 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | [#9] json-stringify-tinderbox Cycles:10 Average:64.80 Median:65.00 stddev:0.79 (1.2%) stddev-sans-first:0.83 12:33:33 INFO - PROCESS | 13108 | Values: 65.0 64.0 66.0 65.0 64.0 65.0 64.0 64.0 65.0 66.0 12:33:33 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | [#10] stanford-crypto-aes Cycles:10 Average:82.10 Median:82.00 stddev:3.25 (4.0%) stddev-sans-first:3.35 12:33:33 INFO - PROCESS | 13108 | Values: 80.0 79.0 80.0 80.0 85.0 81.0 82.0 82.0 82.0 90.0 12:33:33 INFO - PROCESS | 13108 | 12:33:33 INFO - PROCESS | 13108 | [#11] stanford-crypto-ccm Cycles:10 Average:140.00 Median:136.50 stddev:14.06 (10.3%) stddev-sans-first:14.68 12:33:33 INFO - PROCESS | 13108 | Values: 133.0 144.0 131.0 139.0 133.0 134.0 133.0 133.0 178.0 142.0 12:33:34 INFO - PROCESS | 13108 | 12:33:34 INFO - PROCESS | 13108 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:181.70 Median:182.00 stddev:3.30 (1.8%) stddev-sans-first:3.50 12:33:34 INFO - PROCESS | 13108 | Values: 182.0 181.0 182.0 186.0 181.0 188.0 178.0 180.0 182.0 177.0 12:33:34 INFO - PROCESS | 13108 | 12:33:34 INFO - PROCESS | 13108 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:75.30 Median:76.00 stddev:1.34 (1.8%) stddev-sans-first:1.41 12:33:34 INFO - PROCESS | 13108 | Values: 75.0 77.0 77.0 76.0 75.0 74.0 76.0 74.0 76.0 73.0 12:33:34 INFO - PROCESS | 13108 | -------- Summary: end -------- 12:33:34 INFO - PROCESS | 13108 | 12:33:34 INFO - TEST-INFO | 13108: exit 0 12:33:34 INFO - TEST-OK | kraken | took 63595ms 12:33:34 INFO - SUITE-END | took 1178s 12:33:35 INFO - Completed test suite (00:19:39) 12:33:35 INFO - javascript benchmark 12:33:35 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2589.766920977112, 2678.54464740994, 2712.823666461681, 2716.6468359113314, 2725.7138000509945, 4607.193741095311, 4618.3303421003975, 4646.51211622779, 4670.579647831694, 4684.765761711909, 4613.515580864003, 4698.694584851983, 4719.07977944301, 4789.497102804199, 4811.783469743861, 4329.26402511573, 4374.825006999717, 4383.3863259143745, 4401.735895846244, 4402.8679139625865, 577.0361885892952, 4295.548967358429, 4364.912701745963, 4418.491873434548, 4440.8001639926115, 4398.296272596369, 4403.581659742319, 4405.118976204756, 4407.228734971367, 4443.37792709021, 4246.2356775780345, 4447.066116115588, 4465.553444655541, 4472.642188624902, 4515.322701594754, 4323.935140972888, 4375.278079116942, 4390.538993405678, 4431.224535706238, 4434.977825110854, 4626.074785043005, 4633.7914793834025, 4651.2557990721325, 4689.695169813951, 4743.407074115736, 5096.745162741885, 5110.8466745997675, 5112.846614601568, 5117.923231151536, 5181.4300426953005, 5189.040027594907, 5194.37667479901, 5197.922031169535, 5207.218917162418, 5208.114620514484, 4810.542998415145, 4817.7591120444185, 4817.8313759018265, 4834.444038935497, 4853.684510506806, 5151.845444636667, 5196.58427325813, 5246.31797866275, 5249.632525723163, 5274.683518988873, 5082.491750824962, 5094.821681241138, 5119.206522988943, 5121.4622464641425, 5159.432462429129, 4933.136701077297, 5183.455737147545, 5192.1952097424955, 5196.68819870809, 5200.219967004904, 5013.573846223112, 5063.620228482805, 5065.696058236517, 5095.87260318495, 5116.820911268088, 4914.90170196594, 5036.7733451994745, 5076.44159142494, 5080.59355251579, 5124.615653825978, 4199.622034016953, 4328.632066274402, 4352.912941741148, 4358.455193100863, 4386.0, 3757.1922036762226, 3790.5451345838123, 3803.0682482791894, 3826.445165450994, 3859.996400935777, 4440.3561483585345, 4458.0, 4466.888327791767, 4470.485894122217, 4511.278195488706, 5198.0, 5210.583153347723, 5211.296474975906, 5215.765290561933, 5223.738813059332, 4356.847510337123, 4423.51341352451, 4444.177827101932, 4498.572635599613, 4502.932456013163, 4592.2193227151465, 4608.193566125915, 4619.792109355087, 4620.214563524209, 4674.789634466457, 4709.458412282632, 4798.256270278112, 4812.639052071108, 4827.710337379698, 4864.197407427735, 5166.173412254021, 5199.48005199477, 5217.921731173959, 5235.188545775411, 5262.473752624707, 4785.545373189541, 4802.711837289774, 4809.398825146856, 4809.567138957511, 4866.90266194667, 4906.63200259989, 5000.1749711297225, 5038.067957427887, 5063.746812659426, 5108.642395032461, 5125.205593133071, 5156.793728250828, 5196.168613021899, 5214.217867319932, 5237.790488380422, 4925.1381008324115, 4930.309756634146, 4931.334269873521, 4937.703737775745, 4992.475790041994, 4795.304680821331, 4917.5328343808715, 4921.557059864629, 4947.18371468718, 4970.602351811919, 4773.284007398779, 4844.491328410607, 4907.067657145131, 4912.066707325596, 4931.9753401232765, 5026.0, 5058.317127187783, 5060.721660308718, 5063.088644044107, 5079.390473143247, 4639.5128511507155, 4961.131801934719, 4967.801287948586, 4979.302897594413, 5009.023240468074], "value": 4670.994703532622, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [585.6749504025267, 607.7143742441051, 607.8146165419547, 628.531743850831, 643.7714611312983, 28593.42813143736, 29281.853590732044, 34757.65242347579, 35380.64619353806, 35540.82229588855, 38651.0, 39424.0, 39456.40815387772, 39526.60473395265, 39529.40705889414, 7634.5037572557885, 7832.451728379016, 7846.489978151402, 7863.921360786405, 7866.488678235896, 7728.304452599265, 7852.882206766903, 7856.567888766115, 7858.449908506407, 7866.842663146734, 8014.078380986203, 8026.398020148483, 8036.27673509384, 8077.071136819253, 8082.515049097044, 7909.209079092102, 7966.163552826985, 7989.360851131895, 8012.839743205132, 8040.994875640574, 7862.095858976234, 7997.280244777998, 8008.719694810654, 8009.799755006114, 8033.076196237449, 39398.80300598479, 39671.8016409919, 40266.194676106315, 40275.194496109914, 40304.79847600743, 3336.8331583420972, 3358.580177477815, 3422.57217847769, 3460.8442620082155, 3674.4855720199193, 29663.53856717798, 29689.0, 29992.55011174834, 30179.69820301791, 30921.8453907729, 3374.6794054564775, 3398.4732366483236, 3409.641987591292, 3440.6559344065645, 3466.116140384211, 245017.0, 245889.0, 246487.0, 246498.0, 247034.7648261765, 30742.385152297276, 31140.065798026095, 53985.0, 54565.454345456834, 54657.72671136698, 32767.18082047968, 32774.67225327764, 32791.50812737811, 33014.17464563357, 33066.504002439986, 13812.0, 13910.234937078558, 13917.86082139186, 13920.234387108603, 13987.580372588838, 11102.333859968428, 11110.888891111146, 11117.722056948642, 11123.332600044023, 11147.498362573704, 8207.768834674727, 8242.381821363422, 8247.381446391544, 8308.875366869503, 8349.872767176475, 3214.9839250804066, 3219.259570298844, 3245.0913744151676, 3275.6724327567053, 3279.2785587170783, 926.5135803703109, 948.6964171465065, 949.924006079512, 976.7069879036261, 1010.9090181883665, 29011.12966611005, 29220.561691574643, 29466.410671786445, 29591.556126658117, 29957.850210748806, 973.6786860336072, 1053.731298518888, 1055.2244100586217, 1078.191356482638, 1079.185215162563, 15555.45555905538, 15823.0, 15941.362345506283, 16037.198140092949, 16181.110038947736, 336691.0, 339692.0, 341830.0, 343701.0, 344274.0, 52240.47759522432, 52795.736021319644, 52801.2079818803, 52804.73597631987, 52921.2061819073, 1226.9447874845653, 1252.511520507003, 1291.806229065629, 1299.7270573179737, 1303.0357535423907, 27461.588076179272, 28447.431051378444, 28631.570526442538, 28665.713342866304, 28728.0, 44722.3291650632, 44756.32865506955, 44835.32747008732, 45062.77468612636, 45173.77413112913, 285596.0, 289517.0, 290957.0, 291346.0, 291449.0, 25882.094126705473, 26003.869980649975, 26331.736682632927, 26394.868025659747, 26493.867530662996, 44309.0, 44346.0, 44467.0, 44530.3320450187, 45584.77207613941, 37719.434208486346, 38265.773914249425, 38754.2249155021, 38797.0, 39449.40825887671, 37687.0, 37784.43323350097, 38389.232215354976, 38742.6125738739, 38877.61122388853, 37405.62594374021, 37982.0, 38161.0, 38259.04352391101, 38436.80781596074, 33131.83434082814, 34089.147771305914, 34632.480512792834, 34646.82676586601, 34719.305613888086, 26154.86922565375, 26289.73710262873, 26451.0, 26546.60180097339, 26686.332841679112], "value": 16794.452742118454, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [382.6766382406866, 384.9826757795899, 386.1157948298397, 399.01642451357435, 399.3769719237989, 15104.546863594096, 16812.41156559521, 17148.742768858476, 17221.22504487298, 17287.0, 17240.655186896285, 17632.294708211688, 17849.10754462278, 18157.546061348472, 18239.361622343222, 5095.082885080684, 5287.127623942045, 5298.09932311508, 5310.548603368718, 5318.893622127555, 3677.8896633100917, 5769.5672824538115, 6034.818955431322, 6087.969560152215, 6100.847478813043, 5231.529162375386, 6011.699415029253, 6020.367861374536, 6021.307549631782, 6033.185519954794, 5562.7774889004395, 5566.332040155166, 5601.971990140044, 5604.047311956957, 5604.635698679573, 5213.087709650796, 5415.512603865671, 5443.700596467193, 5583.832485025456, 5593.664380137164, 12591.118621696485, 12708.682282942907, 12760.0, 12829.61511154667, 17234.0, 1926.5857840564206, 1958.6964020576834, 1983.2562788954142, 2001.9299324523718, 2131.955341882482, 9544.141027307507, 9865.914749377564, 10063.086323697784, 11014.229003969645, 13025.218486890817, 1754.1843042984945, 1755.2715623016434, 1756.332593614431, 1790.1586254460383, 1843.3087592152942, 71406.64296678535, 73091.63454182749, 73540.63229683817, 74020.0, 75161.0, 9771.21830253578, 10067.798644027078, 10333.431661258703, 10377.221708371902, 10456.895431045592, 14184.290785460893, 14281.14313141215, 14282.285885705673, 14305.64235894111, 14322.427102915975, 7479.626464541422, 7555.395568354518, 7588.354989825927, 7626.275503827128, 7712.383009359238, 7191.568505889663, 7317.0, 7370.815729606803, 7397.297256760599, 7423.591702456417, 4365.039691267916, 4416.697074363071, 4465.084657645175, 4506.571875671806, 4583.541645835457, 1686.1822016322074, 1824.6259516799025, 1871.2982631513182, 1898.0, 1902.5053486093716, 922.4926290540176, 958.3770549143113, 962.1725316228038, 1013.8023085498257, 1017.8982101789762, 14646.414143434356, 15784.842151578338, 16033.839661603468, 16197.433089842034, 16323.0, 877.6708734224666, 888.9822203555892, 889.0842432294746, 904.1275169461501, 932.3566738950238, 8089.2315230053055, 9330.206932410822, 9419.529023548932, 9424.293178011676, 9639.566219520138, 415104.0, 417555.0, 418301.0, 419139.0, 424735.0, 74675.62662186654, 75020.0, 77535.0, 79290.60354698305, 79953.20046799458, 981.8330883749637, 985.2364417576435, 991.2367477042781, 994.8507723841482, 1007.1741172238694, 14502.709945801236, 14635.34140963638, 14907.55277341638, 15082.472113475975, 15691.0, 32683.673163268064, 33540.66459335375, 34374.656253438145, 35156.472652910736, 35974.64025359713, 42822.57177428186, 44232.0, 44476.33285500785, 44672.0, 44878.10243795171, 5700.458456446631, 7461.365783908429, 7741.45809793309, 7820.491668041559, 8070.354371650371, 11406.20156589064, 12225.755484890431, 12274.570390036306, 12333.93833030829, 12444.377781111089, 4952.5295096967175, 7568.470207085451, 9202.38958182302, 10062.748431288983, 10427.582896684047, 9978.550965206437, 10124.0, 10128.797424051625, 10170.644027459004, 10419.322744021918, 10564.049235568837, 10645.520951557044, 10695.411752353695, 10983.450827458755, 11099.500522476346, 7874.978868126968, 7909.841803164019, 7990.680372785256, 8157.877631835646, 8282.751517454486, 8136.918630813616, 10348.172146228435, 10685.732856678645, 10844.566217351534, 10925.344479331265], "value": 8247.4361447267, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1504.420797992773, 1527.9915255931085, 1684.83994020568, 1779.4839496546003, 1816.881902676326, 6751.426128779048, 7452.515586486875, 7503.962480187605, 7755.767326980193, 7775.416843736722, 7477.065366829146, 7497.887531687015, 7599.582022988733, 7616.0, 7621.771346859589, 1872.5880306332585, 1884.4629280655015, 1899.1358931686118, 1904.2192700992596, 1905.9237630494763, 2163.426691926633, 2163.8809865457392, 2183.11583808557, 2206.9448263793374, 2213.5904857601313, 2154.5583155453173, 2156.4716644422138, 2158.212252527832, 2161.3407910587266, 2175.9564808703817, 2123.140128248054, 2133.25336132354, 2138.882361470111, 2140.6146893559153, 2147.6563749799957, 2134.237261178148, 2143.389134096775, 2174.282486779359, 2179.1174574297434, 2189.879556624385, 7588.430867684946, 7645.808854778619, 7648.54108753471, 7657.157712651604, 7668.424868134856, 4485.1254005468945, 4631.4673812511655, 4634.953650463486, 4644.489106198315, 4656.324832899245, 2755.2836262571677, 2871.3395918938554, 2884.2887685575492, 2893.3056066544086, 2894.2619631993916, 906.3610154840821, 940.149165005671, 977.4233202410541, 1574.7559128335126, 1624.7400415933394, 9847.950760246225, 9929.702108936743, 9944.105030547213, 9981.151602113756, 9989.550470228785, 4030.879073627796, 4036.2734707752297, 4104.220198162339, 4107.096438783463, 4107.486564179478, 8032.518048917083, 8037.7588672339925, 8059.073206581201, 8065.758027259191, 8072.919270807334, 4427.800748966304, 4544.045750392388, 4579.335996280521, 4579.473360563511, 4584.129015487047, 3791.3554695701796, 4183.079722461053, 4239.745615263094, 4263.126059157865, 4309.181255561433, 3331.1172539277113, 3340.3987282288936, 3440.4323286657423, 3456.291460250693, 3482.59950105736, 1043.6034306963456, 1064.0902028765295, 1078.5524007536942, 1086.4241951765578, 1096.7751610919743, 730.9049823522907, 834.5034704350901, 878.789090618247, 879.384430898361, 886.7650072730731, 4946.332245146859, 5050.3182070420025, 5105.897882042338, 5125.794968201305, 5196.818111366084, 419.53222157295005, 432.9458817647794, 453.28381157770644, 454.56588957545466, 458.92198326284614, 3456.879009234715, 3494.8602055917477, 3500.072480792592, 3519.683228509395, 3536.2397084626928, 9114.40756350835, 9341.673041443517, 9439.764005899908, 9549.09283618055, 9551.808963820684, 9366.67216647414, 9402.952985235166, 9429.3399462037, 9435.716928492157, 9437.103475169848, 7289.781306560812, 7311.780646580611, 7322.084739407681, 7367.373773229336, 7396.297351751575, 5345.38528069277, 5350.117230656898, 5477.780888764405, 5536.141898005815, 5578.776848925998, 8457.238848503664, 8483.321334293118, 8556.10160933093, 8557.0, 8596.226339629464, 8361.289290410383, 8580.184882436159, 8583.0, 8612.0, 8773.254273386578, 5852.678102704393, 6363.331850155852, 6488.351164883474, 6495.285518593046, 6871.862562748817, 7150.713971441084, 7264.927350726425, 7279.4540409468445, 7288.0, 7294.489385742947, 6361.968190159019, 6621.470282377494, 6630.801075967729, 6637.933620663732, 6719.0, 6377.266614339411, 6489.1888513935755, 6506.089147519446, 6612.636305003271, 6641.867162656623, 6027.909581356371, 6110.877782444238, 6142.201513803177, 6157.599756015845, 6177.19696439478, 4199.045126750464, 4271.914561708811, 4356.390105385185, 4406.030673251879, 4513.638779737785, 4443.911121777482, 4474.731516109044, 4479.260921947973, 4505.43682039745, 4525.773711314487], "value": 3992.15214959197, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [302.7169596427339, 309.48470796124457, 318.30609271787523, 319.77296119754965, 320.5848426287957, 4727.314539391786, 4817.325574419579, 4924.0, 4998.225275082359, 5043.117454445471, 4879.072556466119, 4931.580815630676, 4941.555260026596, 4947.554720075193, 4952.405711314647, 3957.3272543667645, 3958.287508248521, 3969.563348031714, 3969.5831937646562, 3976.582458841823, 3671.816409179544, 3934.665553427962, 3940.783256920868, 3984.1434091670285, 3986.70099742519, 3819.8854034379015, 3833.731638785272, 3867.149227170018, 3869.8839034829, 3874.321993651114, 3845.8846234612865, 3849.2101172954713, 3849.40334248192, 3850.7689538627633, 3867.2265546890453, 3407.8296085195643, 3415.84628691707, 3416.760826742129, 3419.7093247074026, 3429.794212347267, 4639.466461356953, 4731.33761273422, 4762.1903676603015, 4781.258904869751, 4801.375821143264, 4321.956780432187, 4345.869623911288, 4382.8904277393, 4393.165298593289, 4413.713108647959, 5156.355455568054, 5156.793728250866, 5183.559397451183, 5187.870303242411, 5190.506901844319, 3611.1694310308776, 3693.0, 3697.1681371691425, 3703.6481534254203, 3714.628537146291, 5393.487618676219, 5430.321209848769, 5440.4015558288165, 5448.400675925645, 5467.234587157801, 3805.9048523786573, 3814.237152569497, 3818.427235914635, 3820.312343778091, 3822.636849499293, 3850.614938506127, 3853.807309634507, 3861.1505468796818, 3864.7294689371474, 3870.2646497165447, 4219.7046206765235, 4382.824687012548, 4402.977985110054, 4407.0, 4407.162639098561, 5185.585153187736, 5190.532852043334, 5201.101597916809, 5228.55557277628, 5233.659812112201, 1300.174389262825, 1365.5766712319212, 1392.997042129665, 1398.1680899864564, 1398.825146856643, 893.1648908270788, 923.7044145873256, 926.545992463688, 937.8686983822271, 942.5946842857637, 4712.952870471251, 4752.477227504972, 4753.619710423158, 4761.5714585686765, 4786.1863483207935, 5587.357453892854, 5618.91571626426, 5624.184493248456, 5634.746436410372, 5649.915251271234, 4666.230072038144, 4708.835190768306, 4768.427788665313, 4769.42766867978, 4776.617870570346, 2979.478591246523, 2997.1757766614355, 3002.8048176868433, 3007.203091180839, 3010.5785190073407, 5219.0, 5290.391604965402, 5292.708901010405, 5295.788168473218, 5296.788128474895, 5224.50367215114, 5559.805406810742, 5575.916361254584, 5753.942460575425, 5798.5071268941765, 5024.648274620815, 5047.141985862486, 5061.31672224245, 5099.87250318745, 5102.285680004802, 5360.946390536201, 5362.92741451719, 5375.763574377836, 5393.325834270716, 5434.755436005468, 5182.300389447376, 5206.583473322201, 5268.578513718817, 5307.867303317448, 5316.175992721134, 5039.571636410946, 5053.938672878589, 5054.646174767731, 5067.5185857343495, 5078.949210507995, 3696.4085746280466, 3700.648438398348, 3712.0163156762937, 3712.461693054438, 3713.628637136265, 5044.924326135184, 5058.571885495056, 5337.492938170868, 5374.328208973879, 5392.406835248041, 5072.467390924047, 5136.871578210575, 5161.200013997836, 5170.508801663836, 5190.247414125006, 5130.896332503656, 5193.636445448782, 5194.402643695872, 5206.271122042993, 5233.188855727369, 4843.789052736815, 5113.386393632639, 5143.768530416065, 5148.43367229612, 5173.767180476812, 5182.300389447376, 5196.818111366084, 5247.2129180623215, 5255.605829562722, 5274.235235890697, 5131.794728210979, 5157.793688252428, 5160.741962901765, 5161.948380516147, 5175.508326708957], "value": 3955.5245833023946, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [699.8775214337492, 787.322902304018, 789.7670187294751, 803.009548766204, 807.4670717326566, 11518.942405287973, 11533.711657208574, 11908.22596531225, 12059.216150950182, 12067.21563098398, 12442.066844986617, 12489.68775780606, 12545.059120565948, 12601.117921745481, 12625.684357891058, 696.2550071423578, 856.2850020233082, 872.7818045488627, 875.2385424680521, 877.473515890467, 863.1282404771164, 865.926396256319, 871.5772850167696, 875.3653601139155, 876.0494863073573, 922.6171138977317, 923.7829110159107, 924.6347692661394, 925.3661242049218, 925.8287216864868, 917.4724533393326, 918.3571499950061, 918.6646873891015, 920.627146005862, 921.4517362169532, 675.9155105611799, 676.9255381907986, 677.0926957876469, 680.0750978669006, 680.3196803196803, 11855.644330670008, 11880.58417955376, 11884.0, 11942.701432464171, 11949.462274197682, 12612.621621351374, 13019.804702929463, 13112.213267203999, 13164.86835131646, 13341.19952802835, 10315.948420257926, 10490.108340791043, 10549.630762923338, 10608.886066962936, 10632.096271816905, 3463.428534291839, 3490.4938783876196, 3499.7550171488006, 3523.0, 3603.045193023851, 46511.30233046507, 46652.33476652342, 46848.063038739376, 47884.0, 48018.5198148021, 10589.788204235872, 10592.788144237073, 10636.255462117577, 10636.41499717523, 10844.620438284623, 19056.71414928777, 19219.903900480407, 19238.903805481164, 19299.421017369503, 19303.034848257532, 7210.174401301532, 7229.89155162673, 7283.344498995116, 7411.592362420119, 7464.104307483137, 3829.0810205550465, 3861.2470568239487, 3863.285292220948, 3865.1110244643887, 3900.863469778544, 3008.3832814273023, 3082.784205105621, 3089.4902341113466, 3230.8869189578722, 3394.35507253621, 583.8160979291509, 590.3240789296232, 595.9303051023423, 605.9636421814705, 605.9727312270959, 516.3007054454864, 590.7489317040327, 613.9386061393825, 626.3266987987931, 658.2474533865484, 7234.891476627855, 7431.0, 7632.0, 7998.0, 8360.28937540316, 542.0622323380495, 602.6625089949642, 605.276694350256, 613.2303958532013, 620.3672254300678, 3595.388783906742, 3850.1914597934747, 3891.9416208756893, 3904.6876249899938, 4002.579729128458, 49587.752061239466, 50837.74581127071, 51603.22595161076, 51618.0, 51632.22551661728, 44790.77604611956, 46774.29838552424, 46886.76556617263, 47114.5288547117, 48753.0, 41830.37254441186, 42045.15909681789, 42785.0, 43099.353509698005, 43188.784056079516, 7276.345128938421, 7434.479586428898, 7489.700411983677, 7608.695652173851, 7618.314351708373, 28774.0, 29108.7089129106, 29635.703642964156, 29811.72071072137, 29815.254618634706, 35347.293054139285, 37256.81371593125, 37515.43726844045, 37807.81096094502, 37985.62014379821, 9740.0, 9827.11555959967, 9938.204943604349, 9943.0, 10090.747731306776, 10396.688099357032, 10498.580056797642, 10499.002594753487, 10743.838842417214, 10855.45722713877, 9447.0, 9477.952610236905, 9577.904220957702, 9864.753381165241, 9973.60105595768, 8883.466991980502, 8917.0, 9030.63877444895, 9172.862407063765, 9891.604335826487, 9735.26985476078, 10003.649872254437, 10564.630237941636, 11008.944955275172, 11049.729281132773, 9415.529223538659, 9499.335046546676, 9506.90493095088, 9682.177014953808, 9711.3202075854, 9173.954130229573, 9361.765955851159, 9563.330566860253, 9607.13535781783, 9623.278254130828], "value": 6016.161782994527, "unit": "score"}], "name": "dromaeo_css", "value": 6282.204305086211, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 111.0, 115.0, 115.0, 117.0, 128.0, 114.0, 117.0, 119.0, 117.0], "value": 117.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 133.0, 151.0, 183.0, 132.0, 158.0, 163.0, 135.0, 199.0, 135.0], "value": 155.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 165.0, 166.0, 170.0, 176.0, 163.0, 163.0, 164.0, 167.0, 163.0], "value": 166.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 74.0, 74.0, 151.0, 74.0, 75.0, 73.0, 77.0, 173.0, 74.0], "value": 91.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 94.0, 149.0, 95.0, 95.0, 94.0, 150.0, 94.0, 93.0, 144.0], "value": 110.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 118.0, 117.0, 118.0, 118.0, 118.0, 118.0, 117.0, 118.0, 117.0], "value": 117.6, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 147.0, 147.0, 148.0, 146.0, 147.0, 148.0, 148.0, 148.0, 148.0], "value": 147.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 95.0, 95.0, 95.0, 96.0, 96.0, 95.0, 96.0, 95.0], "value": 95.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 66.0, 67.0, 70.0, 67.0, 68.0, 68.0, 83.0, 66.0, 66.0], "value": 69.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 64.0, 66.0, 65.0, 64.0, 65.0, 64.0, 64.0, 65.0, 66.0], "value": 64.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 79.0, 80.0, 80.0, 85.0, 81.0, 82.0, 82.0, 82.0, 90.0], "value": 82.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [133.0, 144.0, 131.0, 139.0, 133.0, 134.0, 133.0, 133.0, 178.0, 142.0], "value": 140.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [182.0, 181.0, 182.0, 186.0, 181.0, 188.0, 178.0, 180.0, 182.0, 177.0], "value": 181.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 77.0, 77.0, 76.0, 75.0, 74.0, 76.0, 74.0, 76.0, 73.0], "value": 75.3, "unit": "score"}], "name": "kraken", "value": 1613.8, "alertThreshold": 2.0}]} 12:33:35 INFO - Return code: 0 12:33:35 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 12:33:35 ERROR - # TBPL SUCCESS # 12:33:35 INFO - Running post-action listener: _resource_record_post_action 12:33:35 INFO - Running post-run listener: _resource_record_post_run 12:33:36 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 4096; Write bytes: 349204480; Read time: 8; Write time: 204460 12:33:36 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 68984832; Read time: 0; Write time: 42936 12:33:36 INFO - run-tests - Wall time: 1180s; CPU: 13.0%; Read bytes: 4096; Write bytes: 280219648; Read time: 8; Write time: 161524 12:33:36 INFO - Running post-run listener: _upload_blobber_files 12:33:36 INFO - Blob upload gear active. 12:33:36 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 12:33:36 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 12:33:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 12:33:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 12:33:36 INFO - (blobuploader) - INFO - Open directory for files ... 12:33:36 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 12:33:36 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:33:36 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:33:37 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 12:33:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:33:37 INFO - (blobuploader) - INFO - Done attempting. 12:33:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 12:33:37 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:33:37 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:33:38 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 12:33:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:33:38 INFO - (blobuploader) - INFO - Done attempting. 12:33:38 INFO - (blobuploader) - INFO - Iteration through files over. 12:33:38 INFO - Return code: 0 12:33:38 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 12:33:38 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 12:33:38 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/5eedd673927c10d611cc11953f70de983101389c45a7b798691c41c04fe4d45a0b4128de494b7cd38166fa248fad054a529f1b3da4095e269617474e1d7288a8", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/24b388e0a6239577fee697fe223c00b8ab0a0a676271ae492e24381f062333193ecede2741553f195077cc32bf6e013941e4c4d5778c59c7cea05cbd193cf32a"} 12:33:38 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 12:33:38 INFO - Writing to file /builds/slave/test/properties/blobber_files 12:33:38 INFO - Contents: 12:33:38 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/5eedd673927c10d611cc11953f70de983101389c45a7b798691c41c04fe4d45a0b4128de494b7cd38166fa248fad054a529f1b3da4095e269617474e1d7288a8", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/24b388e0a6239577fee697fe223c00b8ab0a0a676271ae492e24381f062333193ecede2741553f195077cc32bf6e013941e4c4d5778c59c7cea05cbd193cf32a"} 12:33:38 INFO - Running post-run listener: copy_logs_to_upload_dir 12:33:38 INFO - Copying logs to upload dir... 12:33:38 INFO - mkdir: /builds/slave/test/build/upload/logs 12:33:38 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=2135.365626 ========= master_lag: -0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 35 mins, 35 secs) (at 2016-05-04 12:33:37.450552) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-04 12:33:37.453910) ========= 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=6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/5eedd673927c10d611cc11953f70de983101389c45a7b798691c41c04fe4d45a0b4128de494b7cd38166fa248fad054a529f1b3da4095e269617474e1d7288a8", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/24b388e0a6239577fee697fe223c00b8ab0a0a676271ae492e24381f062333193ecede2741553f195077cc32bf6e013941e4c4d5778c59c7cea05cbd193cf32a"} build_url:https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011350 build_url: 'https://queue.taskcluster.net/v1/task/FoFTv3xdQ8KHqpG6K05oQg/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/5eedd673927c10d611cc11953f70de983101389c45a7b798691c41c04fe4d45a0b4128de494b7cd38166fa248fad054a529f1b3da4095e269617474e1d7288a8", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/24b388e0a6239577fee697fe223c00b8ab0a0a676271ae492e24381f062333193ecede2741553f195077cc32bf6e013941e4c4d5778c59c7cea05cbd193cf32a"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-05-04 12:33:37.478141) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-04 12:33:37.478445) ========= 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=6dbc10da6d83fee962c624be000001a8-1462388281.634543-670424731 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004499 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-05-04 12:33:37.561332) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-04 12:33:37.561678) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-05-04 12:33:37.561966) ========= ========= Total master_lag: 0.13 =========