builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-021 starttime: 1472759306.7 results: success (0) buildid: 20160901111321 builduid: f0df6025abeb4b85b733ba7b66f4dc2d revision: d667c9cd84f16752ae92c2b683afcc35e0483ec3 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-09-01 12:48:26.697925) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-09-01 12:48:26.698474) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-01 12:48:26.698787) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-01 12:48:26.713348) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-01 12:48:26.713635) ========= 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=df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-09-01 12:48:26-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 112M=0s 2016-09-01 12:48:26 (112 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.074228 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-01 12:48:26.801792) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-01 12:48:26.802125) ========= 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=df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017508 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-01 12:48:26.852162) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-01 12:48:26.852513) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev d667c9cd84f16752ae92c2b683afcc35e0483ec3 --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 d667c9cd84f16752ae92c2b683afcc35e0483ec3 --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=df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-09-01 12:48:26,973 truncating revision to first 12 chars 2016-09-01 12:48:26,973 Setting DEBUG logging. 2016-09-01 12:48:26,973 attempt 1/10 2016-09-01 12:48:26,973 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/d667c9cd84f1?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-09-01 12:48:27,267 unpacking tar archive at: fx-team-d667c9cd84f1/testing/mozharness/ program finished with exit code 0 elapsedTime=0.629152 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-01 12:48:27.495331) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-01 12:48:27.495646) ========= script_repo_revision: d667c9cd84f16752ae92c2b683afcc35e0483ec3 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-01 12:48:27.496059) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-01 12:48:27.496330) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-01 12:48:27.504994) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 48 secs) (at 2016-09-01 12:48:27.505272) ========= /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=df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 12:48:27 INFO - MultiFileLogger online at 20160901 12:48:27 in /builds/slave/test 12:48:27 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 12:48:27 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 12:48:27 INFO - {'append_to_log': False, 12:48:27 INFO - 'base_work_dir': '/builds/slave/test', 12:48:27 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 12:48:27 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 12:48:27 INFO - 'branch': 'Fx-Team-Non-PGO', 12:48:27 INFO - 'buildbot_json_path': 'buildprops.json', 12:48:27 INFO - 'config_files': ('talos/linux_config.py',), 12:48:27 INFO - 'default_actions': ('clobber', 12:48:27 INFO - 'read-buildbot-config', 12:48:27 INFO - 'download-and-extract', 12:48:27 INFO - 'populate-webroot', 12:48:27 INFO - 'create-virtualenv', 12:48:27 INFO - 'install', 12:48:27 INFO - 'run-tests'), 12:48:27 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 12:48:27 INFO - 'download_minidump_stackwalk': True, 12:48:27 INFO - 'download_symbols': 'ondemand', 12:48:27 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 12:48:27 INFO - 'tooltool.py': '/tools/tooltool.py', 12:48:27 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 12:48:27 INFO - '/tools/misc-python/virtualenv.py')}, 12:48:27 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 12:48:27 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 12:48:27 INFO - 'installer_path': 'installer.exe', 12:48:27 INFO - 'log_level': 'info', 12:48:27 INFO - 'log_name': 'talos', 12:48:27 INFO - 'log_to_console': True, 12:48:27 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 12:48:27 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 12:48:27 INFO - 'opt_config_files': (), 12:48:27 INFO - 'pip_index': False, 12:48:27 INFO - 'sps_profile': False, 12:48:27 INFO - 'sps_profile_interval': 0, 12:48:27 INFO - 'suite': 'dromaeojs-e10s', 12:48:27 INFO - 'system_bits': '32', 12:48:27 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 12:48:27 INFO - 'title': 'talos-linux64-ix-021', 12:48:27 INFO - 'tooltool_cache': '/builds/tooltool_cache', 12:48:27 INFO - 'use_talos_json': True, 12:48:27 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 12:48:27 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 12:48:27 INFO - 'work_dir': 'build'} 12:48:27 INFO - [mozharness: 2016-09-01 19:48:27.719173Z] Running clobber step. 12:48:27 INFO - Running pre-action listener: _resource_record_pre_action 12:48:27 INFO - Running main action method: clobber 12:48:27 INFO - rmtree: /builds/slave/test/build 12:48:27 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 12:48:28 INFO - Running post-action listener: _resource_record_post_action 12:48:28 INFO - [mozharness: 2016-09-01 19:48:28.708363Z] Finished clobber step (success) 12:48:28 INFO - [mozharness: 2016-09-01 19:48:28.708463Z] Running read-buildbot-config step. 12:48:28 INFO - Running pre-action listener: _resource_record_pre_action 12:48:28 INFO - Running main action method: read_buildbot_config 12:48:28 INFO - Using buildbot properties: 12:48:28 INFO - { 12:48:28 INFO - "project": "", 12:48:28 INFO - "product": "firefox", 12:48:28 INFO - "script_repo_revision": "production", 12:48:28 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 12:48:28 INFO - "repository": "", 12:48:28 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 12:48:28 INFO - "buildid": "20160901111321", 12:48:28 INFO - "pgo_build": "False", 12:48:28 INFO - "basedir": "/builds/slave/test", 12:48:28 INFO - "buildnumber": 1559, 12:48:28 INFO - "slavename": "talos-linux64-ix-021", 12:48:28 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 12:48:28 INFO - "platform": "ubuntu64_hw", 12:48:28 INFO - "scheduler": "tests-fx-team-linux64-talos-7-3600", 12:48:28 INFO - "branch": "fx-team", 12:48:28 INFO - "repo_path": "integration/fx-team", 12:48:28 INFO - "revision": "d667c9cd84f16752ae92c2b683afcc35e0483ec3", 12:48:28 INFO - "stage_platform": "linux64", 12:48:28 INFO - "builduid": "f0df6025abeb4b85b733ba7b66f4dc2d", 12:48:28 INFO - "slavebuilddir": "test" 12:48:28 INFO - } 12:48:28 INFO - Found installer url https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 12:48:28 INFO - Running post-action listener: _resource_record_post_action 12:48:28 INFO - [mozharness: 2016-09-01 19:48:28.710940Z] Finished read-buildbot-config step (success) 12:48:28 INFO - [mozharness: 2016-09-01 19:48:28.711030Z] Running download-and-extract step. 12:48:28 INFO - Running pre-action listener: _resource_record_pre_action 12:48:28 INFO - Running main action method: download_and_extract 12:48:28 INFO - mkdir: /builds/slave/test/build/tests 12:48:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:28 INFO - trying https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 12:48:28 INFO - Downloading https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 12:48:28 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 12:48:29 INFO - Downloaded 1361 bytes. 12:48:29 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 12:48:29 INFO - Using the following test package requirements: 12:48:29 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 12:48:29 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 12:48:29 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 12:48:29 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 12:48:29 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 12:48:29 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 12:48:29 INFO - u'jsshell-linux-x86_64.zip'], 12:48:29 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 12:48:29 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 12:48:29 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 12:48:29 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 12:48:29 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 12:48:29 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 12:48:29 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 12:48:29 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 12:48:29 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 12:48:29 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 12:48:29 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 12:48:29 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 12:48: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:29 INFO - trying https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 12:48:29 INFO - Downloading https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 12:48:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:48:30 INFO - Downloaded 20334629 bytes. 12:48:30 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/tests 12:48:34 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 12:48:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:34 INFO - trying https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 12:48:34 INFO - Downloading https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 12:48:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:48:35 INFO - Downloaded 20334629 bytes. 12:48:35 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/tests 12:48:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:40 INFO - trying https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 12:48:40 INFO - Downloading https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 12:48:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 12:48:40 INFO - Downloaded 14413998 bytes. 12:48:40 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/tests 12:48:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:41 INFO - trying https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 12:48:41 INFO - Downloading https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 12:48:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 12:48:42 INFO - Downloaded 55868627 bytes. 12:48:42 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 12:48:42 INFO - mkdir: /builds/slave/test/properties 12:48:42 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 12:48:42 INFO - Writing to file /builds/slave/test/properties/build_url 12:48:42 INFO - Contents: 12:48:42 INFO - build_url:https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 12:48:42 INFO - Running post-action listener: _resource_record_post_action 12:48:42 INFO - Running post-action listener: set_extra_try_arguments 12:48:42 INFO - [mozharness: 2016-09-01 19:48:42.856244Z] Finished download-and-extract step (success) 12:48:42 INFO - [mozharness: 2016-09-01 19:48:42.856472Z] Running populate-webroot step. 12:48:42 INFO - Running pre-action listener: _resource_record_pre_action 12:48:42 INFO - Running main action method: populate_webroot 12:48:42 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 12:48:42 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 12:48:42 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 12:48:42 INFO - '--tppagecycles', 12:48:42 INFO - '7'], 12:48:42 INFO - 'tests': ['tsvgm']}}, 12:48:42 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 12:48:42 INFO - 'tests': ['tresize', 'tcanvasmark']}, 12:48:42 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 12:48:42 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 12:48:42 INFO - 'tests': ['dromaeo_css', 'kraken']}, 12:48:42 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 12:48:42 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:48:42 INFO - 'talos_options': ['--disable-e10s'], 12:48:42 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:48:42 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:48:42 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:48:42 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:48:42 INFO - 'talos_options': ['--disable-e10s'], 12:48:42 INFO - 'tests': ['damp', 'tps']}, 12:48:42 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:48:42 INFO - 'tests': ['damp', 'tps']}, 12:48:42 INFO - 'g3': {'talos_options': ['--disable-e10s'], 12:48:42 INFO - 'tests': ['dromaeo_dom']}, 12:48:42 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 12:48:42 INFO - 'g4': {'talos_options': ['--disable-e10s'], 12:48:42 INFO - 'tests': ['basic_compositor_video']}, 12:48:42 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 12:48:42 INFO - 'other': {'talos_options': ['--disable-e10s'], 12:48:42 INFO - 'tests': ['a11yr', 12:48:42 INFO - 'ts_paint', 12:48:42 INFO - 'tpaint', 12:48:42 INFO - 'sessionrestore', 12:48:42 INFO - 'sessionrestore_no_auto_restore', 12:48:42 INFO - 'tabpaint']}, 12:48:42 INFO - 'other-e10s': {'tests': ['a11yr', 12:48:42 INFO - 'ts_paint', 12:48:42 INFO - 'tpaint', 12:48:42 INFO - 'sessionrestore', 12:48:42 INFO - 'sessionrestore_no_auto_restore', 12:48:42 INFO - 'tabpaint']}, 12:48:42 INFO - 'other-e10s_l64': {'tests': ['a11yr', 12:48:42 INFO - 'ts_paint', 12:48:42 INFO - 'tpaint', 12:48:42 INFO - 'sessionrestore', 12:48:42 INFO - 'sessionrestore_no_auto_restore', 12:48:42 INFO - 'tabpaint']}, 12:48:42 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 12:48:42 INFO - 'ts_paint', 12:48:42 INFO - 'tpaint', 12:48:42 INFO - 'sessionrestore', 12:48:42 INFO - 'sessionrestore_no_auto_restore', 12:48:42 INFO - 'tabpaint']}, 12:48:42 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 12:48:42 INFO - 'tests': ['a11yr', 12:48:42 INFO - 'ts_paint', 12:48:42 INFO - 'tpaint', 12:48:42 INFO - 'sessionrestore', 12:48:42 INFO - 'sessionrestore_no_auto_restore', 12:48:42 INFO - 'tabpaint']}, 12:48:42 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 12:48:42 INFO - 'tests': ['a11yr', 12:48:42 INFO - 'ts_paint', 12:48:42 INFO - 'tpaint', 12:48:42 INFO - 'sessionrestore', 12:48:42 INFO - 'sessionrestore_no_auto_restore', 12:48:42 INFO - 'tabpaint']}, 12:48:42 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 12:48:42 INFO - 'tests': ['tsvgx', 12:48:42 INFO - 'tsvgr_opacity', 12:48:42 INFO - 'tart', 12:48:42 INFO - 'tscrollx', 12:48:42 INFO - 'cart']}, 12:48:42 INFO - 'svgr-e10s': {'tests': ['tsvgx', 12:48:42 INFO - 'tsvgr_opacity', 12:48:42 INFO - 'tart', 12:48:42 INFO - 'tscrollx', 12:48:42 INFO - 'cart']}, 12:48:42 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:48:42 INFO - 'talos_options': ['--disable-e10s'], 12:48:42 INFO - 'tests': ['tp5o']}, 12:48:42 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:48:42 INFO - 'tests': ['tp5o']}, 12:48:42 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:48:42 INFO - 'talos_options': ['--disable-e10s', 12:48:42 INFO - '--xperf_path', 12:48:42 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:48:42 INFO - 'tests': ['tp5n']}, 12:48:42 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:48:42 INFO - 'talos_options': ['--xperf_path', 12:48:42 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:48:42 INFO - 'tests': ['tp5n']}}, 12:48:42 INFO - 'talos.zip': {'path': '', 12:48:42 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 12:48:42 INFO - Running post-action listener: _resource_record_post_action 12:48:42 INFO - [mozharness: 2016-09-01 19:48:42.872872Z] Finished populate-webroot step (success) 12:48:42 INFO - [mozharness: 2016-09-01 19:48:42.872962Z] Running create-virtualenv step. 12:48:42 INFO - Running pre-action listener: _resource_record_pre_action 12:48:42 INFO - Running main action method: create_virtualenv 12:48:42 INFO - Creating virtualenv /builds/slave/test/build/venv 12:48:42 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:48:42 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 12:48:42 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 12:48:42 INFO - Using real prefix '/usr' 12:48:42 INFO - New python executable in /builds/slave/test/build/venv/bin/python 12:48:43 INFO - Installing distribute.............................................................................................................................................................................................done. 12:48:45 INFO - Installing pip.................done. 12:48:45 INFO - Return code: 0 12:48:45 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 12:48:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:48:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:48:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:48:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:48:45 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 0x7f9448e0df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f08230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f02090>, '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 0x1f059b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f05e40>, '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': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', '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:48:45 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:48:45 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:48:45 INFO - Using env: {'DISPLAY': ':0', 12:48:45 INFO - 'HOME': '/home/cltbld', 12:48:45 INFO - 'LANG': 'en_US.UTF-8', 12:48:45 INFO - 'LANGUAGE': 'en_US:en', 12:48:45 INFO - 'LOGNAME': 'cltbld', 12:48:45 INFO - 'MAIL': '/var/mail/cltbld', 12:48:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:48:45 INFO - 'MOZ_NO_REMOTE': '1', 12:48:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:48:45 INFO - 'NO_EM_RESTART': '1', 12:48:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:48:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:48:45 INFO - 'PWD': '/builds/slave/test', 12:48:45 INFO - 'SHELL': '/bin/bash', 12:48:45 INFO - 'SHLVL': '1', 12:48:45 INFO - 'TERM': 'linux', 12:48:45 INFO - 'TMOUT': '86400', 12:48:45 INFO - 'USER': 'cltbld', 12:48:45 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', 12:48:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:48:45 INFO - '_': '/tools/buildbot/bin/python'} 12:48:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:48:45 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:48:45 INFO - Cleaning up... 12:48:45 INFO - Return code: 0 12:48:45 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 12:48:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:48:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:48:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:48:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:48:45 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9448e0df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f08230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f02090>, '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 0x1f059b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f05e40>, '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': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', '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:48:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 12:48:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 12:48:45 INFO - Using env: {'DISPLAY': ':0', 12:48:45 INFO - 'HOME': '/home/cltbld', 12:48:45 INFO - 'LANG': 'en_US.UTF-8', 12:48:45 INFO - 'LANGUAGE': 'en_US:en', 12:48:45 INFO - 'LOGNAME': 'cltbld', 12:48:45 INFO - 'MAIL': '/var/mail/cltbld', 12:48:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:48:45 INFO - 'MOZ_NO_REMOTE': '1', 12:48:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:48:45 INFO - 'NO_EM_RESTART': '1', 12:48:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:48:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:48:45 INFO - 'PWD': '/builds/slave/test', 12:48:45 INFO - 'SHELL': '/bin/bash', 12:48:45 INFO - 'SHLVL': '1', 12:48:45 INFO - 'TERM': 'linux', 12:48:45 INFO - 'TMOUT': '86400', 12:48:45 INFO - 'USER': 'cltbld', 12:48:45 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', 12:48:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:48:45 INFO - '_': '/tools/buildbot/bin/python'} 12:48:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:48:45 INFO - Downloading/unpacking psutil>=3.1.1 12:48:45 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:48:45 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:48:45 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:48:45 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:48:45 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:48:45 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:48:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 12:48:47 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:48:47 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:48:47 INFO - Installing collected packages: psutil 12:48:47 INFO - Running setup.py install for psutil 12:48:47 INFO - building 'psutil._psutil_linux' extension 12:48:47 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:48:48 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:48:48 INFO - building 'psutil._psutil_posix' extension 12:48:48 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:48:48 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:48:48 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:48:48 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:48:48 INFO - Successfully installed psutil 12:48:48 INFO - Cleaning up... 12:48:48 INFO - Return code: 0 12:48:48 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 12:48:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:48:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:48:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:48:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:48:48 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9448e0df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f08230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f02090>, '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 0x1f059b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f05e40>, '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': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', '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:48:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 12:48:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 12:48:48 INFO - Using env: {'DISPLAY': ':0', 12:48:48 INFO - 'HOME': '/home/cltbld', 12:48:48 INFO - 'LANG': 'en_US.UTF-8', 12:48:48 INFO - 'LANGUAGE': 'en_US:en', 12:48:48 INFO - 'LOGNAME': 'cltbld', 12:48:48 INFO - 'MAIL': '/var/mail/cltbld', 12:48:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:48:48 INFO - 'MOZ_NO_REMOTE': '1', 12:48:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:48:48 INFO - 'NO_EM_RESTART': '1', 12:48:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:48:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:48:48 INFO - 'PWD': '/builds/slave/test', 12:48:48 INFO - 'SHELL': '/bin/bash', 12:48:48 INFO - 'SHLVL': '1', 12:48:48 INFO - 'TERM': 'linux', 12:48:48 INFO - 'TMOUT': '86400', 12:48:48 INFO - 'USER': 'cltbld', 12:48:48 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', 12:48:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:48:48 INFO - '_': '/tools/buildbot/bin/python'} 12:48:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:48:48 INFO - Downloading/unpacking mozsystemmonitor==0.3 12:48:48 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:48:48 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:48:48 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:48:48 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:48:48 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:48:48 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:48:50 INFO - Downloading mozsystemmonitor-0.3.tar.gz 12:48:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 12:48:50 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 12:48:50 INFO - Installing collected packages: mozsystemmonitor 12:48:50 INFO - Running setup.py install for mozsystemmonitor 12:48:50 INFO - Successfully installed mozsystemmonitor 12:48:50 INFO - Cleaning up... 12:48:50 INFO - Return code: 0 12:48:50 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 12:48:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:48:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:48:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:48:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:48:50 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9448e0df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f08230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f02090>, '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 0x1f059b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f05e40>, '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': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', '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:48:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 12:48:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 12:48:50 INFO - Using env: {'DISPLAY': ':0', 12:48:50 INFO - 'HOME': '/home/cltbld', 12:48:50 INFO - 'LANG': 'en_US.UTF-8', 12:48:50 INFO - 'LANGUAGE': 'en_US:en', 12:48:50 INFO - 'LOGNAME': 'cltbld', 12:48:50 INFO - 'MAIL': '/var/mail/cltbld', 12:48:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:48:50 INFO - 'MOZ_NO_REMOTE': '1', 12:48:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:48:50 INFO - 'NO_EM_RESTART': '1', 12:48:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:48:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:48:50 INFO - 'PWD': '/builds/slave/test', 12:48:50 INFO - 'SHELL': '/bin/bash', 12:48:50 INFO - 'SHLVL': '1', 12:48:50 INFO - 'TERM': 'linux', 12:48:50 INFO - 'TMOUT': '86400', 12:48:50 INFO - 'USER': 'cltbld', 12:48:50 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', 12:48:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:48:50 INFO - '_': '/tools/buildbot/bin/python'} 12:48:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:48:50 INFO - Downloading/unpacking jsonschema==2.5.1 12:48:50 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:48:50 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:48:50 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:48:50 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:48:50 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:48:50 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:48:52 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:48:52 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 12:48:52 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:48:52 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:48:52 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:48:52 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:48:52 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:48:52 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:48:53 INFO - Downloading functools32-3.2.3-2.tar.gz 12:48:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 12:48:53 INFO - warning: no files found matching '*.txt' 12:48:53 INFO - no previously-included directories found matching 'build' 12:48:53 INFO - no previously-included directories found matching 'dist' 12:48:53 INFO - no previously-included directories found matching '.git*' 12:48:53 INFO - Installing collected packages: jsonschema, functools32 12:48:53 INFO - Running setup.py install for functools32 12:48:53 INFO - warning: no files found matching '*.txt' 12:48:53 INFO - no previously-included directories found matching 'build' 12:48:53 INFO - no previously-included directories found matching 'dist' 12:48:53 INFO - no previously-included directories found matching '.git*' 12:48:53 INFO - Successfully installed jsonschema functools32 12:48:53 INFO - Cleaning up... 12:48:53 INFO - Return code: 0 12:48:53 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 12:48:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:48:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:48:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:48:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:48:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9448e0df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f08230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f02090>, '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 0x1f059b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f05e40>, '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': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', '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:48:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 12:48:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 12:48:53 INFO - Using env: {'DISPLAY': ':0', 12:48:53 INFO - 'HOME': '/home/cltbld', 12:48:53 INFO - 'LANG': 'en_US.UTF-8', 12:48:53 INFO - 'LANGUAGE': 'en_US:en', 12:48:53 INFO - 'LOGNAME': 'cltbld', 12:48:53 INFO - 'MAIL': '/var/mail/cltbld', 12:48:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:48:53 INFO - 'MOZ_NO_REMOTE': '1', 12:48:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:48:53 INFO - 'NO_EM_RESTART': '1', 12:48:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:48:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:48:53 INFO - 'PWD': '/builds/slave/test', 12:48:53 INFO - 'SHELL': '/bin/bash', 12:48:53 INFO - 'SHLVL': '1', 12:48:53 INFO - 'TERM': 'linux', 12:48:53 INFO - 'TMOUT': '86400', 12:48:53 INFO - 'USER': 'cltbld', 12:48:53 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', 12:48:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:48:53 INFO - '_': '/tools/buildbot/bin/python'} 12:48:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:48:53 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 12:48:53 INFO - Cleaning up... 12:48:53 INFO - Return code: 0 12:48:53 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 12:48:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:48:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:48:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:48:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:48:53 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 0x7f9448e0df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f08230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f02090>, '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 0x1f059b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f05e40>, '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': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', '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:48:53 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:48:53 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:48:53 INFO - Using env: {'DISPLAY': ':0', 12:48:53 INFO - 'HOME': '/home/cltbld', 12:48:53 INFO - 'LANG': 'en_US.UTF-8', 12:48:53 INFO - 'LANGUAGE': 'en_US:en', 12:48:53 INFO - 'LOGNAME': 'cltbld', 12:48:53 INFO - 'MAIL': '/var/mail/cltbld', 12:48:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:48:53 INFO - 'MOZ_NO_REMOTE': '1', 12:48:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:48:53 INFO - 'NO_EM_RESTART': '1', 12:48:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:48:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:48:53 INFO - 'PWD': '/builds/slave/test', 12:48:53 INFO - 'SHELL': '/bin/bash', 12:48:53 INFO - 'SHLVL': '1', 12:48:53 INFO - 'TERM': 'linux', 12:48:53 INFO - 'TMOUT': '86400', 12:48:53 INFO - 'USER': 'cltbld', 12:48:53 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', 12:48:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:48:53 INFO - '_': '/tools/buildbot/bin/python'} 12:48:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:48:53 INFO - Downloading/unpacking blobuploader==1.2.4 12:48:53 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:48:53 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:48:53 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:48:53 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:48:53 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:48:53 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:48:55 INFO - Downloading blobuploader-1.2.4.tar.gz 12:48:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 12:48:55 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:48:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:48:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:48:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:48:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:48:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:48:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:48:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 12:48:56 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:48:56 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:48:56 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:48:56 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:48:56 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:48:56 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:48:56 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:48:56 INFO - Downloading docopt-0.6.1.tar.gz 12:48:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 12:48:56 INFO - Installing collected packages: blobuploader, requests, docopt 12:48:56 INFO - Running setup.py install for blobuploader 12:48:56 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 12:48:56 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 12:48:56 INFO - Running setup.py install for requests 12:48:56 INFO - Running setup.py install for docopt 12:48:56 INFO - Successfully installed blobuploader requests docopt 12:48:56 INFO - Cleaning up... 12:48:56 INFO - Return code: 0 12:48:56 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:48:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:48:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:48:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:48:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:48:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:48:56 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 0x7f9448e0df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f08230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f02090>, '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 0x1f059b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f05e40>, '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': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', '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:48:56 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:48:56 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:48:56 INFO - Using env: {'DISPLAY': ':0', 12:48:56 INFO - 'HOME': '/home/cltbld', 12:48:56 INFO - 'LANG': 'en_US.UTF-8', 12:48:56 INFO - 'LANGUAGE': 'en_US:en', 12:48:56 INFO - 'LOGNAME': 'cltbld', 12:48:56 INFO - 'MAIL': '/var/mail/cltbld', 12:48:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:48:56 INFO - 'MOZ_NO_REMOTE': '1', 12:48:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:48:56 INFO - 'NO_EM_RESTART': '1', 12:48:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:48:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:48:56 INFO - 'PWD': '/builds/slave/test', 12:48:56 INFO - 'SHELL': '/bin/bash', 12:48:56 INFO - 'SHLVL': '1', 12:48:56 INFO - 'TERM': 'linux', 12:48:56 INFO - 'TMOUT': '86400', 12:48:56 INFO - 'USER': 'cltbld', 12:48:56 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', 12:48:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:48:56 INFO - '_': '/tools/buildbot/bin/python'} 12:48:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:48:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:48:57 INFO - Running setup.py (path:/tmp/pip-LqvzKT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:48:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:48:57 INFO - Running setup.py (path:/tmp/pip-i6mWIJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:48:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:48:57 INFO - Running setup.py (path:/tmp/pip-RIee_r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:48:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:48:57 INFO - Running setup.py (path:/tmp/pip-1cBWMh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:48:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:48:57 INFO - Running setup.py (path:/tmp/pip-b21b9m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:48:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:48:57 INFO - Running setup.py (path:/tmp/pip-S2tnGf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:48:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:48:57 INFO - Running setup.py (path:/tmp/pip-xh9d1T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:48:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:48:57 INFO - Running setup.py (path:/tmp/pip-O9CfiE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:48:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:48:57 INFO - Running setup.py (path:/tmp/pip-9qLS8I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:48:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:48:57 INFO - Running setup.py (path:/tmp/pip-aNFqP2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:48:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:48:57 INFO - Running setup.py (path:/tmp/pip-07fvx_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:48:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:48:58 INFO - Running setup.py (path:/tmp/pip-RWnPJH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:48:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:48:58 INFO - Running setup.py (path:/tmp/pip-FEntFu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:48:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:48:58 INFO - Running setup.py (path:/tmp/pip-4cFizP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:48:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:48:58 INFO - Running setup.py (path:/tmp/pip-71ZDu7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:48:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:48:58 INFO - Running setup.py (path:/tmp/pip-Cl159u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:48:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:48:58 INFO - Running setup.py (path:/tmp/pip-hBGrJG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:48:58 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:48:58 INFO - Running setup.py install for manifestparser 12:48:58 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 12:48:58 INFO - Running setup.py install for mozcrash 12:48:58 INFO - Running setup.py install for mozdebug 12:48:58 INFO - Running setup.py install for mozdevice 12:48:58 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 12:48:58 INFO - Installing dm script to /builds/slave/test/build/venv/bin 12:48:58 INFO - Running setup.py install for mozfile 12:48:58 INFO - Running setup.py install for mozhttpd 12:48:59 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 12:48:59 INFO - Running setup.py install for mozinfo 12:48:59 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 12:48:59 INFO - Running setup.py install for mozInstall 12:48:59 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 12:48:59 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 12:48:59 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 12:48:59 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 12:48:59 INFO - Running setup.py install for mozleak 12:48:59 INFO - Running setup.py install for mozlog 12:48:59 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 12:48:59 INFO - Running setup.py install for moznetwork 12:48:59 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 12:48:59 INFO - Running setup.py install for mozprocess 12:48:59 INFO - Running setup.py install for mozprofile 12:48:59 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 12:48:59 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 12:48:59 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 12:48:59 INFO - Running setup.py install for mozrunner 12:48:59 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 12:48:59 INFO - Running setup.py install for mozscreenshot 12:49:00 INFO - Running setup.py install for moztest 12:49:00 INFO - Running setup.py install for mozversion 12:49:00 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 12:49:00 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:49:00 INFO - Cleaning up... 12:49:00 INFO - Return code: 0 12:49:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:49:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:49:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:49:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:49:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:49:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:49:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:49:00 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 0x7f9448e0df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f08230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f02090>, '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 0x1f059b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f05e40>, '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': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', '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:49:00 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:49:00 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:49:00 INFO - Using env: {'DISPLAY': ':0', 12:49:00 INFO - 'HOME': '/home/cltbld', 12:49:00 INFO - 'LANG': 'en_US.UTF-8', 12:49:00 INFO - 'LANGUAGE': 'en_US:en', 12:49:00 INFO - 'LOGNAME': 'cltbld', 12:49:00 INFO - 'MAIL': '/var/mail/cltbld', 12:49:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:49:00 INFO - 'MOZ_NO_REMOTE': '1', 12:49:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:49:00 INFO - 'NO_EM_RESTART': '1', 12:49:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:49:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:49:00 INFO - 'PWD': '/builds/slave/test', 12:49:00 INFO - 'SHELL': '/bin/bash', 12:49:00 INFO - 'SHLVL': '1', 12:49:00 INFO - 'TERM': 'linux', 12:49:00 INFO - 'TMOUT': '86400', 12:49:00 INFO - 'USER': 'cltbld', 12:49:00 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', 12:49:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:49:00 INFO - '_': '/tools/buildbot/bin/python'} 12:49:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:49:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:49:00 INFO - Running setup.py (path:/tmp/pip-cBvVPU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:49:00 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:49:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:49:00 INFO - Running setup.py (path:/tmp/pip-RftkNb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:49:00 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:49:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:49:00 INFO - Running setup.py (path:/tmp/pip-UElZwf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:49:00 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:49:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:49:00 INFO - Running setup.py (path:/tmp/pip-r7dUQe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:49:00 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:49:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:49:00 INFO - Running setup.py (path:/tmp/pip-TMhqLJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:49:00 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:49:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:49:00 INFO - Running setup.py (path:/tmp/pip-dDJDcq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:49:00 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:49:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:49:00 INFO - Running setup.py (path:/tmp/pip-n3edna-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:49:00 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:49:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:49:00 INFO - Running setup.py (path:/tmp/pip-AuPMhp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:49:01 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:49:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:49:01 INFO - Running setup.py (path:/tmp/pip-IBHAlf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:49:01 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:49:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:49:01 INFO - Running setup.py (path:/tmp/pip-30bp8A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:49:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.3 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:49:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:49:01 INFO - Running setup.py (path:/tmp/pip-T2ycM5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:49:01 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:49:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:49:01 INFO - Running setup.py (path:/tmp/pip-ceZmDd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:49:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 12:49:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:49:01 INFO - Running setup.py (path:/tmp/pip-lgAi7P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:49:01 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:49:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:49:01 INFO - Running setup.py (path:/tmp/pip-XQjqtr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:49:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 12:49:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:49:01 INFO - Running setup.py (path:/tmp/pip-EPBlbz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:49:01 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:49:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:49:01 INFO - Running setup.py (path:/tmp/pip-sKy66Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:49:01 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:49:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:49:01 INFO - Running setup.py (path:/tmp/pip-P2gxcE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:49:01 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:49:01 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:49:01 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:49:01 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:49:01 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:49:01 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:49:01 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:49:01 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:49:01 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:49:01 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:49:01 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:49:01 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:49:01 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:49:03 INFO - Downloading blessings-1.6.tar.gz 12:49:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 12:49:03 INFO - Installing collected packages: blessings 12:49:03 INFO - Running setup.py install for blessings 12:49:03 INFO - Successfully installed blessings 12:49:03 INFO - Cleaning up... 12:49:03 INFO - Return code: 0 12:49:03 INFO - Done creating virtualenv /builds/slave/test/build/venv. 12:49:03 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:49:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:49:04 INFO - Reading from file tmpfile_stdout 12:49:04 INFO - Current package versions: 12:49:04 INFO - argparse == 1.2.1 12:49:04 INFO - blessings == 1.6 12:49:04 INFO - blobuploader == 1.2.4 12:49:04 INFO - docopt == 0.6.1 12:49:04 INFO - functools32 == 3.2.3-2 12:49:04 INFO - jsonschema == 2.5.1 12:49:04 INFO - manifestparser == 1.1 12:49:04 INFO - mozInstall == 1.12 12:49:04 INFO - mozcrash == 0.17 12:49:04 INFO - mozdebug == 0.1 12:49:04 INFO - mozdevice == 0.48 12:49:04 INFO - mozfile == 1.2 12:49:04 INFO - mozhttpd == 0.7 12:49:04 INFO - mozinfo == 0.9 12:49:04 INFO - mozleak == 0.1 12:49:04 INFO - mozlog == 3.3 12:49:04 INFO - moznetwork == 0.27 12:49:04 INFO - mozprocess == 0.23 12:49:04 INFO - mozprofile == 0.28 12:49:04 INFO - mozrunner == 6.12 12:49:04 INFO - mozscreenshot == 0.1 12:49:04 INFO - mozsystemmonitor == 0.3 12:49:04 INFO - moztest == 0.7 12:49:04 INFO - mozversion == 1.4 12:49:04 INFO - psutil == 3.1.1 12:49:04 INFO - requests == 1.2.3 12:49:04 INFO - wsgiref == 0.1.2 12:49:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:49: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:49:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:49:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:49: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:49:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:49:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:49:04 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 0x7f9448e0df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f08230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f02090>, '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 0x1f059b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f05e40>, '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': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', '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:49:04 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:49:04 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:49:04 INFO - Using env: {'DISPLAY': ':0', 12:49:04 INFO - 'HOME': '/home/cltbld', 12:49:04 INFO - 'LANG': 'en_US.UTF-8', 12:49:04 INFO - 'LANGUAGE': 'en_US:en', 12:49:04 INFO - 'LOGNAME': 'cltbld', 12:49:04 INFO - 'MAIL': '/var/mail/cltbld', 12:49:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:49:04 INFO - 'MOZ_NO_REMOTE': '1', 12:49:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:49:04 INFO - 'NO_EM_RESTART': '1', 12:49:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:49:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:49:04 INFO - 'PWD': '/builds/slave/test', 12:49:04 INFO - 'SHELL': '/bin/bash', 12:49:04 INFO - 'SHLVL': '1', 12:49:04 INFO - 'TERM': 'linux', 12:49:04 INFO - 'TMOUT': '86400', 12:49:04 INFO - 'USER': 'cltbld', 12:49:04 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', 12:49:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:49:04 INFO - '_': '/tools/buildbot/bin/python'} 12:49:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:49:04 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:49:04 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:49:04 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:49:04 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:49:04 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:49:04 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:49:04 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:49:04 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:49:04 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:49:04 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:49:04 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:49:04 INFO - Cleaning up... 12:49:04 INFO - Return code: 0 12:49:04 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 12:49: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:49:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:49:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:49: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:49:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:49:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:49:04 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 0x7f9448e0df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e398a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f08230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f02090>, '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 0x1f059b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f05e40>, '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': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', '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:49:04 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:49:04 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:49:04 INFO - Using env: {'DISPLAY': ':0', 12:49:04 INFO - 'HOME': '/home/cltbld', 12:49:04 INFO - 'LANG': 'en_US.UTF-8', 12:49:04 INFO - 'LANGUAGE': 'en_US:en', 12:49:04 INFO - 'LOGNAME': 'cltbld', 12:49:04 INFO - 'MAIL': '/var/mail/cltbld', 12:49:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:49:04 INFO - 'MOZ_NO_REMOTE': '1', 12:49:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:49:04 INFO - 'NO_EM_RESTART': '1', 12:49:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:49:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:49:04 INFO - 'PWD': '/builds/slave/test', 12:49:04 INFO - 'SHELL': '/bin/bash', 12:49:04 INFO - 'SHLVL': '1', 12:49:04 INFO - 'TERM': 'linux', 12:49:04 INFO - 'TMOUT': '86400', 12:49:04 INFO - 'USER': 'cltbld', 12:49:04 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', 12:49:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:49:04 INFO - '_': '/tools/buildbot/bin/python'} 12:49:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:49:04 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 12:49:04 INFO - Cleaning up... 12:49:04 INFO - Return code: 0 12:49:04 INFO - Running post-action listener: _resource_record_post_action 12:49:04 INFO - Running post-action listener: _start_resource_monitoring 12:49:04 INFO - Starting resource monitoring. 12:49:04 INFO - [mozharness: 2016-09-01 19:49:04.499982Z] Finished create-virtualenv step (success) 12:49:04 INFO - [mozharness: 2016-09-01 19:49:04.500497Z] Running install step. 12:49:04 INFO - Running pre-action listener: _resource_record_pre_action 12:49:04 INFO - Running main action method: install 12:49:04 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:49:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:49:04 INFO - Reading from file tmpfile_stdout 12:49:04 INFO - Detecting whether we're running mozinstall >=1.0... 12:49:04 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 12:49:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 12:49:04 INFO - Reading from file tmpfile_stdout 12:49:04 INFO - Output received: 12:49:04 INFO - Usage: mozinstall [options] installer 12:49:04 INFO - Options: 12:49:04 INFO - -h, --help show this help message and exit 12:49:04 INFO - -d DEST, --destination=DEST 12:49:04 INFO - Directory to install application into. [default: 12:49:04 INFO - "/builds/slave/test"] 12:49:04 INFO - --app=APP Application being installed. [default: firefox] 12:49:04 INFO - mkdir: /builds/slave/test/build/application 12:49:04 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 12:49:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 12:49:20 INFO - Reading from file tmpfile_stdout 12:49:20 INFO - Output received: 12:49:20 INFO - /builds/slave/test/build/application/firefox/firefox 12:49:20 INFO - Running post-action listener: _resource_record_post_action 12:49:20 INFO - [mozharness: 2016-09-01 19:49:20.960462Z] Finished install step (success) 12:49:20 INFO - [mozharness: 2016-09-01 19:49:20.960743Z] Running run-tests step. 12:49:20 INFO - Running pre-action listener: _resource_record_pre_action 12:49:20 INFO - Running main action method: run_tests 12:49:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 12:49:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 12:49:20 INFO - Python 2.7.3 12:49:20 INFO - Return code: 0 12:49:20 INFO - grabbing minidump binary from tooltool 12:49:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:49:20 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f02090>, '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 0x1f059b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f05e40>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 12:49:20 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:49:20 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:49:20 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 12:49:21 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 12:49:21 INFO - Return code: 0 12:49:21 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 12:49:21 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 12:49:21 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 12:49:21 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 12:49:21 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 12:49:21 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/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-021', '--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:49:21 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/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-021 --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:49:21 INFO - Using env: {'DISPLAY': ':0', 12:49:21 INFO - 'HOME': '/home/cltbld', 12:49:21 INFO - 'LANG': 'en_US.UTF-8', 12:49:21 INFO - 'LANGUAGE': 'en_US:en', 12:49:21 INFO - 'LOGNAME': 'cltbld', 12:49:21 INFO - 'MAIL': '/var/mail/cltbld', 12:49:21 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:49:21 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 12:49:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:49:21 INFO - 'MOZ_NO_REMOTE': '1', 12:49:21 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:49:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:49:21 INFO - 'NO_EM_RESTART': '1', 12:49:21 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:49:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:49:21 INFO - 'PWD': '/builds/slave/test', 12:49:21 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:49:21 INFO - 'SHELL': '/bin/bash', 12:49:21 INFO - 'SHLVL': '1', 12:49:21 INFO - 'TERM': 'linux', 12:49:21 INFO - 'TMOUT': '86400', 12:49:21 INFO - 'USER': 'cltbld', 12:49:21 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663', 12:49:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:49:21 INFO - '_': '/tools/buildbot/bin/python'} 12:49:21 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/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-021', '--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:49:21 INFO - mozversion application_buildid: 20160901111321 12:49:21 INFO - mozversion application_changeset: d667c9cd84f16752ae92c2b683afcc35e0483ec3 12:49:21 INFO - mozversion application_display_name: Nightly 12:49:21 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:49:21 INFO - mozversion application_name: Firefox 12:49:21 INFO - mozversion application_remotingname: firefox 12:49:21 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 12:49:21 INFO - mozversion application_vendor: Mozilla 12:49:21 INFO - mozversion application_version: 51.0a1 12:49:21 INFO - mozversion platform_buildid: 20160901111321 12:49:21 INFO - mozversion platform_changeset: d667c9cd84f16752ae92c2b683afcc35e0483ec3 12:49:21 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 12:49:21 INFO - mozversion platform_version: 51.0a1 12:49:21 INFO - using testdate: 1472759361 12:49:21 INFO - actual date: 1472759361 12:49:21 INFO - starting webserver on 'localhost:55099' 12:49:21 INFO - SUITE-START | Running 2 tests 12:49:21 INFO - TEST-START | dromaeo_css 12:49:21 INFO - operating with platform_type : linux_ 12:49:21 INFO - Initialising browser for dromaeo_css test... 12:49:21 INFO - TEST-INFO | started process 9005 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp7VKyIA/profile http://localhost:55099/getInfo.html) 12:49:27 INFO - PROCESS | 9005 | __metrics Screen width/height:1600/1200 12:49:27 INFO - PROCESS | 9005 | colorDepth:24 12:49:27 INFO - PROCESS | 9005 | Browser inner width/height: 1024/697 12:49:27 INFO - PROCESS | 9005 | __metrics 12:49:28 ERROR - PROCESS | 9005 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2998: TypeError: this.tabs is undefined 12:49:29 INFO - TEST-INFO | 9005: exit 0 12:49:29 INFO - Browser initialized. 12:49:29 INFO - Running cycle 1/1 for dromaeo_css test... 12:49:29 INFO - TEST-INFO | started process 9128 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp7VKyIA/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:49:42 INFO - PROCESS | 9128 | RSS: Main: 193187840 12:49:42 INFO - PROCESS | 9128 | 12:50:31 INFO - PROCESS | 9128 | 1472759431712 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:52:44 INFO - PROCESS | 9128 | Cycle 1(1): loaded http://localhost:55099/tests/dromaeo/cssquery-dojo.html (next: http://localhost:55099/tests/dromaeo/cssquery-ext.html) 12:52:46 INFO - PROCESS | 9128 | RSS: Main: 208580608 12:52:46 INFO - PROCESS | 9128 | 12:55:48 INFO - PROCESS | 9128 | Cycle 1(1): loaded http://localhost:55099/tests/dromaeo/cssquery-ext.html (next: http://localhost:55099/tests/dromaeo/cssquery-jquery.html) 12:55:49 INFO - PROCESS | 9128 | RSS: Main: 204947456 12:55:49 INFO - PROCESS | 9128 | 12:58:51 INFO - PROCESS | 9128 | Cycle 1(1): loaded http://localhost:55099/tests/dromaeo/cssquery-jquery.html (next: http://localhost:55099/tests/dromaeo/cssquery-mootools.html) 12:58:51 INFO - PROCESS | 9128 | RSS: Main: 204554240 12:58:51 INFO - PROCESS | 9128 | 13:01:53 INFO - PROCESS | 9128 | Cycle 1(1): loaded http://localhost:55099/tests/dromaeo/cssquery-mootools.html (next: http://localhost:55099/tests/dromaeo/cssquery-prototype.html) 13:01:54 INFO - PROCESS | 9128 | RSS: Main: 197967872 13:01:54 INFO - PROCESS | 9128 | 13:04:57 INFO - PROCESS | 9128 | Cycle 1(1): loaded http://localhost:55099/tests/dromaeo/cssquery-prototype.html (next: http://localhost:55099/tests/dromaeo/cssquery-yui.html) 13:04:58 INFO - PROCESS | 9128 | RSS: Main: 199888896 13:04:58 INFO - PROCESS | 9128 | 13:08:00 INFO - PROCESS | 9128 | Cycle 1(1): loaded http://localhost:55099/tests/dromaeo/cssquery-yui.html (next: http://localhost:55099/tests/dromaeo/cssquery-dojo.html) 13:08:01 INFO - PROCESS | 9128 | RSS: Main: 201236480 13:08:01 INFO - PROCESS | 9128 | 13:08:01 INFO - PROCESS | 9128 | __start_tp_report 13:08:01 INFO - PROCESS | 9128 | _x_x_mozilla_page_load 13:08:01 INFO - PROCESS | 9128 | _x_x_mozilla_page_load_details 13:08:01 INFO - PROCESS | 9128 | |i|pagename|runs| 13:08:01 INFO - PROCESS | 9128 | |0;dojo.html;2634.723354047825;2653.668291463567;2657.0169037456144;2674.7726443252322;2712.050782226221;4774.188387974044;4851.830185943489;4891.095147397729;4939.036887806879;5007.824726134586;4849.927251091236;4902.264660300957;4903.215485522317;4907.926381104277;4956.355673762415;4438.955610443886;4508.97745511272;4532.274836026237;4647.395838540985;4697.201475749113;4617.607503362218;4626.69926454781;4649;4667.089917466095;4689.132510485554;4402.669799765031;4492.168948744493;4510.673373421589;4526.592606665416;4567.1550763108935;4452.3989261449615;4459.866204013852;4472.373867658531;4584.472785629629;4587.059652771174;4482.753448560328;4487.955120448819;4495.460544734653;4510.842120525798;4573.63410927125;4842.830500932486;4866.343043689092;4902.65681402302;4912.287718280829;4937.333459982892;5269.815556455505;5271.947280527223;5277.788888444457;5295.0468915595175;5295.152775555931;5298.81454149103;5319.946800531984;5328.254044433782;5336.573074154058;5370.060239458118;4823.445303790074;4864.78108485119;4870.829520966749;4928.162212423897;4956.033573453142;5461.6996065216;5465.180222966586;5469.507744302952;5513.283273174542;5530.723463826793;5199.74001299941;5232.947670523322;5238.423773384925;5244.554212891947;5318.9202161967605;5127.8718032048755;5218.869528261748;5277.8416647500635;5320.441353657888;5334.946650533522;5261.131913234273;5272.20916862466;5273.156294992783;5273.235380869829;5323.068463018956;5235.842924712265;5242.16125419931;5252.842414727565;5264.842054738364;5323.547498462596;4348.065165989327;4483.50681425043;4504.954950450519;4513.142502924499;4527.524609915911;3922.156736301709;3924.6664033557468;3935.74417662851;3990.620891015349;3990.6408423242046;4556.270996640522;4557.043020965634;4557.72653640776;4578.97710511452;4609.562091601292;5195.792168313225;5306.7611957462;5348.893022139536;5351.51836334724;5402.567794576425;4508.18852606534;4509.751963642031;4522.615577675869;4570;4585.9770701146945;4803.375561177025;4811.879703007383;4813.229883218738;4821.686590371614;4847.418309802846;4772.331873537638;4912.484189160086;4953.925691114636;4959.97520012412;4982.925256121089;5342.198670199501;5361.195820626937;5365.248865158803;5392.649477783932;5411.810586629606;4974.900501989868;4980.750962451791;4983.380451038157;4983.975080124576;5039.798408063783;5083.822066227664;5172.767225474788;5183.740812959412;5204.661696989683;5259.63182577216;5290.127129023668;5303.681779093266;5306.044911915892;5315.069862774077;5318.920216196838;5118.3090282811345;5154.768035438489;5161.561267292323;5169.276301317894;5218.321618189763;5028.1200789860895;5102.438731739431;5168.715720635401;5180.663256888291;5265.78936842522;5060.291559181644;5085.00842335741;5095.363079615048;5117.104506711236;5122.1548444507725;5165.845024649267;5166.121759300852;5209.4530074343165;5220.425753167073;5271.420143784104;4975.402951645826;5001.424836143745;5017.498250175099;5055.87360315995;5074.391073071255 13:08:01 INFO - PROCESS | 9128 | |1;ext.html;546.7157078319274;549.2804426201675;559.4573263933985;562.8592851787054;577.8613132848118;33610.327793444114;37312.81343593282;37329.62670373292;37417.812910935405;37460.25079498409;37783;38218.61781382185;38240.80879595598;38254.8087259564;38334;7605.315521603055;7793.142754297023;7803.687852485894;7803.882941755878;7814.413918956101;7556.131044929848;7593.08882934046;7596.202398748107;7628.160902300742;7635.083789945214;7514;7617.5048621839405;7632.809179770522;7670.463067585271;7703.576303303316;7464.290892365217;7540.698372065111;7542;7547.773566793005;7587.696492140308;7501.28737769911;7574.772756817304;7575.356094731899;7577.2422757724335;7585.544867307924;35768;35948.281034379426;36239.094022649384;36461.45307820385;36500.904972850854;2952.4833154198145;3082.922926926822;3105.534169874537;3179.3164469639137;3344.866205351783;27283.454330913468;27508.17475475739;27784.722152778417;29141.85429072862;29783.404331913458;3499.4051011328133;3522.982385088058;3580.4987301777774;3650.7261955353456;3724.6647801697704;251524;252238;252259;252930;255027.72486137637;30712.84643576768;31674.208144796565;52240.47759522356;52577.474225258025;52619.68450788761;32846;32944.83527582347;32967;32969.340613188084;33081.17297067593;13389.531366402129;13547.25490098054;13561.728765424636;13577.864221357857;13583;10957;11047.72380690489;11055.668329950115;11063.834042489369;11065.557377704801;7648.158702542716;7693.961530192313;7753.728619498291;7764.301212890867;7778.922210777933;2945.381469891347;3020.411019851152;3021.1993821637284;3058.969410305913;3123.2191952012;792.5126047480758;837.9874301885477;901.7790641292794;976.199516396548;980.9901900981041;26597.33506662349;27763;27861.554782229232;28002.29994250119;28276.293092672848;895.9417637853519;949.6723630347519;972.2173650211647;1045.8849526552074;1047.1413440978324;13713.314334283246;14036.157830530201;14203.289835508183;14389.28053597316;14524.564263072125;190468;191423;191760;193298;194463;47113.5288647116;47672.5232747675;47859.5214047862;48098.27852582214;48162.759186204545;1099.5821587796745;1125.971850703739;1127.2672762704144;1128.210252823027;1160.5357856857156;25064.62403063992;26111.608325874746;26470.338241543344;26816;26926.59610105889;41090.79454602708;41551.7922410386;41931.95170120771;41952;42068.158636827706;360149.58279798157;360656;362211;363491;363668;24702.382440439134;24719.38201544976;24822.37944051413;25065.498690026463;25260.115895943552;40652.3902141474;40730.592694073865;41008.384874226314;41063.794681026404;42087.158256835304;34442.655573443946;35111.47332789959;35113;35186;35561;32867.50698739473;34738.48399708123;35072.47391289082;35140.472892907135;35734.46398303976;33912.660873391935;34079.4888076684;34227.315453691284;35006;35074.82462587773;29864.402711946073;32126;32395.19012024718;32459.20978964984;32522.512162318057;23752.762472375747;24309.635355470036;24384.6342304862;24427.75572244326;24537.263882083567 13:08:01 INFO - PROCESS | 9128 | |2;jquery.html;359.66012118547985;362.6319285924787;365.3241503219045;374.68713624123853;389.4605970730539;15597.376104955802;15855.365785368585;15916.92041539792;15971.121588312639;16013.19934003301;14022.78965815511;16216.432424865132;16294.185290735446;16512.17439128042;16943.237554310086;4537.205988951929;4793.113274044295;4823.0353929214125;4832.685875418104;4834.564889159975;3433.3476639438427;4689.88275293117;4728.645351598644;5242.2660827484;5470.234167216593;5555.638883472581;5559.805406810762;5564.443555644443;5580.190872323511;5601.187827764971;5365.275687782138;5551.084071128279;5576.86057848553;5578.665280083167;5591.944080559183;5301.60237982149;5329.600279979017;5353.625246232766;5376.086065368897;5388.218708287276;11967.581134660246;12302.261864288172;12420.316882571455;12555.623331300076;12687.809682854764;1786.767720196366;1825.516238196879;1837.200817644329;1867.7571915651015;1891.9337823176122;9037.412568183046;9176.8623470648;9250.583723732381;9716.90283097167;9729.90270097297;1754.3859649122833;1788.5171003829023;1790.301782304889;1794.2105473591578;1803;70026.29973700248;71844.64077679579;72251;72514.63742681306;73754.63122684353;9744.756381090388;9849.950750246202;9875.901240987641;10178.745531361776;10244.641437549799;13929;13940.86059139416;13944.16335019902;13987.650308742363;13989.650258743613;7171.39043181325;7352.411807055422;7441.441891858132;7582.431317651198;7723.459357844897;7056.082709247765;7154.141503019671;7374.557526548424;7400.555966642019;7465.776026719207;4207.978960105241;4232.195882782262;4307.22469955411;4429.269170586817;4448.933266001012;1679.8162388894389;1753.4919968826798;1809.3757653609484;1833.6791061564172;1877.0614692653674;776.7242628866784;776.9417293702995;855.1662129423762;865.2731705367521;899.7840518275567;16312.918435407984;16499.917500412423;16782.832171678372;17105.657886842193;17544.736828947574;767.3094215206359;772.9458937874294;805.2269820971933;830.1408042675802;878.5607196401799;9327.393719408217;9517.333786634868;9646.372985756043;9699;9883.901160988442;377019;382880;384196;385536;386191;73515;76190;76663.61668191735;76669;76775.61612192015;867.119873328572;869.7040200834897;888.4269646078243;898.0166717444388;899.5322432335149;14997.850021499646;15019.474318398803;15076.170810605521;15374.615634608777;15715.764263535828;36394.09014774546;36413.81793091124;36820.07949801169;37270.44094338533;37605.05987350338;47670.28494572653;48417.27374089462;54728.726356367966;56958;57106.42893571011;7423.888641670272;7842.529448233125;7893.881591776243;8092.473989190684;8104.27061564462;9228.907710923073;9375.73427587267;11815.291082535075;12064.155509114278;12067.698307542381;5193.169092945111;10030.598776048877;10110.949445252727;10168.440735759605;10529.736756581147;10018.799624007333;10072.7694368364;10168.389896606228;10220.233482488991;10521.842172367267;5441.319835020622;7111.502194846311;8558.78603034929;10724.195685323475;10733.302335348177;6540.476761859135;7754.457187996786;7856.292933635772;8024.799380015546;8174.305184059422;8728.476291422536;10395.376277423378;10432.582696692047;10512.894871051498;10608.893911061099 13:08:01 INFO - PROCESS | 9128 | |3;mootools.html;1346.616214378902;1372.1424109931293;1432;1635.1905806625723;1661.235831517502;7015.964920175405;7622.542647441151;7682.270184332493;8216.178382161788;8225.25972662461;7833.725819596315;8106.432549721522;8106.837863242732;8106.905567748352;8118.634661440235;2222.088943533148;2248.6064938635755;2255.109231853417;2255.5150642611834;2257.424356789025;2137.668661357492;2176.836737244705;2197.7142971413696;2200.1639377036704;2201.196563254409;2180.7819218078143;2194.7585765565773;2213.6347502662043;2216.612092883739;2261.1407665087245;2170.978290217093;2178.7276590426195;2186.7813218678166;2187.037703410502;2190.6823510591034;2151.128792838903;2156.223759446598;2158.2769772126358;2178.3900507857825;2185.344396681005;7955.920440795576;8157.388195885333;8170.060443049066;8188.222118898755;8206.917930820675;4526.818927242906;4650.465196502378;4665.603423708989;4667.486576476585;4677.391939047936;2916.300087978891;2921.6932222116798;2952.3652414730936;3036.6811484794;3037.6810434904237;900.2887718702217;943.2689665509216;951.4196340232453;954.4702690007043;954.575214029757;10424.94787526065;10494.790104197873;10524.158067354594;10550.366977981346;10613.787724245549;3986.4418981342637;4110.7328023678365;4251.192273468031;4307.246231909466;4328.177646247203;9071.863922041175;9089.863652045224;9091.954540227389;9107.499087550115;9110.362274640844;4643.721376717408;4690.343351930733;4693.014466961908;4697.295405689174;4710.528947105262;3547.184147646056;4172.436721042621;4285.935710964338;4317.7193482423545;4322.157179349996;3703.7037037037207;3777.471154038437;3842.442845787401;3923;3955.7824319662695;1216.9391530423443;1225.2709637765515;1227.864934857165;1241.9689507762378;1252.5303011370736;706.5548704316247;743.9367653749492;785.2775446589037;814.4746638418305;820.8794994832011;5105.5149760772665;5110.2590124431745;5121.641485096082;5212.5569326607665;5384.9730751346;395.51549352043514;413.115931905722;413.8737685006102;416.3151615592394;420.81273833143956;3620;3644.7084233261276;3668.6514781095752;3688.428293614494;3711.5339440920684;9649.614015439443;9941.105300522988;10004;10020.198384129399;10104.74738131538;9713.562889669982;9749.171320437701;9898.65354712596;9933;9973.301868869255;7451.776446706607;7481.476296659291;7518.436117291116;7526.5107767994905;7547.132079810783;5197.792088316425;5203.141481655484;5314.176302673091;5319;5516.751746171512;8940;9106.863397048917;9116.635334586808;9204.539773011189;9240.214581760625;8630.82738345217;8790.736277911672;8852.070532593985;9221.400608960395;9331;6109.725062372293;6490.221173459215;6627.23786764509;6698.765543205965;6924.549904256207;7587.127480339832;7599.772006839804;7643.541387516767;7645.579493127709;7649.158592554926;6870.45036397077;7021.5787052777;7030.543014704028;7031.824204394931;7177.892331614926;6412.35876412355;6594.373534514213;6634.369734875179;6737.696803643946;6792.320767923168;6522.184726909137;6577.2107347116735;6604.735810567524;6619.304972977768;6700.865982680221;4519.751413672279;4535.501094879626;4593.44878614555;4599.885002874821;4725.267583524559;4499.707519011254;4560.88597785058;4569.565891240327;4701.694389864648;4707.058588282289 13:08:01 INFO - PROCESS | 9128 | |4;prototype.html;291.13387671676765;297.7885701152182;304.7333583114775;305.95257735051064;307.2840282142608;4826.404328775058;4903.803847846082;5048.873778155548;5071.644984851057;5081.999999999995;4935.3337299464565;4966.776495057722;5037.4458809530925;5051.419086805018;5062.316587260719;3983.880483585497;3992.361222204448;3997.5202975642965;4000.719949603529;4017.558068612465;3931.9017024574327;3959.3467077932105;4000.159966407058;4028.9597104028876;4053.8581149659767;3909.706771992098;3916.159405079622;3920.725764126656;3929.8799842045023;3938.6258305460933;3940.586238444965;3942.9211415771665;3943.8225279862477;3950.802459876995;3964.920701585981;3516.4022116240044;3530.1880567469625;3535.345960997198;3537.9115522111897;3563;4674.813007479696;4906.754662266872;4974.950250497485;5037.672551284191;5039.92440113395;4442.466903971512;4450.977745111286;4468.329750537413;4478.238699421074;4494.325851122358;5264.394359720284;5300.814471493518;5355.973220133875;5364.973175134139;5386.5152136307925;3649.39784935488;3695.9630403695887;3714.182879766447;3718.6572459350436;3774.4338349247832;5485.424030476823;5499.50504454601;5521.3926468088475;5522.30971128609;5531.557475401998;3776.4712940188397;3780.336651873167;3800.543934727795;3804.2201348723447;3822.598627144165;3768.924621507609;3843.7501562398356;3854.7494412863075;3858.8070596470066;3860.942085868714;4303.1393721255245;4387.210302145644;4387.605115539553;4392.143532011227;4394.209042372404;5319.175527793198;5341.118715411992;5342.545883599938;5345.732713364317;5349.652272602269;1263.368315842079;1299.4542292237284;1319.182107093589;1326.9517081505696;1330.9534166304327;881.5812489067641;895.3329769321897;915.9679411220709;922.5894476957824;927.2535608834953;4578.816847326069;4580.519045500175;4591.265397536378;4595.816167353269;4599.632029437637;5424.996375670514;5435.211894275308;5436.103042997861;5440.510354068153;5440.619156659075;4388.034632380871;4491.797869095899;4530.70550414222;4532.614727748179;4610.7694615269775;2526.974730252674;2547.1467058535227;2560.2191331643653;2563.4360440703017;2563.897444102215;4458.509563947963;4513.345564893138;4516.683832131719;4520.367148599199;4522.326739106552;4681.695689780154;4910.90178196434;4918.90162196754;4954.777035033432;4964.354633897642;4484.439445069366;4500.437445319335;4507.6168525675685;4518.84769383805;4534.659900507475;4817.518977726404;4838.927416088832;4839.3141806297845;4855.344528488608;4898.167311556973;4620.722756634613;4669.556392142741;4696.694714843524;4728.3380326753595;4773.687236010125;4691.5308469152815;5088.949110508847;5093.2105523643895;5124.205748109049;5142.100132476727;3844.519435070616;3847.711421643332;3848.230353929281;3863.188730366542;3881.8835434936996;5293.60297977661;5575.526080283222;5576.944230557642;5580.9162862557905;5592.69240191777;5172.818951336685;5270.73646317675;5281.57747380201;5282.392524859691;5323.946760532345;5307.495787900143;5330.786768529216;5342.519173274424;5362.115250983544;5382.327209098863;5127.743612819419;5242.842714718565;5269.340157850265;5271.841844744664;5273.393559740679;5341.893162136813;5356.143017117242;5374.381946076252;5398.568114550905;5408.405075441777;5250;5273.947260527346;5293.894122117613;5301.814436494704;5319.335083114611 13:08:01 INFO - PROCESS | 9128 | |5;yui.html;580.6051884718391;612.1796792298325;696.5020010692353;715.712054409933;727.5561907236588;13132.868671313285;13630.250336231491;13775.51785687501;14122.576322710309;14138.787918181235;12432.440540175714;13046.347682615879;13145.605631831037;13163.07858449909;13172.275524846129;724.7390939261861;737.7823542055106;738.6786747764712;738.7008261654039;740.0933856026378;586.3198689520158;724.5906063074373;739.9482036257464;743.7582785594676;746.358132006474;770.7186876789988;775.4068137874531;780.3445106110865;780.55898417394;783.8197214640636;770.5453782268461;771.5717776633966;772.2393442459173;774.3534148985603;775.7633921653893;569.115026134365;569.6610516742574;571.0549041336594;571.7370009795499;572.6678526454647;11775.7056073598;11881.049516038782;11887.524499020028;11888.821667674993;11926;13318.334083295797;13561.258089027735;13804.654883627889;13939.093958892741;13981.370838312301;9706.029397060309;9816.65641702537;10094.545745441474;10564.418956957365;10688.14494840411;4092.1201941582704;4115.691323150776;4115.773632450214;4125.566815484391;4162.771047592381;52262;52286.47713522854;52338.1492776079;52624;52720.94558108855;9821.165200957856;10064.899351006543;10144.442055687008;10210.846837297298;10218.386896786216;17236.138193090545;18373;18373.908130459262;18389.90805045966;18481.445556633324;7014.368706816411;7060.258672839381;7065.57606543609;7091.858162836715;7362.3373896349585;3736.688295606475;3780.4518344839844;3798.2023775007005;3826.7895265760094;3838.2899163654815;2910.650721913384;3011.0816201058888;3029.257831831171;3032.150997720642;3034.6192482420447;516.9534741873174;519.4364114935338;519.9168133098686;524.0279281931961;530.6444682063027;368.71793078294587;455.1852184589614;484.2832607740564;525.9579233661298;528.3791544934686;7638.847223055508;8328.208820162075;8360.12218717026;8364.37267204962;8436.915630843736;475.3653872080811;493.9947207432857;505.68142070495355;518.9429162792089;584.885947240284;3788.924221515554;3827.885163445101;3851.8651847185215;3891.066144125446;3957.722959392815;102824.48587757163;106153;106332;107140;111266;87113.56443217743;89497;90453.45705623878;90713;94566;81278;84539.5773021131;84835.57582212049;85347;85500;7076;7142.821439461014;7224.458165637493;7324.414046876131;7371;44651.77674111609;45329.320060198464;46540.7672961633;46568.53431465642;47944.28083578679;47934;64136;65688.34311657013;66044.33955660382;66392.66803665951;8910.910890891008;8935.151160639729;9169.35814492979;9307.69692243073;9408.106229908148;9872.85190722154;9929.404235745878;9951.047426521454;9977;10084.294099412971;9826.705198844045;9864.112229899343;9878.75303117399;10794.73013174677;10847.67456976292;9390.429309311516;9516.429014259167;9657.275704322345;9674.613015479303;9703.320767546204;9957.20342372594;10132.44271565071;10239.846402303823;10524.421156836448;10699.090577301016;8115.75652730419;8171.673133074611;8173.836523269621;8328.375371847014;8329.208725171098;8367.497950123012;8959.865602015845;9009.27925765924;9016.413933094327;9026.277897768294 13:08:01 INFO - PROCESS | 9128 | __end_tp_report 13:08:01 INFO - PROCESS | 9128 | __start_cc_report 13:08:01 INFO - PROCESS | 9128 | _x_x_mozilla_cycle_collect,362 13:08:01 INFO - PROCESS | 9128 | __end_cc_report 13:08:01 INFO - PROCESS | 9128 | __startTimestamp1472760481156__endTimestamp 13:08:01 INFO - PROCESS | 9128 | 13:08:01 INFO - PROCESS | 9128 | ------- Summary: start ------- 13:08:01 INFO - PROCESS | 9128 | Number of tests: 6 13:08:01 INFO - PROCESS | 9128 | 13:08:01 INFO - PROCESS | 9128 | [#0] dojo.html Cycles:165 Average:4885.48 Median:4983.38 stddev:528.20 (10.6%) stddev-sans-first:499.44 13:08:01 INFO - PROCESS | 9128 | Values: 2634.7 2653.7 2657.0 2674.8 2712.1 4774.2 4851.8 4891.1 4939.0 5007.8 4849.9 4902.3 4903.2 4907.9 4956.4 4439.0 4509.0 4532.3 4647.4 4697.2 4617.6 4626.7 4649.0 4667.1 4689.1 4402.7 4492.2 4510.7 4526.6 4567.2 4452.4 4459.9 4472.4 4584.5 4587.1 4482.8 4488.0 4495.5 4510.8 4573.6 4842.8 4866.3 4902.7 4912.3 4937.3 5269.8 5271.9 5277.8 5295.0 5295.2 5298.8 5319.9 5328.3 5336.6 5370.1 4823.4 4864.8 4870.8 4928.2 4956.0 5461.7 5465.2 5469.5 5513.3 5530.7 5199.7 5232.9 5238.4 5244.6 5318.9 5127.9 5218.9 5277.8 5320.4 5334.9 5261.1 5272.2 5273.2 5273.2 5323.1 5235.8 5242.2 5252.8 5264.8 5323.5 4348.1 4483.5 4505.0 4513.1 4527.5 3922.2 3924.7 3935.7 3990.6 3990.6 4556.3 4557.0 4557.7 4579.0 4609.6 5195.8 5306.8 5348.9 5351.5 5402.6 4508.2 4509.8 4522.6 4570.0 4586.0 4803.4 4811.9 4813.2 4821.7 4847.4 4772.3 4912.5 4953.9 4960.0 4982.9 5342.2 5361.2 5365.2 5392.6 5411.8 4974.9 4980.8 4983.4 4984.0 5039.8 5083.8 5172.8 5183.7 5204.7 5259.6 5290.1 5303.7 5306.0 5315.1 5318.9 5118.3 5154.8 5161.6 5169.3 5218.3 5028.1 5102.4 5168.7 5180.7 5265.8 5060.3 5085.0 5095.4 5117.1 5122.2 5165.8 5166.1 5209.5 5220.4 5271.4 4975.4 5001.4 5017.5 5055.9 5074.4 13:08:01 INFO - PROCESS | 9128 | 13:08:01 INFO - PROCESS | 9128 | [#1] ext.html Cycles:180 Average:41420.00 Median:35112.24 stddev:73261.32 (208.6%) stddev-sans-first:73402.56 13:08:01 INFO - PROCESS | 9128 | Values: 546.7 549.3 559.5 562.9 577.9 33610.3 37312.8 37329.6 37417.8 37460.3 37783.0 38218.6 38240.8 38254.8 38334.0 7605.3 7793.1 7803.7 7803.9 7814.4 7556.1 7593.1 7596.2 7628.2 7635.1 7514.0 7617.5 7632.8 7670.5 7703.6 7464.3 7540.7 7542.0 7547.8 7587.7 7501.3 7574.8 7575.4 7577.2 7585.5 35768.0 35948.3 36239.1 36461.5 36500.9 2952.5 3082.9 3105.5 3179.3 3344.9 27283.5 27508.2 27784.7 29141.9 29783.4 3499.4 3523.0 3580.5 3650.7 3724.7 251524.0 252238.0 252259.0 252930.0 255027.7 30712.8 31674.2 52240.5 52577.5 52619.7 32846.0 32944.8 32967.0 32969.3 33081.2 13389.5 13547.3 13561.7 13577.9 13583.0 10957.0 11047.7 11055.7 11063.8 11065.6 7648.2 7694.0 7753.7 7764.3 7778.9 2945.4 3020.4 3021.2 3059.0 3123.2 792.5 838.0 901.8 976.2 981.0 26597.3 27763.0 27861.6 28002.3 28276.3 895.9 949.7 972.2 1045.9 1047.1 13713.3 14036.2 14203.3 14389.3 14524.6 190468.0 191423.0 191760.0 193298.0 194463.0 47113.5 47672.5 47859.5 48098.3 48162.8 1099.6 1126.0 1127.3 1128.2 1160.5 25064.6 26111.6 26470.3 26816.0 26926.6 41090.8 41551.8 41932.0 41952.0 42068.2 360149.6 360656.0 362211.0 363491.0 363668.0 24702.4 24719.4 24822.4 25065.5 25260.1 40652.4 40730.6 41008.4 41063.8 42087.2 34442.7 35111.5 35113.0 35186.0 35561.0 32867.5 34738.5 35072.5 35140.5 35734.5 33912.7 34079.5 34227.3 35006.0 35074.8 29864.4 32126.0 32395.2 32459.2 32522.5 23752.8 24309.6 24384.6 24427.8 24537.3 13:08:01 INFO - PROCESS | 9128 | 13:08:01 INFO - PROCESS | 9128 | [#2] jquery.html Cycles:180 Average:23838.51 Median:4808.07 stddev:63436.41 (1319.4%) stddev-sans-first:63589.87 13:08:01 INFO - PROCESS | 9128 | Values: 359.7 362.6 365.3 374.7 389.5 15597.4 15855.4 15916.9 15971.1 16013.2 14022.8 16216.4 16294.2 16512.2 16943.2 4537.2 4793.1 4823.0 4832.7 4834.6 3433.3 4689.9 4728.6 5242.3 5470.2 5555.6 5559.8 5564.4 5580.2 5601.2 5365.3 5551.1 5576.9 5578.7 5591.9 5301.6 5329.6 5353.6 5376.1 5388.2 11967.6 12302.3 12420.3 12555.6 12687.8 1786.8 1825.5 1837.2 1867.8 1891.9 9037.4 9176.9 9250.6 9716.9 9729.9 1754.4 1788.5 1790.3 1794.2 1803.0 70026.3 71844.6 72251.0 72514.6 73754.6 9744.8 9850.0 9875.9 10178.7 10244.6 13929.0 13940.9 13944.2 13987.7 13989.7 7171.4 7352.4 7441.4 7582.4 7723.5 7056.1 7154.1 7374.6 7400.6 7465.8 4208.0 4232.2 4307.2 4429.3 4448.9 1679.8 1753.5 1809.4 1833.7 1877.1 776.7 776.9 855.2 865.3 899.8 16312.9 16499.9 16782.8 17105.7 17544.7 767.3 772.9 805.2 830.1 878.6 9327.4 9517.3 9646.4 9699.0 9883.9 377019.0 382880.0 384196.0 385536.0 386191.0 73515.0 76190.0 76663.6 76669.0 76775.6 867.1 869.7 888.4 898.0 899.5 14997.9 15019.5 15076.2 15374.6 15715.8 36394.1 36413.8 36820.1 37270.4 37605.1 47670.3 48417.3 54728.7 56958.0 57106.4 7423.9 7842.5 7893.9 8092.5 8104.3 9228.9 9375.7 11815.3 12064.2 12067.7 5193.2 10030.6 10110.9 10168.4 10529.7 10018.8 10072.8 10168.4 10220.2 10521.8 5441.3 7111.5 8558.8 10724.2 10733.3 6540.5 7754.5 7856.3 8024.8 8174.3 8728.5 10395.4 10432.6 10512.9 10608.9 13:08:01 INFO - PROCESS | 9128 | 13:08:01 INFO - PROCESS | 9128 | [#3] mootools.html Cycles:180 Average:5196.69 Median:4708.79 stddev:2939.70 (62.4%) stddev-sans-first:2933.70 13:08:01 INFO - PROCESS | 9128 | Values: 1346.6 1372.1 1432.0 1635.2 1661.2 7016.0 7622.5 7682.3 8216.2 8225.3 7833.7 8106.4 8106.8 8106.9 8118.6 2222.1 2248.6 2255.1 2255.5 2257.4 2137.7 2176.8 2197.7 2200.2 2201.2 2180.8 2194.8 2213.6 2216.6 2261.1 2171.0 2178.7 2186.8 2187.0 2190.7 2151.1 2156.2 2158.3 2178.4 2185.3 7955.9 8157.4 8170.1 8188.2 8206.9 4526.8 4650.5 4665.6 4667.5 4677.4 2916.3 2921.7 2952.4 3036.7 3037.7 900.3 943.3 951.4 954.5 954.6 10424.9 10494.8 10524.2 10550.4 10613.8 3986.4 4110.7 4251.2 4307.2 4328.2 9071.9 9089.9 9092.0 9107.5 9110.4 4643.7 4690.3 4693.0 4697.3 4710.5 3547.2 4172.4 4285.9 4317.7 4322.2 3703.7 3777.5 3842.4 3923.0 3955.8 1216.9 1225.3 1227.9 1242.0 1252.5 706.6 743.9 785.3 814.5 820.9 5105.5 5110.3 5121.6 5212.6 5385.0 395.5 413.1 413.9 416.3 420.8 3620.0 3644.7 3668.7 3688.4 3711.5 9649.6 9941.1 10004.0 10020.2 10104.7 9713.6 9749.2 9898.7 9933.0 9973.3 7451.8 7481.5 7518.4 7526.5 7547.1 5197.8 5203.1 5314.2 5319.0 5516.8 8940.0 9106.9 9116.6 9204.5 9240.2 8630.8 8790.7 8852.1 9221.4 9331.0 6109.7 6490.2 6627.2 6698.8 6924.5 7587.1 7599.8 7643.5 7645.6 7649.2 6870.5 7021.6 7030.5 7031.8 7177.9 6412.4 6594.4 6634.4 6737.7 6792.3 6522.2 6577.2 6604.7 6619.3 6700.9 4519.8 4535.5 4593.4 4599.9 4725.3 4499.7 4560.9 4569.6 4701.7 4707.1 13:08:01 INFO - PROCESS | 9128 | 13:08:01 INFO - PROCESS | 9128 | [#4] prototype.html Cycles:180 Average:4296.45 Median:4645.14 stddev:1251.24 (26.9%) stddev-sans-first:1218.09 13:08:01 INFO - PROCESS | 9128 | Values: 291.1 297.8 304.7 306.0 307.3 4826.4 4903.8 5048.9 5071.6 5082.0 4935.3 4966.8 5037.4 5051.4 5062.3 3983.9 3992.4 3997.5 4000.7 4017.6 3931.9 3959.3 4000.2 4029.0 4053.9 3909.7 3916.2 3920.7 3929.9 3938.6 3940.6 3942.9 3943.8 3950.8 3964.9 3516.4 3530.2 3535.3 3537.9 3563.0 4674.8 4906.8 4975.0 5037.7 5039.9 4442.5 4451.0 4468.3 4478.2 4494.3 5264.4 5300.8 5356.0 5365.0 5386.5 3649.4 3696.0 3714.2 3718.7 3774.4 5485.4 5499.5 5521.4 5522.3 5531.6 3776.5 3780.3 3800.5 3804.2 3822.6 3768.9 3843.8 3854.7 3858.8 3860.9 4303.1 4387.2 4387.6 4392.1 4394.2 5319.2 5341.1 5342.5 5345.7 5349.7 1263.4 1299.5 1319.2 1327.0 1331.0 881.6 895.3 916.0 922.6 927.3 4578.8 4580.5 4591.3 4595.8 4599.6 5425.0 5435.2 5436.1 5440.5 5440.6 4388.0 4491.8 4530.7 4532.6 4610.8 2527.0 2547.1 2560.2 2563.4 2563.9 4458.5 4513.3 4516.7 4520.4 4522.3 4681.7 4910.9 4918.9 4954.8 4964.4 4484.4 4500.4 4507.6 4518.8 4534.7 4817.5 4838.9 4839.3 4855.3 4898.2 4620.7 4669.6 4696.7 4728.3 4773.7 4691.5 5088.9 5093.2 5124.2 5142.1 3844.5 3847.7 3848.2 3863.2 3881.9 5293.6 5575.5 5576.9 5580.9 5592.7 5172.8 5270.7 5281.6 5282.4 5323.9 5307.5 5330.8 5342.5 5362.1 5382.3 5127.7 5242.8 5269.3 5271.8 5273.4 5341.9 5356.1 5374.4 5398.6 5408.4 5250.0 5273.9 5293.9 5301.8 5319.3 13:08:01 INFO - PROCESS | 9128 | 13:08:01 INFO - PROCESS | 9128 | [#5] yui.html Cycles:180 Average:17845.46 Median:570.36 stddev:27005.37 (4734.8%) stddev-sans-first:27050.01 13:08:01 INFO - PROCESS | 9128 | Values: 580.6 612.2 696.5 715.7 727.6 13132.9 13630.3 13775.5 14122.6 14138.8 12432.4 13046.3 13145.6 13163.1 13172.3 724.7 737.8 738.7 738.7 740.1 586.3 724.6 739.9 743.8 746.4 770.7 775.4 780.3 780.6 783.8 770.5 771.6 772.2 774.4 775.8 569.1 569.7 571.1 571.7 572.7 11775.7 11881.0 11887.5 11888.8 11926.0 13318.3 13561.3 13804.7 13939.1 13981.4 9706.0 9816.7 10094.5 10564.4 10688.1 4092.1 4115.7 4115.8 4125.6 4162.8 52262.0 52286.5 52338.1 52624.0 52720.9 9821.2 10064.9 10144.4 10210.8 10218.4 17236.1 18373.0 18373.9 18389.9 18481.4 7014.4 7060.3 7065.6 7091.9 7362.3 3736.7 3780.5 3798.2 3826.8 3838.3 2910.7 3011.1 3029.3 3032.2 3034.6 517.0 519.4 519.9 524.0 530.6 368.7 455.2 484.3 526.0 528.4 7638.8 8328.2 8360.1 8364.4 8436.9 475.4 494.0 505.7 518.9 584.9 3788.9 3827.9 3851.9 3891.1 3957.7 102824.5 106153.0 106332.0 107140.0 111266.0 87113.6 89497.0 90453.5 90713.0 94566.0 81278.0 84539.6 84835.6 85347.0 85500.0 7076.0 7142.8 7224.5 7324.4 7371.0 44651.8 45329.3 46540.8 46568.5 47944.3 47934.0 64136.0 65688.3 66044.3 66392.7 8910.9 8935.2 9169.4 9307.7 9408.1 9872.9 9929.4 9951.0 9977.0 10084.3 9826.7 9864.1 9878.8 10794.7 10847.7 9390.4 9516.4 9657.3 9674.6 9703.3 9957.2 10132.4 10239.8 10524.4 10699.1 8115.8 8171.7 8173.8 8328.4 8329.2 8367.5 8959.9 9009.3 9016.4 9026.3 13:08:01 INFO - PROCESS | 9128 | -------- Summary: end -------- 13:08:01 INFO - PROCESS | 9128 | 13:08:02 INFO - TEST-INFO | 9128: exit 0 13:08:02 INFO - TEST-OK | dromaeo_css | took 1121184ms 13:08:02 INFO - TEST-START | kraken 13:08:02 INFO - operating with platform_type : linux_ 13:08:02 INFO - Initialising browser for kraken test... 13:08:02 INFO - TEST-INFO | started process 9481 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpOuKvuV/profile http://localhost:55099/getInfo.html) 13:08:08 INFO - PROCESS | 9481 | __metrics Screen width/height:1600/1200 13:08:08 INFO - PROCESS | 9481 | colorDepth:24 13:08:08 INFO - PROCESS | 9481 | Browser inner width/height: 1024/697 13:08:08 INFO - PROCESS | 9481 | __metrics 13:08:09 ERROR - PROCESS | 9481 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2998: TypeError: this.tabs is undefined 13:08:10 INFO - TEST-INFO | 9481: exit 0 13:08:10 INFO - Browser initialized. 13:08:10 INFO - Running cycle 1/1 for kraken test... 13:08:10 INFO - TEST-INFO | started process 9599 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpOuKvuV/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:08:22 INFO - PROCESS | 9599 | RSS: Main: 193073152 13:08:22 INFO - PROCESS | 9599 | 13:08:25 INFO - PROCESS | 9599 | Cycle 1(1): loaded http://localhost:55099/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:55099/tests/kraken/driver.html?testName=audio-beat-detection) 13:08:26 INFO - PROCESS | 9599 | RSS: Main: 205570048 13:08:26 INFO - PROCESS | 9599 | 13:08:29 INFO - PROCESS | 9599 | Cycle 1(1): loaded http://localhost:55099/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:55099/tests/kraken/driver.html?testName=audio-dft) 13:08:30 INFO - PROCESS | 9599 | RSS: Main: 204730368 13:08:30 INFO - PROCESS | 9599 | 13:08:32 INFO - PROCESS | 9599 | Cycle 1(1): loaded http://localhost:55099/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:55099/tests/kraken/driver.html?testName=audio-fft) 13:08:33 INFO - PROCESS | 9599 | RSS: Main: 198090752 13:08:33 INFO - PROCESS | 9599 | 13:08:35 INFO - PROCESS | 9599 | Cycle 1(1): loaded http://localhost:55099/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:55099/tests/kraken/driver.html?testName=audio-oscillator) 13:08:36 INFO - PROCESS | 9599 | RSS: Main: 198803456 13:08:36 INFO - PROCESS | 9599 | 13:08:38 INFO - PROCESS | 9599 | Cycle 1(1): loaded http://localhost:55099/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:55099/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:08:39 INFO - PROCESS | 9599 | RSS: Main: 199032832 13:08:39 INFO - PROCESS | 9599 | 13:08:42 INFO - PROCESS | 9599 | Cycle 1(1): loaded http://localhost:55099/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:55099/tests/kraken/driver.html?testName=imaging-darkroom) 13:08:43 INFO - PROCESS | 9599 | RSS: Main: 199385088 13:08:43 INFO - PROCESS | 9599 | 13:08:46 INFO - PROCESS | 9599 | Cycle 1(1): loaded http://localhost:55099/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:55099/tests/kraken/driver.html?testName=imaging-desaturate) 13:08:47 INFO - PROCESS | 9599 | RSS: Main: 194985984 13:08:47 INFO - PROCESS | 9599 | 13:08:50 INFO - PROCESS | 9599 | Cycle 1(1): loaded http://localhost:55099/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:55099/tests/kraken/driver.html?testName=json-parse-financial) 13:08:50 INFO - PROCESS | 9599 | RSS: Main: 196722688 13:08:50 INFO - PROCESS | 9599 | 13:08:52 INFO - PROCESS | 9599 | Cycle 1(1): loaded http://localhost:55099/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:55099/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:08:53 INFO - PROCESS | 9599 | RSS: Main: 196939776 13:08:53 INFO - PROCESS | 9599 | 13:08:55 INFO - PROCESS | 9599 | Cycle 1(1): loaded http://localhost:55099/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:55099/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:08:55 INFO - PROCESS | 9599 | RSS: Main: 197226496 13:08:55 INFO - PROCESS | 9599 | 13:08:58 INFO - PROCESS | 9599 | Cycle 1(1): loaded http://localhost:55099/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:55099/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:08:59 INFO - PROCESS | 9599 | RSS: Main: 197836800 13:08:59 INFO - PROCESS | 9599 | 13:09:01 INFO - PROCESS | 9599 | Cycle 1(1): loaded http://localhost:55099/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:55099/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:09:02 INFO - PROCESS | 9599 | RSS: Main: 197951488 13:09:02 INFO - PROCESS | 9599 | 13:09:05 INFO - PROCESS | 9599 | Cycle 1(1): loaded http://localhost:55099/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:55099/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:09:06 INFO - PROCESS | 9599 | RSS: Main: 198094848 13:09:06 INFO - PROCESS | 9599 | 13:09:07 INFO - PROCESS | 9599 | Cycle 1(1): loaded http://localhost:55099/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:55099/tests/kraken/driver.html?testName=ai-astar) 13:09:08 INFO - PROCESS | 9599 | RSS: Main: 201031680 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | __start_tp_report 13:09:08 INFO - PROCESS | 9599 | _x_x_mozilla_page_load 13:09:08 INFO - PROCESS | 9599 | _x_x_mozilla_page_load_details 13:09:08 INFO - PROCESS | 9599 | |i|pagename|runs| 13:09:08 INFO - PROCESS | 9599 | |0;ai-astar;109;116;116;119;118;115;116;115;115;133 13:09:08 INFO - PROCESS | 9599 | |1;audio-beat-detection;152;124;154;193;131;160;162;129;190;125 13:09:08 INFO - PROCESS | 9599 | |2;audio-dft;173;165;166;167;164;164;166;165;162;167 13:09:08 INFO - PROCESS | 9599 | |3;audio-fft;78;77;77;190;78;78;77;76;155;78 13:09:08 INFO - PROCESS | 9599 | |4;audio-oscillator;84;83;138;85;85;85;138;84;85;144 13:09:08 INFO - PROCESS | 9599 | |5;imaging-gaussian-blur;118;118;118;117;117;118;119;117;119;119 13:09:08 INFO - PROCESS | 9599 | |6;imaging-darkroom;148;148;149;149;149;149;149;150;148;147 13:09:08 INFO - PROCESS | 9599 | |7;imaging-desaturate;96;96;96;97;96;95;97;98;97;96 13:09:08 INFO - PROCESS | 9599 | |8;json-parse-financial;68;68;67;68;69;67;69;67;68;70 13:09:08 INFO - PROCESS | 9599 | |9;json-stringify-tinderbox;68;68;68;68;69;69;69;69;68;70 13:09:08 INFO - PROCESS | 9599 | |10;stanford-crypto-aes;86;85;84;90;85;84;93;84;84;83 13:09:08 INFO - PROCESS | 9599 | |11;stanford-crypto-ccm;138;137;142;136;137;146;150;144;177;136 13:09:08 INFO - PROCESS | 9599 | |12;stanford-crypto-pbkdf2;176;174;176;172;175;176;176;172;176;173 13:09:08 INFO - PROCESS | 9599 | |13;stanford-crypto-sha256-iterative;73;74;70;70;72;71;71;79;69;68 13:09:08 INFO - PROCESS | 9599 | __end_tp_report 13:09:08 INFO - PROCESS | 9599 | __start_cc_report 13:09:08 INFO - PROCESS | 9599 | _x_x_mozilla_cycle_collect,939 13:09:08 INFO - PROCESS | 9599 | __end_cc_report 13:09:08 INFO - PROCESS | 9599 | __startTimestamp1472760548172__endTimestamp 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | ------- Summary: start ------- 13:09:08 INFO - PROCESS | 9599 | Number of tests: 14 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | [#0] ai-astar Cycles:10 Average:117.20 Median:116.00 stddev:6.14 (5.3%) stddev-sans-first:5.75 13:09:08 INFO - PROCESS | 9599 | Values: 109.0 116.0 116.0 119.0 118.0 115.0 116.0 115.0 115.0 133.0 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | [#1] audio-beat-detection Cycles:10 Average:152.00 Median:157.00 stddev:25.33 (16.1%) stddev-sans-first:26.87 13:09:08 INFO - PROCESS | 9599 | Values: 152.0 124.0 154.0 193.0 131.0 160.0 162.0 129.0 190.0 125.0 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | [#2] audio-dft Cycles:10 Average:165.90 Median:166.00 stddev:2.92 (1.8%) stddev-sans-first:1.62 13:09:08 INFO - PROCESS | 9599 | Values: 173.0 165.0 166.0 167.0 164.0 164.0 166.0 165.0 162.0 167.0 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | [#3] audio-fft Cycles:10 Average:96.40 Median:77.50 stddev:40.95 (52.8%) stddev-sans-first:42.89 13:09:08 INFO - PROCESS | 9599 | Values: 78.0 77.0 77.0 190.0 78.0 78.0 77.0 76.0 155.0 78.0 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | [#4] audio-oscillator Cycles:10 Average:101.10 Median:84.50 stddev:26.90 (31.8%) stddev-sans-first:27.81 13:09:08 INFO - PROCESS | 9599 | Values: 84.0 83.0 138.0 85.0 85.0 85.0 138.0 84.0 85.0 144.0 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | [#5] imaging-gaussian-blur Cycles:10 Average:118.00 Median:118.00 stddev:0.82 (0.7%) stddev-sans-first:0.87 13:09:08 INFO - PROCESS | 9599 | Values: 118.0 118.0 118.0 117.0 117.0 118.0 119.0 117.0 119.0 119.0 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | [#6] imaging-darkroom Cycles:10 Average:148.60 Median:149.00 stddev:0.84 (0.6%) stddev-sans-first:0.87 13:09:08 INFO - PROCESS | 9599 | Values: 148.0 148.0 149.0 149.0 149.0 149.0 149.0 150.0 148.0 147.0 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | [#7] imaging-desaturate Cycles:10 Average:96.40 Median:96.50 stddev:0.84 (0.9%) stddev-sans-first:0.88 13:09:08 INFO - PROCESS | 9599 | Values: 96.0 96.0 96.0 97.0 96.0 95.0 97.0 98.0 97.0 96.0 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | [#8] json-parse-financial Cycles:10 Average:68.10 Median:68.00 stddev:0.99 (1.5%) stddev-sans-first:1.05 13:09:08 INFO - PROCESS | 9599 | Values: 68.0 68.0 67.0 68.0 69.0 67.0 69.0 67.0 68.0 70.0 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | [#9] json-stringify-tinderbox Cycles:10 Average:68.60 Median:69.00 stddev:0.70 (1.0%) stddev-sans-first:0.71 13:09:08 INFO - PROCESS | 9599 | Values: 68.0 68.0 68.0 68.0 69.0 69.0 69.0 69.0 68.0 70.0 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | [#10] stanford-crypto-aes Cycles:10 Average:85.80 Median:85.00 stddev:3.19 (3.8%) stddev-sans-first:3.38 13:09:08 INFO - PROCESS | 9599 | Values: 86.0 85.0 84.0 90.0 85.0 84.0 93.0 84.0 84.0 83.0 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | [#11] stanford-crypto-ccm Cycles:10 Average:144.30 Median:143.00 stddev:12.45 (8.7%) stddev-sans-first:12.99 13:09:08 INFO - PROCESS | 9599 | Values: 138.0 137.0 142.0 136.0 137.0 146.0 150.0 144.0 177.0 136.0 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:174.60 Median:176.00 stddev:1.71 (1.0%) stddev-sans-first:1.74 13:09:08 INFO - PROCESS | 9599 | Values: 176.0 174.0 176.0 172.0 175.0 176.0 176.0 172.0 176.0 173.0 13:09:08 INFO - PROCESS | 9599 | 13:09:08 INFO - PROCESS | 9599 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:71.70 Median:71.50 stddev:3.13 (4.4%) stddev-sans-first:3.28 13:09:08 INFO - PROCESS | 9599 | Values: 73.0 74.0 70.0 70.0 72.0 71.0 71.0 79.0 69.0 68.0 13:09:08 INFO - PROCESS | 9599 | -------- Summary: end -------- 13:09:08 INFO - PROCESS | 9599 | 13:09:09 INFO - TEST-INFO | 9599: exit 0 13:09:09 INFO - TEST-OK | kraken | took 67110ms 13:09:09 INFO - SUITE-END | took 1188s 13:09:09 INFO - Completed test suite (00:19:48) 13:09:09 INFO - javascript benchmark 13:09:09 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6276.741378275335, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2634.723354047825, 2653.668291463567, 2657.0169037456144, 2674.7726443252322, 2712.050782226221, 4774.188387974044, 4851.830185943489, 4891.095147397729, 4939.036887806879, 5007.824726134586, 4849.927251091236, 4902.264660300957, 4903.215485522317, 4907.926381104277, 4956.355673762415, 4438.955610443886, 4508.97745511272, 4532.274836026237, 4647.395838540985, 4697.201475749113, 4617.607503362218, 4626.69926454781, 4649.0, 4667.089917466095, 4689.132510485554, 4402.669799765031, 4492.168948744493, 4510.673373421589, 4526.592606665416, 4567.1550763108935, 4452.3989261449615, 4459.866204013852, 4472.373867658531, 4584.472785629629, 4587.059652771174, 4482.753448560328, 4487.955120448819, 4495.460544734653, 4510.842120525798, 4573.63410927125, 4842.830500932486, 4866.343043689092, 4902.65681402302, 4912.287718280829, 4937.333459982892, 5269.815556455505, 5271.947280527223, 5277.788888444457, 5295.0468915595175, 5295.152775555931, 5298.81454149103, 5319.946800531984, 5328.254044433782, 5336.573074154058, 5370.060239458118, 4823.445303790074, 4864.78108485119, 4870.829520966749, 4928.162212423897, 4956.033573453142, 5461.6996065216, 5465.180222966586, 5469.507744302952, 5513.283273174542, 5530.723463826793, 5199.74001299941, 5232.947670523322, 5238.423773384925, 5244.554212891947, 5318.9202161967605, 5127.8718032048755, 5218.869528261748, 5277.8416647500635, 5320.441353657888, 5334.946650533522, 5261.131913234273, 5272.20916862466, 5273.156294992783, 5273.235380869829, 5323.068463018956, 5235.842924712265, 5242.16125419931, 5252.842414727565, 5264.842054738364, 5323.547498462596, 4348.065165989327, 4483.50681425043, 4504.954950450519, 4513.142502924499, 4527.524609915911, 3922.156736301709, 3924.6664033557468, 3935.74417662851, 3990.620891015349, 3990.6408423242046, 4556.270996640522, 4557.043020965634, 4557.72653640776, 4578.97710511452, 4609.562091601292, 5195.792168313225, 5306.7611957462, 5348.893022139536, 5351.51836334724, 5402.567794576425, 4508.18852606534, 4509.751963642031, 4522.615577675869, 4570.0, 4585.9770701146945, 4803.375561177025, 4811.879703007383, 4813.229883218738, 4821.686590371614, 4847.418309802846, 4772.331873537638, 4912.484189160086, 4953.925691114636, 4959.97520012412, 4982.925256121089, 5342.198670199501, 5361.195820626937, 5365.248865158803, 5392.649477783932, 5411.810586629606, 4974.900501989868, 4980.750962451791, 4983.380451038157, 4983.975080124576, 5039.798408063783, 5083.822066227664, 5172.767225474788, 5183.740812959412, 5204.661696989683, 5259.63182577216, 5290.127129023668, 5303.681779093266, 5306.044911915892, 5315.069862774077, 5318.920216196838, 5118.3090282811345, 5154.768035438489, 5161.561267292323, 5169.276301317894, 5218.321618189763, 5028.1200789860895, 5102.438731739431, 5168.715720635401, 5180.663256888291, 5265.78936842522, 5060.291559181644, 5085.00842335741, 5095.363079615048, 5117.104506711236, 5122.1548444507725, 5165.845024649267, 5166.121759300852, 5209.4530074343165, 5220.425753167073, 5271.420143784104, 4975.402951645826, 5001.424836143745, 5017.498250175099, 5055.87360315995, 5074.391073071255], "value": 4850.151793406516, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [546.7157078319274, 549.2804426201675, 559.4573263933985, 562.8592851787054, 577.8613132848118, 33610.327793444114, 37312.81343593282, 37329.62670373292, 37417.812910935405, 37460.25079498409, 37783.0, 38218.61781382185, 38240.80879595598, 38254.8087259564, 38334.0, 7605.315521603055, 7793.142754297023, 7803.687852485894, 7803.882941755878, 7814.413918956101, 7556.131044929848, 7593.08882934046, 7596.202398748107, 7628.160902300742, 7635.083789945214, 7514.0, 7617.5048621839405, 7632.809179770522, 7670.463067585271, 7703.576303303316, 7464.290892365217, 7540.698372065111, 7542.0, 7547.773566793005, 7587.696492140308, 7501.28737769911, 7574.772756817304, 7575.356094731899, 7577.2422757724335, 7585.544867307924, 35768.0, 35948.281034379426, 36239.094022649384, 36461.45307820385, 36500.904972850854, 2952.4833154198145, 3082.922926926822, 3105.534169874537, 3179.3164469639137, 3344.866205351783, 27283.454330913468, 27508.17475475739, 27784.722152778417, 29141.85429072862, 29783.404331913458, 3499.4051011328133, 3522.982385088058, 3580.4987301777774, 3650.7261955353456, 3724.6647801697704, 251524.0, 252238.0, 252259.0, 252930.0, 255027.72486137637, 30712.84643576768, 31674.208144796565, 52240.47759522356, 52577.474225258025, 52619.68450788761, 32846.0, 32944.83527582347, 32967.0, 32969.340613188084, 33081.17297067593, 13389.531366402129, 13547.25490098054, 13561.728765424636, 13577.864221357857, 13583.0, 10957.0, 11047.72380690489, 11055.668329950115, 11063.834042489369, 11065.557377704801, 7648.158702542716, 7693.961530192313, 7753.728619498291, 7764.301212890867, 7778.922210777933, 2945.381469891347, 3020.411019851152, 3021.1993821637284, 3058.969410305913, 3123.2191952012, 792.5126047480758, 837.9874301885477, 901.7790641292794, 976.199516396548, 980.9901900981041, 26597.33506662349, 27763.0, 27861.554782229232, 28002.29994250119, 28276.293092672848, 895.9417637853519, 949.6723630347519, 972.2173650211647, 1045.8849526552074, 1047.1413440978324, 13713.314334283246, 14036.157830530201, 14203.289835508183, 14389.28053597316, 14524.564263072125, 190468.0, 191423.0, 191760.0, 193298.0, 194463.0, 47113.5288647116, 47672.5232747675, 47859.5214047862, 48098.27852582214, 48162.759186204545, 1099.5821587796745, 1125.971850703739, 1127.2672762704144, 1128.210252823027, 1160.5357856857156, 25064.62403063992, 26111.608325874746, 26470.338241543344, 26816.0, 26926.59610105889, 41090.79454602708, 41551.7922410386, 41931.95170120771, 41952.0, 42068.158636827706, 360149.58279798157, 360656.0, 362211.0, 363491.0, 363668.0, 24702.382440439134, 24719.38201544976, 24822.37944051413, 25065.498690026463, 25260.115895943552, 40652.3902141474, 40730.592694073865, 41008.384874226314, 41063.794681026404, 42087.158256835304, 34442.655573443946, 35111.47332789959, 35113.0, 35186.0, 35561.0, 32867.50698739473, 34738.48399708123, 35072.47391289082, 35140.472892907135, 35734.46398303976, 33912.660873391935, 34079.4888076684, 34227.315453691284, 35006.0, 35074.82462587773, 29864.402711946073, 32126.0, 32395.19012024718, 32459.20978964984, 32522.512162318057, 23752.762472375747, 24309.635355470036, 24384.6342304862, 24427.75572244326, 24537.263882083567], "value": 15798.675262035298, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [359.66012118547985, 362.6319285924787, 365.3241503219045, 374.68713624123853, 389.4605970730539, 15597.376104955802, 15855.365785368585, 15916.92041539792, 15971.121588312639, 16013.19934003301, 14022.78965815511, 16216.432424865132, 16294.185290735446, 16512.17439128042, 16943.237554310086, 4537.205988951929, 4793.113274044295, 4823.0353929214125, 4832.685875418104, 4834.564889159975, 3433.3476639438427, 4689.88275293117, 4728.645351598644, 5242.2660827484, 5470.234167216593, 5555.638883472581, 5559.805406810762, 5564.443555644443, 5580.190872323511, 5601.187827764971, 5365.275687782138, 5551.084071128279, 5576.86057848553, 5578.665280083167, 5591.944080559183, 5301.60237982149, 5329.600279979017, 5353.625246232766, 5376.086065368897, 5388.218708287276, 11967.581134660246, 12302.261864288172, 12420.316882571455, 12555.623331300076, 12687.809682854764, 1786.767720196366, 1825.516238196879, 1837.200817644329, 1867.7571915651015, 1891.9337823176122, 9037.412568183046, 9176.8623470648, 9250.583723732381, 9716.90283097167, 9729.90270097297, 1754.3859649122833, 1788.5171003829023, 1790.301782304889, 1794.2105473591578, 1803.0, 70026.29973700248, 71844.64077679579, 72251.0, 72514.63742681306, 73754.63122684353, 9744.756381090388, 9849.950750246202, 9875.901240987641, 10178.745531361776, 10244.641437549799, 13929.0, 13940.86059139416, 13944.16335019902, 13987.650308742363, 13989.650258743613, 7171.39043181325, 7352.411807055422, 7441.441891858132, 7582.431317651198, 7723.459357844897, 7056.082709247765, 7154.141503019671, 7374.557526548424, 7400.555966642019, 7465.776026719207, 4207.978960105241, 4232.195882782262, 4307.22469955411, 4429.269170586817, 4448.933266001012, 1679.8162388894389, 1753.4919968826798, 1809.3757653609484, 1833.6791061564172, 1877.0614692653674, 776.7242628866784, 776.9417293702995, 855.1662129423762, 865.2731705367521, 899.7840518275567, 16312.918435407984, 16499.917500412423, 16782.832171678372, 17105.657886842193, 17544.736828947574, 767.3094215206359, 772.9458937874294, 805.2269820971933, 830.1408042675802, 878.5607196401799, 9327.393719408217, 9517.333786634868, 9646.372985756043, 9699.0, 9883.901160988442, 377019.0, 382880.0, 384196.0, 385536.0, 386191.0, 73515.0, 76190.0, 76663.61668191735, 76669.0, 76775.61612192015, 867.119873328572, 869.7040200834897, 888.4269646078243, 898.0166717444388, 899.5322432335149, 14997.850021499646, 15019.474318398803, 15076.170810605521, 15374.615634608777, 15715.764263535828, 36394.09014774546, 36413.81793091124, 36820.07949801169, 37270.44094338533, 37605.05987350338, 47670.28494572653, 48417.27374089462, 54728.726356367966, 56958.0, 57106.42893571011, 7423.888641670272, 7842.529448233125, 7893.881591776243, 8092.473989190684, 8104.27061564462, 9228.907710923073, 9375.73427587267, 11815.291082535075, 12064.155509114278, 12067.698307542381, 5193.169092945111, 10030.598776048877, 10110.949445252727, 10168.440735759605, 10529.736756581147, 10018.799624007333, 10072.7694368364, 10168.389896606228, 10220.233482488991, 10521.842172367267, 5441.319835020622, 7111.502194846311, 8558.78603034929, 10724.195685323475, 10733.302335348177, 6540.476761859135, 7754.457187996786, 7856.292933635772, 8024.799380015546, 8174.305184059422, 8728.476291422536, 10395.376277423378, 10432.582696692047, 10512.894871051498, 10608.893911061099], "value": 7945.8556761084665, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1346.616214378902, 1372.1424109931293, 1432.0, 1635.1905806625723, 1661.235831517502, 7015.964920175405, 7622.542647441151, 7682.270184332493, 8216.178382161788, 8225.25972662461, 7833.725819596315, 8106.432549721522, 8106.837863242732, 8106.905567748352, 8118.634661440235, 2222.088943533148, 2248.6064938635755, 2255.109231853417, 2255.5150642611834, 2257.424356789025, 2137.668661357492, 2176.836737244705, 2197.7142971413696, 2200.1639377036704, 2201.196563254409, 2180.7819218078143, 2194.7585765565773, 2213.6347502662043, 2216.612092883739, 2261.1407665087245, 2170.978290217093, 2178.7276590426195, 2186.7813218678166, 2187.037703410502, 2190.6823510591034, 2151.128792838903, 2156.223759446598, 2158.2769772126358, 2178.3900507857825, 2185.344396681005, 7955.920440795576, 8157.388195885333, 8170.060443049066, 8188.222118898755, 8206.917930820675, 4526.818927242906, 4650.465196502378, 4665.603423708989, 4667.486576476585, 4677.391939047936, 2916.300087978891, 2921.6932222116798, 2952.3652414730936, 3036.6811484794, 3037.6810434904237, 900.2887718702217, 943.2689665509216, 951.4196340232453, 954.4702690007043, 954.575214029757, 10424.94787526065, 10494.790104197873, 10524.158067354594, 10550.366977981346, 10613.787724245549, 3986.4418981342637, 4110.7328023678365, 4251.192273468031, 4307.246231909466, 4328.177646247203, 9071.863922041175, 9089.863652045224, 9091.954540227389, 9107.499087550115, 9110.362274640844, 4643.721376717408, 4690.343351930733, 4693.014466961908, 4697.295405689174, 4710.528947105262, 3547.184147646056, 4172.436721042621, 4285.935710964338, 4317.7193482423545, 4322.157179349996, 3703.7037037037207, 3777.471154038437, 3842.442845787401, 3923.0, 3955.7824319662695, 1216.9391530423443, 1225.2709637765515, 1227.864934857165, 1241.9689507762378, 1252.5303011370736, 706.5548704316247, 743.9367653749492, 785.2775446589037, 814.4746638418305, 820.8794994832011, 5105.5149760772665, 5110.2590124431745, 5121.641485096082, 5212.5569326607665, 5384.9730751346, 395.51549352043514, 413.115931905722, 413.8737685006102, 416.3151615592394, 420.81273833143956, 3620.0, 3644.7084233261276, 3668.6514781095752, 3688.428293614494, 3711.5339440920684, 9649.614015439443, 9941.105300522988, 10004.0, 10020.198384129399, 10104.74738131538, 9713.562889669982, 9749.171320437701, 9898.65354712596, 9933.0, 9973.301868869255, 7451.776446706607, 7481.476296659291, 7518.436117291116, 7526.5107767994905, 7547.132079810783, 5197.792088316425, 5203.141481655484, 5314.176302673091, 5319.0, 5516.751746171512, 8940.0, 9106.863397048917, 9116.635334586808, 9204.539773011189, 9240.214581760625, 8630.82738345217, 8790.736277911672, 8852.070532593985, 9221.400608960395, 9331.0, 6109.725062372293, 6490.221173459215, 6627.23786764509, 6698.765543205965, 6924.549904256207, 7587.127480339832, 7599.772006839804, 7643.541387516767, 7645.579493127709, 7649.158592554926, 6870.45036397077, 7021.5787052777, 7030.543014704028, 7031.824204394931, 7177.892331614926, 6412.35876412355, 6594.373534514213, 6634.369734875179, 6737.696803643946, 6792.320767923168, 6522.184726909137, 6577.2107347116735, 6604.735810567524, 6619.304972977768, 6700.865982680221, 4519.751413672279, 4535.501094879626, 4593.44878614555, 4599.885002874821, 4725.267583524559, 4499.707519011254, 4560.88597785058, 4569.565891240327, 4701.694389864648, 4707.058588282289], "value": 4102.847102719888, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [291.13387671676765, 297.7885701152182, 304.7333583114775, 305.95257735051064, 307.2840282142608, 4826.404328775058, 4903.803847846082, 5048.873778155548, 5071.644984851057, 5081.999999999995, 4935.3337299464565, 4966.776495057722, 5037.4458809530925, 5051.419086805018, 5062.316587260719, 3983.880483585497, 3992.361222204448, 3997.5202975642965, 4000.719949603529, 4017.558068612465, 3931.9017024574327, 3959.3467077932105, 4000.159966407058, 4028.9597104028876, 4053.8581149659767, 3909.706771992098, 3916.159405079622, 3920.725764126656, 3929.8799842045023, 3938.6258305460933, 3940.586238444965, 3942.9211415771665, 3943.8225279862477, 3950.802459876995, 3964.920701585981, 3516.4022116240044, 3530.1880567469625, 3535.345960997198, 3537.9115522111897, 3563.0, 4674.813007479696, 4906.754662266872, 4974.950250497485, 5037.672551284191, 5039.92440113395, 4442.466903971512, 4450.977745111286, 4468.329750537413, 4478.238699421074, 4494.325851122358, 5264.394359720284, 5300.814471493518, 5355.973220133875, 5364.973175134139, 5386.5152136307925, 3649.39784935488, 3695.9630403695887, 3714.182879766447, 3718.6572459350436, 3774.4338349247832, 5485.424030476823, 5499.50504454601, 5521.3926468088475, 5522.30971128609, 5531.557475401998, 3776.4712940188397, 3780.336651873167, 3800.543934727795, 3804.2201348723447, 3822.598627144165, 3768.924621507609, 3843.7501562398356, 3854.7494412863075, 3858.8070596470066, 3860.942085868714, 4303.1393721255245, 4387.210302145644, 4387.605115539553, 4392.143532011227, 4394.209042372404, 5319.175527793198, 5341.118715411992, 5342.545883599938, 5345.732713364317, 5349.652272602269, 1263.368315842079, 1299.4542292237284, 1319.182107093589, 1326.9517081505696, 1330.9534166304327, 881.5812489067641, 895.3329769321897, 915.9679411220709, 922.5894476957824, 927.2535608834953, 4578.816847326069, 4580.519045500175, 4591.265397536378, 4595.816167353269, 4599.632029437637, 5424.996375670514, 5435.211894275308, 5436.103042997861, 5440.510354068153, 5440.619156659075, 4388.034632380871, 4491.797869095899, 4530.70550414222, 4532.614727748179, 4610.7694615269775, 2526.974730252674, 2547.1467058535227, 2560.2191331643653, 2563.4360440703017, 2563.897444102215, 4458.509563947963, 4513.345564893138, 4516.683832131719, 4520.367148599199, 4522.326739106552, 4681.695689780154, 4910.90178196434, 4918.90162196754, 4954.777035033432, 4964.354633897642, 4484.439445069366, 4500.437445319335, 4507.6168525675685, 4518.84769383805, 4534.659900507475, 4817.518977726404, 4838.927416088832, 4839.3141806297845, 4855.344528488608, 4898.167311556973, 4620.722756634613, 4669.556392142741, 4696.694714843524, 4728.3380326753595, 4773.687236010125, 4691.5308469152815, 5088.949110508847, 5093.2105523643895, 5124.205748109049, 5142.100132476727, 3844.519435070616, 3847.711421643332, 3848.230353929281, 3863.188730366542, 3881.8835434936996, 5293.60297977661, 5575.526080283222, 5576.944230557642, 5580.9162862557905, 5592.69240191777, 5172.818951336685, 5270.73646317675, 5281.57747380201, 5282.392524859691, 5323.946760532345, 5307.495787900143, 5330.786768529216, 5342.519173274424, 5362.115250983544, 5382.327209098863, 5127.743612819419, 5242.842714718565, 5269.340157850265, 5271.841844744664, 5273.393559740679, 5341.893162136813, 5356.143017117242, 5374.381946076252, 5398.568114550905, 5408.405075441777, 5250.0, 5273.947260527346, 5293.894122117613, 5301.814436494704, 5319.335083114611], "value": 3898.4771372927407, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [580.6051884718391, 612.1796792298325, 696.5020010692353, 715.712054409933, 727.5561907236588, 13132.868671313285, 13630.250336231491, 13775.51785687501, 14122.576322710309, 14138.787918181235, 12432.440540175714, 13046.347682615879, 13145.605631831037, 13163.07858449909, 13172.275524846129, 724.7390939261861, 737.7823542055106, 738.6786747764712, 738.7008261654039, 740.0933856026378, 586.3198689520158, 724.5906063074373, 739.9482036257464, 743.7582785594676, 746.358132006474, 770.7186876789988, 775.4068137874531, 780.3445106110865, 780.55898417394, 783.8197214640636, 770.5453782268461, 771.5717776633966, 772.2393442459173, 774.3534148985603, 775.7633921653893, 569.115026134365, 569.6610516742574, 571.0549041336594, 571.7370009795499, 572.6678526454647, 11775.7056073598, 11881.049516038782, 11887.524499020028, 11888.821667674993, 11926.0, 13318.334083295797, 13561.258089027735, 13804.654883627889, 13939.093958892741, 13981.370838312301, 9706.029397060309, 9816.65641702537, 10094.545745441474, 10564.418956957365, 10688.14494840411, 4092.1201941582704, 4115.691323150776, 4115.773632450214, 4125.566815484391, 4162.771047592381, 52262.0, 52286.47713522854, 52338.1492776079, 52624.0, 52720.94558108855, 9821.165200957856, 10064.899351006543, 10144.442055687008, 10210.846837297298, 10218.386896786216, 17236.138193090545, 18373.0, 18373.908130459262, 18389.90805045966, 18481.445556633324, 7014.368706816411, 7060.258672839381, 7065.57606543609, 7091.858162836715, 7362.3373896349585, 3736.688295606475, 3780.4518344839844, 3798.2023775007005, 3826.7895265760094, 3838.2899163654815, 2910.650721913384, 3011.0816201058888, 3029.257831831171, 3032.150997720642, 3034.6192482420447, 516.9534741873174, 519.4364114935338, 519.9168133098686, 524.0279281931961, 530.6444682063027, 368.71793078294587, 455.1852184589614, 484.2832607740564, 525.9579233661298, 528.3791544934686, 7638.847223055508, 8328.208820162075, 8360.12218717026, 8364.37267204962, 8436.915630843736, 475.3653872080811, 493.9947207432857, 505.68142070495355, 518.9429162792089, 584.885947240284, 3788.924221515554, 3827.885163445101, 3851.8651847185215, 3891.066144125446, 3957.722959392815, 102824.48587757163, 106153.0, 106332.0, 107140.0, 111266.0, 87113.56443217743, 89497.0, 90453.45705623878, 90713.0, 94566.0, 81278.0, 84539.5773021131, 84835.57582212049, 85347.0, 85500.0, 7076.0, 7142.821439461014, 7224.458165637493, 7324.414046876131, 7371.0, 44651.77674111609, 45329.320060198464, 46540.7672961633, 46568.53431465642, 47944.28083578679, 47934.0, 64136.0, 65688.34311657013, 66044.33955660382, 66392.66803665951, 8910.910890891008, 8935.151160639729, 9169.35814492979, 9307.69692243073, 9408.106229908148, 9872.85190722154, 9929.404235745878, 9951.047426521454, 9977.0, 10084.294099412971, 9826.705198844045, 9864.112229899343, 9878.75303117399, 10794.73013174677, 10847.67456976292, 9390.429309311516, 9516.429014259167, 9657.275704322345, 9674.613015479303, 9703.320767546204, 9957.20342372594, 10132.44271565071, 10239.846402303823, 10524.421156836448, 10699.090577301016, 8115.75652730419, 8171.673133074611, 8173.836523269621, 8328.375371847014, 8329.208725171098, 8367.497950123012, 8959.865602015845, 9009.27925765924, 9016.413933094327, 9026.277897768294], "value": 6278.638171981188, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1608.6999999999998, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 116.0, 116.0, 119.0, 118.0, 115.0, 116.0, 115.0, 115.0, 133.0], "value": 117.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 124.0, 154.0, 193.0, 131.0, 160.0, 162.0, 129.0, 190.0, 125.0], "value": 152.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [173.0, 165.0, 166.0, 167.0, 164.0, 164.0, 166.0, 165.0, 162.0, 167.0], "value": 165.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 77.0, 77.0, 190.0, 78.0, 78.0, 77.0, 76.0, 155.0, 78.0], "value": 96.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 83.0, 138.0, 85.0, 85.0, 85.0, 138.0, 84.0, 85.0, 144.0], "value": 101.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 118.0, 117.0, 117.0, 118.0, 119.0, 117.0, 119.0, 119.0], "value": 118.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 148.0, 149.0, 149.0, 149.0, 149.0, 149.0, 150.0, 148.0, 147.0], "value": 148.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 96.0, 96.0, 97.0, 96.0, 95.0, 97.0, 98.0, 97.0, 96.0], "value": 96.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 68.0, 67.0, 68.0, 69.0, 67.0, 69.0, 67.0, 68.0, 70.0], "value": 68.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 68.0, 68.0, 68.0, 69.0, 69.0, 69.0, 69.0, 68.0, 70.0], "value": 68.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 85.0, 84.0, 90.0, 85.0, 84.0, 93.0, 84.0, 84.0, 83.0], "value": 85.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [138.0, 137.0, 142.0, 136.0, 137.0, 146.0, 150.0, 144.0, 177.0, 136.0], "value": 144.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [176.0, 174.0, 176.0, 172.0, 175.0, 176.0, 176.0, 172.0, 176.0, 173.0], "value": 174.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [73.0, 74.0, 70.0, 70.0, 72.0, 71.0, 71.0, 79.0, 69.0, 68.0], "value": 71.7, "unit": "score"}]}]} 13:09:09 INFO - Return code: 0 13:09:09 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 13:09:10 ERROR - # TBPL SUCCESS # 13:09:10 INFO - Running post-action listener: _resource_record_post_action 13:09:10 INFO - [mozharness: 2016-09-01 20:09:10.000623Z] Finished run-tests step (success) 13:09:10 INFO - Running post-run listener: _resource_record_post_run 13:09:10 INFO - Total resource usage - Wall time: 1205s; CPU: 14.0%; Read bytes: 4096; Write bytes: 423448576; Read time: 16; Write time: 1077760 13:09:10 INFO - TinderboxPrint: CPU usage
13.5% 13:09:10 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 16 13:09:10 INFO - TinderboxPrint: I/O write bytes / time
423,448,576 / 1,077,760 13:09:10 INFO - TinderboxPrint: CPU idle
8,310.2 (86.5%) 13:09:10 INFO - TinderboxPrint: CPU user
1,226.2 (12.8%) 13:09:10 INFO - TinderboxPrint: Swap in / out
0 / 0 13:09:10 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 132091904; Read time: 0; Write time: 233856 13:09:10 INFO - run-tests - Wall time: 1189s; CPU: 14.0%; Read bytes: 0; Write bytes: 291356672; Read time: 0; Write time: 843904 13:09:10 INFO - Running post-run listener: _upload_blobber_files 13:09:10 INFO - Blob upload gear active. 13:09:10 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 13:09:10 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 13:09:10 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'] 13:09:10 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 13:09:11 INFO - (blobuploader) - INFO - Open directory for files ... 13:09:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 13:09:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:09:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:09:14 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 13:09:14 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:09:14 INFO - (blobuploader) - INFO - Done attempting. 13:09:14 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 13:09:14 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:09:14 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:09:15 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 13:09:15 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:09:15 INFO - (blobuploader) - INFO - Done attempting. 13:09:15 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 13:09:15 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:09:15 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:09:16 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 13:09:16 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:09:16 INFO - (blobuploader) - INFO - Done attempting. 13:09:16 INFO - (blobuploader) - INFO - Iteration through files over. 13:09:16 INFO - Return code: 0 13:09:16 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 13:09:16 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 13:09:16 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/b257d48f6c40a2cbf2f42057dbcc5e6b67e0c40880bfe9f43bce36b79b1a7b2ac149456a12fef8514b07019fe5ca125ac27f63a93807aace7958d5589b050655", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/fa3275adb6f0c16a80de5254eb147937a6c5c44792c70c6092e246c01091f95b30e1ef682274c2fa0da23549fd0b857e892f6bdd004deff039ccd76e145e3ed9", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/b6e5f69bec9a829d11d01d29f147f18769fbbea97053336e1612f5ecccab4e6578245c0f7688a371174647f8d856b5258ec196dc6a669184ef1dad9b63e87601"} 13:09:16 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 13:09:16 INFO - Writing to file /builds/slave/test/properties/blobber_files 13:09:16 INFO - Contents: 13:09:16 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/b257d48f6c40a2cbf2f42057dbcc5e6b67e0c40880bfe9f43bce36b79b1a7b2ac149456a12fef8514b07019fe5ca125ac27f63a93807aace7958d5589b050655", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/fa3275adb6f0c16a80de5254eb147937a6c5c44792c70c6092e246c01091f95b30e1ef682274c2fa0da23549fd0b857e892f6bdd004deff039ccd76e145e3ed9", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/b6e5f69bec9a829d11d01d29f147f18769fbbea97053336e1612f5ecccab4e6578245c0f7688a371174647f8d856b5258ec196dc6a669184ef1dad9b63e87601"} 13:09:16 INFO - Running post-run listener: copy_logs_to_upload_dir 13:09:16 INFO - Copying logs to upload dir... 13:09:16 INFO - mkdir: /builds/slave/test/build/upload/logs 13:09:16 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1248.767790 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 48 secs) (at 2016-09-01 13:09:16.287513) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-01 13:09:16.291501) ========= 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=df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663 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/b257d48f6c40a2cbf2f42057dbcc5e6b67e0c40880bfe9f43bce36b79b1a7b2ac149456a12fef8514b07019fe5ca125ac27f63a93807aace7958d5589b050655", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/fa3275adb6f0c16a80de5254eb147937a6c5c44792c70c6092e246c01091f95b30e1ef682274c2fa0da23549fd0b857e892f6bdd004deff039ccd76e145e3ed9", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/b6e5f69bec9a829d11d01d29f147f18769fbbea97053336e1612f5ecccab4e6578245c0f7688a371174647f8d856b5258ec196dc6a669184ef1dad9b63e87601"} build_url:https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011315 build_url: 'https://queue.taskcluster.net/v1/task/DMsUQ7C4QfSHr7kWZWGLWA/artifacts/public/build/firefox-51.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/b257d48f6c40a2cbf2f42057dbcc5e6b67e0c40880bfe9f43bce36b79b1a7b2ac149456a12fef8514b07019fe5ca125ac27f63a93807aace7958d5589b050655", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/fa3275adb6f0c16a80de5254eb147937a6c5c44792c70c6092e246c01091f95b30e1ef682274c2fa0da23549fd0b857e892f6bdd004deff039ccd76e145e3ed9", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/b6e5f69bec9a829d11d01d29f147f18769fbbea97053336e1612f5ecccab4e6578245c0f7688a371174647f8d856b5258ec196dc6a669184ef1dad9b63e87601"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-01 13:09:16.316491) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-01 13:09:16.316808) ========= 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=df17445c3590ff7897617a0e00000225-1472757269.628946-1278027663 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-09-01 13:09:16.401883) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-01 13:09:16.402216) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-01 13:09:16.402502) ========= ========= Total master_lag: 0.17 =========