builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-029 starttime: 1472689734.83 results: success (0) buildid: 20160831143002 builduid: c2c06897505a4509b181ba5752defe21 revision: 215b219482a545aea1118d436eb77334bbb4be21 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-31 17:28:54.827660) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-31 17:28:54.828657) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-31 17:28:54.829356) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-31 17:28:54.848551) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-31 17:28:54.849165) ========= 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=9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-08-31 17:28:55-- 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% 226M=0s 2016-08-31 17:28:55 (226 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.143735 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-31 17:28:55.012848) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-31 17:28:55.013602) ========= 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=9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020312 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-31 17:28:55.069742) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-31 17:28:55.070540) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 215b219482a545aea1118d436eb77334bbb4be21 --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 215b219482a545aea1118d436eb77334bbb4be21 --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=9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-08-31 17:28:55,294 truncating revision to first 12 chars 2016-08-31 17:28:55,294 Setting DEBUG logging. 2016-08-31 17:28:55,294 attempt 1/10 2016-08-31 17:28:55,294 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/215b219482a5?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-31 17:28:56,449 unpacking tar archive at: fx-team-215b219482a5/testing/mozharness/ program finished with exit code 0 elapsedTime=1.452293 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-31 17:28:56.538303) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-31 17:28:56.538704) ========= script_repo_revision: 215b219482a545aea1118d436eb77334bbb4be21 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-31 17:28:56.539163) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-31 17:28:56.539466) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-31 17:28:56.549074) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 40 secs) (at 2016-08-31 17:28:56.549436) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 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', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 17:28:56 INFO - MultiFileLogger online at 20160831 17:28:56 in /builds/slave/test 17:28:56 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 17:28:56 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 17:28:56 INFO - {'append_to_log': False, 17:28:56 INFO - 'base_work_dir': '/builds/slave/test', 17:28:56 INFO - 'blob_upload_branch': 'Fx-Team', 17:28:56 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 17:28:56 INFO - 'branch': 'Fx-Team', 17:28:56 INFO - 'buildbot_json_path': 'buildprops.json', 17:28:56 INFO - 'config_files': ('talos/linux_config.py',), 17:28:56 INFO - 'default_actions': ('clobber', 17:28:56 INFO - 'read-buildbot-config', 17:28:56 INFO - 'download-and-extract', 17:28:56 INFO - 'populate-webroot', 17:28:56 INFO - 'create-virtualenv', 17:28:56 INFO - 'install', 17:28:56 INFO - 'run-tests'), 17:28:56 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 17:28:56 INFO - 'download_minidump_stackwalk': True, 17:28:56 INFO - 'download_symbols': 'ondemand', 17:28:56 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 17:28:56 INFO - 'tooltool.py': '/tools/tooltool.py', 17:28:56 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 17:28:56 INFO - '/tools/misc-python/virtualenv.py')}, 17:28:56 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 17:28:56 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 17:28:56 INFO - 'installer_path': 'installer.exe', 17:28:56 INFO - 'log_level': 'info', 17:28:56 INFO - 'log_name': 'talos', 17:28:56 INFO - 'log_to_console': True, 17:28:56 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 17:28:56 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 17:28:56 INFO - 'opt_config_files': (), 17:28:56 INFO - 'pip_index': False, 17:28:56 INFO - 'sps_profile': False, 17:28:56 INFO - 'sps_profile_interval': 0, 17:28:56 INFO - 'suite': 'dromaeojs-e10s', 17:28:56 INFO - 'system_bits': '32', 17:28:56 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 17:28:56 INFO - 'title': 'talos-linux64-ix-029', 17:28:56 INFO - 'tooltool_cache': '/builds/tooltool_cache', 17:28:56 INFO - 'use_talos_json': True, 17:28:56 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 17:28:56 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 17:28:56 INFO - 'work_dir': 'build'} 17:28:56 INFO - [mozharness: 2016-09-01 00:28:56.869632Z] Running clobber step. 17:28:56 INFO - Running pre-action listener: _resource_record_pre_action 17:28:56 INFO - Running main action method: clobber 17:28:56 INFO - rmtree: /builds/slave/test/build 17:28:56 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 17:28:57 INFO - Running post-action listener: _resource_record_post_action 17:28:57 INFO - [mozharness: 2016-09-01 00:28:57.326466Z] Finished clobber step (success) 17:28:57 INFO - [mozharness: 2016-09-01 00:28:57.326569Z] Running read-buildbot-config step. 17:28:57 INFO - Running pre-action listener: _resource_record_pre_action 17:28:57 INFO - Running main action method: read_buildbot_config 17:28:57 INFO - Using buildbot properties: 17:28:57 INFO - { 17:28:57 INFO - "project": "", 17:28:57 INFO - "product": "firefox", 17:28:57 INFO - "script_repo_revision": "production", 17:28:57 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 17:28:57 INFO - "repository": "", 17:28:57 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 17:28:57 INFO - "buildid": "20160831143002", 17:28:57 INFO - "pgo_build": "True", 17:28:57 INFO - "basedir": "/builds/slave/test", 17:28:57 INFO - "buildnumber": 1099, 17:28:57 INFO - "slavename": "talos-linux64-ix-029", 17:28:57 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 17:28:57 INFO - "platform": "ubuntu64_hw", 17:28:57 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 17:28:57 INFO - "branch": "fx-team", 17:28:57 INFO - "repo_path": "integration/fx-team", 17:28:57 INFO - "revision": "215b219482a545aea1118d436eb77334bbb4be21", 17:28:57 INFO - "stage_platform": "linux64-pgo", 17:28:57 INFO - "builduid": "c2c06897505a4509b181ba5752defe21", 17:28:57 INFO - "slavebuilddir": "test" 17:28:57 INFO - } 17:28:57 INFO - Found installer url https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 17:28:57 INFO - Running post-action listener: _resource_record_post_action 17:28:57 INFO - [mozharness: 2016-09-01 00:28:57.329032Z] Finished read-buildbot-config step (success) 17:28:57 INFO - [mozharness: 2016-09-01 00:28:57.329123Z] Running download-and-extract step. 17:28:57 INFO - Running pre-action listener: _resource_record_pre_action 17:28:57 INFO - Running main action method: download_and_extract 17:28:57 INFO - mkdir: /builds/slave/test/build/tests 17:28:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:28:57 INFO - trying https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 17:28:57 INFO - Downloading https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/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 17:28:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/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 17:28:57 INFO - Downloaded 1361 bytes. 17:28:57 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 17:28:57 INFO - Using the following test package requirements: 17:28:57 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 17:28:57 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 17:28:57 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 17:28:57 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 17:28:57 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 17:28:57 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 17:28:57 INFO - u'jsshell-linux-x86_64.zip'], 17:28:57 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 17:28:57 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 17:28:57 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 17:28:57 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 17:28:57 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 17:28:57 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 17:28:57 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 17:28:57 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 17:28:57 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 17:28:57 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 17:28:57 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 17:28:57 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 17:28:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:28:57 INFO - trying https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 17:28:57 INFO - Downloading https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/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 17:28:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/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 17:28:58 INFO - Downloaded 21902436 bytes. 17:28:58 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 17:29:03 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 17:29:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:29:03 INFO - trying https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 17:29:03 INFO - Downloading https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/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 17:29:03 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/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 17:29:03 INFO - Downloaded 21902436 bytes. 17:29:03 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 17:29:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:29:08 INFO - trying https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 17:29:08 INFO - Downloading https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/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 17:29:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/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 17:29:09 INFO - Downloaded 14413998 bytes. 17:29:09 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 17:29:09 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')]} 17:29:09 INFO - trying https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 17:29:09 INFO - Downloading https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/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 17:29:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/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 17:29:10 INFO - Downloaded 59737620 bytes. 17:29:10 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 17:29:10 INFO - mkdir: /builds/slave/test/properties 17:29:10 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 17:29:10 INFO - Writing to file /builds/slave/test/properties/build_url 17:29:10 INFO - Contents: 17:29:10 INFO - build_url:https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 17:29:12 INFO - Running post-action listener: _resource_record_post_action 17:29:12 INFO - Running post-action listener: set_extra_try_arguments 17:29:12 INFO - [mozharness: 2016-09-01 00:29:12.053330Z] Finished download-and-extract step (success) 17:29:12 INFO - [mozharness: 2016-09-01 00:29:12.053705Z] Running populate-webroot step. 17:29:12 INFO - Running pre-action listener: _resource_record_pre_action 17:29:12 INFO - Running main action method: populate_webroot 17:29:12 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 17:29:12 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 17:29:12 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 17:29:12 INFO - '--tppagecycles', 17:29:12 INFO - '7'], 17:29:12 INFO - 'tests': ['tsvgm']}}, 17:29:12 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 17:29:12 INFO - 'tests': ['tresize', 'tcanvasmark']}, 17:29:12 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 17:29:12 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 17:29:12 INFO - 'tests': ['dromaeo_css', 'kraken']}, 17:29:12 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 17:29:12 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:29:12 INFO - 'talos_options': ['--disable-e10s'], 17:29:12 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:29:12 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:29:12 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:29:12 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:29:12 INFO - 'talos_options': ['--disable-e10s'], 17:29:12 INFO - 'tests': ['damp', 'tps']}, 17:29:12 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:29:12 INFO - 'tests': ['damp', 'tps']}, 17:29:12 INFO - 'g3': {'talos_options': ['--disable-e10s'], 17:29:12 INFO - 'tests': ['dromaeo_dom']}, 17:29:12 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 17:29:12 INFO - 'g4': {'talos_options': ['--disable-e10s'], 17:29:12 INFO - 'tests': ['basic_compositor_video']}, 17:29:12 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 17:29:12 INFO - 'other': {'talos_options': ['--disable-e10s'], 17:29:12 INFO - 'tests': ['a11yr', 17:29:12 INFO - 'ts_paint', 17:29:12 INFO - 'tpaint', 17:29:12 INFO - 'sessionrestore', 17:29:12 INFO - 'sessionrestore_no_auto_restore', 17:29:12 INFO - 'tabpaint']}, 17:29:12 INFO - 'other-e10s': {'tests': ['a11yr', 17:29:12 INFO - 'ts_paint', 17:29:12 INFO - 'tpaint', 17:29:12 INFO - 'sessionrestore', 17:29:12 INFO - 'sessionrestore_no_auto_restore', 17:29:12 INFO - 'tabpaint']}, 17:29:12 INFO - 'other-e10s_l64': {'tests': ['a11yr', 17:29:12 INFO - 'ts_paint', 17:29:12 INFO - 'tpaint', 17:29:12 INFO - 'sessionrestore', 17:29:12 INFO - 'sessionrestore_no_auto_restore', 17:29:12 INFO - 'tabpaint']}, 17:29:12 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 17:29:12 INFO - 'ts_paint', 17:29:12 INFO - 'tpaint', 17:29:12 INFO - 'sessionrestore', 17:29:12 INFO - 'sessionrestore_no_auto_restore', 17:29:12 INFO - 'tabpaint']}, 17:29:12 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 17:29:12 INFO - 'tests': ['a11yr', 17:29:12 INFO - 'ts_paint', 17:29:12 INFO - 'tpaint', 17:29:12 INFO - 'sessionrestore', 17:29:12 INFO - 'sessionrestore_no_auto_restore', 17:29:12 INFO - 'tabpaint']}, 17:29:12 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 17:29:12 INFO - 'tests': ['a11yr', 17:29:12 INFO - 'ts_paint', 17:29:12 INFO - 'tpaint', 17:29:12 INFO - 'sessionrestore', 17:29:12 INFO - 'sessionrestore_no_auto_restore', 17:29:12 INFO - 'tabpaint']}, 17:29:12 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 17:29:12 INFO - 'tests': ['tsvgx', 17:29:12 INFO - 'tsvgr_opacity', 17:29:12 INFO - 'tart', 17:29:12 INFO - 'tscrollx', 17:29:12 INFO - 'cart']}, 17:29:12 INFO - 'svgr-e10s': {'tests': ['tsvgx', 17:29:12 INFO - 'tsvgr_opacity', 17:29:12 INFO - 'tart', 17:29:12 INFO - 'tscrollx', 17:29:12 INFO - 'cart']}, 17:29:12 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:29:12 INFO - 'talos_options': ['--disable-e10s'], 17:29:12 INFO - 'tests': ['tp5o']}, 17:29:12 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:29:12 INFO - 'tests': ['tp5o']}, 17:29:12 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:29:12 INFO - 'talos_options': ['--disable-e10s', 17:29:12 INFO - '--xperf_path', 17:29:12 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:29:12 INFO - 'tests': ['tp5n']}, 17:29:12 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:29:12 INFO - 'talos_options': ['--xperf_path', 17:29:12 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:29:12 INFO - 'tests': ['tp5n']}}, 17:29:12 INFO - 'talos.zip': {'path': '', 17:29:12 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 17:29:12 INFO - Running post-action listener: _resource_record_post_action 17:29:12 INFO - [mozharness: 2016-09-01 00:29:12.069602Z] Finished populate-webroot step (success) 17:29:12 INFO - [mozharness: 2016-09-01 00:29:12.069693Z] Running create-virtualenv step. 17:29:12 INFO - Running pre-action listener: _resource_record_pre_action 17:29:12 INFO - Running main action method: create_virtualenv 17:29:12 INFO - Creating virtualenv /builds/slave/test/build/venv 17:29:12 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 17:29:12 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 17:29:12 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 17:29:12 INFO - Using real prefix '/usr' 17:29:12 INFO - New python executable in /builds/slave/test/build/venv/bin/python 17:29:12 INFO - Installing distribute.............................................................................................................................................................................................done. 17:29:14 INFO - Installing pip.................done. 17:29:14 INFO - Return code: 0 17:29:14 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 17:29:14 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')]} 17:29:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:29:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:14 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')]} 17:29:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:29:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:14 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 0x7f2068dc9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1596850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1591370>, '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 0x15948f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1594d80>, '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': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', '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 17:29:14 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 17:29:14 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 17:29:14 INFO - Using env: {'DISPLAY': ':0', 17:29:14 INFO - 'HOME': '/home/cltbld', 17:29:14 INFO - 'LANG': 'en_US.UTF-8', 17:29:14 INFO - 'LANGUAGE': 'en_US:en', 17:29:14 INFO - 'LOGNAME': 'cltbld', 17:29:14 INFO - 'MAIL': '/var/mail/cltbld', 17:29:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:29:14 INFO - 'MOZ_NO_REMOTE': '1', 17:29:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:29:14 INFO - 'NO_EM_RESTART': '1', 17:29:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:29:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:29:14 INFO - 'PWD': '/builds/slave/test', 17:29:14 INFO - 'SHELL': '/bin/bash', 17:29:14 INFO - 'SHLVL': '1', 17:29:14 INFO - 'TERM': 'linux', 17:29:14 INFO - 'TMOUT': '86400', 17:29:14 INFO - 'USER': 'cltbld', 17:29:14 INFO - 'XDG_SESSION_COOKIE': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', 17:29:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:29:14 INFO - '_': '/tools/buildbot/bin/python'} 17:29:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:29:14 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 17:29:14 INFO - Cleaning up... 17:29:14 INFO - Return code: 0 17:29:14 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 17:29:14 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')]} 17:29:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:29:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:14 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')]} 17:29:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:29:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:14 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 0x7f2068dc9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1596850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1591370>, '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 0x15948f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1594d80>, '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': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', '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 17:29:14 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 17:29:14 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 17:29:14 INFO - Using env: {'DISPLAY': ':0', 17:29:14 INFO - 'HOME': '/home/cltbld', 17:29:14 INFO - 'LANG': 'en_US.UTF-8', 17:29:14 INFO - 'LANGUAGE': 'en_US:en', 17:29:14 INFO - 'LOGNAME': 'cltbld', 17:29:14 INFO - 'MAIL': '/var/mail/cltbld', 17:29:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:29:14 INFO - 'MOZ_NO_REMOTE': '1', 17:29:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:29:14 INFO - 'NO_EM_RESTART': '1', 17:29:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:29:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:29:14 INFO - 'PWD': '/builds/slave/test', 17:29:14 INFO - 'SHELL': '/bin/bash', 17:29:14 INFO - 'SHLVL': '1', 17:29:14 INFO - 'TERM': 'linux', 17:29:14 INFO - 'TMOUT': '86400', 17:29:14 INFO - 'USER': 'cltbld', 17:29:14 INFO - 'XDG_SESSION_COOKIE': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', 17:29:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:29:14 INFO - '_': '/tools/buildbot/bin/python'} 17:29:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:29:15 INFO - Downloading/unpacking psutil>=3.1.1 17:29:15 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 17:29:15 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 17:29:15 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 17:29:15 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 17:29:15 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 17:29:15 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 17:29:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 17:29:17 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:29:17 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:29:17 INFO - Installing collected packages: psutil 17:29:17 INFO - Running setup.py install for psutil 17:29:17 INFO - building 'psutil._psutil_linux' extension 17:29:17 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 17:29:17 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 17:29:17 INFO - building 'psutil._psutil_posix' extension 17:29:17 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 17:29:17 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 17:29:17 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:29:17 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:29:17 INFO - Successfully installed psutil 17:29:17 INFO - Cleaning up... 17:29:17 INFO - Return code: 0 17:29:17 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 17:29:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:29:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:29:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:29:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:29:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:17 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2068dc9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1596850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1591370>, '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 0x15948f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1594d80>, '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': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', '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 17:29:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 17:29:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 17:29:17 INFO - Using env: {'DISPLAY': ':0', 17:29:17 INFO - 'HOME': '/home/cltbld', 17:29:17 INFO - 'LANG': 'en_US.UTF-8', 17:29:17 INFO - 'LANGUAGE': 'en_US:en', 17:29:17 INFO - 'LOGNAME': 'cltbld', 17:29:17 INFO - 'MAIL': '/var/mail/cltbld', 17:29:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:29:17 INFO - 'MOZ_NO_REMOTE': '1', 17:29:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:29:17 INFO - 'NO_EM_RESTART': '1', 17:29:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:29:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:29:17 INFO - 'PWD': '/builds/slave/test', 17:29:17 INFO - 'SHELL': '/bin/bash', 17:29:17 INFO - 'SHLVL': '1', 17:29:17 INFO - 'TERM': 'linux', 17:29:17 INFO - 'TMOUT': '86400', 17:29:17 INFO - 'USER': 'cltbld', 17:29:17 INFO - 'XDG_SESSION_COOKIE': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', 17:29:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:29:17 INFO - '_': '/tools/buildbot/bin/python'} 17:29:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:29:17 INFO - Downloading/unpacking mozsystemmonitor==0.3 17:29:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:29:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:29:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:29:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:29:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:29:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:29:19 INFO - Downloading mozsystemmonitor-0.3.tar.gz 17:29:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 17:29:19 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 17:29:19 INFO - Installing collected packages: mozsystemmonitor 17:29:19 INFO - Running setup.py install for mozsystemmonitor 17:29:19 INFO - Successfully installed mozsystemmonitor 17:29:19 INFO - Cleaning up... 17:29:19 INFO - Return code: 0 17:29:19 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 17:29:19 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')]} 17:29:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:29:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:19 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')]} 17:29:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:29:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:19 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 0x7f2068dc9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1596850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1591370>, '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 0x15948f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1594d80>, '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': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', '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 17:29:19 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 17:29:19 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 17:29:19 INFO - Using env: {'DISPLAY': ':0', 17:29:19 INFO - 'HOME': '/home/cltbld', 17:29:19 INFO - 'LANG': 'en_US.UTF-8', 17:29:19 INFO - 'LANGUAGE': 'en_US:en', 17:29:19 INFO - 'LOGNAME': 'cltbld', 17:29:19 INFO - 'MAIL': '/var/mail/cltbld', 17:29:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:29:19 INFO - 'MOZ_NO_REMOTE': '1', 17:29:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:29:19 INFO - 'NO_EM_RESTART': '1', 17:29:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:29:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:29:19 INFO - 'PWD': '/builds/slave/test', 17:29:19 INFO - 'SHELL': '/bin/bash', 17:29:19 INFO - 'SHLVL': '1', 17:29:19 INFO - 'TERM': 'linux', 17:29:19 INFO - 'TMOUT': '86400', 17:29:19 INFO - 'USER': 'cltbld', 17:29:19 INFO - 'XDG_SESSION_COOKIE': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', 17:29:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:29:19 INFO - '_': '/tools/buildbot/bin/python'} 17:29:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:29:20 INFO - Downloading/unpacking jsonschema==2.5.1 17:29:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:29:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:29:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:29:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:29:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:29:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:29:21 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 17:29:21 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 17:29:21 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 17:29:21 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 17:29:21 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 17:29:21 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 17:29:21 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 17:29:21 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 17:29:22 INFO - Downloading functools32-3.2.3-2.tar.gz 17:29:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 17:29:22 INFO - warning: no files found matching '*.txt' 17:29:22 INFO - no previously-included directories found matching 'build' 17:29:22 INFO - no previously-included directories found matching 'dist' 17:29:22 INFO - no previously-included directories found matching '.git*' 17:29:22 INFO - Installing collected packages: jsonschema, functools32 17:29:22 INFO - Running setup.py install for functools32 17:29:22 INFO - warning: no files found matching '*.txt' 17:29:22 INFO - no previously-included directories found matching 'build' 17:29:22 INFO - no previously-included directories found matching 'dist' 17:29:22 INFO - no previously-included directories found matching '.git*' 17:29:22 INFO - Successfully installed jsonschema functools32 17:29:22 INFO - Cleaning up... 17:29:22 INFO - Return code: 0 17:29:22 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 17:29:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:29:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:29:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:29:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:29:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f2068dc9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1596850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1591370>, '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 0x15948f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1594d80>, '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': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', '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 17:29:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 17:29:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 17:29:22 INFO - Using env: {'DISPLAY': ':0', 17:29:22 INFO - 'HOME': '/home/cltbld', 17:29:22 INFO - 'LANG': 'en_US.UTF-8', 17:29:22 INFO - 'LANGUAGE': 'en_US:en', 17:29:22 INFO - 'LOGNAME': 'cltbld', 17:29:22 INFO - 'MAIL': '/var/mail/cltbld', 17:29:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:29:22 INFO - 'MOZ_NO_REMOTE': '1', 17:29:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:29:22 INFO - 'NO_EM_RESTART': '1', 17:29:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:29:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:29:22 INFO - 'PWD': '/builds/slave/test', 17:29:22 INFO - 'SHELL': '/bin/bash', 17:29:22 INFO - 'SHLVL': '1', 17:29:22 INFO - 'TERM': 'linux', 17:29:22 INFO - 'TMOUT': '86400', 17:29:22 INFO - 'USER': 'cltbld', 17:29:22 INFO - 'XDG_SESSION_COOKIE': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', 17:29:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:29:22 INFO - '_': '/tools/buildbot/bin/python'} 17:29:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:29:22 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 17:29:22 INFO - Cleaning up... 17:29:22 INFO - Return code: 0 17:29:22 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 17:29:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:29:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:29:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:29:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:29:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2068dc9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1596850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1591370>, '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 0x15948f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1594d80>, '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': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', '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 17:29:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 17:29:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 17:29:22 INFO - Using env: {'DISPLAY': ':0', 17:29:22 INFO - 'HOME': '/home/cltbld', 17:29:22 INFO - 'LANG': 'en_US.UTF-8', 17:29:22 INFO - 'LANGUAGE': 'en_US:en', 17:29:22 INFO - 'LOGNAME': 'cltbld', 17:29:22 INFO - 'MAIL': '/var/mail/cltbld', 17:29:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:29:22 INFO - 'MOZ_NO_REMOTE': '1', 17:29:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:29:22 INFO - 'NO_EM_RESTART': '1', 17:29:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:29:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:29:22 INFO - 'PWD': '/builds/slave/test', 17:29:22 INFO - 'SHELL': '/bin/bash', 17:29:22 INFO - 'SHLVL': '1', 17:29:22 INFO - 'TERM': 'linux', 17:29:22 INFO - 'TMOUT': '86400', 17:29:22 INFO - 'USER': 'cltbld', 17:29:22 INFO - 'XDG_SESSION_COOKIE': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', 17:29:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:29:22 INFO - '_': '/tools/buildbot/bin/python'} 17:29:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:29:22 INFO - Downloading/unpacking blobuploader==1.2.4 17:29:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:29:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:29:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:29:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:29:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:29:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:29:24 INFO - Downloading blobuploader-1.2.4.tar.gz 17:29:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 17:29:24 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 17:29:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:29:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:29:24 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:29:24 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:29:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:29:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:29:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 17:29:25 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 17:29:25 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 17:29:25 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 17:29:25 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 17:29:25 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 17:29:25 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 17:29:25 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 17:29:25 INFO - Downloading docopt-0.6.1.tar.gz 17:29:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 17:29:25 INFO - Installing collected packages: blobuploader, requests, docopt 17:29:25 INFO - Running setup.py install for blobuploader 17:29:25 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 17:29:25 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 17:29:25 INFO - Running setup.py install for requests 17:29:25 INFO - Running setup.py install for docopt 17:29:26 INFO - Successfully installed blobuploader requests docopt 17:29:26 INFO - Cleaning up... 17:29:26 INFO - Return code: 0 17:29:26 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:29:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:29:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:29:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:29:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:29:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:26 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 0x7f2068dc9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1596850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1591370>, '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 0x15948f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1594d80>, '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': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', '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 17:29:26 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 17:29:26 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 17:29:26 INFO - Using env: {'DISPLAY': ':0', 17:29:26 INFO - 'HOME': '/home/cltbld', 17:29:26 INFO - 'LANG': 'en_US.UTF-8', 17:29:26 INFO - 'LANGUAGE': 'en_US:en', 17:29:26 INFO - 'LOGNAME': 'cltbld', 17:29:26 INFO - 'MAIL': '/var/mail/cltbld', 17:29:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:29:26 INFO - 'MOZ_NO_REMOTE': '1', 17:29:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:29:26 INFO - 'NO_EM_RESTART': '1', 17:29:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:29:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:29:26 INFO - 'PWD': '/builds/slave/test', 17:29:26 INFO - 'SHELL': '/bin/bash', 17:29:26 INFO - 'SHLVL': '1', 17:29:26 INFO - 'TERM': 'linux', 17:29:26 INFO - 'TMOUT': '86400', 17:29:26 INFO - 'USER': 'cltbld', 17:29:26 INFO - 'XDG_SESSION_COOKIE': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', 17:29:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:29:26 INFO - '_': '/tools/buildbot/bin/python'} 17:29:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:29:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:29:26 INFO - Running setup.py (path:/tmp/pip-08xGZr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:29:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:29:26 INFO - Running setup.py (path:/tmp/pip-ffWvrC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:29:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:29:26 INFO - Running setup.py (path:/tmp/pip-8ItQzX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:29:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:29:26 INFO - Running setup.py (path:/tmp/pip-46mRtL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:29:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:29:26 INFO - Running setup.py (path:/tmp/pip-mF9Cva-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:29:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:29:26 INFO - Running setup.py (path:/tmp/pip-Xd2BgB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:29:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:29:26 INFO - Running setup.py (path:/tmp/pip-_dJoEm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:29:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:29:26 INFO - Running setup.py (path:/tmp/pip-Tbd3l4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:29:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:29:26 INFO - Running setup.py (path:/tmp/pip-Tbf8IG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:29:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:29:26 INFO - Running setup.py (path:/tmp/pip-BNHo_y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:29:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:29:27 INFO - Running setup.py (path:/tmp/pip-vVkV_J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:29:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:29:27 INFO - Running setup.py (path:/tmp/pip-axQWVN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:29:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:29:27 INFO - Running setup.py (path:/tmp/pip-GG8uLE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:29:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:29:27 INFO - Running setup.py (path:/tmp/pip-jFFxhV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:29:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:29:27 INFO - Running setup.py (path:/tmp/pip-lqPtEA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:29:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:29:27 INFO - Running setup.py (path:/tmp/pip-E8DID9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:29:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:29:27 INFO - Running setup.py (path:/tmp/pip-I8MRot-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:29:27 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 17:29:27 INFO - Running setup.py install for manifestparser 17:29:27 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 17:29:27 INFO - Running setup.py install for mozcrash 17:29:27 INFO - Running setup.py install for mozdebug 17:29:27 INFO - Running setup.py install for mozdevice 17:29:27 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 17:29:27 INFO - Installing dm script to /builds/slave/test/build/venv/bin 17:29:28 INFO - Running setup.py install for mozfile 17:29:28 INFO - Running setup.py install for mozhttpd 17:29:28 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 17:29:28 INFO - Running setup.py install for mozinfo 17:29:28 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 17:29:28 INFO - Running setup.py install for mozInstall 17:29:28 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 17:29:28 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 17:29:28 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 17:29:28 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 17:29:28 INFO - Running setup.py install for mozleak 17:29:28 INFO - Running setup.py install for mozlog 17:29:28 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 17:29:28 INFO - Running setup.py install for moznetwork 17:29:28 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 17:29:28 INFO - Running setup.py install for mozprocess 17:29:28 INFO - Running setup.py install for mozprofile 17:29:28 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 17:29:28 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 17:29:28 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 17:29:28 INFO - Running setup.py install for mozrunner 17:29:29 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 17:29:29 INFO - Running setup.py install for mozscreenshot 17:29:29 INFO - Running setup.py install for moztest 17:29:29 INFO - Running setup.py install for mozversion 17:29:29 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 17:29:29 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 17:29:29 INFO - Cleaning up... 17:29:29 INFO - Return code: 0 17:29:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:29: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')]} 17:29:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:29:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29: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')]} 17:29:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:29:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:29 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2068dc9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1596850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1591370>, '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 0x15948f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1594d80>, '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': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', '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 17:29:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 17:29:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:29:29 INFO - Using env: {'DISPLAY': ':0', 17:29:29 INFO - 'HOME': '/home/cltbld', 17:29:29 INFO - 'LANG': 'en_US.UTF-8', 17:29:29 INFO - 'LANGUAGE': 'en_US:en', 17:29:29 INFO - 'LOGNAME': 'cltbld', 17:29:29 INFO - 'MAIL': '/var/mail/cltbld', 17:29:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:29:29 INFO - 'MOZ_NO_REMOTE': '1', 17:29:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:29:29 INFO - 'NO_EM_RESTART': '1', 17:29:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:29:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:29:29 INFO - 'PWD': '/builds/slave/test', 17:29:29 INFO - 'SHELL': '/bin/bash', 17:29:29 INFO - 'SHLVL': '1', 17:29:29 INFO - 'TERM': 'linux', 17:29:29 INFO - 'TMOUT': '86400', 17:29:29 INFO - 'USER': 'cltbld', 17:29:29 INFO - 'XDG_SESSION_COOKIE': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', 17:29:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:29:29 INFO - '_': '/tools/buildbot/bin/python'} 17:29:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:29:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:29:29 INFO - Running setup.py (path:/tmp/pip-Ab0uMZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:29:29 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 17:29:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:29:29 INFO - Running setup.py (path:/tmp/pip-3McnVq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:29:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:29:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:29:29 INFO - Running setup.py (path:/tmp/pip-_XjBrQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:29:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 17:29:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:29:29 INFO - Running setup.py (path:/tmp/pip-uDB7c4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:29:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:29:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:29:29 INFO - Running setup.py (path:/tmp/pip-GgvpFx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:29:29 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 17:29:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:29:29 INFO - Running setup.py (path:/tmp/pip-P1pZNH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:29:30 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)) 17:29:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:29:30 INFO - Running setup.py (path:/tmp/pip-yTUvsL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:29:30 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)) 17:29:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:29:30 INFO - Running setup.py (path:/tmp/pip-yzR51C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:29:30 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)) 17:29:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:29:30 INFO - Running setup.py (path:/tmp/pip-ETAk7Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:29:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 17:29:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:29:30 INFO - Running setup.py (path:/tmp/pip-CPUzOM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:29:30 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)) 17:29:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:29:30 INFO - Running setup.py (path:/tmp/pip-GsGGzT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:29:30 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 17:29:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:29:30 INFO - Running setup.py (path:/tmp/pip-cBOmfL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:29:30 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)) 17:29:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:29:30 INFO - Running setup.py (path:/tmp/pip-PcYqxO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:29:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 17:29:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:29:30 INFO - Running setup.py (path:/tmp/pip-uWV1HE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:29:30 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)) 17:29:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:29:30 INFO - Running setup.py (path:/tmp/pip-Jx83Ln-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:29:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 17:29:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:29:30 INFO - Running setup.py (path:/tmp/pip-2as_Hu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:29:30 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 17:29:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:29:30 INFO - Running setup.py (path:/tmp/pip-r_3LM5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:29:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 17:29:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:29:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:29:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 17:29:30 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:29:30 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:29:30 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 17:29:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:29:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:29:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:29:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:29:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:29:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:29:32 INFO - Downloading blessings-1.6.tar.gz 17:29:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 17:29:32 INFO - Installing collected packages: blessings 17:29:32 INFO - Running setup.py install for blessings 17:29:32 INFO - Successfully installed blessings 17:29:32 INFO - Cleaning up... 17:29:32 INFO - Return code: 0 17:29:32 INFO - Done creating virtualenv /builds/slave/test/build/venv. 17:29:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:29:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:29:33 INFO - Reading from file tmpfile_stdout 17:29:33 INFO - Current package versions: 17:29:33 INFO - argparse == 1.2.1 17:29:33 INFO - blessings == 1.6 17:29:33 INFO - blobuploader == 1.2.4 17:29:33 INFO - docopt == 0.6.1 17:29:33 INFO - functools32 == 3.2.3-2 17:29:33 INFO - jsonschema == 2.5.1 17:29:33 INFO - manifestparser == 1.1 17:29:33 INFO - mozInstall == 1.12 17:29:33 INFO - mozcrash == 0.17 17:29:33 INFO - mozdebug == 0.1 17:29:33 INFO - mozdevice == 0.48 17:29:33 INFO - mozfile == 1.2 17:29:33 INFO - mozhttpd == 0.7 17:29:33 INFO - mozinfo == 0.9 17:29:33 INFO - mozleak == 0.1 17:29:33 INFO - mozlog == 3.3 17:29:33 INFO - moznetwork == 0.27 17:29:33 INFO - mozprocess == 0.23 17:29:33 INFO - mozprofile == 0.28 17:29:33 INFO - mozrunner == 6.12 17:29:33 INFO - mozscreenshot == 0.1 17:29:33 INFO - mozsystemmonitor == 0.3 17:29:33 INFO - moztest == 0.7 17:29:33 INFO - mozversion == 1.4 17:29:33 INFO - psutil == 3.1.1 17:29:33 INFO - requests == 1.2.3 17:29:33 INFO - wsgiref == 0.1.2 17:29:33 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:29:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:29:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:29:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:29:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:29:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:33 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 0x7f2068dc9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1596850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1591370>, '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 0x15948f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1594d80>, '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': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', '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 17:29:33 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 17:29:33 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 17:29:33 INFO - Using env: {'DISPLAY': ':0', 17:29:33 INFO - 'HOME': '/home/cltbld', 17:29:33 INFO - 'LANG': 'en_US.UTF-8', 17:29:33 INFO - 'LANGUAGE': 'en_US:en', 17:29:33 INFO - 'LOGNAME': 'cltbld', 17:29:33 INFO - 'MAIL': '/var/mail/cltbld', 17:29:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:29:33 INFO - 'MOZ_NO_REMOTE': '1', 17:29:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:29:33 INFO - 'NO_EM_RESTART': '1', 17:29:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:29:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:29:33 INFO - 'PWD': '/builds/slave/test', 17:29:33 INFO - 'SHELL': '/bin/bash', 17:29:33 INFO - 'SHLVL': '1', 17:29:33 INFO - 'TERM': 'linux', 17:29:33 INFO - 'TMOUT': '86400', 17:29:33 INFO - 'USER': 'cltbld', 17:29:33 INFO - 'XDG_SESSION_COOKIE': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', 17:29:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:29:33 INFO - '_': '/tools/buildbot/bin/python'} 17:29:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:29:33 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 17:29:33 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 17:29:33 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 17:29:33 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 17:29:33 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 17:29:33 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 17:29:33 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 17:29:33 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 17:29:33 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 17:29:33 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 17:29:33 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 17:29:33 INFO - Cleaning up... 17:29:33 INFO - Return code: 0 17:29:33 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 17:29:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:29:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:29:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 17:29:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:29:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:29:33 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2068dc9f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14c98a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1596850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1591370>, '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 0x15948f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1594d80>, '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': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', '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 17:29:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 17:29:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 17:29:33 INFO - Using env: {'DISPLAY': ':0', 17:29:33 INFO - 'HOME': '/home/cltbld', 17:29:33 INFO - 'LANG': 'en_US.UTF-8', 17:29:33 INFO - 'LANGUAGE': 'en_US:en', 17:29:33 INFO - 'LOGNAME': 'cltbld', 17:29:33 INFO - 'MAIL': '/var/mail/cltbld', 17:29:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:29:33 INFO - 'MOZ_NO_REMOTE': '1', 17:29:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:29:33 INFO - 'NO_EM_RESTART': '1', 17:29:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:29:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:29:33 INFO - 'PWD': '/builds/slave/test', 17:29:33 INFO - 'SHELL': '/bin/bash', 17:29:33 INFO - 'SHLVL': '1', 17:29:33 INFO - 'TERM': 'linux', 17:29:33 INFO - 'TMOUT': '86400', 17:29:33 INFO - 'USER': 'cltbld', 17:29:33 INFO - 'XDG_SESSION_COOKIE': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', 17:29:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:29:33 INFO - '_': '/tools/buildbot/bin/python'} 17:29:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:29:33 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 17:29:33 INFO - Cleaning up... 17:29:33 INFO - Return code: 0 17:29:33 INFO - Running post-action listener: _resource_record_post_action 17:29:33 INFO - Running post-action listener: _start_resource_monitoring 17:29:33 INFO - Starting resource monitoring. 17:29:33 INFO - [mozharness: 2016-09-01 00:29:33.647917Z] Finished create-virtualenv step (success) 17:29:33 INFO - [mozharness: 2016-09-01 00:29:33.648377Z] Running install step. 17:29:33 INFO - Running pre-action listener: _resource_record_pre_action 17:29:33 INFO - Running main action method: install 17:29:33 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:29:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:29:33 INFO - Reading from file tmpfile_stdout 17:29:33 INFO - Detecting whether we're running mozinstall >=1.0... 17:29:33 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 17:29:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 17:29:33 INFO - Reading from file tmpfile_stdout 17:29:33 INFO - Output received: 17:29:33 INFO - Usage: mozinstall [options] installer 17:29:33 INFO - Options: 17:29:33 INFO - -h, --help show this help message and exit 17:29:33 INFO - -d DEST, --destination=DEST 17:29:33 INFO - Directory to install application into. [default: 17:29:33 INFO - "/builds/slave/test"] 17:29:33 INFO - --app=APP Application being installed. [default: firefox] 17:29:33 INFO - mkdir: /builds/slave/test/build/application 17:29:33 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'] 17:29:33 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 17:29:50 INFO - Reading from file tmpfile_stdout 17:29:50 INFO - Output received: 17:29:50 INFO - /builds/slave/test/build/application/firefox/firefox 17:29:50 INFO - Running post-action listener: _resource_record_post_action 17:29:50 INFO - [mozharness: 2016-09-01 00:29:50.974800Z] Finished install step (success) 17:29:50 INFO - [mozharness: 2016-09-01 00:29:50.975086Z] Running run-tests step. 17:29:50 INFO - Running pre-action listener: _resource_record_pre_action 17:29:50 INFO - Running main action method: run_tests 17:29:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 17:29:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 17:29:50 INFO - Python 2.7.3 17:29:50 INFO - Return code: 0 17:29:50 INFO - grabbing minidump binary from tooltool 17:29: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')]} 17:29:50 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 0x1591370>, '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 0x15948f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1594d80>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 17:29:50 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 17:29:50 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 17:29:50 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 17:29:51 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 17:29:51 INFO - Return code: 0 17:29:51 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 17:29:51 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 17:29:51 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 17:29:51 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 17:29:51 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 17:29:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-029', '--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 17:29:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-029 --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 17:29:51 INFO - Using env: {'DISPLAY': ':0', 17:29:51 INFO - 'HOME': '/home/cltbld', 17:29:51 INFO - 'LANG': 'en_US.UTF-8', 17:29:51 INFO - 'LANGUAGE': 'en_US:en', 17:29:51 INFO - 'LOGNAME': 'cltbld', 17:29:51 INFO - 'MAIL': '/var/mail/cltbld', 17:29:51 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 17:29:51 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 17:29:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:29:51 INFO - 'MOZ_NO_REMOTE': '1', 17:29:51 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 17:29:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:29:51 INFO - 'NO_EM_RESTART': '1', 17:29:51 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:29:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:29:51 INFO - 'PWD': '/builds/slave/test', 17:29:51 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 17:29:51 INFO - 'SHELL': '/bin/bash', 17:29:51 INFO - 'SHLVL': '1', 17:29:51 INFO - 'TERM': 'linux', 17:29:51 INFO - 'TMOUT': '86400', 17:29:51 INFO - 'USER': 'cltbld', 17:29:51 INFO - 'XDG_SESSION_COOKIE': '9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583', 17:29:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:29:51 INFO - '_': '/tools/buildbot/bin/python'} 17:29:51 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-029', '--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 17:29:51 INFO - mozversion application_buildid: 20160831143002 17:29:51 INFO - mozversion application_changeset: 215b219482a545aea1118d436eb77334bbb4be21 17:29:51 INFO - mozversion application_display_name: Nightly 17:29:51 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 17:29:51 INFO - mozversion application_name: Firefox 17:29:51 INFO - mozversion application_remotingname: firefox 17:29:51 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 17:29:51 INFO - mozversion application_vendor: Mozilla 17:29:51 INFO - mozversion application_version: 51.0a1 17:29:51 INFO - mozversion platform_buildid: 20160831143002 17:29:51 INFO - mozversion platform_changeset: 215b219482a545aea1118d436eb77334bbb4be21 17:29:51 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 17:29:51 INFO - mozversion platform_version: 51.0a1 17:29:51 INFO - using testdate: 1472689791 17:29:51 INFO - actual date: 1472689791 17:29:51 INFO - starting webserver on 'localhost:49562' 17:29:51 INFO - SUITE-START | Running 2 tests 17:29:51 INFO - TEST-START | dromaeo_css 17:29:51 INFO - operating with platform_type : linux_ 17:29:51 INFO - Initialising browser for dromaeo_css test... 17:29:51 INFO - TEST-INFO | started process 13812 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpzW2LWD/profile http://localhost:49562/getInfo.html) 17:29:56 INFO - PROCESS | 13812 | __metrics Screen width/height:1600/1200 17:29:56 INFO - PROCESS | 13812 | colorDepth:24 17:29:56 INFO - PROCESS | 13812 | Browser inner width/height: 1024/697 17:29:56 INFO - PROCESS | 13812 | __metrics 17:29:56 ERROR - PROCESS | 13812 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2998: TypeError: this.tabs is undefined 17:29:57 INFO - TEST-INFO | 13812: exit 0 17:29:57 INFO - Browser initialized. 17:29:57 INFO - Running cycle 1/1 for dromaeo_css test... 17:29:57 INFO - TEST-INFO | started process 13936 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpzW2LWD/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:30:09 INFO - PROCESS | 13936 | RSS: Main: 191594496 17:30:09 INFO - PROCESS | 13936 | 17:30:59 INFO - PROCESS | 13936 | 1472689859265 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] 17:33:09 INFO - PROCESS | 13936 | Cycle 1(1): loaded http://localhost:49562/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49562/tests/dromaeo/cssquery-ext.html) 17:33:10 INFO - PROCESS | 13936 | RSS: Main: 211496960 17:33:10 INFO - PROCESS | 13936 | 17:36:12 INFO - PROCESS | 13936 | Cycle 1(1): loaded http://localhost:49562/tests/dromaeo/cssquery-ext.html (next: http://localhost:49562/tests/dromaeo/cssquery-jquery.html) 17:36:13 INFO - PROCESS | 13936 | RSS: Main: 205295616 17:36:13 INFO - PROCESS | 13936 | 17:39:15 INFO - PROCESS | 13936 | Cycle 1(1): loaded http://localhost:49562/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49562/tests/dromaeo/cssquery-mootools.html) 17:39:15 INFO - PROCESS | 13936 | RSS: Main: 200982528 17:39:15 INFO - PROCESS | 13936 | 17:42:17 INFO - PROCESS | 13936 | Cycle 1(1): loaded http://localhost:49562/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49562/tests/dromaeo/cssquery-prototype.html) 17:42:18 INFO - PROCESS | 13936 | RSS: Main: 195178496 17:42:18 INFO - PROCESS | 13936 | 17:45:20 INFO - PROCESS | 13936 | Cycle 1(1): loaded http://localhost:49562/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49562/tests/dromaeo/cssquery-yui.html) 17:45:21 INFO - PROCESS | 13936 | RSS: Main: 199450624 17:45:21 INFO - PROCESS | 13936 | 17:48:24 INFO - PROCESS | 13936 | Cycle 1(1): loaded http://localhost:49562/tests/dromaeo/cssquery-yui.html (next: http://localhost:49562/tests/dromaeo/cssquery-dojo.html) 17:48:24 INFO - PROCESS | 13936 | RSS: Main: 199962624 17:48:24 INFO - PROCESS | 13936 | 17:48:24 INFO - PROCESS | 13936 | __start_tp_report 17:48:24 INFO - PROCESS | 13936 | _x_x_mozilla_page_load 17:48:24 INFO - PROCESS | 13936 | _x_x_mozilla_page_load_details 17:48:24 INFO - PROCESS | 13936 | |i|pagename|runs| 17:48:24 INFO - PROCESS | 13936 | |0;dojo.html;3093.6751641077685;3119.1422358851314;3134.5141503067025;3141.387429451258;3152.8738850445984;5394.487523685253;5453.509184173424;5518.2550355701915;5535.972320138399;5549.056660367737;5471.097268950618;5493.23094766732;5498.257735205746;5507.4767897049815;5527.806526771564;4872.585830204428;4958.3306253655655;4988.625853061017;4999.225120106371;5014.548690617844;4995.925061124086;5024.271480635306;5087.923681144785;5096.617753668471;5129.53834154926;4817.566419022287;4847.5637192652475;4871.951280487186;4935.53112454318;4972.552470277692;4874.878128046792;4885.8778530536665;4896.583790377822;4906.107593210594;4928.654994150411;4860.270959356125;4862.878428039292;4880.267959806022;4884.877878053042;4892.608591312722;5359.490848369438;5368.892622147574;5503.091989821674;5539.584531160139;5605.047141985872;5819.7672093116225;5848.356680765112;5855.473007429352;5857.882842343172;5867.325257595388;5928.051511758141;5934.495567876736;5942.049272116441;5942.227510423617;5958.314793798725;5407.3781515125875;5548.4174161713245;5578.079616863212;5588.105903055492;5669.971650141723;6101.60339577926;6115.541334399938;6118.969405152946;6123.203983482119;6129.908051379233;5857.179994800731;5861.912071318934;5863.618864773776;5864.824055278348;5869.735861886225;5750.913736293959;5777.566682498829;5858.794942177088;5912.970435147797;5914.201582786355;5796.652200867961;5802.970985145047;5812.38969908162;5888.205092312483;5896.734646940898;5883.058710606368;5941.792037278761;5946.256717910262;5946.43508866657;5959.553033522503;4437.755923424178;4466.3523789050405;4473.261911784584;4541.227991241497;4557.544245575482;3959.267535505883;3979.820908059144;4028.3353246713964;4038.9394159087637;4039.636432721069;5581.413951535031;5583.4137415571595;5585.972070139624;5589.888202236014;5604.047311956977;5730;5870.060790273621;5875.148103524965;5875.324337701134;5906.0255057914965;5621.803236886771;5637.379888212294;5656.4060773619;5689.402612725687;5705.543556515552;4996.675216110941;5002.824901128443;5011.273365362002;5023.547880690755;5072.036313100499;5956.7319470623925;6038.63768173911;6078.848028799139;6159.476444502267;6159.84600384994;5913.083472061838;5923.940760592512;5936.495397891227;5972.492338151305;5996.430339117776;6098.237720284965;6110.7861224856915;6119.2350956130485;6126.1423400724825;6139.877202455837;5740.311162660508;5767.2502574666705;5771.94228057714;5773;5799.188113664175;5890.263717035371;5890.322612899571;5946.256717910262;5969.820905372846;6061.333253342217;5800.158976948234;5835.79574714883;5843.065109582616;5845.503132233638;5853.151293062397;5684.914726279192;5685.77256909719;5804.5356371491025;5832.445917637818;5833.270841144857;5657.066584013756;5665.518430933417;5696.772129114789;5726.713664316851;5754.597178197486;5728.742206600629;5733;5787.36339002701;5789.884202316014;5796.536277097906;5536;5581.274434323512;5609.354924183608;5646.2942132233475;5671.376148623731 17:48:24 INFO - PROCESS | 13936 | |1;ext.html;571.0976656882127;578.7598146769091;591.8845825064111;595.609875531527;602.8756369371124;38354.42468362973;42674.57325426749;42768.358474622866;42773.14453710924;42825.14349713004;43709.12581748363;44489.55510444895;44498;44631.77684111575;44686.32970505445;8850.468971861677;8980;8992.190702836744;9011.774705632346;9015.549222538879;8832.735017949472;8884.378093533454;8902.688405905794;8925.73222803317;8950.686725964593;8938;8967.148120928501;9020.909790902106;9030.909690903105;9044.728658140266;8902.510361930092;8930.910690893106;8940.195382415548;8943.64225430982;9025.458472491671;8870.201681848665;8888.466691998501;8953.820923581492;8970.775730606721;8976.192142707188;41804.372934406005;42019.57980420187;42150;42158;42420;3454.758166928316;3470.35798377301;3475.14858859581;3487.511748355232;3544.663256990582;31718.682813171803;31736.36527269465;33201.169970750685;33570.832145839115;33869.83065084684;4158.542560318362;4166.062635906927;4199.9370009449885;4383.3863259143745;4389.122175564899;371179;373238;373384;373446;375120;56635.43364566384;56770.43229567652;57048;57115.000974965675;57175.714121429126;36051;36901;37037.07407314785;38496.80751596224;59514.70242648759;17148.657026859393;17239.310427582757;17333.393331233598;17376.739348909778;17386.913065434845;13177.802332965013;13358.86449651771;13382.799258011137;13409.396577154052;13416.664583385493;18415.605971223922;18478.722819157723;18640.627187456175;18650.440486785417;18804.905975470036;6746.460283177334;6817.842905287858;6915.412189963909;6928.16861976566;7106.7157313706875;858.4634603372892;983.6999715086824;993.5777294649889;1105.6019832860163;1154.1228666213738;31678.208044799063;32007;32234;32283.51574726381;32780.83609581985;1112.4604566785104;1134.812755895268;1138.3283862521153;1147.460693474066;1211.1945556205026;16863.578410539834;16938.745918811226;16986.235619397157;16999.32002719902;17064.658706825794;519579;522062;526066;526649;527988;57718.7114064427;58195.70902145462;58473.70763146157;58537.70731146317;58565;1285.318781046047;1334.1728128560355;1361.9659508512168;1369.2811274080989;1372.9656758580916;29872.00127203677;31948;31981.520277195395;32153.196170095936;32313.351267449503;51173.488265116874;51465.7426712864;51480.48519514757;51624;51633;454861;458100;461027;463213;463906;28366.574501382907;28707;28935.565966510097;29107.7089229105;29138.125856224346;47689.52310476851;48030.279545806145;48295.51704483051;49332;49823.501764981884;40429.24332618632;40823.38764918588;40846;41142.38286425646;42355;40542.59457405388;41466.58533414627;41581;41647;41970.58029419667;39811.40282895701;40187.79906100451;40502.81819892782;40673;41291.587084128776;34676.306473870885;37098.44352334663;37311.44032839455;37515.62484375121;37586.81206593949;27964.720352796212;28249;28285.292867678472;28300;28386.574201386582 17:48:24 INFO - PROCESS | 13936 | |2;jquery.html;377.11378261086435;386.7061033614454;402.24980411532493;407.9959200407995;418.3703526193081;16635.334586616522;18281.08594570273;19913.701294480594;19971.600567988633;20543.486412839688;11534.250273732201;11603.477843497041;11842.526298948052;11897.4051297435;11910.928016478516;4745.90508189836;5250.579953603703;5270.156774916014;5307.787688492475;5333.146696528556;5020.39755229373;5142.691438513682;5197.688138711689;5210.947890521084;5259.13224317989;5212.843614691566;5226.216067589854;5226.660267082628;5241.266222728821;5248.501392367719;5078.4921507849285;5187.818426355059;5196.61025423091;5228.738563071831;5249.553787928031;5060.84817455477;5092.236164575306;5107.1828507439;5112.36095488064;5119.692818430869;12675.429605667767;13027.674308142372;13048.86951130486;13111.147775394664;13159.736805263841;2230.7546169921297;2259.4916143867663;2358.1982126077046;2468.222509909373;2650.50965571368;9324.160825525667;10064.798704025952;10126.066294167946;10197.18422526196;10383.169346452341;1874.2034635279952;1919.9232030718754;1927.6144771045847;1954.4039068084228;1965.3907288740393;78829.60585197095;84401.57799210964;86123.5693821527;87980.12019879783;89668.55165724194;9549.522523873917;10048.145907597936;10063.245256605784;10161.4919254037;10188;13925.303734813218;13965;13978.86021139796;14021.439142434392;14028.719425611635;7827.608619569112;7926.365890728728;8030.919690803017;8218.137095604994;8234.670613175405;7998.920010799818;8058.435909486397;8121.512709237465;8302.335813134934;8396.664133434595;3919.529656441245;4023.195360927826;4053.331200351909;4100.220958017967;4295.548967358445;1906.1136571494321;1957.1388589020785;1957.8531610129298;2006.137360934783;2028.7768345481986;947.3794664494767;964.064857088623;966.4829316315737;1063.6170978447753;1074;19696.40910772679;19712.60574788496;19822.20711171566;20057.39827805168;20063.197472101245;931.4830269200523;947.6351604632266;952.9571169297399;972.9854052189223;1005.5123265216364;10500.527476263587;11019.228653994303;11031.83452248217;11113.83329250062;11167.888321116685;445852.729895745;479444;481960;486569;501269;88806.55596722104;91637.334506619;94026;94285.70009486604;94374;950.382251536493;979.603260679426;1003.603576587244;1015.6496008876926;1017.6692574913183;17658.381956631456;17853;18635.534111646775;18784.812151878305;18824.717629235845;43388.56611433845;43438.34842477302;43463.56536434595;43530.34704479372;43826.34260486159;58684.706576466844;59323;59420.70289648524;59570.10644840418;61052.694736526035;7215.747448839265;7617.771466856003;7621.237876212334;7741.690332386642;8838.55807209624;12029.578964736193;13254.337283135612;13293.13594616347;13346.799798002843;13741.862581374458;11132.220744547803;11169.329840209613;11620.244684095507;12021.939890300493;12444.875551244371;11582.536698531965;11613.941930290295;11757.176997610086;11809.409529523662;11883.881161188277;6243.282022567463;7775.844483110193;11186.272892261977;12112.878871211175;12237.143399961917;7192.568445893263;7606.847863042819;7694.653740581575;7714.575698336421;8063.27430531255;11091.667249982513;11811.173217874666;11874.16880818369;12100.394980250776;12424.440900159696 17:48:24 INFO - PROCESS | 13936 | |3;mootools.html;1435.275186031054;1458.2490017640914;1611.4682154888887;1743.5118166913269;1795.6229191869716;7618.73334433295;8418.789530261747;8473.364497662677;9139.086091390865;9167.633294668205;8507.744767656965;8768.912310876889;8818.955905220464;8842.1599948005;8848.469091854477;2333.638286065658;2353.246960972481;2359.315798418465;2365.5924724788724;2371.0397289097855;2264.852784569006;2321.7213934327906;2383.356493746687;2389.390705370128;2391.7966972807244;2362.728286247078;2368.95262094758;2381.1903952656094;2384.344305316043;2385.4632707640817;2312.6993490846085;2337.4623836517694;2343.8945247463903;2352.0356653771955;2360.280114565057;2293.954120917589;2299.9540009199723;2302.067662596651;2315.791578757903;2317.7798109179603;8850.424722393023;9064.592093355815;9189.540522973824;9227.815443691155;9238.58426370815;5073.923891141636;5124.974375128138;5142.922856157161;5250.291210686547;5258.027264955996;3191.3457741163006;3369.309291595217;3462.1517728156764;3478.9652103478893;3480.8085555294447;1159.9594014209463;1216.3700641140824;1240.1690867119053;1242.3415589737454;2047.836173106148;12286.078544109228;12613.74772504554;12672.87327126726;12786.42461089244;12809.871901280962;4026;4291.420658211102;4321.524632290446;4449.822007119679;4466.129104824593;9297.814043719087;9367.953160234156;9378.90621093794;9395.90604093964;9410.43537387759;5021.824236151717;5038.118329292359;5042.168042273057;5046.924296135561;5058.822941197041;4250.53244143144;4682.601978831769;4708.317293992352;4800.015996720664;4802.991371811889;3582.3193593217206;3616.638336166415;3683.7605555638797;3723.5345581802276;3758.4362345647824;1096.8683757948938;1098.7143342730787;1103.6964834670368;1121.5906194239044;1133.824257240129;778.7313376884965;931.1852129386651;933.5705575435376;937.6436953957452;957.1433566957534;5737.713114344266;5785.595008349459;5907.409259074058;6100.72546735398;6192.907106393408;415.37278709149405;425.3555862867758;431.6352681983719;432.4831825967938;434.1490678270562;3993.5008123984503;4061.614146656063;4065.776382299002;4108.958910410857;4126.504819421689;11070.889291107147;11368.431578421212;11538.365389903636;11552.306861588331;11603.07175425964;11324;11325.943370283096;11340.716482087848;11344.376059316652;11351.602693905674;7943.682252709942;8348.165183481604;8359.080501144868;8363.916360836436;8526.31789456842;5872.442117998783;6044.063170208625;6124.142620033288;6183.474404675653;6246.656433896179;10011.499425028866;10382.584696612052;10413.895861041596;10433.634822781167;10596.258261921592;10647.201459890384;10651.414172220293;10682.198835087554;10746.24776265654;10818.783624327627;6841.692123854538;7794.766157015299;7796.064472263365;7946.682132714626;7994.760157195294;8938.86591701112;8963.955180224057;8988.28093752485;8990.82018359616;8999.415038022507;7633.503822251536;7697.153313135439;7793.337566306927;7793.4154938378715;8070.677172913018;7906.565138917184;7955.4828936118965;7993.240642138988;8009.118996910219;8043.19568043191;7140.321669441395;7166.283371662792;7209.71161153548;7292.562446253241;7293.671784769592;5352.732363381893;5364.758585863724;5469;5486.094794358886;5562.833115006556;5057.595392368676;5327.866803329793;5373.35519737634;5450.618456707993;5567.387587365306 17:48:24 INFO - PROCESS | 13936 | |4;prototype.html;317.4270441852456;317.57603599195073;323.59712158362834;331.20015163380435;331.57061605221236;5426.348838139424;5511.311086114236;5534.252875861763;5539.806106786264;5554.361248456429;5434.157705555645;5439.755211015504;5441.2654291670615;5446.7276636168235;5456;4013.4180543821203;4046.7167298289132;4138.317177665696;4174.7893110997775;4175.185838761443;4147.315692910666;4147.357159640261;4156.521999970012;4157.484721743332;4159.188958153161;4119.752814831119;4119.794010299488;4123.237201117788;4125.535434920605;4137.2552940470705;4023.7988100595;4087.4073259377224;4109.075458021951;4110.609492098246;4134.193832202722;3616.4575313702894;3624.7281453891064;3632.7093832493338;3632.9636703633155;3637.1452708613456;5311.707856067915;5311.867203319909;5325.360956685184;5325.760340784674;5337.224643185561;4690.273007683814;4753.667243292971;4792.880177995543;4828.758562071883;4843.467218605951;5640.605157638925;5648.406917273709;5658.322090641075;5666.603337766358;5675.716214189315;3980.3034468968103;4026.8993275168064;4027;4032.758034517909;4043.474348334698;5687.317521897398;5886.882262354772;5926.570106256414;5936.317323507766;5956.434138756811;4047.210793895221;4056.229316429869;4058.9594104058583;4067.4171900843176;4071.959280407158;4091.8363265469643;4103.8974025649595;4105.952981989573;4108.8356465741035;4112.424260603518;4530.29780384041;4725.64557658177;4738.147133516;4756.381670382828;4770.546798054179;5649.971750141223;5679.971600142056;5704.629199102045;5705.286839145107;5705.857353566194;1429.9642508937359;1452.157748505864;1452.2158034661377;1452.9854701453062;1455.825300963891;893.0581973064557;938.5448057692014;946.1248345280588;951.1059603972244;958.1568219966385;5423.755930983115;5492.395836457987;5500.7524661390335;5514.897020595897;5519.172124181325;5802.506786923074;5854.941450585525;5858.912116318259;5867.413258674099;5879.588428809942;5326.627136100513;5501.944980550224;5533.363663178786;5537.8061767837935;5558.861028474321;3097.7057179567905;3100.8294194064247;3113.159446949311;3114.174743692923;3119.5476655885222;5857.7656893724625;6021.187139736079;6024.759009639653;6031.366706495843;6037.094435834572;5932.970335148297;5934.673592952429;5937.406259374115;5950.404959504015;5972.4770183602905;5917.171595976567;5926;5994.22075130239;5995;6032.4663641271645;5643.915341269802;5657.15142728594;5694.829155125353;5720.770034442615;5729.427057294404;5720.570957178312;5730.828075157752;5735.741891614971;5742.655440673573;5759.366469688414;5660.46225608583;5988.5508586855285;6009.90985135232;6011.497125718571;6022.397760223943;4086.182763447382;4086.508424425004;4105.97947010263;4106.876793696194;4128.587141285848;5781.884362312646;5798.768049277982;5814.447627475383;5839.678817665069;5846.707664616837;5435.619506634498;5606.271184745957;5677.261955945701;5684.289463817023;5685.914711279252;5672.290963629546;5687.488126068673;5696.8006119785605;5711.571632127524;5712.857178570569;5628.493435590816;5638.85902852432;5654.15187721845;5668.348139963792;5686.886262274814;5629.8592535186945;5860.593457570238;5868.23712917318;5875.3243377012195;5888.1452342513685;5640.182173584889;5689;5696.259486266758;5704.344000439836;5704.828855134353 17:48:24 INFO - PROCESS | 13936 | |5;yui.html;747.4506237915132;758.9354904833089;765.8008917681401;801.9318357939577;844.3751623798391;15496.845031549681;16051.598710032255;16065.196740163003;16116.274767635456;16153.111578863158;15177.08937463753;15335.84664153358;15354;15420.922895385507;15422.61443463914;645.6094063091832;775.7827808213709;786.4573444323413;792.3819420851745;797.1948332184506;780.8867714181469;783.4515838912755;785.5522352259214;785.7721260834351;786.1077676836803;852.3138873207097;853.4836423963505;853.8420392227426;854.4616891358436;854.7606670132373;835.0855812884881;837.9958100209491;838.9035260944947;838.9958050209771;839.4879123734516;611.339753066687;615.8583525789048;620.6927570852457;620.8634100497883;621.083901245659;14661.70676586473;14715.411383544646;14732.48436304735;14740.484083057148;14758.55724328272;15530.534083977498;15670.764938525932;15723.37106515738;15919.442819501377;15937.362505499766;11968.880311196863;12062.215955962834;12102.636920892388;12173.08701847365;12467.625971220878;3865.4008628662323;3915.256101340736;3981.8009099545197;4070.8575199867864;4070.959290407088;82972.58513707393;84790.57604711999;85800;85936;86087.56956215242;10829.458527073615;11342.489587968561;11472.426378681033;11600.88647625698;11803.114766392555;20837.270695525585;20845.061972211286;20908.58182836335;20915.895420523106;20993.265235716983;8511.872321915176;8641.179087986631;8655.394122411371;8742.86885696715;8808.91191088081;4775.808967641325;4822.590079843182;4825.758712064383;4866.78099485524;4913.582345500601;3516.191276006533;3626.3472574936236;3630.9273814523563;3631.927361452756;3640.7439433395434;586.8239528141626;598.6587645042371;603.1736520966217;604.0727483313093;612.2255346986066;684.4421796236052;711.9572825630479;736.5727877830846;752.8193233623891;759.8936148939152;8844.690435834715;9329.253659707207;9813.754656133653;9817.116459518678;9899.713681811958;754.5849782619538;763.9121501027341;778.9766307010799;786.4691333349966;794.8251384695358;4829.058333624979;4848.127337079289;4873.878153046131;5009.599232061426;5095.337606111182;87664;101391;106338.46830765797;106762;117110.41444792892;100197;101928.49035754774;102758;104027;109282;89101.55449222712;90295;91532;91747;93405.53297233471;8553.230209281195;8982.358755228935;9283.767905802139;9325.487098209664;9451.243900488082;50274.49725502698;50718.23922641089;51733.7413312931;52272.738636308095;54601.1809822845;78072.60963695146;81581;81581;82614.76077858957;83090.58454707688;11135.498902549567;11204.775904482029;11313.321200727984;11423.543058277575;11757.76484470323;13029.218246905217;13517;13719.588412347646;13819.723605528034;13892;12568.622941311774;12600.495980160691;13179.802302965654;13311.933440332736;13668.248246346546;12874.742505150032;13114.60656180316;13258.138221015988;13278.269695166859;13827.723445531234;12183.208091474025;12924.095313327976;13022;13124.813821864684;13137.671558211121;10437.791244175225;10456.26806123564;10747.677569672922;10843.837342439712;11442.370669612917;9431.669891554036;9531;10481.213908957012;11048.558057677603;11113.333000050057 17:48:24 INFO - PROCESS | 13936 | __end_tp_report 17:48:24 INFO - PROCESS | 13936 | __start_cc_report 17:48:24 INFO - PROCESS | 13936 | _x_x_mozilla_cycle_collect,327 17:48:24 INFO - PROCESS | 13936 | __end_cc_report 17:48:24 INFO - PROCESS | 13936 | __startTimestamp1472690904673__endTimestamp 17:48:24 INFO - PROCESS | 13936 | 17:48:24 INFO - PROCESS | 13936 | ------- Summary: start ------- 17:48:24 INFO - PROCESS | 13936 | Number of tests: 6 17:48:24 INFO - PROCESS | 13936 | 17:48:24 INFO - PROCESS | 13936 | [#0] dojo.html Cycles:165 Average:5467.11 Median:5689.40 stddev:644.69 (11.3%) stddev-sans-first:619.19 17:48:24 INFO - PROCESS | 13936 | Values: 3093.7 3119.1 3134.5 3141.4 3152.9 5394.5 5453.5 5518.3 5536.0 5549.1 5471.1 5493.2 5498.3 5507.5 5527.8 4872.6 4958.3 4988.6 4999.2 5014.5 4995.9 5024.3 5087.9 5096.6 5129.5 4817.6 4847.6 4872.0 4935.5 4972.6 4874.9 4885.9 4896.6 4906.1 4928.7 4860.3 4862.9 4880.3 4884.9 4892.6 5359.5 5368.9 5503.1 5539.6 5605.0 5819.8 5848.4 5855.5 5857.9 5867.3 5928.1 5934.5 5942.0 5942.2 5958.3 5407.4 5548.4 5578.1 5588.1 5670.0 6101.6 6115.5 6119.0 6123.2 6129.9 5857.2 5861.9 5863.6 5864.8 5869.7 5750.9 5777.6 5858.8 5913.0 5914.2 5796.7 5803.0 5812.4 5888.2 5896.7 5883.1 5941.8 5946.3 5946.4 5959.6 4437.8 4466.4 4473.3 4541.2 4557.5 3959.3 3979.8 4028.3 4038.9 4039.6 5581.4 5583.4 5586.0 5589.9 5604.0 5730.0 5870.1 5875.1 5875.3 5906.0 5621.8 5637.4 5656.4 5689.4 5705.5 4996.7 5002.8 5011.3 5023.5 5072.0 5956.7 6038.6 6078.8 6159.5 6159.8 5913.1 5923.9 5936.5 5972.5 5996.4 6098.2 6110.8 6119.2 6126.1 6139.9 5740.3 5767.3 5771.9 5773.0 5799.2 5890.3 5890.3 5946.3 5969.8 6061.3 5800.2 5835.8 5843.1 5845.5 5853.2 5684.9 5685.8 5804.5 5832.4 5833.3 5657.1 5665.5 5696.8 5726.7 5754.6 5728.7 5733.0 5787.4 5789.9 5796.5 5536.0 5581.3 5609.4 5646.3 5671.4 17:48:24 INFO - PROCESS | 13936 | 17:48:24 INFO - PROCESS | 13936 | [#1] ext.html Cycles:180 Average:60741.02 Median:22906.53 stddev:121112.84 (528.7%) stddev-sans-first:121368.34 17:48:24 INFO - PROCESS | 13936 | Values: 571.1 578.8 591.9 595.6 602.9 38354.4 42674.6 42768.4 42773.1 42825.1 43709.1 44489.6 44498.0 44631.8 44686.3 8850.5 8980.0 8992.2 9011.8 9015.5 8832.7 8884.4 8902.7 8925.7 8950.7 8938.0 8967.1 9020.9 9030.9 9044.7 8902.5 8930.9 8940.2 8943.6 9025.5 8870.2 8888.5 8953.8 8970.8 8976.2 41804.4 42019.6 42150.0 42158.0 42420.0 3454.8 3470.4 3475.1 3487.5 3544.7 31718.7 31736.4 33201.2 33570.8 33869.8 4158.5 4166.1 4199.9 4383.4 4389.1 371179.0 373238.0 373384.0 373446.0 375120.0 56635.4 56770.4 57048.0 57115.0 57175.7 36051.0 36901.0 37037.1 38496.8 59514.7 17148.7 17239.3 17333.4 17376.7 17386.9 13177.8 13358.9 13382.8 13409.4 13416.7 18415.6 18478.7 18640.6 18650.4 18804.9 6746.5 6817.8 6915.4 6928.2 7106.7 858.5 983.7 993.6 1105.6 1154.1 31678.2 32007.0 32234.0 32283.5 32780.8 1112.5 1134.8 1138.3 1147.5 1211.2 16863.6 16938.7 16986.2 16999.3 17064.7 519579.0 522062.0 526066.0 526649.0 527988.0 57718.7 58195.7 58473.7 58537.7 58565.0 1285.3 1334.2 1362.0 1369.3 1373.0 29872.0 31948.0 31981.5 32153.2 32313.4 51173.5 51465.7 51480.5 51624.0 51633.0 454861.0 458100.0 461027.0 463213.0 463906.0 28366.6 28707.0 28935.6 29107.7 29138.1 47689.5 48030.3 48295.5 49332.0 49823.5 40429.2 40823.4 40846.0 41142.4 42355.0 40542.6 41466.6 41581.0 41647.0 41970.6 39811.4 40187.8 40502.8 40673.0 41291.6 34676.3 37098.4 37311.4 37515.6 37586.8 27964.7 28249.0 28285.3 28300.0 28386.6 17:48:24 INFO - PROCESS | 13936 | 17:48:24 INFO - PROCESS | 13936 | [#2] jquery.html Cycles:180 Average:28244.44 Median:2212.72 stddev:79355.77 (3586.3%) stddev-sans-first:79550.80 17:48:24 INFO - PROCESS | 13936 | Values: 377.1 386.7 402.2 408.0 418.4 16635.3 18281.1 19913.7 19971.6 20543.5 11534.3 11603.5 11842.5 11897.4 11910.9 4745.9 5250.6 5270.2 5307.8 5333.1 5020.4 5142.7 5197.7 5210.9 5259.1 5212.8 5226.2 5226.7 5241.3 5248.5 5078.5 5187.8 5196.6 5228.7 5249.6 5060.8 5092.2 5107.2 5112.4 5119.7 12675.4 13027.7 13048.9 13111.1 13159.7 2230.8 2259.5 2358.2 2468.2 2650.5 9324.2 10064.8 10126.1 10197.2 10383.2 1874.2 1919.9 1927.6 1954.4 1965.4 78829.6 84401.6 86123.6 87980.1 89668.6 9549.5 10048.1 10063.2 10161.5 10188.0 13925.3 13965.0 13978.9 14021.4 14028.7 7827.6 7926.4 8030.9 8218.1 8234.7 7998.9 8058.4 8121.5 8302.3 8396.7 3919.5 4023.2 4053.3 4100.2 4295.5 1906.1 1957.1 1957.9 2006.1 2028.8 947.4 964.1 966.5 1063.6 1074.0 19696.4 19712.6 19822.2 20057.4 20063.2 931.5 947.6 953.0 973.0 1005.5 10500.5 11019.2 11031.8 11113.8 11167.9 445852.7 479444.0 481960.0 486569.0 501269.0 88806.6 91637.3 94026.0 94285.7 94374.0 950.4 979.6 1003.6 1015.6 1017.7 17658.4 17853.0 18635.5 18784.8 18824.7 43388.6 43438.3 43463.6 43530.3 43826.3 58684.7 59323.0 59420.7 59570.1 61052.7 7215.7 7617.8 7621.2 7741.7 8838.6 12029.6 13254.3 13293.1 13346.8 13741.9 11132.2 11169.3 11620.2 12021.9 12444.9 11582.5 11613.9 11757.2 11809.4 11883.9 6243.3 7775.8 11186.3 12112.9 12237.1 7192.6 7606.8 7694.7 7714.6 8063.3 11091.7 11811.2 11874.2 12100.4 12424.4 17:48:24 INFO - PROCESS | 13936 | 17:48:24 INFO - PROCESS | 13936 | [#3] mootools.html Cycles:180 Average:5848.87 Median:4574.37 stddev:3406.65 (74.5%) stddev-sans-first:3400.06 17:48:24 INFO - PROCESS | 13936 | Values: 1435.3 1458.2 1611.5 1743.5 1795.6 7618.7 8418.8 8473.4 9139.1 9167.6 8507.7 8768.9 8819.0 8842.2 8848.5 2333.6 2353.2 2359.3 2365.6 2371.0 2264.9 2321.7 2383.4 2389.4 2391.8 2362.7 2369.0 2381.2 2384.3 2385.5 2312.7 2337.5 2343.9 2352.0 2360.3 2294.0 2300.0 2302.1 2315.8 2317.8 8850.4 9064.6 9189.5 9227.8 9238.6 5073.9 5125.0 5142.9 5250.3 5258.0 3191.3 3369.3 3462.2 3479.0 3480.8 1160.0 1216.4 1240.2 1242.3 2047.8 12286.1 12613.7 12672.9 12786.4 12809.9 4026.0 4291.4 4321.5 4449.8 4466.1 9297.8 9368.0 9378.9 9395.9 9410.4 5021.8 5038.1 5042.2 5046.9 5058.8 4250.5 4682.6 4708.3 4800.0 4803.0 3582.3 3616.6 3683.8 3723.5 3758.4 1096.9 1098.7 1103.7 1121.6 1133.8 778.7 931.2 933.6 937.6 957.1 5737.7 5785.6 5907.4 6100.7 6192.9 415.4 425.4 431.6 432.5 434.1 3993.5 4061.6 4065.8 4109.0 4126.5 11070.9 11368.4 11538.4 11552.3 11603.1 11324.0 11325.9 11340.7 11344.4 11351.6 7943.7 8348.2 8359.1 8363.9 8526.3 5872.4 6044.1 6124.1 6183.5 6246.7 10011.5 10382.6 10413.9 10433.6 10596.3 10647.2 10651.4 10682.2 10746.2 10818.8 6841.7 7794.8 7796.1 7946.7 7994.8 8938.9 8964.0 8988.3 8990.8 8999.4 7633.5 7697.2 7793.3 7793.4 8070.7 7906.6 7955.5 7993.2 8009.1 8043.2 7140.3 7166.3 7209.7 7292.6 7293.7 5352.7 5364.8 5469.0 5486.1 5562.8 5057.6 5327.9 5373.4 5450.6 5567.4 17:48:24 INFO - PROCESS | 13936 | 17:48:24 INFO - PROCESS | 13936 | [#4] prototype.html Cycles:180 Average:4767.24 Median:5533.81 stddev:1423.55 (25.7%) stddev-sans-first:1387.81 17:48:24 INFO - PROCESS | 13936 | Values: 317.4 317.6 323.6 331.2 331.6 5426.3 5511.3 5534.3 5539.8 5554.4 5434.2 5439.8 5441.3 5446.7 5456.0 4013.4 4046.7 4138.3 4174.8 4175.2 4147.3 4147.4 4156.5 4157.5 4159.2 4119.8 4119.8 4123.2 4125.5 4137.3 4023.8 4087.4 4109.1 4110.6 4134.2 3616.5 3624.7 3632.7 3633.0 3637.1 5311.7 5311.9 5325.4 5325.8 5337.2 4690.3 4753.7 4792.9 4828.8 4843.5 5640.6 5648.4 5658.3 5666.6 5675.7 3980.3 4026.9 4027.0 4032.8 4043.5 5687.3 5886.9 5926.6 5936.3 5956.4 4047.2 4056.2 4059.0 4067.4 4072.0 4091.8 4103.9 4106.0 4108.8 4112.4 4530.3 4725.6 4738.1 4756.4 4770.5 5650.0 5680.0 5704.6 5705.3 5705.9 1430.0 1452.2 1452.2 1453.0 1455.8 893.1 938.5 946.1 951.1 958.2 5423.8 5492.4 5500.8 5514.9 5519.2 5802.5 5854.9 5858.9 5867.4 5879.6 5326.6 5501.9 5533.4 5537.8 5558.9 3097.7 3100.8 3113.2 3114.2 3119.5 5857.8 6021.2 6024.8 6031.4 6037.1 5933.0 5934.7 5937.4 5950.4 5972.5 5917.2 5926.0 5994.2 5995.0 6032.5 5643.9 5657.2 5694.8 5720.8 5729.4 5720.6 5730.8 5735.7 5742.7 5759.4 5660.5 5988.6 6009.9 6011.5 6022.4 4086.2 4086.5 4106.0 4106.9 4128.6 5781.9 5798.8 5814.4 5839.7 5846.7 5435.6 5606.3 5677.3 5684.3 5685.9 5672.3 5687.5 5696.8 5711.6 5712.9 5628.5 5638.9 5654.2 5668.3 5686.9 5629.9 5860.6 5868.2 5875.3 5888.1 5640.2 5689.0 5696.3 5704.3 5704.8 17:48:24 INFO - PROCESS | 13936 | 17:48:24 INFO - PROCESS | 13936 | [#5] yui.html Cycles:180 Average:21114.34 Median:4838.59 stddev:30601.51 (632.4%) stddev-sans-first:30649.14 17:48:24 INFO - PROCESS | 13936 | Values: 747.5 758.9 765.8 801.9 844.4 15496.8 16051.6 16065.2 16116.3 16153.1 15177.1 15335.8 15354.0 15420.9 15422.6 645.6 775.8 786.5 792.4 797.2 780.9 783.5 785.6 785.8 786.1 852.3 853.5 853.8 854.5 854.8 835.1 838.0 838.9 839.0 839.5 611.3 615.9 620.7 620.9 621.1 14661.7 14715.4 14732.5 14740.5 14758.6 15530.5 15670.8 15723.4 15919.4 15937.4 11968.9 12062.2 12102.6 12173.1 12467.6 3865.4 3915.3 3981.8 4070.9 4071.0 82972.6 84790.6 85800.0 85936.0 86087.6 10829.5 11342.5 11472.4 11600.9 11803.1 20837.3 20845.1 20908.6 20915.9 20993.3 8511.9 8641.2 8655.4 8742.9 8808.9 4775.8 4822.6 4825.8 4866.8 4913.6 3516.2 3626.3 3630.9 3631.9 3640.7 586.8 598.7 603.2 604.1 612.2 684.4 712.0 736.6 752.8 759.9 8844.7 9329.3 9813.8 9817.1 9899.7 754.6 763.9 779.0 786.5 794.8 4829.1 4848.1 4873.9 5009.6 5095.3 87664.0 101391.0 106338.5 106762.0 117110.4 100197.0 101928.5 102758.0 104027.0 109282.0 89101.6 90295.0 91532.0 91747.0 93405.5 8553.2 8982.4 9283.8 9325.5 9451.2 50274.5 50718.2 51733.7 52272.7 54601.2 78072.6 81581.0 81581.0 82614.8 83090.6 11135.5 11204.8 11313.3 11423.5 11757.8 13029.2 13517.0 13719.6 13819.7 13892.0 12568.6 12600.5 13179.8 13311.9 13668.2 12874.7 13114.6 13258.1 13278.3 13827.7 12183.2 12924.1 13022.0 13124.8 13137.7 10437.8 10456.3 10747.7 10843.8 11442.4 9431.7 9531.0 10481.2 11048.6 11113.3 17:48:24 INFO - PROCESS | 13936 | -------- Summary: end -------- 17:48:24 INFO - PROCESS | 13936 | 17:48:25 INFO - TEST-INFO | 13936: exit 0 17:48:25 INFO - TEST-OK | dromaeo_css | took 1114400ms 17:48:25 INFO - TEST-START | kraken 17:48:25 INFO - operating with platform_type : linux_ 17:48:25 INFO - Initialising browser for kraken test... 17:48:25 INFO - TEST-INFO | started process 14296 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp8qsh_D/profile http://localhost:49562/getInfo.html) 17:48:30 INFO - PROCESS | 14296 | __metrics Screen width/height:1600/1200 17:48:30 INFO - PROCESS | 14296 | colorDepth:24 17:48:30 INFO - PROCESS | 14296 | Browser inner width/height: 1024/697 17:48:30 INFO - PROCESS | 14296 | __metrics 17:48:31 ERROR - PROCESS | 14296 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2998: TypeError: this.tabs is undefined 17:48:32 INFO - TEST-INFO | 14296: exit 0 17:48:32 INFO - Browser initialized. 17:48:32 INFO - Running cycle 1/1 for kraken test... 17:48:32 INFO - TEST-INFO | started process 14421 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp8qsh_D/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:48:44 INFO - PROCESS | 14421 | RSS: Main: 191320064 17:48:44 INFO - PROCESS | 14421 | 17:48:46 INFO - PROCESS | 14421 | Cycle 1(1): loaded http://localhost:49562/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49562/tests/kraken/driver.html?testName=audio-beat-detection) 17:48:47 INFO - PROCESS | 14421 | RSS: Main: 204623872 17:48:47 INFO - PROCESS | 14421 | 17:48:50 INFO - PROCESS | 14421 | Cycle 1(1): loaded http://localhost:49562/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49562/tests/kraken/driver.html?testName=audio-dft) 17:48:50 INFO - PROCESS | 14421 | RSS: Main: 203919360 17:48:50 INFO - PROCESS | 14421 | 17:48:53 INFO - PROCESS | 14421 | Cycle 1(1): loaded http://localhost:49562/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49562/tests/kraken/driver.html?testName=audio-fft) 17:48:54 INFO - PROCESS | 14421 | RSS: Main: 196071424 17:48:54 INFO - PROCESS | 14421 | 17:48:56 INFO - PROCESS | 14421 | Cycle 1(1): loaded http://localhost:49562/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49562/tests/kraken/driver.html?testName=audio-oscillator) 17:48:57 INFO - PROCESS | 14421 | RSS: Main: 196706304 17:48:57 INFO - PROCESS | 14421 | 17:48:59 INFO - PROCESS | 14421 | Cycle 1(1): loaded http://localhost:49562/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49562/tests/kraken/driver.html?testName=imaging-gaussian-blur) 17:48:59 INFO - PROCESS | 14421 | RSS: Main: 196845568 17:48:59 INFO - PROCESS | 14421 | 17:49:03 INFO - PROCESS | 14421 | Cycle 1(1): loaded http://localhost:49562/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49562/tests/kraken/driver.html?testName=imaging-darkroom) 17:49:03 INFO - PROCESS | 14421 | RSS: Main: 196788224 17:49:03 INFO - PROCESS | 14421 | 17:49:07 INFO - PROCESS | 14421 | Cycle 1(1): loaded http://localhost:49562/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49562/tests/kraken/driver.html?testName=imaging-desaturate) 17:49:07 INFO - PROCESS | 14421 | RSS: Main: 194056192 17:49:07 INFO - PROCESS | 14421 | 17:49:10 INFO - PROCESS | 14421 | Cycle 1(1): loaded http://localhost:49562/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49562/tests/kraken/driver.html?testName=json-parse-financial) 17:49:11 INFO - PROCESS | 14421 | RSS: Main: 195751936 17:49:11 INFO - PROCESS | 14421 | 17:49:12 INFO - PROCESS | 14421 | Cycle 1(1): loaded http://localhost:49562/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49562/tests/kraken/driver.html?testName=json-stringify-tinderbox) 17:49:13 INFO - PROCESS | 14421 | RSS: Main: 196571136 17:49:13 INFO - PROCESS | 14421 | 17:49:15 INFO - PROCESS | 14421 | Cycle 1(1): loaded http://localhost:49562/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49562/tests/kraken/driver.html?testName=stanford-crypto-aes) 17:49:15 INFO - PROCESS | 14421 | RSS: Main: 196235264 17:49:15 INFO - PROCESS | 14421 | 17:49:18 INFO - PROCESS | 14421 | Cycle 1(1): loaded http://localhost:49562/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49562/tests/kraken/driver.html?testName=stanford-crypto-ccm) 17:49:18 INFO - PROCESS | 14421 | RSS: Main: 196755456 17:49:18 INFO - PROCESS | 14421 | 17:49:21 INFO - PROCESS | 14421 | Cycle 1(1): loaded http://localhost:49562/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49562/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 17:49:22 INFO - PROCESS | 14421 | RSS: Main: 197517312 17:49:22 INFO - PROCESS | 14421 | 17:49:24 INFO - PROCESS | 14421 | Cycle 1(1): loaded http://localhost:49562/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49562/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 17:49:25 INFO - PROCESS | 14421 | RSS: Main: 196661248 17:49:25 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | Cycle 1(1): loaded http://localhost:49562/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49562/tests/kraken/driver.html?testName=ai-astar) 17:49:27 INFO - PROCESS | 14421 | RSS: Main: 198496256 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | __start_tp_report 17:49:27 INFO - PROCESS | 14421 | _x_x_mozilla_page_load 17:49:27 INFO - PROCESS | 14421 | _x_x_mozilla_page_load_details 17:49:27 INFO - PROCESS | 14421 | |i|pagename|runs| 17:49:27 INFO - PROCESS | 14421 | |0;ai-astar;107;113;114;115;114;113;115;116;113;130 17:49:27 INFO - PROCESS | 14421 | |1;audio-beat-detection;147;128;149;178;121;157;146;121;183;123 17:49:27 INFO - PROCESS | 14421 | |2;audio-dft;162;164;162;168;165;162;162;163;163;162 17:49:27 INFO - PROCESS | 14421 | |3;audio-fft;75;75;76;197;77;76;76;75;172;76 17:49:27 INFO - PROCESS | 14421 | |4;audio-oscillator;82;81;155;83;83;86;144;83;84;149 17:49:27 INFO - PROCESS | 14421 | |5;imaging-gaussian-blur;118;119;118;119;117;118;118;118;117;118 17:49:27 INFO - PROCESS | 14421 | |6;imaging-darkroom;147;147;148;148;147;149;148;147;148;147 17:49:27 INFO - PROCESS | 14421 | |7;imaging-desaturate;97;97;96;95;95;95;95;95;95;96 17:49:27 INFO - PROCESS | 14421 | |8;json-parse-financial;57;56;53;54;55;54;55;57;53;55 17:49:27 INFO - PROCESS | 14421 | |9;json-stringify-tinderbox;62;62;62;62;62;61;62;63;63;61 17:49:27 INFO - PROCESS | 14421 | |10;stanford-crypto-aes;82;80;82;85;78;79;88;81;82;89 17:49:27 INFO - PROCESS | 14421 | |11;stanford-crypto-ccm;141;140;145;123;126;126;136;145;162;133 17:49:27 INFO - PROCESS | 14421 | |12;stanford-crypto-pbkdf2;166;173;166;172;166;168;168;168;166;171 17:49:27 INFO - PROCESS | 14421 | |13;stanford-crypto-sha256-iterative;72;69;66;67;68;65;65;66;68;65 17:49:27 INFO - PROCESS | 14421 | __end_tp_report 17:49:27 INFO - PROCESS | 14421 | __start_cc_report 17:49:27 INFO - PROCESS | 14421 | _x_x_mozilla_cycle_collect,804 17:49:27 INFO - PROCESS | 14421 | __end_cc_report 17:49:27 INFO - PROCESS | 14421 | __startTimestamp1472690967586__endTimestamp 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | ------- Summary: start ------- 17:49:27 INFO - PROCESS | 14421 | Number of tests: 14 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | [#0] ai-astar Cycles:10 Average:115.00 Median:114.50 stddev:5.81 (5.1%) stddev-sans-first:5.40 17:49:27 INFO - PROCESS | 14421 | Values: 107.0 113.0 114.0 115.0 114.0 113.0 115.0 116.0 113.0 130.0 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | [#1] audio-beat-detection Cycles:10 Average:145.30 Median:148.00 stddev:22.66 (15.3%) stddev-sans-first:24.03 17:49:27 INFO - PROCESS | 14421 | Values: 147.0 128.0 149.0 178.0 121.0 157.0 146.0 121.0 183.0 123.0 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | [#2] audio-dft Cycles:10 Average:163.30 Median:163.00 stddev:1.95 (1.2%) stddev-sans-first:2.01 17:49:27 INFO - PROCESS | 14421 | Values: 162.0 164.0 162.0 168.0 165.0 162.0 162.0 163.0 163.0 162.0 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | [#3] audio-fft Cycles:10 Average:97.50 Median:76.00 stddev:46.23 (60.8%) stddev-sans-first:48.32 17:49:27 INFO - PROCESS | 14421 | Values: 75.0 75.0 76.0 197.0 77.0 76.0 76.0 75.0 172.0 76.0 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | [#4] audio-oscillator Cycles:10 Average:103.00 Median:83.00 stddev:32.10 (38.7%) stddev-sans-first:33.14 17:49:27 INFO - PROCESS | 14421 | Values: 82.0 81.0 155.0 83.0 83.0 86.0 144.0 83.0 84.0 149.0 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | [#5] imaging-gaussian-blur Cycles:10 Average:118.00 Median:118.00 stddev:0.67 (0.6%) stddev-sans-first:0.71 17:49:27 INFO - PROCESS | 14421 | Values: 118.0 119.0 118.0 119.0 117.0 118.0 118.0 118.0 117.0 118.0 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | [#6] imaging-darkroom Cycles:10 Average:147.60 Median:148.00 stddev:0.70 (0.5%) stddev-sans-first:0.71 17:49:27 INFO - PROCESS | 14421 | Values: 147.0 147.0 148.0 148.0 147.0 149.0 148.0 147.0 148.0 147.0 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:95.50 stddev:0.84 (0.9%) stddev-sans-first:0.73 17:49:27 INFO - PROCESS | 14421 | Values: 97.0 97.0 96.0 95.0 95.0 95.0 95.0 95.0 95.0 96.0 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | [#8] json-parse-financial Cycles:10 Average:54.90 Median:55.00 stddev:1.45 (2.6%) stddev-sans-first:1.32 17:49:27 INFO - PROCESS | 14421 | Values: 57.0 56.0 53.0 54.0 55.0 54.0 55.0 57.0 53.0 55.0 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | [#9] json-stringify-tinderbox Cycles:10 Average:62.00 Median:62.00 stddev:0.67 (1.1%) stddev-sans-first:0.71 17:49:27 INFO - PROCESS | 14421 | Values: 62.0 62.0 62.0 62.0 62.0 61.0 62.0 63.0 63.0 61.0 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | [#10] stanford-crypto-aes Cycles:10 Average:82.60 Median:82.00 stddev:3.66 (4.5%) stddev-sans-first:3.87 17:49:27 INFO - PROCESS | 14421 | Values: 82.0 80.0 82.0 85.0 78.0 79.0 88.0 81.0 82.0 89.0 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | [#11] stanford-crypto-ccm Cycles:10 Average:137.70 Median:140.50 stddev:11.68 (8.3%) stddev-sans-first:12.33 17:49:27 INFO - PROCESS | 14421 | Values: 141.0 140.0 145.0 123.0 126.0 126.0 136.0 145.0 162.0 133.0 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:168.40 Median:168.00 stddev:2.67 (1.6%) stddev-sans-first:2.69 17:49:27 INFO - PROCESS | 14421 | Values: 166.0 173.0 166.0 172.0 166.0 168.0 168.0 168.0 166.0 171.0 17:49:27 INFO - PROCESS | 14421 | 17:49:27 INFO - PROCESS | 14421 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.10 Median:67.50 stddev:2.23 (3.3%) stddev-sans-first:1.51 17:49:27 INFO - PROCESS | 14421 | Values: 72.0 69.0 66.0 67.0 68.0 65.0 65.0 66.0 68.0 65.0 17:49:27 INFO - PROCESS | 14421 | -------- Summary: end -------- 17:49:27 INFO - PROCESS | 14421 | 17:49:28 INFO - TEST-INFO | 14421: exit 0 17:49:28 INFO - TEST-OK | kraken | took 63150ms 17:49:28 INFO - SUITE-END | took 1177s 17:49:29 INFO - Completed test suite (00:19:37) 17:49:29 INFO - javascript benchmark 17:49:29 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7209.939431444767, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3093.6751641077685, 3119.1422358851314, 3134.5141503067025, 3141.387429451258, 3152.8738850445984, 5394.487523685253, 5453.509184173424, 5518.2550355701915, 5535.972320138399, 5549.056660367737, 5471.097268950618, 5493.23094766732, 5498.257735205746, 5507.4767897049815, 5527.806526771564, 4872.585830204428, 4958.3306253655655, 4988.625853061017, 4999.225120106371, 5014.548690617844, 4995.925061124086, 5024.271480635306, 5087.923681144785, 5096.617753668471, 5129.53834154926, 4817.566419022287, 4847.5637192652475, 4871.951280487186, 4935.53112454318, 4972.552470277692, 4874.878128046792, 4885.8778530536665, 4896.583790377822, 4906.107593210594, 4928.654994150411, 4860.270959356125, 4862.878428039292, 4880.267959806022, 4884.877878053042, 4892.608591312722, 5359.490848369438, 5368.892622147574, 5503.091989821674, 5539.584531160139, 5605.047141985872, 5819.7672093116225, 5848.356680765112, 5855.473007429352, 5857.882842343172, 5867.325257595388, 5928.051511758141, 5934.495567876736, 5942.049272116441, 5942.227510423617, 5958.314793798725, 5407.3781515125875, 5548.4174161713245, 5578.079616863212, 5588.105903055492, 5669.971650141723, 6101.60339577926, 6115.541334399938, 6118.969405152946, 6123.203983482119, 6129.908051379233, 5857.179994800731, 5861.912071318934, 5863.618864773776, 5864.824055278348, 5869.735861886225, 5750.913736293959, 5777.566682498829, 5858.794942177088, 5912.970435147797, 5914.201582786355, 5796.652200867961, 5802.970985145047, 5812.38969908162, 5888.205092312483, 5896.734646940898, 5883.058710606368, 5941.792037278761, 5946.256717910262, 5946.43508866657, 5959.553033522503, 4437.755923424178, 4466.3523789050405, 4473.261911784584, 4541.227991241497, 4557.544245575482, 3959.267535505883, 3979.820908059144, 4028.3353246713964, 4038.9394159087637, 4039.636432721069, 5581.413951535031, 5583.4137415571595, 5585.972070139624, 5589.888202236014, 5604.047311956977, 5730.0, 5870.060790273621, 5875.148103524965, 5875.324337701134, 5906.0255057914965, 5621.803236886771, 5637.379888212294, 5656.4060773619, 5689.402612725687, 5705.543556515552, 4996.675216110941, 5002.824901128443, 5011.273365362002, 5023.547880690755, 5072.036313100499, 5956.7319470623925, 6038.63768173911, 6078.848028799139, 6159.476444502267, 6159.84600384994, 5913.083472061838, 5923.940760592512, 5936.495397891227, 5972.492338151305, 5996.430339117776, 6098.237720284965, 6110.7861224856915, 6119.2350956130485, 6126.1423400724825, 6139.877202455837, 5740.311162660508, 5767.2502574666705, 5771.94228057714, 5773.0, 5799.188113664175, 5890.263717035371, 5890.322612899571, 5946.256717910262, 5969.820905372846, 6061.333253342217, 5800.158976948234, 5835.79574714883, 5843.065109582616, 5845.503132233638, 5853.151293062397, 5684.914726279192, 5685.77256909719, 5804.5356371491025, 5832.445917637818, 5833.270841144857, 5657.066584013756, 5665.518430933417, 5696.772129114789, 5726.713664316851, 5754.597178197486, 5728.742206600629, 5733.0, 5787.36339002701, 5789.884202316014, 5796.536277097906, 5536.0, 5581.274434323512, 5609.354924183608, 5646.2942132233475, 5671.376148623731], "value": 5421.792785764969, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [571.0976656882127, 578.7598146769091, 591.8845825064111, 595.609875531527, 602.8756369371124, 38354.42468362973, 42674.57325426749, 42768.358474622866, 42773.14453710924, 42825.14349713004, 43709.12581748363, 44489.55510444895, 44498.0, 44631.77684111575, 44686.32970505445, 8850.468971861677, 8980.0, 8992.190702836744, 9011.774705632346, 9015.549222538879, 8832.735017949472, 8884.378093533454, 8902.688405905794, 8925.73222803317, 8950.686725964593, 8938.0, 8967.148120928501, 9020.909790902106, 9030.909690903105, 9044.728658140266, 8902.510361930092, 8930.910690893106, 8940.195382415548, 8943.64225430982, 9025.458472491671, 8870.201681848665, 8888.466691998501, 8953.820923581492, 8970.775730606721, 8976.192142707188, 41804.372934406005, 42019.57980420187, 42150.0, 42158.0, 42420.0, 3454.758166928316, 3470.35798377301, 3475.14858859581, 3487.511748355232, 3544.663256990582, 31718.682813171803, 31736.36527269465, 33201.169970750685, 33570.832145839115, 33869.83065084684, 4158.542560318362, 4166.062635906927, 4199.9370009449885, 4383.3863259143745, 4389.122175564899, 371179.0, 373238.0, 373384.0, 373446.0, 375120.0, 56635.43364566384, 56770.43229567652, 57048.0, 57115.000974965675, 57175.714121429126, 36051.0, 36901.0, 37037.07407314785, 38496.80751596224, 59514.70242648759, 17148.657026859393, 17239.310427582757, 17333.393331233598, 17376.739348909778, 17386.913065434845, 13177.802332965013, 13358.86449651771, 13382.799258011137, 13409.396577154052, 13416.664583385493, 18415.605971223922, 18478.722819157723, 18640.627187456175, 18650.440486785417, 18804.905975470036, 6746.460283177334, 6817.842905287858, 6915.412189963909, 6928.16861976566, 7106.7157313706875, 858.4634603372892, 983.6999715086824, 993.5777294649889, 1105.6019832860163, 1154.1228666213738, 31678.208044799063, 32007.0, 32234.0, 32283.51574726381, 32780.83609581985, 1112.4604566785104, 1134.812755895268, 1138.3283862521153, 1147.460693474066, 1211.1945556205026, 16863.578410539834, 16938.745918811226, 16986.235619397157, 16999.32002719902, 17064.658706825794, 519579.0, 522062.0, 526066.0, 526649.0, 527988.0, 57718.7114064427, 58195.70902145462, 58473.70763146157, 58537.70731146317, 58565.0, 1285.318781046047, 1334.1728128560355, 1361.9659508512168, 1369.2811274080989, 1372.9656758580916, 29872.00127203677, 31948.0, 31981.520277195395, 32153.196170095936, 32313.351267449503, 51173.488265116874, 51465.7426712864, 51480.48519514757, 51624.0, 51633.0, 454861.0, 458100.0, 461027.0, 463213.0, 463906.0, 28366.574501382907, 28707.0, 28935.565966510097, 29107.7089229105, 29138.125856224346, 47689.52310476851, 48030.279545806145, 48295.51704483051, 49332.0, 49823.501764981884, 40429.24332618632, 40823.38764918588, 40846.0, 41142.38286425646, 42355.0, 40542.59457405388, 41466.58533414627, 41581.0, 41647.0, 41970.58029419667, 39811.40282895701, 40187.79906100451, 40502.81819892782, 40673.0, 41291.587084128776, 34676.306473870885, 37098.44352334663, 37311.44032839455, 37515.62484375121, 37586.81206593949, 27964.720352796212, 28249.0, 28285.292867678472, 28300.0, 28386.574201386582], "value": 19989.265643952385, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [377.11378261086435, 386.7061033614454, 402.24980411532493, 407.9959200407995, 418.3703526193081, 16635.334586616522, 18281.08594570273, 19913.701294480594, 19971.600567988633, 20543.486412839688, 11534.250273732201, 11603.477843497041, 11842.526298948052, 11897.4051297435, 11910.928016478516, 4745.90508189836, 5250.579953603703, 5270.156774916014, 5307.787688492475, 5333.146696528556, 5020.39755229373, 5142.691438513682, 5197.688138711689, 5210.947890521084, 5259.13224317989, 5212.843614691566, 5226.216067589854, 5226.660267082628, 5241.266222728821, 5248.501392367719, 5078.4921507849285, 5187.818426355059, 5196.61025423091, 5228.738563071831, 5249.553787928031, 5060.84817455477, 5092.236164575306, 5107.1828507439, 5112.36095488064, 5119.692818430869, 12675.429605667767, 13027.674308142372, 13048.86951130486, 13111.147775394664, 13159.736805263841, 2230.7546169921297, 2259.4916143867663, 2358.1982126077046, 2468.222509909373, 2650.50965571368, 9324.160825525667, 10064.798704025952, 10126.066294167946, 10197.18422526196, 10383.169346452341, 1874.2034635279952, 1919.9232030718754, 1927.6144771045847, 1954.4039068084228, 1965.3907288740393, 78829.60585197095, 84401.57799210964, 86123.5693821527, 87980.12019879783, 89668.55165724194, 9549.522523873917, 10048.145907597936, 10063.245256605784, 10161.4919254037, 10188.0, 13925.303734813218, 13965.0, 13978.86021139796, 14021.439142434392, 14028.719425611635, 7827.608619569112, 7926.365890728728, 8030.919690803017, 8218.137095604994, 8234.670613175405, 7998.920010799818, 8058.435909486397, 8121.512709237465, 8302.335813134934, 8396.664133434595, 3919.529656441245, 4023.195360927826, 4053.331200351909, 4100.220958017967, 4295.548967358445, 1906.1136571494321, 1957.1388589020785, 1957.8531610129298, 2006.137360934783, 2028.7768345481986, 947.3794664494767, 964.064857088623, 966.4829316315737, 1063.6170978447753, 1074.0, 19696.40910772679, 19712.60574788496, 19822.20711171566, 20057.39827805168, 20063.197472101245, 931.4830269200523, 947.6351604632266, 952.9571169297399, 972.9854052189223, 1005.5123265216364, 10500.527476263587, 11019.228653994303, 11031.83452248217, 11113.83329250062, 11167.888321116685, 445852.729895745, 479444.0, 481960.0, 486569.0, 501269.0, 88806.55596722104, 91637.334506619, 94026.0, 94285.70009486604, 94374.0, 950.382251536493, 979.603260679426, 1003.603576587244, 1015.6496008876926, 1017.6692574913183, 17658.381956631456, 17853.0, 18635.534111646775, 18784.812151878305, 18824.717629235845, 43388.56611433845, 43438.34842477302, 43463.56536434595, 43530.34704479372, 43826.34260486159, 58684.706576466844, 59323.0, 59420.70289648524, 59570.10644840418, 61052.694736526035, 7215.747448839265, 7617.771466856003, 7621.237876212334, 7741.690332386642, 8838.55807209624, 12029.578964736193, 13254.337283135612, 13293.13594616347, 13346.799798002843, 13741.862581374458, 11132.220744547803, 11169.329840209613, 11620.244684095507, 12021.939890300493, 12444.875551244371, 11582.536698531965, 11613.941930290295, 11757.176997610086, 11809.409529523662, 11883.881161188277, 6243.282022567463, 7775.844483110193, 11186.272892261977, 12112.878871211175, 12237.143399961917, 7192.568445893263, 7606.847863042819, 7694.653740581575, 7714.575698336421, 8063.27430531255, 11091.667249982513, 11811.173217874666, 11874.16880818369, 12100.394980250776, 12424.440900159696], "value": 8714.30907888197, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1435.275186031054, 1458.2490017640914, 1611.4682154888887, 1743.5118166913269, 1795.6229191869716, 7618.73334433295, 8418.789530261747, 8473.364497662677, 9139.086091390865, 9167.633294668205, 8507.744767656965, 8768.912310876889, 8818.955905220464, 8842.1599948005, 8848.469091854477, 2333.638286065658, 2353.246960972481, 2359.315798418465, 2365.5924724788724, 2371.0397289097855, 2264.852784569006, 2321.7213934327906, 2383.356493746687, 2389.390705370128, 2391.7966972807244, 2362.728286247078, 2368.95262094758, 2381.1903952656094, 2384.344305316043, 2385.4632707640817, 2312.6993490846085, 2337.4623836517694, 2343.8945247463903, 2352.0356653771955, 2360.280114565057, 2293.954120917589, 2299.9540009199723, 2302.067662596651, 2315.791578757903, 2317.7798109179603, 8850.424722393023, 9064.592093355815, 9189.540522973824, 9227.815443691155, 9238.58426370815, 5073.923891141636, 5124.974375128138, 5142.922856157161, 5250.291210686547, 5258.027264955996, 3191.3457741163006, 3369.309291595217, 3462.1517728156764, 3478.9652103478893, 3480.8085555294447, 1159.9594014209463, 1216.3700641140824, 1240.1690867119053, 1242.3415589737454, 2047.836173106148, 12286.078544109228, 12613.74772504554, 12672.87327126726, 12786.42461089244, 12809.871901280962, 4026.0, 4291.420658211102, 4321.524632290446, 4449.822007119679, 4466.129104824593, 9297.814043719087, 9367.953160234156, 9378.90621093794, 9395.90604093964, 9410.43537387759, 5021.824236151717, 5038.118329292359, 5042.168042273057, 5046.924296135561, 5058.822941197041, 4250.53244143144, 4682.601978831769, 4708.317293992352, 4800.015996720664, 4802.991371811889, 3582.3193593217206, 3616.638336166415, 3683.7605555638797, 3723.5345581802276, 3758.4362345647824, 1096.8683757948938, 1098.7143342730787, 1103.6964834670368, 1121.5906194239044, 1133.824257240129, 778.7313376884965, 931.1852129386651, 933.5705575435376, 937.6436953957452, 957.1433566957534, 5737.713114344266, 5785.595008349459, 5907.409259074058, 6100.72546735398, 6192.907106393408, 415.37278709149405, 425.3555862867758, 431.6352681983719, 432.4831825967938, 434.1490678270562, 3993.5008123984503, 4061.614146656063, 4065.776382299002, 4108.958910410857, 4126.504819421689, 11070.889291107147, 11368.431578421212, 11538.365389903636, 11552.306861588331, 11603.07175425964, 11324.0, 11325.943370283096, 11340.716482087848, 11344.376059316652, 11351.602693905674, 7943.682252709942, 8348.165183481604, 8359.080501144868, 8363.916360836436, 8526.31789456842, 5872.442117998783, 6044.063170208625, 6124.142620033288, 6183.474404675653, 6246.656433896179, 10011.499425028866, 10382.584696612052, 10413.895861041596, 10433.634822781167, 10596.258261921592, 10647.201459890384, 10651.414172220293, 10682.198835087554, 10746.24776265654, 10818.783624327627, 6841.692123854538, 7794.766157015299, 7796.064472263365, 7946.682132714626, 7994.760157195294, 8938.86591701112, 8963.955180224057, 8988.28093752485, 8990.82018359616, 8999.415038022507, 7633.503822251536, 7697.153313135439, 7793.337566306927, 7793.4154938378715, 8070.677172913018, 7906.565138917184, 7955.4828936118965, 7993.240642138988, 8009.118996910219, 8043.19568043191, 7140.321669441395, 7166.283371662792, 7209.71161153548, 7292.562446253241, 7293.671784769592, 5352.732363381893, 5364.758585863724, 5469.0, 5486.094794358886, 5562.833115006556, 5057.595392368676, 5327.866803329793, 5373.35519737634, 5450.618456707993, 5567.387587365306], "value": 4570.570627744312, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [317.4270441852456, 317.57603599195073, 323.59712158362834, 331.20015163380435, 331.57061605221236, 5426.348838139424, 5511.311086114236, 5534.252875861763, 5539.806106786264, 5554.361248456429, 5434.157705555645, 5439.755211015504, 5441.2654291670615, 5446.7276636168235, 5456.0, 4013.4180543821203, 4046.7167298289132, 4138.317177665696, 4174.7893110997775, 4175.185838761443, 4147.315692910666, 4147.357159640261, 4156.521999970012, 4157.484721743332, 4159.188958153161, 4119.752814831119, 4119.794010299488, 4123.237201117788, 4125.535434920605, 4137.2552940470705, 4023.7988100595, 4087.4073259377224, 4109.075458021951, 4110.609492098246, 4134.193832202722, 3616.4575313702894, 3624.7281453891064, 3632.7093832493338, 3632.9636703633155, 3637.1452708613456, 5311.707856067915, 5311.867203319909, 5325.360956685184, 5325.760340784674, 5337.224643185561, 4690.273007683814, 4753.667243292971, 4792.880177995543, 4828.758562071883, 4843.467218605951, 5640.605157638925, 5648.406917273709, 5658.322090641075, 5666.603337766358, 5675.716214189315, 3980.3034468968103, 4026.8993275168064, 4027.0, 4032.758034517909, 4043.474348334698, 5687.317521897398, 5886.882262354772, 5926.570106256414, 5936.317323507766, 5956.434138756811, 4047.210793895221, 4056.229316429869, 4058.9594104058583, 4067.4171900843176, 4071.959280407158, 4091.8363265469643, 4103.8974025649595, 4105.952981989573, 4108.8356465741035, 4112.424260603518, 4530.29780384041, 4725.64557658177, 4738.147133516, 4756.381670382828, 4770.546798054179, 5649.971750141223, 5679.971600142056, 5704.629199102045, 5705.286839145107, 5705.857353566194, 1429.9642508937359, 1452.157748505864, 1452.2158034661377, 1452.9854701453062, 1455.825300963891, 893.0581973064557, 938.5448057692014, 946.1248345280588, 951.1059603972244, 958.1568219966385, 5423.755930983115, 5492.395836457987, 5500.7524661390335, 5514.897020595897, 5519.172124181325, 5802.506786923074, 5854.941450585525, 5858.912116318259, 5867.413258674099, 5879.588428809942, 5326.627136100513, 5501.944980550224, 5533.363663178786, 5537.8061767837935, 5558.861028474321, 3097.7057179567905, 3100.8294194064247, 3113.159446949311, 3114.174743692923, 3119.5476655885222, 5857.7656893724625, 6021.187139736079, 6024.759009639653, 6031.366706495843, 6037.094435834572, 5932.970335148297, 5934.673592952429, 5937.406259374115, 5950.404959504015, 5972.4770183602905, 5917.171595976567, 5926.0, 5994.22075130239, 5995.0, 6032.4663641271645, 5643.915341269802, 5657.15142728594, 5694.829155125353, 5720.770034442615, 5729.427057294404, 5720.570957178312, 5730.828075157752, 5735.741891614971, 5742.655440673573, 5759.366469688414, 5660.46225608583, 5988.5508586855285, 6009.90985135232, 6011.497125718571, 6022.397760223943, 4086.182763447382, 4086.508424425004, 4105.97947010263, 4106.876793696194, 4128.587141285848, 5781.884362312646, 5798.768049277982, 5814.447627475383, 5839.678817665069, 5846.707664616837, 5435.619506634498, 5606.271184745957, 5677.261955945701, 5684.289463817023, 5685.914711279252, 5672.290963629546, 5687.488126068673, 5696.8006119785605, 5711.571632127524, 5712.857178570569, 5628.493435590816, 5638.85902852432, 5654.15187721845, 5668.348139963792, 5686.886262274814, 5629.8592535186945, 5860.593457570238, 5868.23712917318, 5875.3243377012195, 5888.1452342513685, 5640.182173584889, 5689.0, 5696.259486266758, 5704.344000439836, 5704.828855134353], "value": 4307.951317973268, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [747.4506237915132, 758.9354904833089, 765.8008917681401, 801.9318357939577, 844.3751623798391, 15496.845031549681, 16051.598710032255, 16065.196740163003, 16116.274767635456, 16153.111578863158, 15177.08937463753, 15335.84664153358, 15354.0, 15420.922895385507, 15422.61443463914, 645.6094063091832, 775.7827808213709, 786.4573444323413, 792.3819420851745, 797.1948332184506, 780.8867714181469, 783.4515838912755, 785.5522352259214, 785.7721260834351, 786.1077676836803, 852.3138873207097, 853.4836423963505, 853.8420392227426, 854.4616891358436, 854.7606670132373, 835.0855812884881, 837.9958100209491, 838.9035260944947, 838.9958050209771, 839.4879123734516, 611.339753066687, 615.8583525789048, 620.6927570852457, 620.8634100497883, 621.083901245659, 14661.70676586473, 14715.411383544646, 14732.48436304735, 14740.484083057148, 14758.55724328272, 15530.534083977498, 15670.764938525932, 15723.37106515738, 15919.442819501377, 15937.362505499766, 11968.880311196863, 12062.215955962834, 12102.636920892388, 12173.08701847365, 12467.625971220878, 3865.4008628662323, 3915.256101340736, 3981.8009099545197, 4070.8575199867864, 4070.959290407088, 82972.58513707393, 84790.57604711999, 85800.0, 85936.0, 86087.56956215242, 10829.458527073615, 11342.489587968561, 11472.426378681033, 11600.88647625698, 11803.114766392555, 20837.270695525585, 20845.061972211286, 20908.58182836335, 20915.895420523106, 20993.265235716983, 8511.872321915176, 8641.179087986631, 8655.394122411371, 8742.86885696715, 8808.91191088081, 4775.808967641325, 4822.590079843182, 4825.758712064383, 4866.78099485524, 4913.582345500601, 3516.191276006533, 3626.3472574936236, 3630.9273814523563, 3631.927361452756, 3640.7439433395434, 586.8239528141626, 598.6587645042371, 603.1736520966217, 604.0727483313093, 612.2255346986066, 684.4421796236052, 711.9572825630479, 736.5727877830846, 752.8193233623891, 759.8936148939152, 8844.690435834715, 9329.253659707207, 9813.754656133653, 9817.116459518678, 9899.713681811958, 754.5849782619538, 763.9121501027341, 778.9766307010799, 786.4691333349966, 794.8251384695358, 4829.058333624979, 4848.127337079289, 4873.878153046131, 5009.599232061426, 5095.337606111182, 87664.0, 101391.0, 106338.46830765797, 106762.0, 117110.41444792892, 100197.0, 101928.49035754774, 102758.0, 104027.0, 109282.0, 89101.55449222712, 90295.0, 91532.0, 91747.0, 93405.53297233471, 8553.230209281195, 8982.358755228935, 9283.767905802139, 9325.487098209664, 9451.243900488082, 50274.49725502698, 50718.23922641089, 51733.7413312931, 52272.738636308095, 54601.1809822845, 78072.60963695146, 81581.0, 81581.0, 82614.76077858957, 83090.58454707688, 11135.498902549567, 11204.775904482029, 11313.321200727984, 11423.543058277575, 11757.76484470323, 13029.218246905217, 13517.0, 13719.588412347646, 13819.723605528034, 13892.0, 12568.622941311774, 12600.495980160691, 13179.802302965654, 13311.933440332736, 13668.248246346546, 12874.742505150032, 13114.60656180316, 13258.138221015988, 13278.269695166859, 13827.723445531234, 12183.208091474025, 12924.095313327976, 13022.0, 13124.813821864684, 13137.671558211121, 10437.791244175225, 10456.26806123564, 10747.677569672922, 10843.837342439712, 11442.370669612917, 9431.669891554036, 9531.0, 10481.213908957012, 11048.558057677603, 11113.333000050057], "value": 7553.221182613347, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1558.0, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [107.0, 113.0, 114.0, 115.0, 114.0, 113.0, 115.0, 116.0, 113.0, 130.0], "value": 115.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 128.0, 149.0, 178.0, 121.0, 157.0, 146.0, 121.0, 183.0, 123.0], "value": 145.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 164.0, 162.0, 168.0, 165.0, 162.0, 162.0, 163.0, 163.0, 162.0], "value": 163.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 76.0, 197.0, 77.0, 76.0, 76.0, 75.0, 172.0, 76.0], "value": 97.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 81.0, 155.0, 83.0, 83.0, 86.0, 144.0, 83.0, 84.0, 149.0], "value": 103.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 119.0, 118.0, 119.0, 117.0, 118.0, 118.0, 118.0, 117.0, 118.0], "value": 118.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 148.0, 148.0, 147.0, 149.0, 148.0, 147.0, 148.0, 147.0], "value": 147.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [97.0, 97.0, 96.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 96.0], "value": 95.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 56.0, 53.0, 54.0, 55.0, 54.0, 55.0, 57.0, 53.0, 55.0], "value": 54.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 62.0, 62.0, 62.0, 62.0, 61.0, 62.0, 63.0, 63.0, 61.0], "value": 62.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 80.0, 82.0, 85.0, 78.0, 79.0, 88.0, 81.0, 82.0, 89.0], "value": 82.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [141.0, 140.0, 145.0, 123.0, 126.0, 126.0, 136.0, 145.0, 162.0, 133.0], "value": 137.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 173.0, 166.0, 172.0, 166.0, 168.0, 168.0, 168.0, 166.0, 171.0], "value": 168.4, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 69.0, 66.0, 67.0, 68.0, 65.0, 65.0, 66.0, 68.0, 65.0], "value": 67.1, "unit": "score"}]}]} 17:49:29 INFO - Return code: 0 17:49:29 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 17:49:29 ERROR - # TBPL SUCCESS # 17:49:29 INFO - Running post-action listener: _resource_record_post_action 17:49:29 INFO - [mozharness: 2016-09-01 00:49:29.403279Z] Finished run-tests step (success) 17:49:29 INFO - Running post-run listener: _resource_record_post_run 17:49:29 INFO - Total resource usage - Wall time: 1195s; CPU: 13.0%; Read bytes: 4096; Write bytes: 414437376; Read time: 8; Write time: 382916 17:49:29 INFO - TinderboxPrint: CPU usage
13.4% 17:49:29 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 17:49:29 INFO - TinderboxPrint: I/O write bytes / time
414,437,376 / 382,916 17:49:29 INFO - TinderboxPrint: CPU idle
8,251.9 (86.6%) 17:49:29 INFO - TinderboxPrint: CPU user
1,213.2 (12.7%) 17:49:29 INFO - TinderboxPrint: Swap in / out
0 / 0 17:49:29 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 125489152; Read time: 0; Write time: 112308 17:49:29 INFO - run-tests - Wall time: 1178s; CPU: 13.0%; Read bytes: 0; Write bytes: 288948224; Read time: 0; Write time: 270608 17:49:30 INFO - Running post-run listener: _upload_blobber_files 17:49:30 INFO - Blob upload gear active. 17:49:30 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 17:49:30 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 17:49:30 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', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 17:49:30 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 -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 17:49:30 INFO - (blobuploader) - INFO - Open directory for files ... 17:49:30 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 17:49:30 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:49:30 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:49:31 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 17:49:31 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:49:31 INFO - (blobuploader) - INFO - Done attempting. 17:49:31 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 17:49:31 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:49:31 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:49:36 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 17:49:36 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:49:36 INFO - (blobuploader) - INFO - Done attempting. 17:49:36 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 17:49:36 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:49:36 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:49:37 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 17:49:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:49:37 INFO - (blobuploader) - INFO - Done attempting. 17:49:37 INFO - (blobuploader) - INFO - Iteration through files over. 17:49:37 INFO - Return code: 0 17:49:37 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 17:49:37 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 17:49:37 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/86b2f01656dc174a2b496a04bff67255c90646da63211f83d410276dfdb4d6d125b2223a07794e6568b0fda5127c8123d100971059310c54d5851fc7081dc32d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1fb22b8148d68c6e5727d35bd600d6e7bb42378442a3c42c90b1b2b268ea89b7ffb3830cce0bae2e3130abdc1688fbc850df8a7910fe0996840ea07e3a465ae2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2e1711497507e424648b1ac5b1cdad4b6ca99769e8be508f58a656fbad6a0f15a38e467182394a6137f09d92fd6e23fd30c6298e80284d0b1711f5789e2a8ba1"} 17:49:37 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 17:49:37 INFO - Writing to file /builds/slave/test/properties/blobber_files 17:49:37 INFO - Contents: 17:49:37 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/86b2f01656dc174a2b496a04bff67255c90646da63211f83d410276dfdb4d6d125b2223a07794e6568b0fda5127c8123d100971059310c54d5851fc7081dc32d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1fb22b8148d68c6e5727d35bd600d6e7bb42378442a3c42c90b1b2b268ea89b7ffb3830cce0bae2e3130abdc1688fbc850df8a7910fe0996840ea07e3a465ae2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2e1711497507e424648b1ac5b1cdad4b6ca99769e8be508f58a656fbad6a0f15a38e467182394a6137f09d92fd6e23fd30c6298e80284d0b1711f5789e2a8ba1"} 17:49:37 INFO - Running post-run listener: copy_logs_to_upload_dir 17:49:37 INFO - Copying logs to upload dir... 17:49:37 INFO - mkdir: /builds/slave/test/build/upload/logs 17:49:37 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1240.943470 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 40 secs) (at 2016-08-31 17:49:37.507453) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-31 17:49:37.511107) ========= 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=9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583 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/sha512/86b2f01656dc174a2b496a04bff67255c90646da63211f83d410276dfdb4d6d125b2223a07794e6568b0fda5127c8123d100971059310c54d5851fc7081dc32d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1fb22b8148d68c6e5727d35bd600d6e7bb42378442a3c42c90b1b2b268ea89b7ffb3830cce0bae2e3130abdc1688fbc850df8a7910fe0996840ea07e3a465ae2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2e1711497507e424648b1ac5b1cdad4b6ca99769e8be508f58a656fbad6a0f15a38e467182394a6137f09d92fd6e23fd30c6298e80284d0b1711f5789e2a8ba1"} build_url:https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011365 build_url: 'https://queue.taskcluster.net/v1/task/PHeElPyERKSarXvU5C4tDQ/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/sha512/86b2f01656dc174a2b496a04bff67255c90646da63211f83d410276dfdb4d6d125b2223a07794e6568b0fda5127c8123d100971059310c54d5851fc7081dc32d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/1fb22b8148d68c6e5727d35bd600d6e7bb42378442a3c42c90b1b2b268ea89b7ffb3830cce0bae2e3130abdc1688fbc850df8a7910fe0996840ea07e3a465ae2", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2e1711497507e424648b1ac5b1cdad4b6ca99769e8be508f58a656fbad6a0f15a38e467182394a6137f09d92fd6e23fd30c6298e80284d0b1711f5789e2a8ba1"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-31 17:49:37.544708) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-31 17:49:37.545587) ========= 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=9ee515b9ec57ce2c386832a8000001b4-1472689734.7400-79023583 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004379 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-31 17:49:37.624972) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-31 17:49:37.625331) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-31 17:49:37.625700) ========= ========= Total master_lag: 0.18 =========