builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-027 starttime: 1468865504.51 results: success (0) buildid: 20160718093651 builduid: 96205e0bd14b423d8839fb356c338dd0 revision: 8b57c89f86db1e9a8ae0ef756363558f86130ff4 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-18 11:11:44.508223) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-18 11:11:44.508691) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-18 11:11:44.508970) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-18 11:11:44.520318) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-18 11:11:44.520613) ========= 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=1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-18 11:11:44-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 103M=0s 2016-07-18 11:11:44 (103 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.111876 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-18 11:11:44.644138) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-18 11:11:44.644474) ========= 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=1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017996 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-18 11:11:44.695365) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-07-18 11:11:44.695718) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 8b57c89f86db1e9a8ae0ef756363558f86130ff4 --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 8b57c89f86db1e9a8ae0ef756363558f86130ff4 --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=1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-18 11:11:44,878 truncating revision to first 12 chars 2016-07-18 11:11:44,878 Setting DEBUG logging. 2016-07-18 11:11:44,878 attempt 1/10 2016-07-18 11:11:44,878 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/8b57c89f86db?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-18 11:11:46,055 unpacking tar archive at: fx-team-8b57c89f86db/testing/mozharness/ program finished with exit code 0 elapsedTime=1.579672 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-07-18 11:11:46.290398) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-18 11:11:46.290878) ========= script_repo_revision: 8b57c89f86db1e9a8ae0ef756363558f86130ff4 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-18 11:11:46.291498) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-18 11:11:46.291942) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-18 11:11:46.303232) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 39 secs) (at 2016-07-18 11:11:46.303655) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:11:46 INFO - MultiFileLogger online at 20160718 11:11:46 in /builds/slave/test 11:11:46 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 11:11:46 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 11:11:46 INFO - {'append_to_log': False, 11:11:46 INFO - 'base_work_dir': '/builds/slave/test', 11:11:46 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 11:11:46 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 11:11:46 INFO - 'branch': 'Fx-Team-Non-PGO', 11:11:46 INFO - 'buildbot_json_path': 'buildprops.json', 11:11:46 INFO - 'config_files': ('talos/linux_config.py',), 11:11:46 INFO - 'default_actions': ('clobber', 11:11:46 INFO - 'read-buildbot-config', 11:11:46 INFO - 'download-and-extract', 11:11:46 INFO - 'populate-webroot', 11:11:46 INFO - 'create-virtualenv', 11:11:46 INFO - 'install', 11:11:46 INFO - 'run-tests'), 11:11:46 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:11:46 INFO - 'download_minidump_stackwalk': True, 11:11:46 INFO - 'download_symbols': 'ondemand', 11:11:46 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:11:46 INFO - 'tooltool.py': '/tools/tooltool.py', 11:11:46 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:11:46 INFO - '/tools/misc-python/virtualenv.py')}, 11:11:46 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:11:46 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:11:46 INFO - 'installer_path': 'installer.exe', 11:11:46 INFO - 'log_level': 'info', 11:11:46 INFO - 'log_name': 'talos', 11:11:46 INFO - 'log_to_console': True, 11:11:46 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:11:46 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:11:46 INFO - 'opt_config_files': (), 11:11:46 INFO - 'pip_index': False, 11:11:46 INFO - 'sps_profile': False, 11:11:46 INFO - 'sps_profile_interval': 0, 11:11:46 INFO - 'suite': 'dromaeojs-e10s', 11:11:46 INFO - 'system_bits': '32', 11:11:46 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:11:46 INFO - 'title': 'talos-linux64-ix-027', 11:11:46 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:11:46 INFO - 'use_talos_json': True, 11:11:46 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 11:11:46 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:11:46 INFO - 'work_dir': 'build'} 11:11:46 INFO - ##### 11:11:46 INFO - ##### Running clobber step. 11:11:46 INFO - ##### 11:11:46 INFO - Running pre-action listener: _resource_record_pre_action 11:11:46 INFO - Running main action method: clobber 11:11:46 INFO - rmtree: /builds/slave/test/build 11:11:46 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 11:11:47 INFO - Running post-action listener: _resource_record_post_action 11:11:47 INFO - ##### 11:11:47 INFO - ##### Finished clobber step (success) 11:11:47 INFO - ##### 11:11:47 INFO - ##### 11:11:47 INFO - ##### Running read-buildbot-config step. 11:11:47 INFO - ##### 11:11:47 INFO - Running pre-action listener: _resource_record_pre_action 11:11:47 INFO - Running main action method: read_buildbot_config 11:11:47 INFO - Using buildbot properties: 11:11:47 INFO - { 11:11:47 INFO - "project": "", 11:11:47 INFO - "product": "firefox", 11:11:47 INFO - "script_repo_revision": "production", 11:11:47 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 11:11:47 INFO - "repository": "", 11:11:47 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 11:11:47 INFO - "buildid": "20160718093651", 11:11:47 INFO - "pgo_build": "False", 11:11:47 INFO - "basedir": "/builds/slave/test", 11:11:47 INFO - "buildnumber": 1671, 11:11:47 INFO - "slavename": "talos-linux64-ix-027", 11:11:47 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 11:11:47 INFO - "platform": "ubuntu64_hw", 11:11:47 INFO - "scheduler": "tests-fx-team-linux64-talos", 11:11:47 INFO - "branch": "fx-team", 11:11:47 INFO - "repo_path": "integration/fx-team", 11:11:47 INFO - "revision": "8b57c89f86db1e9a8ae0ef756363558f86130ff4", 11:11:47 INFO - "stage_platform": "linux64", 11:11:47 INFO - "builduid": "96205e0bd14b423d8839fb356c338dd0", 11:11:47 INFO - "slavebuilddir": "test" 11:11:47 INFO - } 11:11:47 INFO - Found installer url https://queue.taskcluster.net/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 11:11:47 INFO - Running post-action listener: _resource_record_post_action 11:11:47 INFO - ##### 11:11:47 INFO - ##### Finished read-buildbot-config step (success) 11:11:47 INFO - ##### 11:11:47 INFO - ##### 11:11:47 INFO - ##### Running download-and-extract step. 11:11:47 INFO - ##### 11:11:47 INFO - Running pre-action listener: _resource_record_pre_action 11:11:47 INFO - Running main action method: download_and_extract 11:11:47 INFO - mkdir: /builds/slave/test/build/tests 11:11:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:11:47 INFO - https://queue.taskcluster.net/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 11:11:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:11:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:11:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:11:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 11:11:47 INFO - Downloaded 1361 bytes. 11:11:47 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:11:47 INFO - Using the following test package requirements: 11:11:47 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:11:47 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:47 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 11:11:47 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:47 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 11:11:47 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:47 INFO - u'jsshell-linux-x86_64.zip'], 11:11:47 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:47 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 11:11:47 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:11:47 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:47 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 11:11:47 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:47 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 11:11:47 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:47 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 11:11:47 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:11:47 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 11:11:47 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 11:11:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:11:47 INFO - https://queue.taskcluster.net/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:11:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:11:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:11:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:11:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 11:11:49 INFO - Downloaded 22763363 bytes. 11:11:49 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:11:49 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 11:11:51 INFO - Return code: 0 11:11:51 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 11:11:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:11:51 INFO - https://queue.taskcluster.net/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:11:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:11:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:11:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:11:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 11:11:53 INFO - Downloaded 22763363 bytes. 11:11:53 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:11:53 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 11:11:54 INFO - Return code: 0 11:11:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:11:54 INFO - https://queue.taskcluster.net/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 11:11:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:11:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:11:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:11:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 11:11:55 INFO - Downloaded 14403317 bytes. 11:11:55 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:11:55 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 11:11:55 INFO - Return code: 0 11:11:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:11:55 INFO - https://queue.taskcluster.net/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 11:11:55 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:11:55 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:11:55 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:11:55 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 11:11:57 INFO - Downloaded 57126734 bytes. 11:11:57 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:11:57 INFO - mkdir: /builds/slave/test/properties 11:11:57 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 11:11:57 INFO - Writing to file /builds/slave/test/properties/build_url 11:11:57 INFO - Contents: 11:11:57 INFO - build_url:https://queue.taskcluster.net/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:11:57 INFO - Running post-action listener: _resource_record_post_action 11:11:57 INFO - Running post-action listener: set_extra_try_arguments 11:11:57 INFO - ##### 11:11:57 INFO - ##### Finished download-and-extract step (success) 11:11:57 INFO - ##### 11:11:57 INFO - ##### 11:11:57 INFO - ##### Running populate-webroot step. 11:11:57 INFO - ##### 11:11:57 INFO - Running pre-action listener: _resource_record_pre_action 11:11:57 INFO - Running main action method: populate_webroot 11:11:57 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:11:57 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:11:57 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:11:57 INFO - '--tppagecycles', 11:11:57 INFO - '7'], 11:11:57 INFO - 'tests': ['tsvgm']}}, 11:11:57 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 11:11:57 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:11:57 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 11:11:57 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 11:11:57 INFO - 'tests': ['dromaeo_css', 'kraken']}, 11:11:57 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 11:11:57 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:57 INFO - 'talos_options': ['--disable-e10s'], 11:11:57 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:11:57 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:57 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:11:57 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:57 INFO - 'talos_options': ['--disable-e10s'], 11:11:57 INFO - 'tests': ['damp', 'tps']}, 11:11:57 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:57 INFO - 'tests': ['damp', 'tps']}, 11:11:57 INFO - 'g3': {'talos_options': ['--disable-e10s'], 11:11:57 INFO - 'tests': ['dromaeo_dom']}, 11:11:57 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:11:57 INFO - 'g4': {'talos_options': ['--disable-e10s'], 11:11:57 INFO - 'tests': ['basic_compositor_video']}, 11:11:57 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 11:11:57 INFO - 'other': {'talos_options': ['--disable-e10s'], 11:11:57 INFO - 'tests': ['a11yr', 11:11:57 INFO - 'ts_paint', 11:11:57 INFO - 'tpaint', 11:11:57 INFO - 'sessionrestore', 11:11:57 INFO - 'sessionrestore_no_auto_restore', 11:11:57 INFO - 'tabpaint']}, 11:11:57 INFO - 'other-e10s': {'tests': ['a11yr', 11:11:57 INFO - 'ts_paint', 11:11:57 INFO - 'tpaint', 11:11:57 INFO - 'sessionrestore', 11:11:57 INFO - 'sessionrestore_no_auto_restore', 11:11:57 INFO - 'tabpaint']}, 11:11:57 INFO - 'other-e10s_l64': {'tests': ['a11yr', 11:11:57 INFO - 'ts_paint', 11:11:57 INFO - 'tpaint', 11:11:57 INFO - 'sessionrestore', 11:11:57 INFO - 'sessionrestore_no_auto_restore', 11:11:57 INFO - 'tabpaint']}, 11:11:57 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 11:11:57 INFO - 'ts_paint', 11:11:57 INFO - 'tpaint', 11:11:57 INFO - 'sessionrestore', 11:11:57 INFO - 'sessionrestore_no_auto_restore', 11:11:57 INFO - 'tabpaint']}, 11:11:57 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 11:11:57 INFO - 'tests': ['a11yr', 11:11:57 INFO - 'ts_paint', 11:11:57 INFO - 'tpaint', 11:11:57 INFO - 'sessionrestore', 11:11:57 INFO - 'sessionrestore_no_auto_restore', 11:11:57 INFO - 'tabpaint']}, 11:11:57 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 11:11:57 INFO - 'tests': ['a11yr', 11:11:57 INFO - 'ts_paint', 11:11:57 INFO - 'tpaint', 11:11:57 INFO - 'sessionrestore', 11:11:57 INFO - 'sessionrestore_no_auto_restore', 11:11:57 INFO - 'tabpaint']}, 11:11:57 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 11:11:57 INFO - 'tests': ['tsvgx', 11:11:57 INFO - 'tsvgr_opacity', 11:11:57 INFO - 'tart', 11:11:57 INFO - 'tscrollx', 11:11:57 INFO - 'cart']}, 11:11:57 INFO - 'svgr-e10s': {'tests': ['tsvgx', 11:11:57 INFO - 'tsvgr_opacity', 11:11:57 INFO - 'tart', 11:11:57 INFO - 'tscrollx', 11:11:57 INFO - 'cart']}, 11:11:57 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:57 INFO - 'talos_options': ['--disable-e10s'], 11:11:57 INFO - 'tests': ['tp5o']}, 11:11:57 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:57 INFO - 'tests': ['tp5o']}, 11:11:57 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:57 INFO - 'talos_options': ['--disable-e10s', 11:11:57 INFO - '--xperf_path', 11:11:57 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:11:57 INFO - 'tests': ['tp5n']}, 11:11:57 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:11:57 INFO - 'talos_options': ['--xperf_path', 11:11:57 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:11:57 INFO - 'tests': ['tp5n']}}, 11:11:57 INFO - 'talos.zip': {'path': '', 11:11:57 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:11:57 INFO - Running post-action listener: _resource_record_post_action 11:11:57 INFO - ##### 11:11:57 INFO - ##### Finished populate-webroot step (success) 11:11:57 INFO - ##### 11:11:57 INFO - ##### 11:11:57 INFO - ##### Running create-virtualenv step. 11:11:57 INFO - ##### 11:11:57 INFO - Running pre-action listener: _resource_record_pre_action 11:11:57 INFO - Running main action method: create_virtualenv 11:11:57 INFO - Creating virtualenv /builds/slave/test/build/venv 11:11:57 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 11:11:57 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 11:11:58 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:11:58 INFO - Using real prefix '/usr' 11:11:58 INFO - New python executable in /builds/slave/test/build/venv/bin/python 11:11:58 INFO - Installing distribute.............................................................................................................................................................................................done. 11:12:00 INFO - Installing pip.................done. 11:12:00 INFO - Return code: 0 11:12:00 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 11:12:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:00 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 0x18c4030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a278a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1af3400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b82570>, '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 0x1b83470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b83900>, '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': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', '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 11:12:00 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 11:12:00 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 11:12:00 INFO - Using env: {'DISPLAY': ':0', 11:12:00 INFO - 'HOME': '/home/cltbld', 11:12:00 INFO - 'LANG': 'en_US.UTF-8', 11:12:00 INFO - 'LANGUAGE': 'en_US:en', 11:12:00 INFO - 'LOGNAME': 'cltbld', 11:12:00 INFO - 'MAIL': '/var/mail/cltbld', 11:12:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:00 INFO - 'MOZ_NO_REMOTE': '1', 11:12:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:00 INFO - 'NO_EM_RESTART': '1', 11:12:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:00 INFO - 'PWD': '/builds/slave/test', 11:12:00 INFO - 'SHELL': '/bin/bash', 11:12:00 INFO - 'SHLVL': '1', 11:12:00 INFO - 'TERM': 'linux', 11:12:00 INFO - 'TMOUT': '86400', 11:12:00 INFO - 'USER': 'cltbld', 11:12:00 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', 11:12:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:00 INFO - '_': '/tools/buildbot/bin/python'} 11:12:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:00 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 11:12:00 INFO - Cleaning up... 11:12:00 INFO - Return code: 0 11:12:00 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 11:12:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:00 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 0x18c4030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a278a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1af3400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b82570>, '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 0x1b83470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b83900>, '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': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', '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 11:12:00 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 11:12:00 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 11:12:00 INFO - Using env: {'DISPLAY': ':0', 11:12:00 INFO - 'HOME': '/home/cltbld', 11:12:00 INFO - 'LANG': 'en_US.UTF-8', 11:12:00 INFO - 'LANGUAGE': 'en_US:en', 11:12:00 INFO - 'LOGNAME': 'cltbld', 11:12:00 INFO - 'MAIL': '/var/mail/cltbld', 11:12:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:00 INFO - 'MOZ_NO_REMOTE': '1', 11:12:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:00 INFO - 'NO_EM_RESTART': '1', 11:12:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:00 INFO - 'PWD': '/builds/slave/test', 11:12:00 INFO - 'SHELL': '/bin/bash', 11:12:00 INFO - 'SHLVL': '1', 11:12:00 INFO - 'TERM': 'linux', 11:12:00 INFO - 'TMOUT': '86400', 11:12:00 INFO - 'USER': 'cltbld', 11:12:00 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', 11:12:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:00 INFO - '_': '/tools/buildbot/bin/python'} 11:12:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:00 INFO - Downloading/unpacking psutil>=3.1.1 11:12:00 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 11:12:00 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 11:12:00 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 11:12:00 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 11:12:00 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 11:12:00 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 11:12:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 11:12:02 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:12:02 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:12:03 INFO - Installing collected packages: psutil 11:12:03 INFO - Running setup.py install for psutil 11:12:03 INFO - building 'psutil._psutil_linux' extension 11:12:03 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 11:12:03 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 11:12:03 INFO - building 'psutil._psutil_posix' extension 11:12:03 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 11:12:03 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 11:12:03 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:12:03 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:12:03 INFO - Successfully installed psutil 11:12:03 INFO - Cleaning up... 11:12:03 INFO - Return code: 0 11:12:03 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 11:12: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:03 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 0x18c4030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a278a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1af3400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b82570>, '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 0x1b83470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b83900>, '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': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', '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 11:12:03 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 11:12:03 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 11:12:03 INFO - Using env: {'DISPLAY': ':0', 11:12:03 INFO - 'HOME': '/home/cltbld', 11:12:03 INFO - 'LANG': 'en_US.UTF-8', 11:12:03 INFO - 'LANGUAGE': 'en_US:en', 11:12:03 INFO - 'LOGNAME': 'cltbld', 11:12:03 INFO - 'MAIL': '/var/mail/cltbld', 11:12:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:03 INFO - 'MOZ_NO_REMOTE': '1', 11:12:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:03 INFO - 'NO_EM_RESTART': '1', 11:12:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:03 INFO - 'PWD': '/builds/slave/test', 11:12:03 INFO - 'SHELL': '/bin/bash', 11:12:03 INFO - 'SHLVL': '1', 11:12:03 INFO - 'TERM': 'linux', 11:12:03 INFO - 'TMOUT': '86400', 11:12:03 INFO - 'USER': 'cltbld', 11:12:03 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', 11:12:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:03 INFO - '_': '/tools/buildbot/bin/python'} 11:12:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:03 INFO - Downloading/unpacking mozsystemmonitor==0.3 11:12:03 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 11:12:03 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 11:12:03 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 11:12:03 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 11:12:03 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 11:12:03 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 11:12:05 INFO - Downloading mozsystemmonitor-0.3.tar.gz 11:12:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:12:05 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 11:12:05 INFO - Installing collected packages: mozsystemmonitor 11:12:05 INFO - Running setup.py install for mozsystemmonitor 11:12:05 INFO - Successfully installed mozsystemmonitor 11:12:05 INFO - Cleaning up... 11:12:05 INFO - Return code: 0 11:12:05 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 11:12:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:05 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 0x18c4030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a278a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1af3400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b82570>, '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 0x1b83470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b83900>, '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': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', '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 11:12:05 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 11:12:05 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 11:12:05 INFO - Using env: {'DISPLAY': ':0', 11:12:05 INFO - 'HOME': '/home/cltbld', 11:12:05 INFO - 'LANG': 'en_US.UTF-8', 11:12:05 INFO - 'LANGUAGE': 'en_US:en', 11:12:05 INFO - 'LOGNAME': 'cltbld', 11:12:05 INFO - 'MAIL': '/var/mail/cltbld', 11:12:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:05 INFO - 'MOZ_NO_REMOTE': '1', 11:12:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:05 INFO - 'NO_EM_RESTART': '1', 11:12:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:05 INFO - 'PWD': '/builds/slave/test', 11:12:05 INFO - 'SHELL': '/bin/bash', 11:12:05 INFO - 'SHLVL': '1', 11:12:05 INFO - 'TERM': 'linux', 11:12:05 INFO - 'TMOUT': '86400', 11:12:05 INFO - 'USER': 'cltbld', 11:12:05 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', 11:12:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:05 INFO - '_': '/tools/buildbot/bin/python'} 11:12:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:06 INFO - Downloading/unpacking jsonschema==2.5.1 11:12:06 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 11:12:06 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 11:12:06 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 11:12:06 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 11:12:06 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 11:12:06 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 11:12:07 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:12:07 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 11:12:07 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 11:12:07 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 11:12:07 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 11:12:07 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 11:12:07 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 11:12:07 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 11:12:08 INFO - Downloading functools32-3.2.3-2.tar.gz 11:12:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 11:12:08 INFO - warning: no files found matching '*.txt' 11:12:08 INFO - no previously-included directories found matching 'build' 11:12:08 INFO - no previously-included directories found matching 'dist' 11:12:08 INFO - no previously-included directories found matching '.git*' 11:12:08 INFO - Installing collected packages: jsonschema, functools32 11:12:08 INFO - Running setup.py install for functools32 11:12:08 INFO - warning: no files found matching '*.txt' 11:12:08 INFO - no previously-included directories found matching 'build' 11:12:08 INFO - no previously-included directories found matching 'dist' 11:12:08 INFO - no previously-included directories found matching '.git*' 11:12:08 INFO - Successfully installed jsonschema functools32 11:12:08 INFO - Cleaning up... 11:12:08 INFO - Return code: 0 11:12:08 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 11:12:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:08 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 0x18c4030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a278a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1af3400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b82570>, '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 0x1b83470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b83900>, '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': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', '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 11:12:08 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 11:12:08 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 11:12:08 INFO - Using env: {'DISPLAY': ':0', 11:12:08 INFO - 'HOME': '/home/cltbld', 11:12:08 INFO - 'LANG': 'en_US.UTF-8', 11:12:08 INFO - 'LANGUAGE': 'en_US:en', 11:12:08 INFO - 'LOGNAME': 'cltbld', 11:12:08 INFO - 'MAIL': '/var/mail/cltbld', 11:12:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:08 INFO - 'MOZ_NO_REMOTE': '1', 11:12:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:08 INFO - 'NO_EM_RESTART': '1', 11:12:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:08 INFO - 'PWD': '/builds/slave/test', 11:12:08 INFO - 'SHELL': '/bin/bash', 11:12:08 INFO - 'SHLVL': '1', 11:12:08 INFO - 'TERM': 'linux', 11:12:08 INFO - 'TMOUT': '86400', 11:12:08 INFO - 'USER': 'cltbld', 11:12:08 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', 11:12:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:08 INFO - '_': '/tools/buildbot/bin/python'} 11:12:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:08 INFO - Downloading/unpacking blobuploader==1.2.4 11:12:08 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 11:12:08 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 11:12:08 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 11:12:08 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 11:12:08 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 11:12:08 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 11:12:10 INFO - Downloading blobuploader-1.2.4.tar.gz 11:12:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:12:10 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:12:10 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 11:12:10 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 11:12:10 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 11:12:10 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 11:12:10 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 11:12:10 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 11:12:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 11:12:11 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:12:11 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 11:12:11 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 11:12:11 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 11:12:11 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 11:12:11 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 11:12:11 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 11:12:11 INFO - Downloading docopt-0.6.1.tar.gz 11:12:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 11:12:11 INFO - Installing collected packages: blobuploader, requests, docopt 11:12:11 INFO - Running setup.py install for blobuploader 11:12:11 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:12:11 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 11:12:11 INFO - Running setup.py install for requests 11:12:11 INFO - Running setup.py install for docopt 11:12:11 INFO - Successfully installed blobuploader requests docopt 11:12:11 INFO - Cleaning up... 11:12:12 INFO - Return code: 0 11:12:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:12:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:12 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 0x18c4030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a278a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1af3400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b82570>, '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 0x1b83470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b83900>, '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': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', '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 11:12:12 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 11:12:12 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 11:12:12 INFO - Using env: {'DISPLAY': ':0', 11:12:12 INFO - 'HOME': '/home/cltbld', 11:12:12 INFO - 'LANG': 'en_US.UTF-8', 11:12:12 INFO - 'LANGUAGE': 'en_US:en', 11:12:12 INFO - 'LOGNAME': 'cltbld', 11:12:12 INFO - 'MAIL': '/var/mail/cltbld', 11:12:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:12 INFO - 'MOZ_NO_REMOTE': '1', 11:12:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:12 INFO - 'NO_EM_RESTART': '1', 11:12:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:12 INFO - 'PWD': '/builds/slave/test', 11:12:12 INFO - 'SHELL': '/bin/bash', 11:12:12 INFO - 'SHLVL': '1', 11:12:12 INFO - 'TERM': 'linux', 11:12:12 INFO - 'TMOUT': '86400', 11:12:12 INFO - 'USER': 'cltbld', 11:12:12 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', 11:12:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:12 INFO - '_': '/tools/buildbot/bin/python'} 11:12:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:12:12 INFO - Running setup.py (path:/tmp/pip-gr_TAb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:12:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:12:12 INFO - Running setup.py (path:/tmp/pip-Ll8I3e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:12:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:12:12 INFO - Running setup.py (path:/tmp/pip-hzweLb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:12:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:12:12 INFO - Running setup.py (path:/tmp/pip-Ap9UK6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:12:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:12:12 INFO - Running setup.py (path:/tmp/pip-Ai27Da-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:12:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:12:12 INFO - Running setup.py (path:/tmp/pip-2_sjZx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:12:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:12:12 INFO - Running setup.py (path:/tmp/pip-XLqe8G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:12:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:12:12 INFO - Running setup.py (path:/tmp/pip-tF9uql-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:12:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:12:12 INFO - Running setup.py (path:/tmp/pip-klsgnf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:12:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:12:12 INFO - Running setup.py (path:/tmp/pip-Ifu26o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:12:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:12:12 INFO - Running setup.py (path:/tmp/pip-d7dyIw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:12:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:12:13 INFO - Running setup.py (path:/tmp/pip-As3hbb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:12:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:12:13 INFO - Running setup.py (path:/tmp/pip-igxSNL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:12:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:12:13 INFO - Running setup.py (path:/tmp/pip-nbbTUX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:12:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:12:13 INFO - Running setup.py (path:/tmp/pip-M6OZd2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:12:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:12:13 INFO - Running setup.py (path:/tmp/pip-Qjn2L9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:12:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:12:13 INFO - Running setup.py (path:/tmp/pip-PGfrdy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:12:13 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:12:13 INFO - Running setup.py install for manifestparser 11:12:13 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 11:12:13 INFO - Running setup.py install for mozcrash 11:12:13 INFO - Running setup.py install for mozdebug 11:12:13 INFO - Running setup.py install for mozdevice 11:12:13 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 11:12:13 INFO - Installing dm script to /builds/slave/test/build/venv/bin 11:12:13 INFO - Running setup.py install for mozfile 11:12:13 INFO - Running setup.py install for mozhttpd 11:12:14 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 11:12:14 INFO - Running setup.py install for mozinfo 11:12:14 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 11:12:14 INFO - Running setup.py install for mozInstall 11:12:14 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 11:12:14 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 11:12:14 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 11:12:14 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 11:12:14 INFO - Running setup.py install for mozleak 11:12:14 INFO - Running setup.py install for mozlog 11:12:14 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 11:12:14 INFO - Running setup.py install for moznetwork 11:12:14 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 11:12:14 INFO - Running setup.py install for mozprocess 11:12:14 INFO - Running setup.py install for mozprofile 11:12:14 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 11:12:14 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 11:12:14 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 11:12:14 INFO - Running setup.py install for mozrunner 11:12:14 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 11:12:14 INFO - Running setup.py install for mozscreenshot 11:12:15 INFO - Running setup.py install for moztest 11:12:15 INFO - Running setup.py install for mozversion 11:12:15 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 11:12:15 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:12:15 INFO - Cleaning up... 11:12:15 INFO - Return code: 0 11:12:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:12:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:15 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 0x18c4030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a278a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1af3400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b82570>, '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 0x1b83470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b83900>, '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': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', '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 11:12:15 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 11:12:15 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 11:12:15 INFO - Using env: {'DISPLAY': ':0', 11:12:15 INFO - 'HOME': '/home/cltbld', 11:12:15 INFO - 'LANG': 'en_US.UTF-8', 11:12:15 INFO - 'LANGUAGE': 'en_US:en', 11:12:15 INFO - 'LOGNAME': 'cltbld', 11:12:15 INFO - 'MAIL': '/var/mail/cltbld', 11:12:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:15 INFO - 'MOZ_NO_REMOTE': '1', 11:12:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:15 INFO - 'NO_EM_RESTART': '1', 11:12:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:15 INFO - 'PWD': '/builds/slave/test', 11:12:15 INFO - 'SHELL': '/bin/bash', 11:12:15 INFO - 'SHLVL': '1', 11:12:15 INFO - 'TERM': 'linux', 11:12:15 INFO - 'TMOUT': '86400', 11:12:15 INFO - 'USER': 'cltbld', 11:12:15 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', 11:12:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:15 INFO - '_': '/tools/buildbot/bin/python'} 11:12:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:12:15 INFO - Running setup.py (path:/tmp/pip-H75P5E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:12:15 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)) 11:12:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:12:15 INFO - Running setup.py (path:/tmp/pip-By603s-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:12:15 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)) 11:12:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:12:15 INFO - Running setup.py (path:/tmp/pip-N9UhNR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:12:15 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)) 11:12:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:12:15 INFO - Running setup.py (path:/tmp/pip-idiJi1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:12:15 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)) 11:12:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:12:15 INFO - Running setup.py (path:/tmp/pip-UMDkYe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:12:15 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)) 11:12:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:12:15 INFO - Running setup.py (path:/tmp/pip-fBQ875-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:12:15 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)) 11:12:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:12:15 INFO - Running setup.py (path:/tmp/pip-0xIHcF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:12:15 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)) 11:12:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:12:15 INFO - Running setup.py (path:/tmp/pip-SSpTLZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:12:16 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)) 11:12:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:12:16 INFO - Running setup.py (path:/tmp/pip-fCa4gV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:12:16 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)) 11:12:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:12:16 INFO - Running setup.py (path:/tmp/pip-hBky7e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:12:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 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)) 11:12:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:12:16 INFO - Running setup.py (path:/tmp/pip-ZzpCD9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:12:16 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)) 11:12:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:12:16 INFO - Running setup.py (path:/tmp/pip-ycdhdn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:12:16 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)) 11:12:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:12:16 INFO - Running setup.py (path:/tmp/pip-iEyjDu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:12:16 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)) 11:12:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:12:16 INFO - Running setup.py (path:/tmp/pip-7GtHs7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:12:16 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)) 11:12:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:12:16 INFO - Running setup.py (path:/tmp/pip-Kmv_t0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:12:16 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)) 11:12:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:12:16 INFO - Running setup.py (path:/tmp/pip-MA66FY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:12:16 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)) 11:12:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:12:16 INFO - Running setup.py (path:/tmp/pip-gE8Rf0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:12:16 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)) 11:12:16 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)) 11:12:16 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)) 11:12:16 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)) 11:12:16 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)) 11:12:16 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)) 11:12:16 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 11:12:16 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 11:12:16 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 11:12:16 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 11:12:16 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 11:12:16 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 11:12:16 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 11:12:18 INFO - Downloading blessings-1.6.tar.gz 11:12:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 11:12:18 INFO - Installing collected packages: blessings 11:12:18 INFO - Running setup.py install for blessings 11:12:18 INFO - Successfully installed blessings 11:12:18 INFO - Cleaning up... 11:12:18 INFO - Return code: 0 11:12:18 INFO - Done creating virtualenv /builds/slave/test/build/venv. 11:12:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:12:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:12:19 INFO - Reading from file tmpfile_stdout 11:12:19 INFO - Current package versions: 11:12:19 INFO - argparse == 1.2.1 11:12:19 INFO - blessings == 1.6 11:12:19 INFO - blobuploader == 1.2.4 11:12:19 INFO - docopt == 0.6.1 11:12:19 INFO - functools32 == 3.2.3-2 11:12:19 INFO - jsonschema == 2.5.1 11:12:19 INFO - manifestparser == 1.1 11:12:19 INFO - mozInstall == 1.12 11:12:19 INFO - mozcrash == 0.17 11:12:19 INFO - mozdebug == 0.1 11:12:19 INFO - mozdevice == 0.48 11:12:19 INFO - mozfile == 1.2 11:12:19 INFO - mozhttpd == 0.7 11:12:19 INFO - mozinfo == 0.9 11:12:19 INFO - mozleak == 0.1 11:12:19 INFO - mozlog == 3.2 11:12:19 INFO - moznetwork == 0.27 11:12:19 INFO - mozprocess == 0.23 11:12:19 INFO - mozprofile == 0.28 11:12:19 INFO - mozrunner == 6.12 11:12:19 INFO - mozscreenshot == 0.1 11:12:19 INFO - mozsystemmonitor == 0.3 11:12:19 INFO - moztest == 0.7 11:12:19 INFO - mozversion == 1.4 11:12:19 INFO - psutil == 3.1.1 11:12:19 INFO - requests == 1.2.3 11:12:19 INFO - wsgiref == 0.1.2 11:12:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:12: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:19 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 0x18c4030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a278a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1af3400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b82570>, '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 0x1b83470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b83900>, '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': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', '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 11:12:19 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 11:12:19 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 11:12:19 INFO - Using env: {'DISPLAY': ':0', 11:12:19 INFO - 'HOME': '/home/cltbld', 11:12:19 INFO - 'LANG': 'en_US.UTF-8', 11:12:19 INFO - 'LANGUAGE': 'en_US:en', 11:12:19 INFO - 'LOGNAME': 'cltbld', 11:12:19 INFO - 'MAIL': '/var/mail/cltbld', 11:12:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:19 INFO - 'MOZ_NO_REMOTE': '1', 11:12:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:19 INFO - 'NO_EM_RESTART': '1', 11:12:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:19 INFO - 'PWD': '/builds/slave/test', 11:12:19 INFO - 'SHELL': '/bin/bash', 11:12:19 INFO - 'SHLVL': '1', 11:12:19 INFO - 'TERM': 'linux', 11:12:19 INFO - 'TMOUT': '86400', 11:12:19 INFO - 'USER': 'cltbld', 11:12:19 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', 11:12:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:19 INFO - '_': '/tools/buildbot/bin/python'} 11:12:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:19 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)) 11:12:19 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)) 11:12:19 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)) 11:12:19 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)) 11:12:19 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)) 11:12:19 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)) 11:12:19 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)) 11:12:19 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)) 11:12:19 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)) 11:12:19 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)) 11:12:19 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)) 11:12:19 INFO - Cleaning up... 11:12:19 INFO - Return code: 0 11:12:19 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 11:12: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12: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']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18c4030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a278a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1af3400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b82570>, '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 0x1b83470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b83900>, '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': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', '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 11:12: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'] in /builds/slave/test/build 11:12: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 11:12:19 INFO - Using env: {'DISPLAY': ':0', 11:12:19 INFO - 'HOME': '/home/cltbld', 11:12:19 INFO - 'LANG': 'en_US.UTF-8', 11:12:19 INFO - 'LANGUAGE': 'en_US:en', 11:12:19 INFO - 'LOGNAME': 'cltbld', 11:12:19 INFO - 'MAIL': '/var/mail/cltbld', 11:12:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:19 INFO - 'MOZ_NO_REMOTE': '1', 11:12:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:19 INFO - 'NO_EM_RESTART': '1', 11:12:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:19 INFO - 'PWD': '/builds/slave/test', 11:12:19 INFO - 'SHELL': '/bin/bash', 11:12:19 INFO - 'SHLVL': '1', 11:12:19 INFO - 'TERM': 'linux', 11:12:19 INFO - 'TMOUT': '86400', 11:12:19 INFO - 'USER': 'cltbld', 11:12:19 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', 11:12:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:19 INFO - '_': '/tools/buildbot/bin/python'} 11:12:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:19 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 11:12:19 INFO - Cleaning up... 11:12:19 INFO - Return code: 0 11:12:19 INFO - Running post-action listener: _resource_record_post_action 11:12:19 INFO - Running post-action listener: _start_resource_monitoring 11:12:19 INFO - Starting resource monitoring. 11:12:19 INFO - ##### 11:12:19 INFO - ##### Finished create-virtualenv step (success) 11:12:19 INFO - ##### 11:12:19 INFO - ##### 11:12:19 INFO - ##### Running install step. 11:12:19 INFO - ##### 11:12:19 INFO - Running pre-action listener: _resource_record_pre_action 11:12:19 INFO - Running main action method: install 11:12:19 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:12:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:12:19 INFO - Reading from file tmpfile_stdout 11:12:19 INFO - Detecting whether we're running mozinstall >=1.0... 11:12:19 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 11:12:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 11:12:19 INFO - Reading from file tmpfile_stdout 11:12:19 INFO - Output received: 11:12:19 INFO - Usage: mozinstall [options] installer 11:12:19 INFO - Options: 11:12:19 INFO - -h, --help show this help message and exit 11:12:19 INFO - -d DEST, --destination=DEST 11:12:19 INFO - Directory to install application into. [default: 11:12:19 INFO - "/builds/slave/test"] 11:12:19 INFO - --app=APP Application being installed. [default: firefox] 11:12:19 INFO - mkdir: /builds/slave/test/build/application 11:12:19 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 11:12:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 11:12:36 INFO - Reading from file tmpfile_stdout 11:12:36 INFO - Output received: 11:12:36 INFO - /builds/slave/test/build/application/firefox/firefox 11:12:36 INFO - Running post-action listener: _resource_record_post_action 11:12:36 INFO - ##### 11:12:36 INFO - ##### Finished install step (success) 11:12:36 INFO - ##### 11:12:36 INFO - ##### 11:12:36 INFO - ##### Running run-tests step. 11:12:36 INFO - ##### 11:12:36 INFO - Running pre-action listener: _resource_record_pre_action 11:12:36 INFO - Running main action method: run_tests 11:12:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 11:12:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 11:12:36 INFO - Python 2.7.3 11:12:36 INFO - Return code: 0 11:12:36 INFO - grabbing minidump binary from tooltool 11:12:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:36 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 0x1b82570>, '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 0x1b83470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b83900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 11:12:36 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 11:12:36 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 11:12:36 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 11:12:36 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:12:36 INFO - Return code: 0 11:12:36 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 11:12:36 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 11:12:36 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 11:12:36 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 11:12:36 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 11:12:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--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 11:12:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-027 --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 11:12:36 INFO - Using env: {'DISPLAY': ':0', 11:12:36 INFO - 'HOME': '/home/cltbld', 11:12:36 INFO - 'LANG': 'en_US.UTF-8', 11:12:36 INFO - 'LANGUAGE': 'en_US:en', 11:12:36 INFO - 'LOGNAME': 'cltbld', 11:12:36 INFO - 'MAIL': '/var/mail/cltbld', 11:12:36 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 11:12:36 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 11:12:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:36 INFO - 'MOZ_NO_REMOTE': '1', 11:12:36 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 11:12:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:36 INFO - 'NO_EM_RESTART': '1', 11:12:36 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:36 INFO - 'PWD': '/builds/slave/test', 11:12:36 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 11:12:36 INFO - 'SHELL': '/bin/bash', 11:12:36 INFO - 'SHLVL': '1', 11:12:36 INFO - 'TERM': 'linux', 11:12:36 INFO - 'TMOUT': '86400', 11:12:36 INFO - 'USER': 'cltbld', 11:12:36 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250', 11:12:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:36 INFO - '_': '/tools/buildbot/bin/python'} 11:12:36 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--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 11:12:36 INFO - mozversion application_buildid: 20160718093651 11:12:36 INFO - mozversion application_changeset: 8b57c89f86db1e9a8ae0ef756363558f86130ff4 11:12:36 INFO - mozversion application_display_name: Nightly 11:12:36 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:12:36 INFO - mozversion application_name: Firefox 11:12:36 INFO - mozversion application_remotingname: firefox 11:12:36 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 11:12:36 INFO - mozversion application_vendor: Mozilla 11:12:36 INFO - mozversion application_version: 50.0a1 11:12:36 INFO - mozversion platform_buildid: 20160718093651 11:12:36 INFO - mozversion platform_changeset: 8b57c89f86db1e9a8ae0ef756363558f86130ff4 11:12:36 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 11:12:36 INFO - mozversion platform_version: 50.0a1 11:12:36 INFO - using testdate: 1468865556 11:12:36 INFO - actual date: 1468865556 11:12:36 INFO - starting webserver on 'localhost:46548' 11:12:36 INFO - SUITE-START | Running 2 tests 11:12:36 INFO - TEST-START | dromaeo_css 11:12:36 INFO - operating with platform_type : linux_ 11:12:36 INFO - Initialising browser for dromaeo_css test... 11:12:36 INFO - TEST-INFO | started process 17544 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp6irXBc/profile http://localhost:46548/getInfo.html) 11:12:41 INFO - PROCESS | 17544 | __metrics Screen width/height:1600/1200 11:12:41 INFO - PROCESS | 17544 | colorDepth:24 11:12:41 INFO - PROCESS | 17544 | Browser inner width/height: 1024/697 11:12:41 INFO - PROCESS | 17544 | __metrics 11:12:41 ERROR - PROCESS | 17544 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2967: TypeError: this.tabs is undefined 11:12:42 INFO - TEST-INFO | 17544: exit 0 11:12:42 INFO - Browser initialized. 11:12:42 INFO - Running cycle 1/1 for dromaeo_css test... 11:12:42 INFO - TEST-INFO | started process 17665 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp6irXBc/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:12:54 INFO - PROCESS | 17665 | RSS: Main: 168939520 11:12:54 INFO - PROCESS | 17665 | 11:13:44 INFO - PROCESS | 17665 | 1468865624123 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] 11:15:56 INFO - PROCESS | 17665 | Cycle 1(1): loaded http://localhost:46548/tests/dromaeo/cssquery-dojo.html (next: http://localhost:46548/tests/dromaeo/cssquery-ext.html) 11:15:57 INFO - PROCESS | 17665 | RSS: Main: 170500096 11:15:57 INFO - PROCESS | 17665 | 11:18:59 INFO - PROCESS | 17665 | Cycle 1(1): loaded http://localhost:46548/tests/dromaeo/cssquery-ext.html (next: http://localhost:46548/tests/dromaeo/cssquery-jquery.html) 11:19:00 INFO - PROCESS | 17665 | RSS: Main: 170184704 11:19:00 INFO - PROCESS | 17665 | 11:22:02 INFO - PROCESS | 17665 | Cycle 1(1): loaded http://localhost:46548/tests/dromaeo/cssquery-jquery.html (next: http://localhost:46548/tests/dromaeo/cssquery-mootools.html) 11:22:03 INFO - PROCESS | 17665 | RSS: Main: 172679168 11:22:03 INFO - PROCESS | 17665 | 11:25:05 INFO - PROCESS | 17665 | Cycle 1(1): loaded http://localhost:46548/tests/dromaeo/cssquery-mootools.html (next: http://localhost:46548/tests/dromaeo/cssquery-prototype.html) 11:25:05 INFO - PROCESS | 17665 | RSS: Main: 167211008 11:25:05 INFO - PROCESS | 17665 | 11:28:08 INFO - PROCESS | 17665 | Cycle 1(1): loaded http://localhost:46548/tests/dromaeo/cssquery-prototype.html (next: http://localhost:46548/tests/dromaeo/cssquery-yui.html) 11:28:09 INFO - PROCESS | 17665 | RSS: Main: 169136128 11:28:09 INFO - PROCESS | 17665 | 11:31:11 INFO - PROCESS | 17665 | Cycle 1(1): loaded http://localhost:46548/tests/dromaeo/cssquery-yui.html (next: http://localhost:46548/tests/dromaeo/cssquery-dojo.html) 11:31:11 INFO - PROCESS | 17665 | RSS: Main: 171126784 11:31:11 INFO - PROCESS | 17665 | 11:31:11 INFO - PROCESS | 17665 | __start_tp_report 11:31:11 INFO - PROCESS | 17665 | _x_x_mozilla_page_load 11:31:11 INFO - PROCESS | 17665 | _x_x_mozilla_page_load_details 11:31:11 INFO - PROCESS | 17665 | |i|pagename|runs| 11:31:11 INFO - PROCESS | 17665 | |0;dojo.html;2624.488224796165;2658.6410834537337;2686.194141757475;2711.4441539484405;2715.8098933074693;4777;4786.593139583135;4849.2726091086315;4869.853904382874;4881.585065269447;4712.787924543395;4764.404449443819;4796.136695394827;4824.107540105083;4855.3688020557365;4408.184485870116;4448.666350023745;4572.771361431932;4581.587657110859;4589.495155532889;479.086078513841;4273.871783846474;4322.027543802651;4407;4425.402570652969;4328.653707703376;4371.519132895379;4373.147236288925;4374.8906277343;4390.16586848501;4351.5648435156545;4377.715448495837;4400.6259467945265;4401.427814384109;4406.986393129599;4275.551067137937;4332.805023773938;4343.19650864591;4347.087111706545;4362.345648152803;4694.906101877943;4714.198586240347;4715.033418149305;4724.314974328738;4734;4950.628702847301;5157.303763991888;5173.844784656466;5216.400113986864;5221.895562088775;5080.364954380702;5082.74586270685;5085.974570127163;5086.4659210783075;5236.554892834114;4777.235642297216;4791.808327666924;4805.6155507559315;4831.323614693945;4865.099956508057;5242.344706911636;5311.415744268127;5324.733763311819;5332.253484512172;5368.275282836845;5139.408967968731;5148.871278218;5158.148905430637;5158.458361872024;5160.664556803796;5242.213667949838;5243.501867322599;5259.132243179909;5260.658057226345;5273.2617433559335;4943.184374578154;5022.372203474566;5064;5077.974610126926;5100.158473851847;5039.899202015939;5065.569426598707;5079.288899554065;5086.0845047891735;5122;4325.718828276152;4397.648188144941;4405.889852753643;4418.403515525427;4464.2633965396;3774.8490060397276;3803.4294855771855;3831.9233615328094;3865;3867.2265546890735;4486.057927835192;4487.88780280489;4492.236319825637;4534.274516077412;4577.656675749332;5249.396319423239;5269.077911365495;5280.551153151949;5282.128448805981;5287.23335116406;4377.233984052778;4427.358033085185;4463.308187230984;4473.485549161888;4474.597286244254;4643.094596553639;4683.320918466803;4691.859244222679;4699.318598803155;4740.834070807505;4717.457492388419;4883;4886.731229782254;4888.9755551222015;4921.827736029293;5152.407473140637;5196.402413722471;5216.269722238813;5226.63413561047;5244.973775131252;4876.853694389174;4895.902081958412;4919.606431485401;4934.235193544862;4934.605231581537;4997.675151115166;5034.194528875362;5136.743162841918;5144.6398752087;5160.458151894147;5123.154679477993;5142.305788718475;5145.511176438233;5146.305248791366;5183.274341592256;4994.875128121826;5005.599552035756;5011.523905228997;5020.648554601143;5049.974750126225;4849.466558678472;4984.800607975785;5054.140796064605;5106.693598384109;5139.537441630122;5039.773210205476;5071.290019397361;5084.542391184663;5091.0581542414775;5133.92299115521;5097.821576244962;5161.251618515219;5163.715995620277;5172.482751724798;5175.171972484384;4837.201861692922;4849.418069831501;4854.514548545118;4906.141425250638;4906.730129842893 11:31:11 INFO - PROCESS | 17665 | |1;ext.html;558.1432501110799;561.5002647643597;573.5440324941671;574.2018594154126;607.7813982964157;34500.65499345006;38083.619163808355;38090.42864357037;38136;38147.809260953654;37711.24577508455;38448.23103537928;38605.8069709651;38625.03437414066;38708.225835483274;7758.991331126959;7788;7894.4868583542175;7897.368210543172;7918.999999999971;7790.727324543642;7854.6465409056445;7880.684772609089;7888.329491993188;7901.170377110407;7873.5275883447175;7899.052113746358;7908.565028923407;7919.881201781978;7920.722774702886;7845.882311765328;7865.842683146305;7882.605869706492;7890.921090789076;7907.881381779278;7810.804729881742;7823.374130069581;7874.133845277015;7879.409044321699;7924.683012679486;35613.82193089044;35739.28521429583;35866.28267434663;35943;36203.81898090493;3075.200447883544;3164.4145833020734;3218.0989322989367;3594.712423006153;3857.614238576148;28241.15276541707;28838.855805720836;28884.277893052633;28988.42023159546;29178;3338.983305083483;3382.238996225854;3391.9321613567836;3404.8297585120645;3421.4354631485776;250650;251562;252983;254893;255208;49676.254856177184;50192.49807501951;50307.24539131916;50314.49685503171;50319.24521132186;29000;29487.705122948497;29510.55734163989;29641.25896852596;29654.406911861643;15263.771043434357;15408.383664653289;15478.5356439307;15484;15502.612434689223;11702.122340824302;11806.46870890812;11853.762924741457;11854.585089521997;11861.881381186078;17866.285348585912;17930;18056.90971545134;18067.819321806877;18161.90919045423;6804.210945471681;7111.4666400020205;7147.784876570995;7201.92798072023;7223.097112860893;784.7567254151231;863.935204859638;874.6545114679666;874.881890944727;888.1429420609143;26678.466430671277;27517.829187684896;27866;27935.58096628552;28224.29439264035;958.520739630185;979.0845559401982;995.5967833027636;1045.7803861189084;1060.0406631998055;14813;14920.70158596822;14936.551903442696;15045.699086018218;15192.164430956404;403542;408781;410252;411041;412143;46661;46968.765156174;47273.290900636515;47367;47506.52493475021;1151.2229245259416;1166.2069792540983;1193.665773583398;1195.2649120790825;1205.102198861836;25812.483750324514;26533.469330613665;26923.192304230903;27279;27288.181354559394;40817.59182408138;40831.38752918649;40894;40971;41255.58744412517;259149;264429;264512;265238;265733;24684.876575617007;24858.751412485643;25014.124505642216;25087.498250034532;25096.74903250944;39972.40041399439;40331.79834100811;40381;41375;41514;34982.82508587441;35398.115047124025;35427.64572354243;35578;35604;35849.82075089608;35876.8206158978;35923;36002.81998590095;36321.45517817288;29235.415291694473;34442.48336275008;34738;34850.30299394049;37847.24305513819;29433.55849662214;29610.407791844475;29956.850215748782;30200.24499387533;30495.847520762254;24203.75796242015;25050.12008972024;25156.874215628806;25395.238142855746;25574.360640984123 11:31:11 INFO - PROCESS | 17665 | |2;jquery.html;363.124869065552;369.60267712209367;370.1597373961108;377.9470874077628;386.040688888113;16073;16561.58596035098;17636.47090587281;17637.382691605795;17690.203940822663;15317.0809751415;15560.84439155608;15866;16134.112623805686;16163.434279800209;5042.218456139295;5166.302549155872;5250.8687282817855;5250.894982100355;5267.394249661281;5135.050015747099;5171.198464238049;5188.37739471264;5220.347456567929;5223.268742376052;4989.276554899538;5107.259447380127;5119.0529751996;5136.768845401947;5149.948500515003;5035.169197082477;5115.181570948649;5146.125158723026;5146.408163061258;5169.534741873231;5182.533571978503;5191.6884986900905;5192.3249977503065;5195.636305458619;5205.817796377147;12135.696607584881;18707.812921870744;19860;20599;20661.8966905166;1951.414575627306;2033.7254470646421;2182.8035476807004;2266.6486694562204;2423.297243799296;9084.137006984325;9097.818043639156;9126.634934602607;9147.176754092097;9275.304352173614;1706.8122506524273;1719.5185348102552;1762.5505496098542;1819.3814103204975;1819.8362147406665;65819.67090164518;67532;69080.6545967267;69491;69959;9777.168940639984;9836.311458198;10026.749331266778;10098.394096354095;10164.33931794431;13661.521846735317;13683.384247708877;13687.015382769641;13716.519921802888;13757.449702012007;6740.696668649923;6872.10662613857;6929.099217101845;6933.7226510939;7089.326513981164;6322.304546499881;6385.457236134887;6403.455706264926;6426.807195784134;6463.321351258144;4234.026173980002;4290.635295999812;4336.804843781974;4400.427944367212;4416.205083085076;1782.777152855893;1804.7653805005527;1845.78773441056;1869.5980364221757;1873.634641244944;776.5263189454429;840.873868919667;841.8989721233492;845.05776059693;848.6435697007148;16129.758053629204;16574;16823.57941051459;17139.485815425556;17239.913800430917;831.2103501673434;853.4836423963412;879.8064425826308;889.74642226965;942.3497786527412;9270.30472714549;9637.614495420105;9665.226781857435;9682.661106861367;9837.360571562825;381377;383461;387670;415685;436457;58641;71663.28336716566;73599.63200184071;80628;86317;906.40177482861;928.7074571510088;939.1876027236527;940.0364626258004;949.2453499467939;15756.212189390713;15819.604509887346;16019.038857668576;16137.67724645524;16433;35939.40605939385;37380;37726.43410348902;38048.23903521859;38471.80764096162;47608.52391476041;48430;48620;48705.512944871516;49132;6609.107770450928;7023.824404389931;7251.202367739439;7259.20148783644;7447.70209191648;11684.474198660911;11843.23019003762;12069.517219311128;12286.324252166216;12416.75166496683;10299.639512617023;10373.222008349554;10795;10855.565777368816;10911.890881091405;10384.792304154025;10542.789144216918;10646.89353106459;10724.946375268073;10902.890971090188;10669.786604268027;10748.193885458466;10949.616763413242;11115;11187.608433704781;7192.71229150849;7304.452166087458;7316.597587132759;7356.374708149653;7544.396448284234;9529.380590261611;10644.308119972176;10683;10698.251122421356;10940.835887461853 11:31:11 INFO - PROCESS | 17665 | |3;mootools.html;1368.3431952662722;1407.4159223922072;1499.2129132205598;1691.0530103142235;1708.1630001299368;6526.510511711617;7240.529365591233;7348.338649521542;7846.176151504095;7882.527048377095;7427.18300986891;7691.692332306701;7692.692292308315;7717.807054823632;7717.845643087135;2163.2536774812665;2199.7800219978035;2201.119552179125;2207.0178770447155;2214.0922221889027;2141.1970511058353;2148.516583768655;2201.922932697356;2206.459417442729;2214.977850221493;2171.1966572368165;2190.288156349185;2191.342597220835;2203.063697928382;2239.0372139979804;2112.292382052007;2122.3738996995844;2123.4160605833363;2123.437289118385;2125.181805005069;2087.7077209190725;2141.635921893282;2141.7108690326763;2148.645473496871;2150.064721846002;7696.230376962315;7734.806629834243;7785.182555831613;7786.532808031537;7806.531608103532;4591.770411479446;4760.95239047612;4765.785539650724;4776.9761151194025;4781.689190202661;2759.9724002759917;2775.8473283969374;2835.6597208334924;2874.439484300562;2882.5964364988918;900.7477906186213;936.3773090894547;961.2982522758425;962.9277804164716;968.9951550242274;10454.738631534197;10501.527431265611;10526.157907367393;10534.104601108838;10605.151587872951;4058;4203.936940945889;4219.113986062961;4358.084802191575;4361.847335343247;8987.77530561728;8995.820083598292;9003.864942025875;9007.81984360309;9011.053839346774;4587.288970209623;4592.724436533818;4608.9308660370125;4614.74618895964;4637.234856248749;3597.2086141048926;4220.282551966173;4249.3413520904305;4261.488621365456;4385.166818304512;3733.701303895736;3779.130799916035;3841.5006049213425;3866.1107945172766;3883.048653079957;1231.4212320209488;1248.9313087780079;1261.0668105601972;1264.7027948432112;1272.611853384708;736.6206403702098;842.5450256861349;858.0989960541407;867.492516877621;867.5315329722006;5182.404023537266;5441.6190866639745;5490.203920431515;5559.027170245191;5562.944370556243;411.49180761759203;415.92513347597117;415.9396887451363;417.42603919610536;428.32538751465944;3730.2912446635596;3769.227308401771;3792.924141517154;3810.790406527612;3818.2554401891366;9225.308101892386;9343.2525397968;9366.438013719198;9415.293852961055;9495.620175193053;9355.391899526508;9366.391184573116;9411.670591529264;9426.764330891783;9437.103475169848;6697.229818570927;7068.222495525488;7219.169795473483;7231.240719724458;7248.528845625017;5386.5152136307925;5416.431274716098;5507;5551.8889622208135;5623.2127502148915;8564.74305770828;8717.346199034972;8835.646574136963;8839.779005524913;8897.377183597346;8632.568371581521;8837.55812209374;9058.320625952949;9080.228180604723;9084.091590840862;5846.94153058481;6659.101021362054;6816.216135144324;6817.965910170417;6905.309469053054;7626.351760100231;7628.084629844454;7629.961850190935;7711.652975615999;7767.417443691858;6682.264950855305;6864.450843932374;6874.346937040973;7003.299670032956;7003.5797852129035;6666.366695163952;6714.4292735116105;6714.597124172566;6743.831404214934;6774.119364482585;6398.808035758934;6423.03654451836;6532.706028228646;6566.606003639606;6610.4711623071;4607.2398054320665;4619.353290539394;4681.485036646034;4698.436187657367;4734.928976065431;4621.745803980813;4666.766661666971;4667.556582124693;4674.602658773906;4675.76621168947 11:31:11 INFO - PROCESS | 17665 | |4;prototype.html;292.866745630738;298.99252518687035;305.9388122375525;307.0603951907163;309.75374577211113;4789.778606455349;4910.116179087771;4962.677425967309;5044.445111037783;5062.114130027245;4584.7019943703635;4871;4896.192128298835;4958.355413796201;4965.975170124144;3902.687784977195;3914.2367238388524;3924.489816323874;3925.6270654287796;3947.624975627311;3926.509186351706;3927.509061367329;3940.2119576084756;3943.605639436062;3959.1685745993377;3594.92810143797;3813.2754776592496;3849.5573009104032;3909.8827035188847;3911.787345922773;3821.2357528494135;3824.3116239076817;3824.521934758155;3847.615238476144;3849.8075096245357;3333.966660333414;3338.332333533303;3353.849076791526;3363.125587347283;3373.7301015918915;4851.34506841579;4884.5848102911295;4890.608751299887;4894.2903279024695;4915.483874193194;4230.751928181194;4405.691601587891;4408.20652282589;4443.955560444387;4470.329450582439;5205.219217117425;5216.1221960094335;5248.317718696545;5256.789728410859;5273.419923808378;3686.502322186524;3701.833417496219;3711.9072023199365;3714.4799728037824;3719.107414220595;5213.748700311936;5236.397814251333;5266.4733526647415;5485.314335708036;5534.833954981316;3669.541307336583;3673.8714145004797;3681.545789413167;3697.7411581189594;3703.9814800925824;3754.7747135171976;3755.267722794029;3784.4323351496946;3790;3791.4881490998914;4380.69335146543;4382.496012958487;4388.71473354231;4389.31965545341;4397.516273209944;5137.40919794221;5179.1454410021925;5188.403333616607;5196.714180720097;5260.447652996457;1283.6341642631805;1290.2323117744927;1305.1907817153426;1305.6213698027466;1307.1960744142284;809.6842231529708;833.212614079701;835.6782638684028;854.2525290370926;858.3819649852096;4091.161311931047;4103.015276333718;4148.647364974011;4149.543550209474;4158.272302347077;4749.216379297377;4802.127170403545;4813.518648135158;4815.951840481621;4870.488598697086;4158.688098392633;4158.688098392633;4159.230542349675;4166.749995000309;4192.685548583869;2483.9751602484107;2542.4406630541253;2544.0205520874597;2553.561348911785;2608.2305719812703;4495.842645507391;4504.414426124583;4517.915700231921;4530.909381812346;4569.451665800125;4839.443464001614;4852.53900879423;4870.201243030442;4894.975525122351;4910.680805747615;4201.432806571135;4435.401220835211;4455.420795296591;4485.215087359699;4505.752183629801;4751.622029611374;4811.326414302071;4811.831585894477;4829.348038014823;4831.033793241436;4647.953520464887;4701.388819453449;4715.764211789328;4738.857834264978;4741.028089241766;4481.574250446202;4606.677532572688;5068;5089.193336365537;5158.987994682002;3798.4302354647025;3799.240151969562;3812.6759225466144;3818.770873747584;3829.617038296148;5442.12925931849;5471.261379713687;5472.972635136799;5474.698891560843;5505.284313039279;5061.898762024665;5305.973470132624;5307.54885834693;5346.438623944586;5351.5718742501285;5289.312389389354;5352.330958630171;5353.376845345831;5372.409035006068;5382.838514844561;5202.713850738246;5205.505476979681;5216.321878155815;5238.266642670105;5250.947490525199;5040.269160971565;5353.625246232727;5362.168863826113;5370.275012873212;5411.864703382447;5214.270002199771;5235.685858848481;5245.737713114406;5256.185291279858;5263.921041184309 11:31:11 INFO - PROCESS | 17665 | |5;yui.html;650.8275307043633;676.283139871736;697.2330436519829;732.0190944134858;750.4221749253079;12321.938390308047;13189.208647481133;13192.604221873335;13205.735885282289;13213.075084744072;12186.878131218686;12941;13156.671083222924;13178.868211317884;14096.929515352409;758.7003133762174;785.2657764989724;785.6739453126945;786.1431040166218;786.2098590916149;776.8756998880152;785.4698078796789;785.5365334452672;785.9331956783681;787.0319507006385;815.7430409421044;818.6888982186761;819.4223072733738;823.1439303124743;823.9505629662209;808.5512540539997;809.336344197761;810.1736229046369;813.259933460551;815.3721634341524;598.9401059894019;599.3437186281016;599.3676671111975;600.0639003155048;600.4535872356179;12724.491020359175;12963.805542916863;13002.739945201138;13038.674033149153;13130.212187268698;13132.999999999904;13155.736885262337;13173.670658233525;13367.398467069006;13658.863411365859;10252.436116013616;10271.897281027244;10379.325343852626;10487.423191724452;10489.895101048967;3278.0821370016197;3279.5244689519886;3322.750793690483;3391.8134502602347;3392.7794693344854;41724.79137604292;46189.769051154864;56149.43850561524;58215;58308.41691583072;10660;10732.946335268274;10735.83896241557;10771.192160587987;10908.50911708975;18590.628187436174;18688.53278668044;18724.719129213074;18782.248710051445;19214.615707685767;7106.111736032996;7132.322429369202;7202.603856787927;7258.564486130744;7286.744963926237;3604.8558057677924;3857.6528112470014;3858.749181303206;3861.787601681878;3887.3197190492115;2770.4320614274025;2881.812682175652;2889.2343528964843;2908.3165456117795;2910.810797298169;502.6255439697376;509.51850501275936;518.1114388823187;521.8956208758264;528.2841749429545;515.8091506142752;560.8878224355145;610.6885488400948;615.9651785001151;622.551762730833;8125.959370203112;8189.549574773326;8355.248027677539;8580.528070956032;8586.613602387908;481.4319103457953;515.5360175841697;536.8926214757064;543.6194663735401;587.3715124816491;3811.6378944000276;3842.9423558646645;3856.5564960029956;3981.7810020448574;4007.8396864125107;99422;103309;103490.48254758678;108450.45774771234;108985;90427;94064.52967735118;94464;94618.79596622114;95025.5248723752;49929.75035124801;71914;81260.18739812526;83338.58330708307;84908;7381.115717680294;7456;7731.7680469586;7794.92205077942;7837.177096405024;36702.44946325861;48163.759181203866;48430.51569484401;48783;49314.75342623264;62744.686276568325;70088;71538.28461715316;72993.27006729865;73957;9859.30984831055;10114.443705596263;10233.130183934449;10235.795284094127;10268.845967310346;11573;11576.36330001858;11596.130290228099;11725.88274117248;11976;10416.947915260374;10443.164546836388;10569.947150264506;10785.892141078803;11268.83096753533;10246.436445995541;10463.738406539898;10468.162546996375;10541.20940929418;10919.071878890383;10448.268621196747;10809.35143891369;10827.917208279108;11025.338479691245;11234.213605047567;8398.244158025807;8540.615672294638;8592.31261499066;8789.077146899483;9025.142611451902;8526.147385261424;8670.956645216733;8883.511406872683;8953.328500362368;9042.095790420904 11:31:11 INFO - PROCESS | 17665 | __end_tp_report 11:31:11 INFO - PROCESS | 17665 | __start_cc_report 11:31:11 INFO - PROCESS | 17665 | _x_x_mozilla_cycle_collect,403 11:31:11 INFO - PROCESS | 17665 | __end_cc_report 11:31:11 INFO - PROCESS | 17665 | __startTimestamp1468866671741__endTimestamp 11:31:11 INFO - PROCESS | 17665 | 11:31:11 INFO - PROCESS | 17665 | ------- Summary: start ------- 11:31:11 INFO - PROCESS | 17665 | Number of tests: 6 11:31:11 INFO - PROCESS | 17665 | 11:31:11 INFO - PROCESS | 17665 | [#0] dojo.html Cycles:165 Average:4747.13 Median:4886.73 stddev:610.49 (12.5%) stddev-sans-first:589.22 11:31:11 INFO - PROCESS | 17665 | Values: 2624.5 2658.6 2686.2 2711.4 2715.8 4777.0 4786.6 4849.3 4869.9 4881.6 4712.8 4764.4 4796.1 4824.1 4855.4 4408.2 4448.7 4572.8 4581.6 4589.5 479.1 4273.9 4322.0 4407.0 4425.4 4328.7 4371.5 4373.1 4374.9 4390.2 4351.6 4377.7 4400.6 4401.4 4407.0 4275.6 4332.8 4343.2 4347.1 4362.3 4694.9 4714.2 4715.0 4724.3 4734.0 4950.6 5157.3 5173.8 5216.4 5221.9 5080.4 5082.7 5086.0 5086.5 5236.6 4777.2 4791.8 4805.6 4831.3 4865.1 5242.3 5311.4 5324.7 5332.3 5368.3 5139.4 5148.9 5158.1 5158.5 5160.7 5242.2 5243.5 5259.1 5260.7 5273.3 4943.2 5022.4 5064.0 5078.0 5100.2 5039.9 5065.6 5079.3 5086.1 5122.0 4325.7 4397.6 4405.9 4418.4 4464.3 3774.8 3803.4 3831.9 3865.0 3867.2 4486.1 4487.9 4492.2 4534.3 4577.7 5249.4 5269.1 5280.6 5282.1 5287.2 4377.2 4427.4 4463.3 4473.5 4474.6 4643.1 4683.3 4691.9 4699.3 4740.8 4717.5 4883.0 4886.7 4889.0 4921.8 5152.4 5196.4 5216.3 5226.6 5245.0 4876.9 4895.9 4919.6 4934.2 4934.6 4997.7 5034.2 5136.7 5144.6 5160.5 5123.2 5142.3 5145.5 5146.3 5183.3 4994.9 5005.6 5011.5 5020.6 5050.0 4849.5 4984.8 5054.1 5106.7 5139.5 5039.8 5071.3 5084.5 5091.1 5133.9 5097.8 5161.3 5163.7 5172.5 5175.2 4837.2 4849.4 4854.5 4906.1 4906.7 11:31:11 INFO - PROCESS | 17665 | 11:31:11 INFO - PROCESS | 17665 | [#1] ext.html Cycles:180 Average:45335.04 Median:35676.55 stddev:83511.85 (234.1%) stddev-sans-first:83678.45 11:31:11 INFO - PROCESS | 17665 | Values: 558.1 561.5 573.5 574.2 607.8 34500.7 38083.6 38090.4 38136.0 38147.8 37711.2 38448.2 38605.8 38625.0 38708.2 7759.0 7788.0 7894.5 7897.4 7919.0 7790.7 7854.6 7880.7 7888.3 7901.2 7873.5 7899.1 7908.6 7919.9 7920.7 7845.9 7865.8 7882.6 7890.9 7907.9 7810.8 7823.4 7874.1 7879.4 7924.7 35613.8 35739.3 35866.3 35943.0 36203.8 3075.2 3164.4 3218.1 3594.7 3857.6 28241.2 28838.9 28884.3 28988.4 29178.0 3339.0 3382.2 3391.9 3404.8 3421.4 250650.0 251562.0 252983.0 254893.0 255208.0 49676.3 50192.5 50307.2 50314.5 50319.2 29000.0 29487.7 29510.6 29641.3 29654.4 15263.8 15408.4 15478.5 15484.0 15502.6 11702.1 11806.5 11853.8 11854.6 11861.9 17866.3 17930.0 18056.9 18067.8 18161.9 6804.2 7111.5 7147.8 7201.9 7223.1 784.8 863.9 874.7 874.9 888.1 26678.5 27517.8 27866.0 27935.6 28224.3 958.5 979.1 995.6 1045.8 1060.0 14813.0 14920.7 14936.6 15045.7 15192.2 403542.0 408781.0 410252.0 411041.0 412143.0 46661.0 46968.8 47273.3 47367.0 47506.5 1151.2 1166.2 1193.7 1195.3 1205.1 25812.5 26533.5 26923.2 27279.0 27288.2 40817.6 40831.4 40894.0 40971.0 41255.6 259149.0 264429.0 264512.0 265238.0 265733.0 24684.9 24858.8 25014.1 25087.5 25096.7 39972.4 40331.8 40381.0 41375.0 41514.0 34982.8 35398.1 35427.6 35578.0 35604.0 35849.8 35876.8 35923.0 36002.8 36321.5 29235.4 34442.5 34738.0 34850.3 37847.2 29433.6 29610.4 29956.9 30200.2 30495.8 24203.8 25050.1 25156.9 25395.2 25574.4 11:31:11 INFO - PROCESS | 17665 | 11:31:11 INFO - PROCESS | 17665 | [#2] jquery.html Cycles:180 Average:24376.38 Median:4408.32 stddev:66160.59 (1500.8%) stddev-sans-first:66321.62 11:31:11 INFO - PROCESS | 17665 | Values: 363.1 369.6 370.2 377.9 386.0 16073.0 16561.6 17636.5 17637.4 17690.2 15317.1 15560.8 15866.0 16134.1 16163.4 5042.2 5166.3 5250.9 5250.9 5267.4 5135.1 5171.2 5188.4 5220.3 5223.3 4989.3 5107.3 5119.1 5136.8 5149.9 5035.2 5115.2 5146.1 5146.4 5169.5 5182.5 5191.7 5192.3 5195.6 5205.8 12135.7 18707.8 19860.0 20599.0 20661.9 1951.4 2033.7 2182.8 2266.6 2423.3 9084.1 9097.8 9126.6 9147.2 9275.3 1706.8 1719.5 1762.6 1819.4 1819.8 65819.7 67532.0 69080.7 69491.0 69959.0 9777.2 9836.3 10026.7 10098.4 10164.3 13661.5 13683.4 13687.0 13716.5 13757.4 6740.7 6872.1 6929.1 6933.7 7089.3 6322.3 6385.5 6403.5 6426.8 6463.3 4234.0 4290.6 4336.8 4400.4 4416.2 1782.8 1804.8 1845.8 1869.6 1873.6 776.5 840.9 841.9 845.1 848.6 16129.8 16574.0 16823.6 17139.5 17239.9 831.2 853.5 879.8 889.7 942.3 9270.3 9637.6 9665.2 9682.7 9837.4 381377.0 383461.0 387670.0 415685.0 436457.0 58641.0 71663.3 73599.6 80628.0 86317.0 906.4 928.7 939.2 940.0 949.2 15756.2 15819.6 16019.0 16137.7 16433.0 35939.4 37380.0 37726.4 38048.2 38471.8 47608.5 48430.0 48620.0 48705.5 49132.0 6609.1 7023.8 7251.2 7259.2 7447.7 11684.5 11843.2 12069.5 12286.3 12416.8 10299.6 10373.2 10795.0 10855.6 10911.9 10384.8 10542.8 10646.9 10724.9 10902.9 10669.8 10748.2 10949.6 11115.0 11187.6 7192.7 7304.5 7316.6 7356.4 7544.4 9529.4 10644.3 10683.0 10698.3 10940.8 11:31:11 INFO - PROCESS | 17665 | 11:31:11 INFO - PROCESS | 17665 | [#3] mootools.html Cycles:180 Average:5125.75 Median:5284.46 stddev:2839.99 (53.7%) stddev-sans-first:2833.92 11:31:11 INFO - PROCESS | 17665 | Values: 1368.3 1407.4 1499.2 1691.1 1708.2 6526.5 7240.5 7348.3 7846.2 7882.5 7427.2 7691.7 7692.7 7717.8 7717.8 2163.3 2199.8 2201.1 2207.0 2214.1 2141.2 2148.5 2201.9 2206.5 2215.0 2171.2 2190.3 2191.3 2203.1 2239.0 2112.3 2122.4 2123.4 2123.4 2125.2 2087.7 2141.6 2141.7 2148.6 2150.1 7696.2 7734.8 7785.2 7786.5 7806.5 4591.8 4761.0 4765.8 4777.0 4781.7 2760.0 2775.8 2835.7 2874.4 2882.6 900.7 936.4 961.3 962.9 969.0 10454.7 10501.5 10526.2 10534.1 10605.2 4058.0 4203.9 4219.1 4358.1 4361.8 8987.8 8995.8 9003.9 9007.8 9011.1 4587.3 4592.7 4608.9 4614.7 4637.2 3597.2 4220.3 4249.3 4261.5 4385.2 3733.7 3779.1 3841.5 3866.1 3883.0 1231.4 1248.9 1261.1 1264.7 1272.6 736.6 842.5 858.1 867.5 867.5 5182.4 5441.6 5490.2 5559.0 5562.9 411.5 415.9 415.9 417.4 428.3 3730.3 3769.2 3792.9 3810.8 3818.3 9225.3 9343.3 9366.4 9415.3 9495.6 9355.4 9366.4 9411.7 9426.8 9437.1 6697.2 7068.2 7219.2 7231.2 7248.5 5386.5 5416.4 5507.0 5551.9 5623.2 8564.7 8717.3 8835.6 8839.8 8897.4 8632.6 8837.6 9058.3 9080.2 9084.1 5846.9 6659.1 6816.2 6818.0 6905.3 7626.4 7628.1 7630.0 7711.7 7767.4 6682.3 6864.5 6874.3 7003.3 7003.6 6666.4 6714.4 6714.6 6743.8 6774.1 6398.8 6423.0 6532.7 6566.6 6610.5 4607.2 4619.4 4681.5 4698.4 4734.9 4621.7 4666.8 4667.6 4674.6 4675.8 11:31:11 INFO - PROCESS | 17665 | 11:31:11 INFO - PROCESS | 17665 | [#4] prototype.html Cycles:180 Average:4202.08 Median:4577.08 stddev:1231.43 (26.9%) stddev-sans-first:1199.42 11:31:11 INFO - PROCESS | 17665 | Values: 292.9 299.0 305.9 307.1 309.8 4789.8 4910.1 4962.7 5044.4 5062.1 4584.7 4871.0 4896.2 4958.4 4966.0 3902.7 3914.2 3924.5 3925.6 3947.6 3926.5 3927.5 3940.2 3943.6 3959.2 3594.9 3813.3 3849.6 3909.9 3911.8 3821.2 3824.3 3824.5 3847.6 3849.8 3334.0 3338.3 3353.8 3363.1 3373.7 4851.3 4884.6 4890.6 4894.3 4915.5 4230.8 4405.7 4408.2 4444.0 4470.3 5205.2 5216.1 5248.3 5256.8 5273.4 3686.5 3701.8 3711.9 3714.5 3719.1 5213.7 5236.4 5266.5 5485.3 5534.8 3669.5 3673.9 3681.5 3697.7 3704.0 3754.8 3755.3 3784.4 3790.0 3791.5 4380.7 4382.5 4388.7 4389.3 4397.5 5137.4 5179.1 5188.4 5196.7 5260.4 1283.6 1290.2 1305.2 1305.6 1307.2 809.7 833.2 835.7 854.3 858.4 4091.2 4103.0 4148.6 4149.5 4158.3 4749.2 4802.1 4813.5 4816.0 4870.5 4158.7 4158.7 4159.2 4166.7 4192.7 2484.0 2542.4 2544.0 2553.6 2608.2 4495.8 4504.4 4517.9 4530.9 4569.5 4839.4 4852.5 4870.2 4895.0 4910.7 4201.4 4435.4 4455.4 4485.2 4505.8 4751.6 4811.3 4811.8 4829.3 4831.0 4648.0 4701.4 4715.8 4738.9 4741.0 4481.6 4606.7 5068.0 5089.2 5159.0 3798.4 3799.2 3812.7 3818.8 3829.6 5442.1 5471.3 5473.0 5474.7 5505.3 5061.9 5306.0 5307.5 5346.4 5351.6 5289.3 5352.3 5353.4 5372.4 5382.8 5202.7 5205.5 5216.3 5238.3 5250.9 5040.3 5353.6 5362.2 5370.3 5411.9 5214.3 5235.7 5245.7 5256.2 5263.9 11:31:11 INFO - PROCESS | 17665 | 11:31:11 INFO - PROCESS | 17665 | [#5] yui.html Cycles:180 Average:18010.89 Median:49622.25 stddev:26891.57 (54.2%) stddev-sans-first:26935.41 11:31:11 INFO - PROCESS | 17665 | Values: 650.8 676.3 697.2 732.0 750.4 12321.9 13189.2 13192.6 13205.7 13213.1 12186.9 12941.0 13156.7 13178.9 14096.9 758.7 785.3 785.7 786.1 786.2 776.9 785.5 785.5 785.9 787.0 815.7 818.7 819.4 823.1 824.0 808.6 809.3 810.2 813.3 815.4 598.9 599.3 599.4 600.1 600.5 12724.5 12963.8 13002.7 13038.7 13130.2 13133.0 13155.7 13173.7 13367.4 13658.9 10252.4 10271.9 10379.3 10487.4 10489.9 3278.1 3279.5 3322.8 3391.8 3392.8 41724.8 46189.8 56149.4 58215.0 58308.4 10660.0 10732.9 10735.8 10771.2 10908.5 18590.6 18688.5 18724.7 18782.2 19214.6 7106.1 7132.3 7202.6 7258.6 7286.7 3604.9 3857.7 3858.7 3861.8 3887.3 2770.4 2881.8 2889.2 2908.3 2910.8 502.6 509.5 518.1 521.9 528.3 515.8 560.9 610.7 616.0 622.6 8126.0 8189.5 8355.2 8580.5 8586.6 481.4 515.5 536.9 543.6 587.4 3811.6 3842.9 3856.6 3981.8 4007.8 99422.0 103309.0 103490.5 108450.5 108985.0 90427.0 94064.5 94464.0 94618.8 95025.5 49929.8 71914.0 81260.2 83338.6 84908.0 7381.1 7456.0 7731.8 7794.9 7837.2 36702.4 48163.8 48430.5 48783.0 49314.8 62744.7 70088.0 71538.3 72993.3 73957.0 9859.3 10114.4 10233.1 10235.8 10268.8 11573.0 11576.4 11596.1 11725.9 11976.0 10416.9 10443.2 10569.9 10785.9 11268.8 10246.4 10463.7 10468.2 10541.2 10919.1 10448.3 10809.4 10827.9 11025.3 11234.2 8398.2 8540.6 8592.3 8789.1 9025.1 8526.1 8671.0 8883.5 8953.3 9042.1 11:31:11 INFO - PROCESS | 17665 | -------- Summary: end -------- 11:31:11 INFO - PROCESS | 17665 | 11:31:12 INFO - TEST-INFO | 17665: exit 0 11:31:12 INFO - TEST-OK | dromaeo_css | took 1116072ms 11:31:12 INFO - TEST-START | kraken 11:31:12 INFO - operating with platform_type : linux_ 11:31:12 INFO - Initialising browser for kraken test... 11:31:12 INFO - TEST-INFO | started process 17915 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmMjN5a/profile http://localhost:46548/getInfo.html) 11:31:17 INFO - PROCESS | 17915 | __metrics Screen width/height:1600/1200 11:31:17 INFO - PROCESS | 17915 | colorDepth:24 11:31:17 INFO - PROCESS | 17915 | Browser inner width/height: 1024/697 11:31:17 INFO - PROCESS | 17915 | __metrics 11:31:17 ERROR - PROCESS | 17915 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2967: TypeError: this.tabs is undefined 11:31:18 INFO - TEST-INFO | 17915: exit 0 11:31:18 INFO - Browser initialized. 11:31:18 INFO - Running cycle 1/1 for kraken test... 11:31:18 INFO - TEST-INFO | started process 18034 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmMjN5a/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:31:30 INFO - PROCESS | 18034 | RSS: Main: 168816640 11:31:30 INFO - PROCESS | 18034 | 11:31:33 INFO - PROCESS | 18034 | Cycle 1(1): loaded http://localhost:46548/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:46548/tests/kraken/driver.html?testName=audio-beat-detection) 11:31:34 INFO - PROCESS | 18034 | RSS: Main: 174026752 11:31:34 INFO - PROCESS | 18034 | 11:31:36 INFO - PROCESS | 18034 | Cycle 1(1): loaded http://localhost:46548/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:46548/tests/kraken/driver.html?testName=audio-dft) 11:31:37 INFO - PROCESS | 18034 | RSS: Main: 174104576 11:31:37 INFO - PROCESS | 18034 | 11:31:40 INFO - PROCESS | 18034 | Cycle 1(1): loaded http://localhost:46548/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:46548/tests/kraken/driver.html?testName=audio-fft) 11:31:41 INFO - PROCESS | 18034 | RSS: Main: 168120320 11:31:41 INFO - PROCESS | 18034 | 11:31:43 INFO - PROCESS | 18034 | Cycle 1(1): loaded http://localhost:46548/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:46548/tests/kraken/driver.html?testName=audio-oscillator) 11:31:43 INFO - PROCESS | 18034 | RSS: Main: 168955904 11:31:43 INFO - PROCESS | 18034 | 11:31:46 INFO - PROCESS | 18034 | Cycle 1(1): loaded http://localhost:46548/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:46548/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:31:46 INFO - PROCESS | 18034 | RSS: Main: 169005056 11:31:46 INFO - PROCESS | 18034 | 11:31:49 INFO - PROCESS | 18034 | Cycle 1(1): loaded http://localhost:46548/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:46548/tests/kraken/driver.html?testName=imaging-darkroom) 11:31:50 INFO - PROCESS | 18034 | RSS: Main: 169332736 11:31:50 INFO - PROCESS | 18034 | 11:31:54 INFO - PROCESS | 18034 | Cycle 1(1): loaded http://localhost:46548/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:46548/tests/kraken/driver.html?testName=imaging-desaturate) 11:31:54 INFO - PROCESS | 18034 | RSS: Main: 166879232 11:31:54 INFO - PROCESS | 18034 | 11:31:57 INFO - PROCESS | 18034 | Cycle 1(1): loaded http://localhost:46548/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:46548/tests/kraken/driver.html?testName=json-parse-financial) 11:31:58 INFO - PROCESS | 18034 | RSS: Main: 168542208 11:31:58 INFO - PROCESS | 18034 | 11:31:59 INFO - PROCESS | 18034 | Cycle 1(1): loaded http://localhost:46548/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:46548/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:32:00 INFO - PROCESS | 18034 | RSS: Main: 169832448 11:32:00 INFO - PROCESS | 18034 | 11:32:02 INFO - PROCESS | 18034 | Cycle 1(1): loaded http://localhost:46548/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:46548/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:32:03 INFO - PROCESS | 18034 | RSS: Main: 169607168 11:32:03 INFO - PROCESS | 18034 | 11:32:05 INFO - PROCESS | 18034 | Cycle 1(1): loaded http://localhost:46548/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:46548/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:32:06 INFO - PROCESS | 18034 | RSS: Main: 169979904 11:32:06 INFO - PROCESS | 18034 | 11:32:08 INFO - PROCESS | 18034 | Cycle 1(1): loaded http://localhost:46548/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:46548/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:32:09 INFO - PROCESS | 18034 | RSS: Main: 170139648 11:32:09 INFO - PROCESS | 18034 | 11:32:12 INFO - PROCESS | 18034 | Cycle 1(1): loaded http://localhost:46548/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:46548/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:32:13 INFO - PROCESS | 18034 | RSS: Main: 169529344 11:32:13 INFO - PROCESS | 18034 | 11:32:14 INFO - PROCESS | 18034 | Cycle 1(1): loaded http://localhost:46548/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:46548/tests/kraken/driver.html?testName=ai-astar) 11:32:15 INFO - PROCESS | 18034 | RSS: Main: 170483712 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | __start_tp_report 11:32:15 INFO - PROCESS | 18034 | _x_x_mozilla_page_load 11:32:15 INFO - PROCESS | 18034 | _x_x_mozilla_page_load_details 11:32:15 INFO - PROCESS | 18034 | |i|pagename|runs| 11:32:15 INFO - PROCESS | 18034 | |0;ai-astar;105;116;107;117;116;114;116;114;116;116 11:32:15 INFO - PROCESS | 18034 | |1;audio-beat-detection;159;125;152;169;134;155;146;126;178;122 11:32:15 INFO - PROCESS | 18034 | |2;audio-dft;163;162;171;167;170;165;163;164;161;161 11:32:15 INFO - PROCESS | 18034 | |3;audio-fft;76;76;76;153;78;79;76;75;163;77 11:32:15 INFO - PROCESS | 18034 | |4;audio-oscillator;85;85;141;86;86;87;129;85;86;136 11:32:15 INFO - PROCESS | 18034 | |5;imaging-gaussian-blur;119;118;118;119;118;118;118;119;123;117 11:32:15 INFO - PROCESS | 18034 | |6;imaging-darkroom;149;147;147;150;148;148;148;152;148;149 11:32:15 INFO - PROCESS | 18034 | |7;imaging-desaturate;95;96;96;96;96;96;96;96;96;95 11:32:15 INFO - PROCESS | 18034 | |8;json-parse-financial;64;64;64;65;65;65;63;64;69;65 11:32:15 INFO - PROCESS | 18034 | |9;json-stringify-tinderbox;74;73;72;73;73;73;74;73;77;72 11:32:15 INFO - PROCESS | 18034 | |10;stanford-crypto-aes;86;80;82;80;80;80;79;81;85;80 11:32:15 INFO - PROCESS | 18034 | |11;stanford-crypto-ccm;131;127;134;142;136;135;139;138;170;133 11:32:15 INFO - PROCESS | 18034 | |12;stanford-crypto-pbkdf2;165;167;168;167;164;178;172;167;170;167 11:32:15 INFO - PROCESS | 18034 | |13;stanford-crypto-sha256-iterative;69;67;69;66;68;68;68;66;65;66 11:32:15 INFO - PROCESS | 18034 | __end_tp_report 11:32:15 INFO - PROCESS | 18034 | __start_cc_report 11:32:15 INFO - PROCESS | 18034 | _x_x_mozilla_cycle_collect,1013 11:32:15 INFO - PROCESS | 18034 | __end_cc_report 11:32:15 INFO - PROCESS | 18034 | __startTimestamp1468866735011__endTimestamp 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | ------- Summary: start ------- 11:32:15 INFO - PROCESS | 18034 | Number of tests: 14 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | [#0] ai-astar Cycles:10 Average:113.70 Median:116.00 stddev:4.19 (3.6%) stddev-sans-first:3.04 11:32:15 INFO - PROCESS | 18034 | Values: 105.0 116.0 107.0 117.0 116.0 114.0 116.0 114.0 116.0 116.0 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | [#1] audio-beat-detection Cycles:10 Average:146.60 Median:153.50 stddev:19.43 (12.7%) stddev-sans-first:20.08 11:32:15 INFO - PROCESS | 18034 | Values: 159.0 125.0 152.0 169.0 134.0 155.0 146.0 126.0 178.0 122.0 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | [#2] audio-dft Cycles:10 Average:164.70 Median:164.50 stddev:3.56 (2.2%) stddev-sans-first:3.72 11:32:15 INFO - PROCESS | 18034 | Values: 163.0 162.0 171.0 167.0 170.0 165.0 163.0 164.0 161.0 161.0 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | [#3] audio-fft Cycles:10 Average:92.90 Median:76.00 stddev:34.41 (45.3%) stddev-sans-first:35.95 11:32:15 INFO - PROCESS | 18034 | Values: 76.0 76.0 76.0 153.0 78.0 79.0 76.0 75.0 163.0 77.0 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | [#4] audio-oscillator Cycles:10 Average:100.60 Median:85.50 stddev:24.14 (28.2%) stddev-sans-first:24.94 11:32:15 INFO - PROCESS | 18034 | Values: 85.0 85.0 141.0 86.0 86.0 87.0 129.0 85.0 86.0 136.0 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | [#5] imaging-gaussian-blur Cycles:10 Average:118.70 Median:118.50 stddev:1.64 (1.4%) stddev-sans-first:1.73 11:32:15 INFO - PROCESS | 18034 | Values: 119.0 118.0 118.0 119.0 118.0 118.0 118.0 119.0 123.0 117.0 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | [#6] imaging-darkroom Cycles:10 Average:148.60 Median:148.50 stddev:1.51 (1.0%) stddev-sans-first:1.59 11:32:15 INFO - PROCESS | 18034 | Values: 149.0 147.0 147.0 150.0 148.0 148.0 148.0 152.0 148.0 149.0 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | [#7] imaging-desaturate Cycles:10 Average:95.80 Median:96.00 stddev:0.42 (0.4%) stddev-sans-first:0.33 11:32:15 INFO - PROCESS | 18034 | Values: 95.0 96.0 96.0 96.0 96.0 96.0 96.0 96.0 96.0 95.0 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | [#8] json-parse-financial Cycles:10 Average:64.80 Median:65.00 stddev:1.62 (2.5%) stddev-sans-first:1.69 11:32:15 INFO - PROCESS | 18034 | Values: 64.0 64.0 64.0 65.0 65.0 65.0 63.0 64.0 69.0 65.0 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | [#9] json-stringify-tinderbox Cycles:10 Average:73.40 Median:73.00 stddev:1.43 (2.0%) stddev-sans-first:1.50 11:32:15 INFO - PROCESS | 18034 | Values: 74.0 73.0 72.0 73.0 73.0 73.0 74.0 73.0 77.0 72.0 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | [#10] stanford-crypto-aes Cycles:10 Average:81.30 Median:80.50 stddev:2.36 (2.9%) stddev-sans-first:1.79 11:32:15 INFO - PROCESS | 18034 | Values: 86.0 80.0 82.0 80.0 80.0 80.0 79.0 81.0 85.0 80.0 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | [#11] stanford-crypto-ccm Cycles:10 Average:138.50 Median:137.00 stddev:11.84 (8.6%) stddev-sans-first:12.25 11:32:15 INFO - PROCESS | 18034 | Values: 131.0 127.0 134.0 142.0 136.0 135.0 139.0 138.0 170.0 133.0 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:168.50 Median:167.50 stddev:4.03 (2.4%) stddev-sans-first:4.08 11:32:15 INFO - PROCESS | 18034 | Values: 165.0 167.0 168.0 167.0 164.0 178.0 172.0 167.0 170.0 167.0 11:32:15 INFO - PROCESS | 18034 | 11:32:15 INFO - PROCESS | 18034 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.20 Median:68.00 stddev:1.40 (2.1%) stddev-sans-first:1.32 11:32:15 INFO - PROCESS | 18034 | Values: 69.0 67.0 69.0 66.0 68.0 68.0 68.0 66.0 65.0 66.0 11:32:15 INFO - PROCESS | 18034 | -------- Summary: end -------- 11:32:15 INFO - PROCESS | 18034 | 11:32:16 INFO - TEST-INFO | 18034: exit 0 11:32:16 INFO - TEST-OK | kraken | took 63561ms 11:32:16 INFO - SUITE-END | took 1179s 11:32:16 INFO - Completed test suite (00:19:39) 11:32:16 INFO - javascript benchmark 11:32:16 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6351.276116787501, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2624.488224796165, 2658.6410834537337, 2686.194141757475, 2711.4441539484405, 2715.8098933074693, 4777.0, 4786.593139583135, 4849.2726091086315, 4869.853904382874, 4881.585065269447, 4712.787924543395, 4764.404449443819, 4796.136695394827, 4824.107540105083, 4855.3688020557365, 4408.184485870116, 4448.666350023745, 4572.771361431932, 4581.587657110859, 4589.495155532889, 479.086078513841, 4273.871783846474, 4322.027543802651, 4407.0, 4425.402570652969, 4328.653707703376, 4371.519132895379, 4373.147236288925, 4374.8906277343, 4390.16586848501, 4351.5648435156545, 4377.715448495837, 4400.6259467945265, 4401.427814384109, 4406.986393129599, 4275.551067137937, 4332.805023773938, 4343.19650864591, 4347.087111706545, 4362.345648152803, 4694.906101877943, 4714.198586240347, 4715.033418149305, 4724.314974328738, 4734.0, 4950.628702847301, 5157.303763991888, 5173.844784656466, 5216.400113986864, 5221.895562088775, 5080.364954380702, 5082.74586270685, 5085.974570127163, 5086.4659210783075, 5236.554892834114, 4777.235642297216, 4791.808327666924, 4805.6155507559315, 4831.323614693945, 4865.099956508057, 5242.344706911636, 5311.415744268127, 5324.733763311819, 5332.253484512172, 5368.275282836845, 5139.408967968731, 5148.871278218, 5158.148905430637, 5158.458361872024, 5160.664556803796, 5242.213667949838, 5243.501867322599, 5259.132243179909, 5260.658057226345, 5273.2617433559335, 4943.184374578154, 5022.372203474566, 5064.0, 5077.974610126926, 5100.158473851847, 5039.899202015939, 5065.569426598707, 5079.288899554065, 5086.0845047891735, 5122.0, 4325.718828276152, 4397.648188144941, 4405.889852753643, 4418.403515525427, 4464.2633965396, 3774.8490060397276, 3803.4294855771855, 3831.9233615328094, 3865.0, 3867.2265546890735, 4486.057927835192, 4487.88780280489, 4492.236319825637, 4534.274516077412, 4577.656675749332, 5249.396319423239, 5269.077911365495, 5280.551153151949, 5282.128448805981, 5287.23335116406, 4377.233984052778, 4427.358033085185, 4463.308187230984, 4473.485549161888, 4474.597286244254, 4643.094596553639, 4683.320918466803, 4691.859244222679, 4699.318598803155, 4740.834070807505, 4717.457492388419, 4883.0, 4886.731229782254, 4888.9755551222015, 4921.827736029293, 5152.407473140637, 5196.402413722471, 5216.269722238813, 5226.63413561047, 5244.973775131252, 4876.853694389174, 4895.902081958412, 4919.606431485401, 4934.235193544862, 4934.605231581537, 4997.675151115166, 5034.194528875362, 5136.743162841918, 5144.6398752087, 5160.458151894147, 5123.154679477993, 5142.305788718475, 5145.511176438233, 5146.305248791366, 5183.274341592256, 4994.875128121826, 5005.599552035756, 5011.523905228997, 5020.648554601143, 5049.974750126225, 4849.466558678472, 4984.800607975785, 5054.140796064605, 5106.693598384109, 5139.537441630122, 5039.773210205476, 5071.290019397361, 5084.542391184663, 5091.0581542414775, 5133.92299115521, 5097.821576244962, 5161.251618515219, 5163.715995620277, 5172.482751724798, 5175.171972484384, 4837.201861692922, 4849.418069831501, 4854.514548545118, 4906.141425250638, 4906.730129842893], "value": 4709.241688624462, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [558.1432501110799, 561.5002647643597, 573.5440324941671, 574.2018594154126, 607.7813982964157, 34500.65499345006, 38083.619163808355, 38090.42864357037, 38136.0, 38147.809260953654, 37711.24577508455, 38448.23103537928, 38605.8069709651, 38625.03437414066, 38708.225835483274, 7758.991331126959, 7788.0, 7894.4868583542175, 7897.368210543172, 7918.999999999971, 7790.727324543642, 7854.6465409056445, 7880.684772609089, 7888.329491993188, 7901.170377110407, 7873.5275883447175, 7899.052113746358, 7908.565028923407, 7919.881201781978, 7920.722774702886, 7845.882311765328, 7865.842683146305, 7882.605869706492, 7890.921090789076, 7907.881381779278, 7810.804729881742, 7823.374130069581, 7874.133845277015, 7879.409044321699, 7924.683012679486, 35613.82193089044, 35739.28521429583, 35866.28267434663, 35943.0, 36203.81898090493, 3075.200447883544, 3164.4145833020734, 3218.0989322989367, 3594.712423006153, 3857.614238576148, 28241.15276541707, 28838.855805720836, 28884.277893052633, 28988.42023159546, 29178.0, 3338.983305083483, 3382.238996225854, 3391.9321613567836, 3404.8297585120645, 3421.4354631485776, 250650.0, 251562.0, 252983.0, 254893.0, 255208.0, 49676.254856177184, 50192.49807501951, 50307.24539131916, 50314.49685503171, 50319.24521132186, 29000.0, 29487.705122948497, 29510.55734163989, 29641.25896852596, 29654.406911861643, 15263.771043434357, 15408.383664653289, 15478.5356439307, 15484.0, 15502.612434689223, 11702.122340824302, 11806.46870890812, 11853.762924741457, 11854.585089521997, 11861.881381186078, 17866.285348585912, 17930.0, 18056.90971545134, 18067.819321806877, 18161.90919045423, 6804.210945471681, 7111.4666400020205, 7147.784876570995, 7201.92798072023, 7223.097112860893, 784.7567254151231, 863.935204859638, 874.6545114679666, 874.881890944727, 888.1429420609143, 26678.466430671277, 27517.829187684896, 27866.0, 27935.58096628552, 28224.29439264035, 958.520739630185, 979.0845559401982, 995.5967833027636, 1045.7803861189084, 1060.0406631998055, 14813.0, 14920.70158596822, 14936.551903442696, 15045.699086018218, 15192.164430956404, 403542.0, 408781.0, 410252.0, 411041.0, 412143.0, 46661.0, 46968.765156174, 47273.290900636515, 47367.0, 47506.52493475021, 1151.2229245259416, 1166.2069792540983, 1193.665773583398, 1195.2649120790825, 1205.102198861836, 25812.483750324514, 26533.469330613665, 26923.192304230903, 27279.0, 27288.181354559394, 40817.59182408138, 40831.38752918649, 40894.0, 40971.0, 41255.58744412517, 259149.0, 264429.0, 264512.0, 265238.0, 265733.0, 24684.876575617007, 24858.751412485643, 25014.124505642216, 25087.498250034532, 25096.74903250944, 39972.40041399439, 40331.79834100811, 40381.0, 41375.0, 41514.0, 34982.82508587441, 35398.115047124025, 35427.64572354243, 35578.0, 35604.0, 35849.82075089608, 35876.8206158978, 35923.0, 36002.81998590095, 36321.45517817288, 29235.415291694473, 34442.48336275008, 34738.0, 34850.30299394049, 37847.24305513819, 29433.55849662214, 29610.407791844475, 29956.850215748782, 30200.24499387533, 30495.847520762254, 24203.75796242015, 25050.12008972024, 25156.874215628806, 25395.238142855746, 25574.360640984123], "value": 17013.285360565173, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [363.124869065552, 369.60267712209367, 370.1597373961108, 377.9470874077628, 386.040688888113, 16073.0, 16561.58596035098, 17636.47090587281, 17637.382691605795, 17690.203940822663, 15317.0809751415, 15560.84439155608, 15866.0, 16134.112623805686, 16163.434279800209, 5042.218456139295, 5166.302549155872, 5250.8687282817855, 5250.894982100355, 5267.394249661281, 5135.050015747099, 5171.198464238049, 5188.37739471264, 5220.347456567929, 5223.268742376052, 4989.276554899538, 5107.259447380127, 5119.0529751996, 5136.768845401947, 5149.948500515003, 5035.169197082477, 5115.181570948649, 5146.125158723026, 5146.408163061258, 5169.534741873231, 5182.533571978503, 5191.6884986900905, 5192.3249977503065, 5195.636305458619, 5205.817796377147, 12135.696607584881, 18707.812921870744, 19860.0, 20599.0, 20661.8966905166, 1951.414575627306, 2033.7254470646421, 2182.8035476807004, 2266.6486694562204, 2423.297243799296, 9084.137006984325, 9097.818043639156, 9126.634934602607, 9147.176754092097, 9275.304352173614, 1706.8122506524273, 1719.5185348102552, 1762.5505496098542, 1819.3814103204975, 1819.8362147406665, 65819.67090164518, 67532.0, 69080.6545967267, 69491.0, 69959.0, 9777.168940639984, 9836.311458198, 10026.749331266778, 10098.394096354095, 10164.33931794431, 13661.521846735317, 13683.384247708877, 13687.015382769641, 13716.519921802888, 13757.449702012007, 6740.696668649923, 6872.10662613857, 6929.099217101845, 6933.7226510939, 7089.326513981164, 6322.304546499881, 6385.457236134887, 6403.455706264926, 6426.807195784134, 6463.321351258144, 4234.026173980002, 4290.635295999812, 4336.804843781974, 4400.427944367212, 4416.205083085076, 1782.777152855893, 1804.7653805005527, 1845.78773441056, 1869.5980364221757, 1873.634641244944, 776.5263189454429, 840.873868919667, 841.8989721233492, 845.05776059693, 848.6435697007148, 16129.758053629204, 16574.0, 16823.57941051459, 17139.485815425556, 17239.913800430917, 831.2103501673434, 853.4836423963412, 879.8064425826308, 889.74642226965, 942.3497786527412, 9270.30472714549, 9637.614495420105, 9665.226781857435, 9682.661106861367, 9837.360571562825, 381377.0, 383461.0, 387670.0, 415685.0, 436457.0, 58641.0, 71663.28336716566, 73599.63200184071, 80628.0, 86317.0, 906.40177482861, 928.7074571510088, 939.1876027236527, 940.0364626258004, 949.2453499467939, 15756.212189390713, 15819.604509887346, 16019.038857668576, 16137.67724645524, 16433.0, 35939.40605939385, 37380.0, 37726.43410348902, 38048.23903521859, 38471.80764096162, 47608.52391476041, 48430.0, 48620.0, 48705.512944871516, 49132.0, 6609.107770450928, 7023.824404389931, 7251.202367739439, 7259.20148783644, 7447.70209191648, 11684.474198660911, 11843.23019003762, 12069.517219311128, 12286.324252166216, 12416.75166496683, 10299.639512617023, 10373.222008349554, 10795.0, 10855.565777368816, 10911.890881091405, 10384.792304154025, 10542.789144216918, 10646.89353106459, 10724.946375268073, 10902.890971090188, 10669.786604268027, 10748.193885458466, 10949.616763413242, 11115.0, 11187.608433704781, 7192.71229150849, 7304.452166087458, 7316.597587132759, 7356.374708149653, 7544.396448284234, 9529.380590261611, 10644.308119972176, 10683.0, 10698.251122421356, 10940.835887461853], "value": 8144.21772895326, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1368.3431952662722, 1407.4159223922072, 1499.2129132205598, 1691.0530103142235, 1708.1630001299368, 6526.510511711617, 7240.529365591233, 7348.338649521542, 7846.176151504095, 7882.527048377095, 7427.18300986891, 7691.692332306701, 7692.692292308315, 7717.807054823632, 7717.845643087135, 2163.2536774812665, 2199.7800219978035, 2201.119552179125, 2207.0178770447155, 2214.0922221889027, 2141.1970511058353, 2148.516583768655, 2201.922932697356, 2206.459417442729, 2214.977850221493, 2171.1966572368165, 2190.288156349185, 2191.342597220835, 2203.063697928382, 2239.0372139979804, 2112.292382052007, 2122.3738996995844, 2123.4160605833363, 2123.437289118385, 2125.181805005069, 2087.7077209190725, 2141.635921893282, 2141.7108690326763, 2148.645473496871, 2150.064721846002, 7696.230376962315, 7734.806629834243, 7785.182555831613, 7786.532808031537, 7806.531608103532, 4591.770411479446, 4760.95239047612, 4765.785539650724, 4776.9761151194025, 4781.689190202661, 2759.9724002759917, 2775.8473283969374, 2835.6597208334924, 2874.439484300562, 2882.5964364988918, 900.7477906186213, 936.3773090894547, 961.2982522758425, 962.9277804164716, 968.9951550242274, 10454.738631534197, 10501.527431265611, 10526.157907367393, 10534.104601108838, 10605.151587872951, 4058.0, 4203.936940945889, 4219.113986062961, 4358.084802191575, 4361.847335343247, 8987.77530561728, 8995.820083598292, 9003.864942025875, 9007.81984360309, 9011.053839346774, 4587.288970209623, 4592.724436533818, 4608.9308660370125, 4614.74618895964, 4637.234856248749, 3597.2086141048926, 4220.282551966173, 4249.3413520904305, 4261.488621365456, 4385.166818304512, 3733.701303895736, 3779.130799916035, 3841.5006049213425, 3866.1107945172766, 3883.048653079957, 1231.4212320209488, 1248.9313087780079, 1261.0668105601972, 1264.7027948432112, 1272.611853384708, 736.6206403702098, 842.5450256861349, 858.0989960541407, 867.492516877621, 867.5315329722006, 5182.404023537266, 5441.6190866639745, 5490.203920431515, 5559.027170245191, 5562.944370556243, 411.49180761759203, 415.92513347597117, 415.9396887451363, 417.42603919610536, 428.32538751465944, 3730.2912446635596, 3769.227308401771, 3792.924141517154, 3810.790406527612, 3818.2554401891366, 9225.308101892386, 9343.2525397968, 9366.438013719198, 9415.293852961055, 9495.620175193053, 9355.391899526508, 9366.391184573116, 9411.670591529264, 9426.764330891783, 9437.103475169848, 6697.229818570927, 7068.222495525488, 7219.169795473483, 7231.240719724458, 7248.528845625017, 5386.5152136307925, 5416.431274716098, 5507.0, 5551.8889622208135, 5623.2127502148915, 8564.74305770828, 8717.346199034972, 8835.646574136963, 8839.779005524913, 8897.377183597346, 8632.568371581521, 8837.55812209374, 9058.320625952949, 9080.228180604723, 9084.091590840862, 5846.94153058481, 6659.101021362054, 6816.216135144324, 6817.965910170417, 6905.309469053054, 7626.351760100231, 7628.084629844454, 7629.961850190935, 7711.652975615999, 7767.417443691858, 6682.264950855305, 6864.450843932374, 6874.346937040973, 7003.299670032956, 7003.5797852129035, 6666.366695163952, 6714.4292735116105, 6714.597124172566, 6743.831404214934, 6774.119364482585, 6398.808035758934, 6423.03654451836, 6532.706028228646, 6566.606003639606, 6610.4711623071, 4607.2398054320665, 4619.353290539394, 4681.485036646034, 4698.436187657367, 4734.928976065431, 4621.745803980813, 4666.766661666971, 4667.556582124693, 4674.602658773906, 4675.76621168947], "value": 4080.063086858437, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [292.866745630738, 298.99252518687035, 305.9388122375525, 307.0603951907163, 309.75374577211113, 4789.778606455349, 4910.116179087771, 4962.677425967309, 5044.445111037783, 5062.114130027245, 4584.7019943703635, 4871.0, 4896.192128298835, 4958.355413796201, 4965.975170124144, 3902.687784977195, 3914.2367238388524, 3924.489816323874, 3925.6270654287796, 3947.624975627311, 3926.509186351706, 3927.509061367329, 3940.2119576084756, 3943.605639436062, 3959.1685745993377, 3594.92810143797, 3813.2754776592496, 3849.5573009104032, 3909.8827035188847, 3911.787345922773, 3821.2357528494135, 3824.3116239076817, 3824.521934758155, 3847.615238476144, 3849.8075096245357, 3333.966660333414, 3338.332333533303, 3353.849076791526, 3363.125587347283, 3373.7301015918915, 4851.34506841579, 4884.5848102911295, 4890.608751299887, 4894.2903279024695, 4915.483874193194, 4230.751928181194, 4405.691601587891, 4408.20652282589, 4443.955560444387, 4470.329450582439, 5205.219217117425, 5216.1221960094335, 5248.317718696545, 5256.789728410859, 5273.419923808378, 3686.502322186524, 3701.833417496219, 3711.9072023199365, 3714.4799728037824, 3719.107414220595, 5213.748700311936, 5236.397814251333, 5266.4733526647415, 5485.314335708036, 5534.833954981316, 3669.541307336583, 3673.8714145004797, 3681.545789413167, 3697.7411581189594, 3703.9814800925824, 3754.7747135171976, 3755.267722794029, 3784.4323351496946, 3790.0, 3791.4881490998914, 4380.69335146543, 4382.496012958487, 4388.71473354231, 4389.31965545341, 4397.516273209944, 5137.40919794221, 5179.1454410021925, 5188.403333616607, 5196.714180720097, 5260.447652996457, 1283.6341642631805, 1290.2323117744927, 1305.1907817153426, 1305.6213698027466, 1307.1960744142284, 809.6842231529708, 833.212614079701, 835.6782638684028, 854.2525290370926, 858.3819649852096, 4091.161311931047, 4103.015276333718, 4148.647364974011, 4149.543550209474, 4158.272302347077, 4749.216379297377, 4802.127170403545, 4813.518648135158, 4815.951840481621, 4870.488598697086, 4158.688098392633, 4158.688098392633, 4159.230542349675, 4166.749995000309, 4192.685548583869, 2483.9751602484107, 2542.4406630541253, 2544.0205520874597, 2553.561348911785, 2608.2305719812703, 4495.842645507391, 4504.414426124583, 4517.915700231921, 4530.909381812346, 4569.451665800125, 4839.443464001614, 4852.53900879423, 4870.201243030442, 4894.975525122351, 4910.680805747615, 4201.432806571135, 4435.401220835211, 4455.420795296591, 4485.215087359699, 4505.752183629801, 4751.622029611374, 4811.326414302071, 4811.831585894477, 4829.348038014823, 4831.033793241436, 4647.953520464887, 4701.388819453449, 4715.764211789328, 4738.857834264978, 4741.028089241766, 4481.574250446202, 4606.677532572688, 5068.0, 5089.193336365537, 5158.987994682002, 3798.4302354647025, 3799.240151969562, 3812.6759225466144, 3818.770873747584, 3829.617038296148, 5442.12925931849, 5471.261379713687, 5472.972635136799, 5474.698891560843, 5505.284313039279, 5061.898762024665, 5305.973470132624, 5307.54885834693, 5346.438623944586, 5351.5718742501285, 5289.312389389354, 5352.330958630171, 5353.376845345831, 5372.409035006068, 5382.838514844561, 5202.713850738246, 5205.505476979681, 5216.321878155815, 5238.266642670105, 5250.947490525199, 5040.269160971565, 5353.625246232727, 5362.168863826113, 5370.275012873212, 5411.864703382447, 5214.270002199771, 5235.685858848481, 5245.737713114406, 5256.185291279858, 5263.921041184309], "value": 3811.0200557056255, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [650.8275307043633, 676.283139871736, 697.2330436519829, 732.0190944134858, 750.4221749253079, 12321.938390308047, 13189.208647481133, 13192.604221873335, 13205.735885282289, 13213.075084744072, 12186.878131218686, 12941.0, 13156.671083222924, 13178.868211317884, 14096.929515352409, 758.7003133762174, 785.2657764989724, 785.6739453126945, 786.1431040166218, 786.2098590916149, 776.8756998880152, 785.4698078796789, 785.5365334452672, 785.9331956783681, 787.0319507006385, 815.7430409421044, 818.6888982186761, 819.4223072733738, 823.1439303124743, 823.9505629662209, 808.5512540539997, 809.336344197761, 810.1736229046369, 813.259933460551, 815.3721634341524, 598.9401059894019, 599.3437186281016, 599.3676671111975, 600.0639003155048, 600.4535872356179, 12724.491020359175, 12963.805542916863, 13002.739945201138, 13038.674033149153, 13130.212187268698, 13132.999999999904, 13155.736885262337, 13173.670658233525, 13367.398467069006, 13658.863411365859, 10252.436116013616, 10271.897281027244, 10379.325343852626, 10487.423191724452, 10489.895101048967, 3278.0821370016197, 3279.5244689519886, 3322.750793690483, 3391.8134502602347, 3392.7794693344854, 41724.79137604292, 46189.769051154864, 56149.43850561524, 58215.0, 58308.41691583072, 10660.0, 10732.946335268274, 10735.83896241557, 10771.192160587987, 10908.50911708975, 18590.628187436174, 18688.53278668044, 18724.719129213074, 18782.248710051445, 19214.615707685767, 7106.111736032996, 7132.322429369202, 7202.603856787927, 7258.564486130744, 7286.744963926237, 3604.8558057677924, 3857.6528112470014, 3858.749181303206, 3861.787601681878, 3887.3197190492115, 2770.4320614274025, 2881.812682175652, 2889.2343528964843, 2908.3165456117795, 2910.810797298169, 502.6255439697376, 509.51850501275936, 518.1114388823187, 521.8956208758264, 528.2841749429545, 515.8091506142752, 560.8878224355145, 610.6885488400948, 615.9651785001151, 622.551762730833, 8125.959370203112, 8189.549574773326, 8355.248027677539, 8580.528070956032, 8586.613602387908, 481.4319103457953, 515.5360175841697, 536.8926214757064, 543.6194663735401, 587.3715124816491, 3811.6378944000276, 3842.9423558646645, 3856.5564960029956, 3981.7810020448574, 4007.8396864125107, 99422.0, 103309.0, 103490.48254758678, 108450.45774771234, 108985.0, 90427.0, 94064.52967735118, 94464.0, 94618.79596622114, 95025.5248723752, 49929.75035124801, 71914.0, 81260.18739812526, 83338.58330708307, 84908.0, 7381.115717680294, 7456.0, 7731.7680469586, 7794.92205077942, 7837.177096405024, 36702.44946325861, 48163.759181203866, 48430.51569484401, 48783.0, 49314.75342623264, 62744.686276568325, 70088.0, 71538.28461715316, 72993.27006729865, 73957.0, 9859.30984831055, 10114.443705596263, 10233.130183934449, 10235.795284094127, 10268.845967310346, 11573.0, 11576.36330001858, 11596.130290228099, 11725.88274117248, 11976.0, 10416.947915260374, 10443.164546836388, 10569.947150264506, 10785.892141078803, 11268.83096753533, 10246.436445995541, 10463.738406539898, 10468.162546996375, 10541.20940929418, 10919.071878890383, 10448.268621196747, 10809.35143891369, 10827.917208279108, 11025.338479691245, 11234.213605047567, 8398.244158025807, 8540.615672294638, 8592.31261499066, 8789.077146899483, 9025.142611451902, 8526.147385261424, 8670.956645216733, 8883.511406872683, 8953.328500362368, 9042.095790420904], "value": 6468.7592083212985, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1575.3000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 116.0, 107.0, 117.0, 116.0, 114.0, 116.0, 114.0, 116.0, 116.0], "value": 113.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [159.0, 125.0, 152.0, 169.0, 134.0, 155.0, 146.0, 126.0, 178.0, 122.0], "value": 146.6, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 162.0, 171.0, 167.0, 170.0, 165.0, 163.0, 164.0, 161.0, 161.0], "value": 164.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 76.0, 76.0, 153.0, 78.0, 79.0, 76.0, 75.0, 163.0, 77.0], "value": 92.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 141.0, 86.0, 86.0, 87.0, 129.0, 85.0, 86.0, 136.0], "value": 100.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [119.0, 118.0, 118.0, 119.0, 118.0, 118.0, 118.0, 119.0, 123.0, 117.0], "value": 118.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 147.0, 147.0, 150.0, 148.0, 148.0, 148.0, 152.0, 148.0, 149.0], "value": 148.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 95.0], "value": 95.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 64.0, 64.0, 65.0, 65.0, 65.0, 63.0, 64.0, 69.0, 65.0], "value": 64.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 73.0, 72.0, 73.0, 73.0, 73.0, 74.0, 73.0, 77.0, 72.0], "value": 73.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 80.0, 82.0, 80.0, 80.0, 80.0, 79.0, 81.0, 85.0, 80.0], "value": 81.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [131.0, 127.0, 134.0, 142.0, 136.0, 135.0, 139.0, 138.0, 170.0, 133.0], "value": 138.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 167.0, 168.0, 167.0, 164.0, 178.0, 172.0, 167.0, 170.0, 167.0], "value": 168.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 67.0, 69.0, 66.0, 68.0, 68.0, 68.0, 66.0, 65.0, 66.0], "value": 67.2, "unit": "score"}]}]} 11:32:16 INFO - Return code: 0 11:32:16 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 11:32:16 ERROR - # TBPL SUCCESS # 11:32:16 INFO - Running post-action listener: _resource_record_post_action 11:32:16 INFO - ##### 11:32:16 INFO - ##### Finished run-tests step (success) 11:32:16 INFO - ##### 11:32:16 INFO - Running post-run listener: _resource_record_post_run 11:32:16 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 4096; Write bytes: 540467200; Read time: 8; Write time: 498668 11:32:16 INFO - TinderboxPrint: CPU usage
13.3% 11:32:16 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 11:32:16 INFO - TinderboxPrint: I/O write bytes / time
540,467,200 / 498,668 11:32:16 INFO - TinderboxPrint: CPU idle
8,267.9 (86.6%) 11:32:16 INFO - TinderboxPrint: CPU user
1,222.0 (12.8%) 11:32:16 INFO - TinderboxPrint: Swap in / out
0 / 0 11:32:16 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 250515456; Read time: 0; Write time: 243844 11:32:16 INFO - run-tests - Wall time: 1180s; CPU: 13.0%; Read bytes: 0; Write bytes: 289669120; Read time: 0; Write time: 254796 11:32:17 INFO - Running post-run listener: _upload_blobber_files 11:32:17 INFO - Blob upload gear active. 11:32:17 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:32:17 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 11:32:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 11:32:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 11:32:17 INFO - (blobuploader) - INFO - Open directory for files ... 11:32:17 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 11:32:17 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:32:17 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:32:23 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 11:32:23 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:32:23 INFO - (blobuploader) - INFO - Done attempting. 11:32:23 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 11:32:23 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:32:23 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:32:24 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 11:32:24 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:32:24 INFO - (blobuploader) - INFO - Done attempting. 11:32:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 11:32:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:32:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:32:25 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 11:32:25 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:32:25 INFO - (blobuploader) - INFO - Done attempting. 11:32:25 INFO - (blobuploader) - INFO - Iteration through files over. 11:32:25 INFO - Return code: 0 11:32:25 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:32:25 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:32:25 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/93cc218d62699ed9507fb0b01a4565d23939b09b4c1641bb1637e43c7de20150e6633f91b81901804d5d18d65d840a50b33ff9b4161ffdff362651e576e473ba", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/322a2d8084069c01a2f01bfe0e99c6bfba49d061a6e1fb1c9e3ab2bec48db109fd8870a3228aa5962683275b090144d7cf04dff98a6ce01c51c47e4cc90feb47", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6191372db73968bf46e7eec0b30a44f97b38fc269e4a5f6426942ffa4537fbab6f34c44da81555d943a92c58351b0ae49bd6a6dadddba7f36fc01a04bbe4f6e6"} 11:32:25 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:32:25 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:32:25 INFO - Contents: 11:32:25 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/93cc218d62699ed9507fb0b01a4565d23939b09b4c1641bb1637e43c7de20150e6633f91b81901804d5d18d65d840a50b33ff9b4161ffdff362651e576e473ba", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/322a2d8084069c01a2f01bfe0e99c6bfba49d061a6e1fb1c9e3ab2bec48db109fd8870a3228aa5962683275b090144d7cf04dff98a6ce01c51c47e4cc90feb47", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6191372db73968bf46e7eec0b30a44f97b38fc269e4a5f6426942ffa4537fbab6f34c44da81555d943a92c58351b0ae49bd6a6dadddba7f36fc01a04bbe4f6e6"} 11:32:25 INFO - Running post-run listener: copy_logs_to_upload_dir 11:32:25 INFO - Copying logs to upload dir... 11:32:25 INFO - mkdir: /builds/slave/test/build/upload/logs 11:32:25 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1239.157545 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 39 secs) (at 2016-07-18 11:32:25.476879) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-18 11:32:25.480818) ========= 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=1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/93cc218d62699ed9507fb0b01a4565d23939b09b4c1641bb1637e43c7de20150e6633f91b81901804d5d18d65d840a50b33ff9b4161ffdff362651e576e473ba", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/322a2d8084069c01a2f01bfe0e99c6bfba49d061a6e1fb1c9e3ab2bec48db109fd8870a3228aa5962683275b090144d7cf04dff98a6ce01c51c47e4cc90feb47", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6191372db73968bf46e7eec0b30a44f97b38fc269e4a5f6426942ffa4537fbab6f34c44da81555d943a92c58351b0ae49bd6a6dadddba7f36fc01a04bbe4f6e6"} build_url:https://queue.taskcluster.net/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011433 build_url: 'https://queue.taskcluster.net/v1/task/GMdBcsN5Q5y2Gsyp-pAs-w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/93cc218d62699ed9507fb0b01a4565d23939b09b4c1641bb1637e43c7de20150e6633f91b81901804d5d18d65d840a50b33ff9b4161ffdff362651e576e473ba", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/322a2d8084069c01a2f01bfe0e99c6bfba49d061a6e1fb1c9e3ab2bec48db109fd8870a3228aa5962683275b090144d7cf04dff98a6ce01c51c47e4cc90feb47", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6191372db73968bf46e7eec0b30a44f97b38fc269e4a5f6426942ffa4537fbab6f34c44da81555d943a92c58351b0ae49bd6a6dadddba7f36fc01a04bbe4f6e6"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-18 11:32:25.506536) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-18 11:32:25.506905) ========= 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=1f5564757af27664ca02d71f000001b0-1468865503.817527-1890656250 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004622 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-18 11:32:25.591462) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-18 11:32:25.591772) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-18 11:32:25.592048) ========= ========= Total master_lag: 0.17 =========