builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-066 starttime: 1469039798.82 results: success (0) buildid: 20160720083024 builduid: 963a633a61224f2fabe12d489bea92dc revision: d8dcff77656ef4a4a87ed1bf6d3c3cbb46eab22b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-20 11:36:38.824985) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-20 11:36:38.825508) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-20 11:36:38.825799) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-20 11:36:38.840947) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-20 11:36:38.841350) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-20 11:36:39-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 43.3M=0s 2016-07-20 11:36:39 (43.3 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.074391 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-20 11:36:38.928576) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-20 11:36:38.929069) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020412 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-20 11:36:38.979134) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-20 11:36:38.979505) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev d8dcff77656ef4a4a87ed1bf6d3c3cbb46eab22b --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 d8dcff77656ef4a4a87ed1bf6d3c3cbb46eab22b --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-20 11:36:39,371 truncating revision to first 12 chars 2016-07-20 11:36:39,372 Setting DEBUG logging. 2016-07-20 11:36:39,372 attempt 1/10 2016-07-20 11:36:39,372 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/d8dcff77656e?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-20 11:36:39,745 unpacking tar archive at: fx-team-d8dcff77656e/testing/mozharness/ program finished with exit code 0 elapsedTime=0.771662 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-20 11:36:39.765649) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-20 11:36:39.766006) ========= script_repo_revision: d8dcff77656ef4a4a87ed1bf6d3c3cbb46eab22b ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-20 11:36:39.766439) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-20 11:36:39.766723) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-20 11:36:39.778048) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 45 secs) (at 2016-07-20 11:36:39.778482) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:36:40 INFO - MultiFileLogger online at 20160720 11:36:40 in /builds/slave/test 11:36:40 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 11:36:40 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 11:36:40 INFO - {'append_to_log': False, 11:36:40 INFO - 'base_work_dir': '/builds/slave/test', 11:36:40 INFO - 'blob_upload_branch': 'Fx-Team', 11:36:40 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 11:36:40 INFO - 'branch': 'Fx-Team', 11:36:40 INFO - 'buildbot_json_path': 'buildprops.json', 11:36:40 INFO - 'config_files': ('talos/linux_config.py',), 11:36:40 INFO - 'default_actions': ('clobber', 11:36:40 INFO - 'read-buildbot-config', 11:36:40 INFO - 'download-and-extract', 11:36:40 INFO - 'populate-webroot', 11:36:40 INFO - 'create-virtualenv', 11:36:40 INFO - 'install', 11:36:40 INFO - 'run-tests'), 11:36:40 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:36:40 INFO - 'download_minidump_stackwalk': True, 11:36:40 INFO - 'download_symbols': 'ondemand', 11:36:40 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:36:40 INFO - 'tooltool.py': '/tools/tooltool.py', 11:36:40 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:36:40 INFO - '/tools/misc-python/virtualenv.py')}, 11:36:40 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:36:40 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:36:40 INFO - 'installer_path': 'installer.exe', 11:36:40 INFO - 'log_level': 'info', 11:36:40 INFO - 'log_name': 'talos', 11:36:40 INFO - 'log_to_console': True, 11:36:40 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:36:40 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:36:40 INFO - 'opt_config_files': (), 11:36:40 INFO - 'pip_index': False, 11:36:40 INFO - 'sps_profile': False, 11:36:40 INFO - 'sps_profile_interval': 0, 11:36:40 INFO - 'suite': 'dromaeojs-e10s', 11:36:40 INFO - 'system_bits': '32', 11:36:40 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:36:40 INFO - 'title': 'talos-linux64-ix-066', 11:36:40 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:36:40 INFO - 'use_talos_json': True, 11:36:40 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 11:36:40 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:36:40 INFO - 'work_dir': 'build'} 11:36:40 INFO - [mozharness: 2016-07-20 18:36:40.254236Z] Running clobber step. 11:36:40 INFO - Running pre-action listener: _resource_record_pre_action 11:36:40 INFO - Running main action method: clobber 11:36:40 INFO - rmtree: /builds/slave/test/build 11:36:40 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 11:36:40 INFO - Running post-action listener: _resource_record_post_action 11:36:40 INFO - [mozharness: 2016-07-20 18:36:40.720898Z] Finished clobber step (success) 11:36:40 INFO - [mozharness: 2016-07-20 18:36:40.720999Z] Running read-buildbot-config step. 11:36:40 INFO - Running pre-action listener: _resource_record_pre_action 11:36:40 INFO - Running main action method: read_buildbot_config 11:36:40 INFO - Using buildbot properties: 11:36:40 INFO - { 11:36:40 INFO - "project": "", 11:36:40 INFO - "product": "firefox", 11:36:40 INFO - "script_repo_revision": "production", 11:36:40 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 11:36:40 INFO - "repository": "", 11:36:40 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 11:36:40 INFO - "buildid": "20160720083024", 11:36:40 INFO - "pgo_build": "True", 11:36:40 INFO - "basedir": "/builds/slave/test", 11:36:40 INFO - "buildnumber": 591, 11:36:40 INFO - "slavename": "talos-linux64-ix-066", 11:36:40 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 11:36:40 INFO - "platform": "ubuntu64_hw", 11:36:40 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 11:36:40 INFO - "branch": "fx-team", 11:36:40 INFO - "repo_path": "integration/fx-team", 11:36:40 INFO - "revision": "d8dcff77656ef4a4a87ed1bf6d3c3cbb46eab22b", 11:36:40 INFO - "stage_platform": "linux64-pgo", 11:36:40 INFO - "builduid": "963a633a61224f2fabe12d489bea92dc", 11:36:40 INFO - "slavebuilddir": "test" 11:36:40 INFO - } 11:36:40 INFO - Found installer url https://queue.taskcluster.net/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 11:36:40 INFO - Running post-action listener: _resource_record_post_action 11:36:40 INFO - [mozharness: 2016-07-20 18:36:40.723438Z] Finished read-buildbot-config step (success) 11:36:40 INFO - [mozharness: 2016-07-20 18:36:40.723527Z] Running download-and-extract step. 11:36:40 INFO - Running pre-action listener: _resource_record_pre_action 11:36:40 INFO - Running main action method: download_and_extract 11:36:40 INFO - mkdir: /builds/slave/test/build/tests 11:36:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:36:40 INFO - https://queue.taskcluster.net/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 11:36:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:36:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:36:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/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:36:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/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:36:41 INFO - Downloaded 1361 bytes. 11:36:41 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:36:41 INFO - Using the following test package requirements: 11:36:41 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:36:41 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:41 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 11:36:41 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:41 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 11:36:41 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:41 INFO - u'jsshell-linux-x86_64.zip'], 11:36:41 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:41 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 11:36:41 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:36:41 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:41 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 11:36:41 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:41 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 11:36:41 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:41 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 11:36:41 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:36:41 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 11:36:41 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 11:36:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:36:41 INFO - https://queue.taskcluster.net/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:36:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:36:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:36:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/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:36:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/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:36:42 INFO - Downloaded 24343159 bytes. 11:36:42 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:36:42 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:36:43 INFO - Return code: 0 11:36:43 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:36:43 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:36:43 INFO - https://queue.taskcluster.net/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:36:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:36:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:36:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/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:36:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/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:36:44 INFO - Downloaded 24343159 bytes. 11:36:44 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:36:44 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:36:46 INFO - Return code: 0 11:36:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:36:46 INFO - https://queue.taskcluster.net/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 11:36:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:36:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:36:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/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:36:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/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:36:47 INFO - Downloaded 14403317 bytes. 11:36:47 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:36:47 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:36:47 INFO - Return code: 0 11:36: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:36:47 INFO - https://queue.taskcluster.net/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 11:36:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:36:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:36:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/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:36:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aSHHpg6kSrGMPQRWU7olkQ/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:36:49 INFO - Downloaded 60917335 bytes. 11:36:49 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:36:49 INFO - mkdir: /builds/slave/test/properties 11:36:49 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 11:36:49 INFO - Writing to file /builds/slave/test/properties/build_url 11:36:49 INFO - Contents: 11:36:49 INFO - build_url:https://queue.taskcluster.net/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:36:49 INFO - Running post-action listener: _resource_record_post_action 11:36:49 INFO - Running post-action listener: set_extra_try_arguments 11:36:49 INFO - [mozharness: 2016-07-20 18:36:49.817721Z] Finished download-and-extract step (success) 11:36:49 INFO - [mozharness: 2016-07-20 18:36:49.817954Z] Running populate-webroot step. 11:36:49 INFO - Running pre-action listener: _resource_record_pre_action 11:36:49 INFO - Running main action method: populate_webroot 11:36:49 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:36:49 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:36:49 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:36:49 INFO - '--tppagecycles', 11:36:49 INFO - '7'], 11:36:49 INFO - 'tests': ['tsvgm']}}, 11:36:49 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 11:36:49 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:36:49 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 11:36:49 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 11:36:49 INFO - 'tests': ['dromaeo_css', 'kraken']}, 11:36:49 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 11:36:49 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:49 INFO - 'talos_options': ['--disable-e10s'], 11:36:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:36:49 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:36:49 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:49 INFO - 'talos_options': ['--disable-e10s'], 11:36:49 INFO - 'tests': ['damp', 'tps']}, 11:36:49 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:49 INFO - 'tests': ['damp', 'tps']}, 11:36:49 INFO - 'g3': {'talos_options': ['--disable-e10s'], 11:36:49 INFO - 'tests': ['dromaeo_dom']}, 11:36:49 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:36:49 INFO - 'g4': {'talos_options': ['--disable-e10s'], 11:36:49 INFO - 'tests': ['basic_compositor_video']}, 11:36:49 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 11:36:49 INFO - 'other': {'talos_options': ['--disable-e10s'], 11:36:49 INFO - 'tests': ['a11yr', 11:36:49 INFO - 'ts_paint', 11:36:49 INFO - 'tpaint', 11:36:49 INFO - 'sessionrestore', 11:36:49 INFO - 'sessionrestore_no_auto_restore', 11:36:49 INFO - 'tabpaint']}, 11:36:49 INFO - 'other-e10s': {'tests': ['a11yr', 11:36:49 INFO - 'ts_paint', 11:36:49 INFO - 'tpaint', 11:36:49 INFO - 'sessionrestore', 11:36:49 INFO - 'sessionrestore_no_auto_restore', 11:36:49 INFO - 'tabpaint']}, 11:36:49 INFO - 'other-e10s_l64': {'tests': ['a11yr', 11:36:49 INFO - 'ts_paint', 11:36:49 INFO - 'tpaint', 11:36:49 INFO - 'sessionrestore', 11:36:49 INFO - 'sessionrestore_no_auto_restore', 11:36:49 INFO - 'tabpaint']}, 11:36:49 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 11:36:49 INFO - 'ts_paint', 11:36:49 INFO - 'tpaint', 11:36:49 INFO - 'sessionrestore', 11:36:49 INFO - 'sessionrestore_no_auto_restore', 11:36:49 INFO - 'tabpaint']}, 11:36:49 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 11:36:49 INFO - 'tests': ['a11yr', 11:36:49 INFO - 'ts_paint', 11:36:49 INFO - 'tpaint', 11:36:49 INFO - 'sessionrestore', 11:36:49 INFO - 'sessionrestore_no_auto_restore', 11:36:49 INFO - 'tabpaint']}, 11:36:49 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 11:36:49 INFO - 'tests': ['a11yr', 11:36:49 INFO - 'ts_paint', 11:36:49 INFO - 'tpaint', 11:36:49 INFO - 'sessionrestore', 11:36:49 INFO - 'sessionrestore_no_auto_restore', 11:36:49 INFO - 'tabpaint']}, 11:36:49 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 11:36:49 INFO - 'tests': ['tsvgx', 11:36:49 INFO - 'tsvgr_opacity', 11:36:49 INFO - 'tart', 11:36:49 INFO - 'tscrollx', 11:36:49 INFO - 'cart']}, 11:36:49 INFO - 'svgr-e10s': {'tests': ['tsvgx', 11:36:49 INFO - 'tsvgr_opacity', 11:36:49 INFO - 'tart', 11:36:49 INFO - 'tscrollx', 11:36:49 INFO - 'cart']}, 11:36:49 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:49 INFO - 'talos_options': ['--disable-e10s'], 11:36:49 INFO - 'tests': ['tp5o']}, 11:36:49 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:49 INFO - 'tests': ['tp5o']}, 11:36:49 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:49 INFO - 'talos_options': ['--disable-e10s', 11:36:49 INFO - '--xperf_path', 11:36:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:36:49 INFO - 'tests': ['tp5n']}, 11:36:49 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:36:49 INFO - 'talos_options': ['--xperf_path', 11:36:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:36:49 INFO - 'tests': ['tp5n']}}, 11:36:49 INFO - 'talos.zip': {'path': '', 11:36:49 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:36:49 INFO - Running post-action listener: _resource_record_post_action 11:36:49 INFO - [mozharness: 2016-07-20 18:36:49.838464Z] Finished populate-webroot step (success) 11:36:49 INFO - [mozharness: 2016-07-20 18:36:49.838553Z] Running create-virtualenv step. 11:36:49 INFO - Running pre-action listener: _resource_record_pre_action 11:36:49 INFO - Running main action method: create_virtualenv 11:36:49 INFO - Creating virtualenv /builds/slave/test/build/venv 11:36:49 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:36:49 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 11:36:49 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:36:49 INFO - Using real prefix '/usr' 11:36:49 INFO - New python executable in /builds/slave/test/build/venv/bin/python 11:36:50 INFO - Installing distribute.............................................................................................................................................................................................done. 11:36:52 INFO - Installing pip.................done. 11:36:52 INFO - Return code: 0 11:36:52 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 11:36:52 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:36:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:36:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:52 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:36:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:36:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:52 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 0x1102030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12658a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13c3180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13c13b0>, '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 0x13c22b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13c2740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', '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:36:52 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:36:52 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:36:52 INFO - Using env: {'DISPLAY': ':0', 11:36:52 INFO - 'HOME': '/home/cltbld', 11:36:52 INFO - 'LANG': 'en_US.UTF-8', 11:36:52 INFO - 'LANGUAGE': 'en_US:en', 11:36:52 INFO - 'LOGNAME': 'cltbld', 11:36:52 INFO - 'MAIL': '/var/mail/cltbld', 11:36:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:36:52 INFO - 'MOZ_NO_REMOTE': '1', 11:36:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:36:52 INFO - 'NO_EM_RESTART': '1', 11:36:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:36:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:36:52 INFO - 'PWD': '/builds/slave/test', 11:36:52 INFO - 'SHELL': '/bin/bash', 11:36:52 INFO - 'SHLVL': '1', 11:36:52 INFO - 'TERM': 'linux', 11:36:52 INFO - 'TMOUT': '86400', 11:36:52 INFO - 'USER': 'cltbld', 11:36:52 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', 11:36:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:36:52 INFO - '_': '/tools/buildbot/bin/python'} 11:36:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:36:52 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:36:52 INFO - Cleaning up... 11:36:52 INFO - Return code: 0 11:36:52 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 11:36:52 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:36:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:36:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:52 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:36:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:36:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:52 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 0x1102030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12658a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13c3180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13c13b0>, '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 0x13c22b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13c2740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', '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:36:52 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:36:52 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:36:52 INFO - Using env: {'DISPLAY': ':0', 11:36:52 INFO - 'HOME': '/home/cltbld', 11:36:52 INFO - 'LANG': 'en_US.UTF-8', 11:36:52 INFO - 'LANGUAGE': 'en_US:en', 11:36:52 INFO - 'LOGNAME': 'cltbld', 11:36:52 INFO - 'MAIL': '/var/mail/cltbld', 11:36:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:36:52 INFO - 'MOZ_NO_REMOTE': '1', 11:36:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:36:52 INFO - 'NO_EM_RESTART': '1', 11:36:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:36:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:36:52 INFO - 'PWD': '/builds/slave/test', 11:36:52 INFO - 'SHELL': '/bin/bash', 11:36:52 INFO - 'SHLVL': '1', 11:36:52 INFO - 'TERM': 'linux', 11:36:52 INFO - 'TMOUT': '86400', 11:36:52 INFO - 'USER': 'cltbld', 11:36:52 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', 11:36:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:36:52 INFO - '_': '/tools/buildbot/bin/python'} 11:36:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:36:52 INFO - Downloading/unpacking psutil>=3.1.1 11:36:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:36:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:36:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:36:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:36:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:36:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:36:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 11:36:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:36:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:36:54 INFO - Installing collected packages: psutil 11:36:54 INFO - Running setup.py install for psutil 11:36:54 INFO - building 'psutil._psutil_linux' extension 11:36:54 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:36:55 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:36:55 INFO - building 'psutil._psutil_posix' extension 11:36:55 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:36:55 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:36:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:36:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:36:55 INFO - Successfully installed psutil 11:36:55 INFO - Cleaning up... 11:36:55 INFO - Return code: 0 11:36:55 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 11:36: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:36:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:36:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36: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:36:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:36:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:55 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 0x1102030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12658a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13c3180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13c13b0>, '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 0x13c22b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13c2740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', '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:36:55 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:36:55 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:36:55 INFO - Using env: {'DISPLAY': ':0', 11:36:55 INFO - 'HOME': '/home/cltbld', 11:36:55 INFO - 'LANG': 'en_US.UTF-8', 11:36:55 INFO - 'LANGUAGE': 'en_US:en', 11:36:55 INFO - 'LOGNAME': 'cltbld', 11:36:55 INFO - 'MAIL': '/var/mail/cltbld', 11:36:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:36:55 INFO - 'MOZ_NO_REMOTE': '1', 11:36:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:36:55 INFO - 'NO_EM_RESTART': '1', 11:36:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:36:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:36:55 INFO - 'PWD': '/builds/slave/test', 11:36:55 INFO - 'SHELL': '/bin/bash', 11:36:55 INFO - 'SHLVL': '1', 11:36:55 INFO - 'TERM': 'linux', 11:36:55 INFO - 'TMOUT': '86400', 11:36:55 INFO - 'USER': 'cltbld', 11:36:55 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', 11:36:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:36:55 INFO - '_': '/tools/buildbot/bin/python'} 11:36:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:36:55 INFO - Downloading/unpacking mozsystemmonitor==0.3 11:36:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:36:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:36:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:36:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:36:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:36:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:36:57 INFO - Downloading mozsystemmonitor-0.3.tar.gz 11:36:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:36:57 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 11:36:57 INFO - Installing collected packages: mozsystemmonitor 11:36:57 INFO - Running setup.py install for mozsystemmonitor 11:36:57 INFO - Successfully installed mozsystemmonitor 11:36:57 INFO - Cleaning up... 11:36:57 INFO - Return code: 0 11:36:57 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 11:36:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:36:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:36:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:36:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:36:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:36:57 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 0x1102030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12658a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13c3180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13c13b0>, '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 0x13c22b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13c2740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', '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:36:57 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:36:57 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:36:57 INFO - Using env: {'DISPLAY': ':0', 11:36:57 INFO - 'HOME': '/home/cltbld', 11:36:57 INFO - 'LANG': 'en_US.UTF-8', 11:36:57 INFO - 'LANGUAGE': 'en_US:en', 11:36:57 INFO - 'LOGNAME': 'cltbld', 11:36:57 INFO - 'MAIL': '/var/mail/cltbld', 11:36:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:36:57 INFO - 'MOZ_NO_REMOTE': '1', 11:36:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:36:57 INFO - 'NO_EM_RESTART': '1', 11:36:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:36:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:36:57 INFO - 'PWD': '/builds/slave/test', 11:36:57 INFO - 'SHELL': '/bin/bash', 11:36:57 INFO - 'SHLVL': '1', 11:36:57 INFO - 'TERM': 'linux', 11:36:57 INFO - 'TMOUT': '86400', 11:36:57 INFO - 'USER': 'cltbld', 11:36:57 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', 11:36:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:36:57 INFO - '_': '/tools/buildbot/bin/python'} 11:36:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:36:57 INFO - Downloading/unpacking jsonschema==2.5.1 11:36:57 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:36:57 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:36:57 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:36:57 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:36:57 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:36:57 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:36:59 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:36:59 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 11:36:59 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:36:59 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:36:59 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:36:59 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:36:59 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:36:59 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:37:00 INFO - Downloading functools32-3.2.3-2.tar.gz 11:37:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 11:37:00 INFO - warning: no files found matching '*.txt' 11:37:00 INFO - no previously-included directories found matching 'build' 11:37:00 INFO - no previously-included directories found matching 'dist' 11:37:00 INFO - no previously-included directories found matching '.git*' 11:37:00 INFO - Installing collected packages: jsonschema, functools32 11:37:00 INFO - Running setup.py install for functools32 11:37:00 INFO - warning: no files found matching '*.txt' 11:37:00 INFO - no previously-included directories found matching 'build' 11:37:00 INFO - no previously-included directories found matching 'dist' 11:37:00 INFO - no previously-included directories found matching '.git*' 11:37:00 INFO - Successfully installed jsonschema functools32 11:37:00 INFO - Cleaning up... 11:37:00 INFO - Return code: 0 11:37:00 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 11:37: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:37:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:37:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:37: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:37:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:37:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:37: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', '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 0x1102030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12658a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13c3180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13c13b0>, '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 0x13c22b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13c2740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', '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:37: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', 'blobuploader==1.2.4'] in /builds/slave/test/build 11:37: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 blobuploader==1.2.4 11:37:00 INFO - Using env: {'DISPLAY': ':0', 11:37:00 INFO - 'HOME': '/home/cltbld', 11:37:00 INFO - 'LANG': 'en_US.UTF-8', 11:37:00 INFO - 'LANGUAGE': 'en_US:en', 11:37:00 INFO - 'LOGNAME': 'cltbld', 11:37:00 INFO - 'MAIL': '/var/mail/cltbld', 11:37:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:37:00 INFO - 'MOZ_NO_REMOTE': '1', 11:37:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:37:00 INFO - 'NO_EM_RESTART': '1', 11:37:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:37:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:37:00 INFO - 'PWD': '/builds/slave/test', 11:37:00 INFO - 'SHELL': '/bin/bash', 11:37:00 INFO - 'SHLVL': '1', 11:37:00 INFO - 'TERM': 'linux', 11:37:00 INFO - 'TMOUT': '86400', 11:37:00 INFO - 'USER': 'cltbld', 11:37:00 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', 11:37:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:37:00 INFO - '_': '/tools/buildbot/bin/python'} 11:37:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:37:00 INFO - Downloading/unpacking blobuploader==1.2.4 11:37: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:37: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:37: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:37: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:37: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:37: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:37:02 INFO - Downloading blobuploader-1.2.4.tar.gz 11:37:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:37:02 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:37:02 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:37:02 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:37:02 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:37:02 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:37:02 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:37:02 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:37:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 11:37:02 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:37:02 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:37:02 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:37:02 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:37:02 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:37:02 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:37:02 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:37:03 INFO - Downloading docopt-0.6.1.tar.gz 11:37:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 11:37:03 INFO - Installing collected packages: blobuploader, requests, docopt 11:37:03 INFO - Running setup.py install for blobuploader 11:37:03 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:37:03 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 11:37:03 INFO - Running setup.py install for requests 11:37:03 INFO - Running setup.py install for docopt 11:37:03 INFO - Successfully installed blobuploader requests docopt 11:37:03 INFO - Cleaning up... 11:37:03 INFO - Return code: 0 11:37:03 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:37: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:37:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:37:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:37: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:37:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:37:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:37:03 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 0x1102030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12658a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13c3180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13c13b0>, '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 0x13c22b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13c2740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', '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:37:03 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:37:03 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:37:03 INFO - Using env: {'DISPLAY': ':0', 11:37:03 INFO - 'HOME': '/home/cltbld', 11:37:03 INFO - 'LANG': 'en_US.UTF-8', 11:37:03 INFO - 'LANGUAGE': 'en_US:en', 11:37:03 INFO - 'LOGNAME': 'cltbld', 11:37:03 INFO - 'MAIL': '/var/mail/cltbld', 11:37:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:37:03 INFO - 'MOZ_NO_REMOTE': '1', 11:37:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:37:03 INFO - 'NO_EM_RESTART': '1', 11:37:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:37:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:37:03 INFO - 'PWD': '/builds/slave/test', 11:37:03 INFO - 'SHELL': '/bin/bash', 11:37:03 INFO - 'SHLVL': '1', 11:37:03 INFO - 'TERM': 'linux', 11:37:03 INFO - 'TMOUT': '86400', 11:37:03 INFO - 'USER': 'cltbld', 11:37:03 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', 11:37:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:37:03 INFO - '_': '/tools/buildbot/bin/python'} 11:37:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:37:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:37:04 INFO - Running setup.py (path:/tmp/pip-_ksE5h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:37:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:37:04 INFO - Running setup.py (path:/tmp/pip-CU4ItG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:37:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:37:04 INFO - Running setup.py (path:/tmp/pip-2maYOz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:37:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:37:04 INFO - Running setup.py (path:/tmp/pip-otU6xI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:37:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:37:04 INFO - Running setup.py (path:/tmp/pip-1A5TrF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:37:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:37:04 INFO - Running setup.py (path:/tmp/pip-jGkhRP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:37:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:37:04 INFO - Running setup.py (path:/tmp/pip-NRNLuK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:37:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:37:04 INFO - Running setup.py (path:/tmp/pip-fIgPDk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:37:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:37:04 INFO - Running setup.py (path:/tmp/pip-X5DikW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:37:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:37:04 INFO - Running setup.py (path:/tmp/pip-3J3OsW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:37:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:37:04 INFO - Running setup.py (path:/tmp/pip-5q69f1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:37:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:37:04 INFO - Running setup.py (path:/tmp/pip-U7arIp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:37:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:37:04 INFO - Running setup.py (path:/tmp/pip-3MQ9SS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:37:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:37:04 INFO - Running setup.py (path:/tmp/pip-Yzz9Ao-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:37:05 INFO - Running setup.py (path:/tmp/pip-TNs8Sq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:37:05 INFO - Running setup.py (path:/tmp/pip-3tsj0N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:37:05 INFO - Running setup.py (path:/tmp/pip-0LbQPJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:37:05 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:37:05 INFO - Running setup.py install for manifestparser 11:37:05 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 11:37:05 INFO - Running setup.py install for mozcrash 11:37:05 INFO - Running setup.py install for mozdebug 11:37:05 INFO - Running setup.py install for mozdevice 11:37:05 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 11:37:05 INFO - Installing dm script to /builds/slave/test/build/venv/bin 11:37:05 INFO - Running setup.py install for mozfile 11:37:05 INFO - Running setup.py install for mozhttpd 11:37:05 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 11:37:05 INFO - Running setup.py install for mozinfo 11:37:05 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 11:37:05 INFO - Running setup.py install for mozInstall 11:37:06 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 11:37:06 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 11:37:06 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 11:37:06 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 11:37:06 INFO - Running setup.py install for mozleak 11:37:06 INFO - Running setup.py install for mozlog 11:37:06 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 11:37:06 INFO - Running setup.py install for moznetwork 11:37:06 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 11:37:06 INFO - Running setup.py install for mozprocess 11:37:06 INFO - Running setup.py install for mozprofile 11:37:06 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 11:37:06 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 11:37:06 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 11:37:06 INFO - Running setup.py install for mozrunner 11:37:06 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 11:37:06 INFO - Running setup.py install for mozscreenshot 11:37:06 INFO - Running setup.py install for moztest 11:37:06 INFO - Running setup.py install for mozversion 11:37:06 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 11:37:06 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:37:06 INFO - Cleaning up... 11:37:07 INFO - Return code: 0 11:37:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:37:07 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:37:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:37:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:37:07 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:37:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:37:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:37:07 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 0x1102030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12658a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13c3180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13c13b0>, '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 0x13c22b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13c2740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', '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:37:07 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:37:07 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:37:07 INFO - Using env: {'DISPLAY': ':0', 11:37:07 INFO - 'HOME': '/home/cltbld', 11:37:07 INFO - 'LANG': 'en_US.UTF-8', 11:37:07 INFO - 'LANGUAGE': 'en_US:en', 11:37:07 INFO - 'LOGNAME': 'cltbld', 11:37:07 INFO - 'MAIL': '/var/mail/cltbld', 11:37:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:37:07 INFO - 'MOZ_NO_REMOTE': '1', 11:37:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:37:07 INFO - 'NO_EM_RESTART': '1', 11:37:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:37:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:37:07 INFO - 'PWD': '/builds/slave/test', 11:37:07 INFO - 'SHELL': '/bin/bash', 11:37:07 INFO - 'SHLVL': '1', 11:37:07 INFO - 'TERM': 'linux', 11:37:07 INFO - 'TMOUT': '86400', 11:37:07 INFO - 'USER': 'cltbld', 11:37:07 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', 11:37:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:37:07 INFO - '_': '/tools/buildbot/bin/python'} 11:37:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:37:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:37:07 INFO - Running setup.py (path:/tmp/pip-pQiEOr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:37:07 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:37:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:37:07 INFO - Running setup.py (path:/tmp/pip-t1LhoS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:37:07 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:37:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:37:07 INFO - Running setup.py (path:/tmp/pip-7QaJAR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:37:07 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:37:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:37:07 INFO - Running setup.py (path:/tmp/pip-9PbhJH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:37:07 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:37:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:37:07 INFO - Running setup.py (path:/tmp/pip-QRpLMo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:37:07 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:37:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:37:07 INFO - Running setup.py (path:/tmp/pip-gYGmj5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:37:07 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:37:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:37:07 INFO - Running setup.py (path:/tmp/pip-BgQO4O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:37:07 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:37:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:37:07 INFO - Running setup.py (path:/tmp/pip-z58tKW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:37:07 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:37:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:37:07 INFO - Running setup.py (path:/tmp/pip-HDFYW8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:37:07 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:37:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:37:07 INFO - Running setup.py (path:/tmp/pip-3IARKk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:37:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.3 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 11:37:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:37:07 INFO - Running setup.py (path:/tmp/pip-g759iR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:37:08 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:37:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:37:08 INFO - Running setup.py (path:/tmp/pip-B3TdUt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:37:08 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:37:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:37:08 INFO - Running setup.py (path:/tmp/pip-8u1M8H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:37:08 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:37:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:37:08 INFO - Running setup.py (path:/tmp/pip-vjp6ev-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:37:08 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:37:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:37:08 INFO - Running setup.py (path:/tmp/pip-PTzKVm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:37:08 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:37:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:37:08 INFO - Running setup.py (path:/tmp/pip-Toy8Qb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:37:08 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:37:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:37:08 INFO - Running setup.py (path:/tmp/pip-CX9hXH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:37:08 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:37:08 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:37:08 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:37:08 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:37:08 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:37:08 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:37:08 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 11:37: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:37: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:37: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:37: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:37: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:37: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:37:10 INFO - Downloading blessings-1.6.tar.gz 11:37:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 11:37:10 INFO - Installing collected packages: blessings 11:37:10 INFO - Running setup.py install for blessings 11:37:10 INFO - Successfully installed blessings 11:37:10 INFO - Cleaning up... 11:37:10 INFO - Return code: 0 11:37:10 INFO - Done creating virtualenv /builds/slave/test/build/venv. 11:37:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:37:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:37:10 INFO - Reading from file tmpfile_stdout 11:37:10 INFO - Current package versions: 11:37:10 INFO - argparse == 1.2.1 11:37:10 INFO - blessings == 1.6 11:37:10 INFO - blobuploader == 1.2.4 11:37:10 INFO - docopt == 0.6.1 11:37:10 INFO - functools32 == 3.2.3-2 11:37:10 INFO - jsonschema == 2.5.1 11:37:10 INFO - manifestparser == 1.1 11:37:10 INFO - mozInstall == 1.12 11:37:10 INFO - mozcrash == 0.17 11:37:10 INFO - mozdebug == 0.1 11:37:10 INFO - mozdevice == 0.48 11:37:10 INFO - mozfile == 1.2 11:37:10 INFO - mozhttpd == 0.7 11:37:10 INFO - mozinfo == 0.9 11:37:10 INFO - mozleak == 0.1 11:37:10 INFO - mozlog == 3.3 11:37:10 INFO - moznetwork == 0.27 11:37:10 INFO - mozprocess == 0.23 11:37:10 INFO - mozprofile == 0.28 11:37:10 INFO - mozrunner == 6.12 11:37:10 INFO - mozscreenshot == 0.1 11:37:10 INFO - mozsystemmonitor == 0.3 11:37:10 INFO - moztest == 0.7 11:37:10 INFO - mozversion == 1.4 11:37:10 INFO - psutil == 3.1.1 11:37:10 INFO - requests == 1.2.3 11:37:10 INFO - wsgiref == 0.1.2 11:37:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:37:10 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:37:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:37:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:37:10 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:37:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:37:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:37:10 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 0x1102030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12658a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13c3180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13c13b0>, '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 0x13c22b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13c2740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', '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:37:10 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:37:10 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:37:10 INFO - Using env: {'DISPLAY': ':0', 11:37:10 INFO - 'HOME': '/home/cltbld', 11:37:10 INFO - 'LANG': 'en_US.UTF-8', 11:37:10 INFO - 'LANGUAGE': 'en_US:en', 11:37:10 INFO - 'LOGNAME': 'cltbld', 11:37:10 INFO - 'MAIL': '/var/mail/cltbld', 11:37:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:37:10 INFO - 'MOZ_NO_REMOTE': '1', 11:37:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:37:10 INFO - 'NO_EM_RESTART': '1', 11:37:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:37:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:37:10 INFO - 'PWD': '/builds/slave/test', 11:37:10 INFO - 'SHELL': '/bin/bash', 11:37:10 INFO - 'SHLVL': '1', 11:37:10 INFO - 'TERM': 'linux', 11:37:10 INFO - 'TMOUT': '86400', 11:37:10 INFO - 'USER': 'cltbld', 11:37:10 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', 11:37:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:37:10 INFO - '_': '/tools/buildbot/bin/python'} 11:37:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:37:11 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:37:11 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:37:11 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:37:11 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:37:11 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:37:11 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:37:11 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:37:11 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:37:11 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:37:11 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:37:11 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:37:11 INFO - Cleaning up... 11:37:11 INFO - Return code: 0 11:37:11 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 11:37:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:37:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:37:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:37:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:37:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:37:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:37:11 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 0x1102030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12658a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x13c3180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x13c13b0>, '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 0x13c22b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13c2740>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', '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:37:11 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:37:11 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:37:11 INFO - Using env: {'DISPLAY': ':0', 11:37:11 INFO - 'HOME': '/home/cltbld', 11:37:11 INFO - 'LANG': 'en_US.UTF-8', 11:37:11 INFO - 'LANGUAGE': 'en_US:en', 11:37:11 INFO - 'LOGNAME': 'cltbld', 11:37:11 INFO - 'MAIL': '/var/mail/cltbld', 11:37:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:37:11 INFO - 'MOZ_NO_REMOTE': '1', 11:37:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:37:11 INFO - 'NO_EM_RESTART': '1', 11:37:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:37:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:37:11 INFO - 'PWD': '/builds/slave/test', 11:37:11 INFO - 'SHELL': '/bin/bash', 11:37:11 INFO - 'SHLVL': '1', 11:37:11 INFO - 'TERM': 'linux', 11:37:11 INFO - 'TMOUT': '86400', 11:37:11 INFO - 'USER': 'cltbld', 11:37:11 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', 11:37:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:37:11 INFO - '_': '/tools/buildbot/bin/python'} 11:37:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:37:11 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 11:37:11 INFO - Cleaning up... 11:37:11 INFO - Return code: 0 11:37:11 INFO - Running post-action listener: _resource_record_post_action 11:37:11 INFO - Running post-action listener: _start_resource_monitoring 11:37:11 INFO - Starting resource monitoring. 11:37:11 INFO - [mozharness: 2016-07-20 18:37:11.335095Z] Finished create-virtualenv step (success) 11:37:11 INFO - [mozharness: 2016-07-20 18:37:11.335573Z] Running install step. 11:37:11 INFO - Running pre-action listener: _resource_record_pre_action 11:37:11 INFO - Running main action method: install 11:37:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:37:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:37:11 INFO - Reading from file tmpfile_stdout 11:37:11 INFO - Detecting whether we're running mozinstall >=1.0... 11:37:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 11:37:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 11:37:11 INFO - Reading from file tmpfile_stdout 11:37:11 INFO - Output received: 11:37:11 INFO - Usage: mozinstall [options] installer 11:37:11 INFO - Options: 11:37:11 INFO - -h, --help show this help message and exit 11:37:11 INFO - -d DEST, --destination=DEST 11:37:11 INFO - Directory to install application into. [default: 11:37:11 INFO - "/builds/slave/test"] 11:37:11 INFO - --app=APP Application being installed. [default: firefox] 11:37:11 INFO - mkdir: /builds/slave/test/build/application 11:37:11 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:37:11 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:37:28 INFO - Reading from file tmpfile_stdout 11:37:28 INFO - Output received: 11:37:28 INFO - /builds/slave/test/build/application/firefox/firefox 11:37:28 INFO - Running post-action listener: _resource_record_post_action 11:37:28 INFO - [mozharness: 2016-07-20 18:37:28.878407Z] Finished install step (success) 11:37:28 INFO - [mozharness: 2016-07-20 18:37:28.878685Z] Running run-tests step. 11:37:28 INFO - Running pre-action listener: _resource_record_pre_action 11:37:28 INFO - Running main action method: run_tests 11:37:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 11:37:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 11:37:28 INFO - Python 2.7.3 11:37:28 INFO - Return code: 0 11:37:28 INFO - grabbing minidump binary from tooltool 11:37:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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:37:28 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 0x13c13b0>, '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 0x13c22b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x13c2740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 11:37:28 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:37:28 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:37:28 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:37:28 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:37:28 INFO - Return code: 0 11:37:28 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 11:37:28 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 11:37:28 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 11:37:28 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 11:37:28 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 11:37:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-066', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 11:37:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-066 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 11:37:28 INFO - Using env: {'DISPLAY': ':0', 11:37:28 INFO - 'HOME': '/home/cltbld', 11:37:28 INFO - 'LANG': 'en_US.UTF-8', 11:37:28 INFO - 'LANGUAGE': 'en_US:en', 11:37:28 INFO - 'LOGNAME': 'cltbld', 11:37:28 INFO - 'MAIL': '/var/mail/cltbld', 11:37:28 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 11:37:28 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 11:37:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:37:28 INFO - 'MOZ_NO_REMOTE': '1', 11:37:28 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 11:37:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:37:28 INFO - 'NO_EM_RESTART': '1', 11:37:28 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:37:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:37:28 INFO - 'PWD': '/builds/slave/test', 11:37:28 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 11:37:28 INFO - 'SHELL': '/bin/bash', 11:37:28 INFO - 'SHLVL': '1', 11:37:28 INFO - 'TERM': 'linux', 11:37:28 INFO - 'TMOUT': '86400', 11:37:28 INFO - 'USER': 'cltbld', 11:37:28 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004', 11:37:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:37:28 INFO - '_': '/tools/buildbot/bin/python'} 11:37:28 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-066', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 11:37:29 INFO - mozversion application_buildid: 20160720083024 11:37:29 INFO - mozversion application_changeset: d8dcff77656ef4a4a87ed1bf6d3c3cbb46eab22b 11:37:29 INFO - mozversion application_display_name: Nightly 11:37:29 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:37:29 INFO - mozversion application_name: Firefox 11:37:29 INFO - mozversion application_remotingname: firefox 11:37:29 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 11:37:29 INFO - mozversion application_vendor: Mozilla 11:37:29 INFO - mozversion application_version: 50.0a1 11:37:29 INFO - mozversion platform_buildid: 20160720083024 11:37:29 INFO - mozversion platform_changeset: d8dcff77656ef4a4a87ed1bf6d3c3cbb46eab22b 11:37:29 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 11:37:29 INFO - mozversion platform_version: 50.0a1 11:37:29 INFO - using testdate: 1469039849 11:37:29 INFO - actual date: 1469039849 11:37:29 INFO - starting webserver on 'localhost:41443' 11:37:29 INFO - SUITE-START | Running 2 tests 11:37:29 INFO - TEST-START | dromaeo_css 11:37:29 INFO - operating with platform_type : linux_ 11:37:29 INFO - Initialising browser for dromaeo_css test... 11:37:29 INFO - TEST-INFO | started process 13023 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp1Puyfc/profile http://localhost:41443/getInfo.html) 11:37:34 INFO - PROCESS | 13023 | __metrics Screen width/height:1600/1200 11:37:34 INFO - PROCESS | 13023 | colorDepth:24 11:37:34 INFO - PROCESS | 13023 | Browser inner width/height: 1024/697 11:37:34 INFO - PROCESS | 13023 | __metrics 11:37:34 ERROR - PROCESS | 13023 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2967: TypeError: this.tabs is undefined 11:37:35 INFO - TEST-INFO | 13023: exit 0 11:37:35 INFO - Browser initialized. 11:37:35 INFO - Running cycle 1/1 for dromaeo_css test... 11:37:35 INFO - TEST-INFO | started process 13146 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp1Puyfc/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:37:47 INFO - PROCESS | 13146 | RSS: Main: 167108608 11:37:47 INFO - PROCESS | 13146 | 11:38:36 INFO - PROCESS | 13146 | 1469039916870 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:40:45 INFO - PROCESS | 13146 | Cycle 1(1): loaded http://localhost:41443/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41443/tests/dromaeo/cssquery-ext.html) 11:40:46 INFO - PROCESS | 13146 | RSS: Main: 173268992 11:40:46 INFO - PROCESS | 13146 | 11:43:48 INFO - PROCESS | 13146 | Cycle 1(1): loaded http://localhost:41443/tests/dromaeo/cssquery-ext.html (next: http://localhost:41443/tests/dromaeo/cssquery-jquery.html) 11:43:49 INFO - PROCESS | 13146 | RSS: Main: 169988096 11:43:49 INFO - PROCESS | 13146 | 11:46:51 INFO - PROCESS | 13146 | Cycle 1(1): loaded http://localhost:41443/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41443/tests/dromaeo/cssquery-mootools.html) 11:46:52 INFO - PROCESS | 13146 | RSS: Main: 173522944 11:46:52 INFO - PROCESS | 13146 | 11:49:53 INFO - PROCESS | 13146 | Cycle 1(1): loaded http://localhost:41443/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41443/tests/dromaeo/cssquery-prototype.html) 11:49:54 INFO - PROCESS | 13146 | RSS: Main: 168083456 11:49:54 INFO - PROCESS | 13146 | 11:52:56 INFO - PROCESS | 13146 | Cycle 1(1): loaded http://localhost:41443/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41443/tests/dromaeo/cssquery-yui.html) 11:52:57 INFO - PROCESS | 13146 | RSS: Main: 169816064 11:52:57 INFO - PROCESS | 13146 | 11:56:00 INFO - PROCESS | 13146 | Cycle 1(1): loaded http://localhost:41443/tests/dromaeo/cssquery-yui.html (next: http://localhost:41443/tests/dromaeo/cssquery-dojo.html) 11:56:00 INFO - PROCESS | 13146 | RSS: Main: 171118592 11:56:00 INFO - PROCESS | 13146 | 11:56:00 INFO - PROCESS | 13146 | __start_tp_report 11:56:00 INFO - PROCESS | 13146 | _x_x_mozilla_page_load 11:56:00 INFO - PROCESS | 13146 | _x_x_mozilla_page_load_details 11:56:00 INFO - PROCESS | 13146 | |i|pagename|runs| 11:56:00 INFO - PROCESS | 13146 | |0;dojo.html;3084.9228769280758;3085.398347322273;3099.3336432666974;3110.8133511989267;3119.0330997390824;5412.864678383043;5472.808451704186;5501.229827824103;5503.724813759316;5524.640898341605;5317.149256119022;5359.517643412092;5383.219433182187;5425.240466334716;5433.918491222625;4961;4977.975110124454;5008.023435430093;5023.171176755831;5083.212102124176;4906.1414252505665;5080.618953578478;5113.539781419671;5125.871853203663;5140.7172605506685;4880.2435622478215;4944.60443164546;4960.082384758831;5008.499150084999;5010.924836127461;4994.550490455877;4997.475265097149;4999.625028122869;5000.924986125211;5027;4935.457099719028;4950.603951683856;4992.725400102993;4993.101241776479;5022.17134172861;5406.756695948692;5417.079096553556;5443.047466693313;5488.204210389511;5556.583256255797;5862.677552734598;5867.11993201019;5868.178455016258;5877.089051197071;5878.294604647427;5894.410558944114;5896.1450589664255;5903.911441328383;5929.110633404981;5929.940700592982;5337.332833395825;5386.407495175527;5398.379186393576;5399.946000539983;5455.1544510600925;5934.881302374015;5937.139114828412;5938.138969849348;5942.168096466498;5960.403959604005;5698.8290351289525;5703.914441283384;5722.914156287659;5730.598858079894;5738;5622.803201887996;5659.207710920475;5692.943070569324;5711.914321285184;5753.165790960371;5600.27196464457;5644.294463192101;5669.574781891375;5711.228984087178;5814.854628634318;5725.742341594639;5768.971155144198;5776.768929242868;5800.419958004166;5807.5644326675665;4311.676624253194;4416.624586910084;4420.093880754438;4438.955610443919;4482.439695038121;3932.036651020518;3947.3684210526176;3965.206958608232;3982.5220973482787;4012.0772222389014;5482.150266708666;5617.9719101404235;5647.519960803295;5658.321001479767;5696.572757043238;5675.631083979528;5873.412658734178;5913.172155898178;5929.851753706192;5935.970320148372;5520.91718624221;5568.443155684399;5587.329520457572;5617.634853734494;5641;4992.151334273182;5037.79848806051;5066.898662026812;5069.695818250917;5077.720725360066;5835.503982161479;6034.547408944347;6059.182010428536;6067.423594758491;6069;5819.127130930395;5857.824265272048;5859.238299021271;5966.76132954677;5972.611780234271;6091.42131497507;6096.420840020191;6098.603590766586;6111.969440152949;6132.6627035513475;5781.595288329777;5821.505172060253;5833.037548804569;5834.445727655866;5854.736536855767;5684.033714268667;5797.9420205797405;5820;5838.1826544282985;5925.4370834770625;5743.511801496752;5768.596198266081;5779.479846813807;5788.450097240924;5793.304803423616;5705.030144875298;5713.771449141987;5714.514266287412;5717.7141142941855;5742.7702891883855;5486.917696234639;5589.77640894376;5636.041872881702;5650.124230744241;5747.597668163188;5744.971275143597;5752.827415177551;5787.681677507778;5788.942110578841;5792.160136780228;5596.692181930033;5608.831735047955;5610.158476228598;5612.7754889803955;5638.548916086621 11:56:00 INFO - PROCESS | 13146 | |1;ext.html;555.2082769347384;591.1694069831885;596.895543279926;606.2633899811727;636.6530241018651;40118.1976360473;44263.99999999992;44382.33426498605;44411.333829992574;44460.3330950036;43947.78026109865;44394.11211775763;44888.77555612226;44941;45106;8824.647014119444;8974.461532308082;9026.413283136575;9029.503377314279;9031.864522032174;8838.33712471564;8918.910810891874;8952.328575356842;8953.418027828204;8954.462732236087;8965.193132618064;9004.414713043663;9011;9012.819743605123;9027.187553120219;8904.065073167321;8910.86633700495;8936.374453788238;8936.463812171225;8977.371583989057;8886.866696999485;8893.599788009555;8895.110488951053;8954.05982371848;8957.910420895772;42524.36213456801;42863.1427371454;42930.78534607307;42977.57022429767;42989.78505107454;3771.17034252464;3818.102745854722;3835.2137811748526;4012.297847876639;4338.089001309729;33393;33933.660663393544;34012;34149.48775768365;34950.825245873864;4154.210699966997;4251.426057482231;4255.74465532066;4270.530241673413;4273;351850;355349;356004;356587;356965.21517392504;31078.22304442362;31858.522122168186;60258.09612855811;60278.69860650756;60410;37365;37632.81183594119;37638.306276217634;37648.62351376506;37848.43227351592;15243.771343429857;15292.847071529364;15371.846281537266;15388.769168462482;15390.384384624713;12464.756343858193;12491.750164996649;12505.874941250471;12513.624591262276;12516.311602861748;8299.419040667217;8389.706360277361;8401.873971890427;8427.241548260687;8495.872561911576;3203.4554125798672;3216.790908590934;3244.3511297740547;3261.5107733840114;3271.0677456924664;994.4232345239743;1073.388049214388;1137.4653912661036;1182.822576613515;1183.2900259844025;33745.83127084349;33989.66010339915;34117.31765364679;34190.14524636904;34387.4841877372;1054.9683509494728;1080.189857606795;1103.5034234594464;1140.3955903371227;1211.4548453196096;16510.05304735341;17416.129193540273;17423.825761742475;17461.38885139014;17479.47561573155;581666;589052;592535;592966;595540;60002.09996850051;60150.398496015354;60786;60791.696041520394;60808;1309.2537253765454;1343.7715588350004;1368.62362850215;1373.4849431463401;1377.0498356134235;31041;31711.682883170874;31886.36227275395;32407.189820254684;32673;52125.478745212065;52382.21426678527;52713.47286527086;52829.207561885836;52837.47162528326;492891;496813;496831;496960;497852;25141.24576262715;25423.23730288094;25483.872580636977;25554.488910222062;25770.484590308464;49542.50457495379;51225.74387128041;51271.23093153531;51332.48667513277;51537.48462515477;41241.58758412497;41934.37098443587;43471;43972.780136099114;46184.53815461802;44241.33637995368;44540.55459445364;45210.321845173006;45267.32099018452;46046;35823.82088089543;41326.586734132274;41421.79289103535;41683.7915810419;43456.13087738291;37741.81129094337;39711.40432893451;40095.799521002205;40121.79939100286;40400.79799600983;29156.416871662874;29394.806940676328;29541;29579.852100739357;29949.850250749478 11:56:00 INFO - PROCESS | 13146 | |2;jquery.html;342.9331280400323;362.45269642839315;366.50338790938275;371.711923259474;379.83201654911153;17905.641887162266;17968.460946171603;18931.86408815472;18968;19310.710339344885;17931.91034044831;18260.543486412847;18296.085195740226;18323.26706931721;18714.53213669659;5476.616636835423;5621.718914054301;5623.044082505963;5645.125005624135;5649.774009039654;5474.808381706641;5484.862878428051;5486.1222204447295;5505.807296744615;5575;5583.106702927533;5600.8319750407345;5605.467480589337;5609.971950140243;5627.2684551008515;5537.363203231619;5550.972245138769;5564.721763911788;5597.104463285896;5620.437956204388;4901.681390709628;4902.460729319772;4917.877053073666;4933.605311575101;4948.406191257036;20765.792342076536;21714.457138571503;22007.889960550256;22091.779082209134;22434.55130897373;2140.464883779055;2319.3158018384615;2371.1819422299277;2667.773239274664;2754.0085569195076;9419;9883.505824708807;10018.3488073275;11984.400779961054;13606;1883.8587105967108;1884.1897983866932;1942.3298961858136;1982.1773963805003;1994.4714650617598;77467.61266193689;77836;78392.21607783964;79124.20875791226;81043.59478202571;10186.694399168036;10269.948650256702;10342.431166285776;10408.553989812388;10709.892901071045;13887.305634718223;14113.78829317561;14155.29223538819;14235.50175743844;14323.78514322286;7548.66031028605;7734.149243583314;7937;8037.477563958441;8056.194380561897;7685.4620176587105;7708.152103268748;7750.263724946121;7936.2857342839425;7953.6818527258265;4294.7852607369505;4394.1651086293505;4410.80151393188;4485.618722408566;4534;1774.1750086209975;1788.910554472271;1790.6776780179694;1824.3614734842963;1831.505493516743;918.6922381002305;926.3515539122641;959.5490119643756;980.1717548671361;1039.9012093851072;17448.738268925976;18988.14553345103;18999.15012748099;19065.747556023867;19115.904420478088;883.6862913665685;951.2485136742034;959.5154447004218;968.404431274775;995.6117114325419;10283.53724082418;10484.895151048544;10542.26204165701;10647.84028239577;10648.627298044532;482718;485736;491794;495028;495419;87587.56206219055;88542;89638;89685.55157224172;90021.54989225011;971.1017308989298;984.5126662302206;999.3803841618243;1011.3173607814696;1011.7571782772081;15649.452269170524;16095.919520402791;16682.916585416995;17080.829191707922;17285.827141728423;38890.61109388983;40116.59883401245;40654;41228.1754364917;41789.164216716104;55537;56369.71815140898;56741.71629141828;57018.42981570131;57845.710771445876;7668.731594394169;7722.498037627536;7859.292663660298;7946.682132714626;8059.233519062235;10497.52761125736;12955.352232388532;13034.543790967271;13325.933370333087;13604.727905442034;11191.216614836883;11299.661010169708;11320.433978301216;11411.714707132389;11586.652400428;11289;11311.434428278388;11469.19715619932;11561.537538498365;11807.23252988553;11199.272047316897;11551.191416600757;11585;11694.88305116972;11839.82240266414;7926.920730792618;8142.307903828241;11740.178187526792;11935.582254621047;12581.496740130659;11285.492152852978;11922;11968.521259149536;11988.520459181535;12508.499660013498 11:56:00 INFO - PROCESS | 13146 | |3;mootools.html;1477.409036385446;1512.2438780609696;1663.7504374343855;1752.0538908989147;1788.651213013462;7234.385077268438;7968.282854543105;8492.617832197551;9066.546672666365;9085.454872707642;8695.043545210037;8907.955460222705;8912.197902188802;8994.460332380062;8999;2279.350385140231;2324.3143272734583;2324.6280595104786;2325.139698311627;2326.4765427778784;2238.418011317061;2287.1194590082773;2326.8371214015024;2327.394877331889;2328.0105954969154;2230.275160572812;2241.9775802241934;2256.548690261954;2282.9086836526517;2286.8513546619415;2175.423512769117;2178.4662757624483;2186.0272178880405;2190.288156349193;2215.4682876109778;2200.7139071920546;2226.821854251656;2246.5057687308768;2250.032486031006;2255.4474153832252;8927.732168034969;8976.147266009719;8980.550972451416;9006.684766033157;9012.909870901272;5031.949680503185;5117.897642047138;5136.409312929024;5154.871128221787;5162.22566615007;3099.9070027898974;3127.9218019549694;3197;3262.526933594639;3294;1081.7241603391085;1084.8860869608657;1102.5314241447434;1106.435717783936;1124.3984468309416;12326.075544334211;12332;12392.752144957141;12482.937585312015;12495.93752031234;4283.400323954649;4311.547287534827;4459.152760975404;4479.55204479556;4556;10462.895371046345;10473.581056757797;10478.318909270873;10501.47492625381;10523.158147348347;5053.8736531587;5088.898222035538;5091.9236211456855;5094.694318340911;5094.872628184251;3929.724919255682;4595.356650068993;4676.812927482931;4695.765211739399;4715.363425937523;3640.4539319102346;3831.7892515911894;3897.0841852164717;3935.5670876203594;3989.940150897739;1194.767020431025;1212.8969037631723;1216.2763155922212;1246.812978053281;1247.5945317771761;882.3735148044832;942.6229508196639;970.7476056225291;1000.1348833259324;1021.2646894236138;5810.157527158538;5931.762729490858;5962.25471816023;5984.970075149597;6022.819315420545;428.0625430307616;437.64550713921824;440.26475785438396;441.58932193060764;443.255331043843;3996.660283875903;4029.49631296088;4043.636072753466;4051.736637118578;4074.7555146691293;9708.514574271258;10214.182865370753;10220.335678180894;10258.230632702576;10266.538005789758;10119.342242754197;10172.745681358025;10188.541515631814;10201.744956376002;10219.540120694437;7804.102528209329;7874.330681891989;7884.369250459949;7896.289333959971;7907.644156012993;5499.890002199853;5503.587230957614;5553.583481239004;5588.273524441796;5683.914741278967;9285.350025498421;9381.296402769956;9428.858567121635;9437.858432123387;9533.952330238304;9250.814983700422;9480.857787133336;9510.47692376926;9747.171490423394;9758.609655613696;6749.966250168718;7428.145763237297;7572.4699271050495;7584.12782529994;7753.4960227585025;8328.500869843487;8405;8452.450590711584;8456.534890580831;8492.278156356531;7119.822004449723;7296.379807716404;7301.561906285639;7356.154042285206;7393.704251830081;7126.857462850818;7243.963780181065;7282;7408.666610002455;7413.740519082022;7171.748988785367;7225.24134965821;7296.635168241461;7309.488335816442;7326.7435639754485;5361.731913404392;5429.077056900415;5442.401335853132;5575.553955683617;5686.317641883001;5447.96488667152;5551.028570000153;5551.25058117149;5603.243562119062;5643.915341269802 11:56:00 INFO - PROCESS | 13146 | |4;prototype.html;294.5875773916518;313.34979916672904;313.49840255591045;315.20725375680183;316.8289123873109;5462;5537.501624853762;5620.8313750587495;5696.601237913348;5774.451427114428;5532.170174473831;5564.33228012638;5582;5592.86017849554;5602.7758889644365;4290.227759003378;4310.331898555729;4331.891702707426;4340.631046361063;4365.454318210223;4027.496562929634;4238.5588899774075;4263.765492897889;4376.606105450509;4399.228486053782;4205.465005273084;4209.663226941852;4214.431051808013;4214.873553793391;4221.197972385237;4192.161567686459;4229.281022226229;4240.236757383655;4257;4266.296061149907;3554.111472131967;3661.7802931824176;3677.889663310105;3678.282734866702;3683.465897444882;5404.703001224464;5422.511973922326;5438.483344082306;5480.808171713971;5544.86137846553;4921.876953076166;4951.613548206508;4959.553640172366;4965.577925876305;4967.329410529568;5577.581681373873;5785.27684039495;5787.971060144714;5814.883702325972;5818;4128.731632443882;4135.400366946776;4146.357314616239;4182.330827067654;4191.3293872980485;6025.849353766147;6061.818145455643;6086;6106.786262480792;6114.877702445926;4049.6760259179196;4092.5293591237387;4125.133721918431;4127.607877251657;4155.688323375759;4180.163967206571;4181.644560212355;4181.91636167281;4190.706650534434;4202.117555313418;4868.853934381974;4890.608751299887;4897.436794768647;4902.852914412573;4925.014997000542;5604.618037334117;5885.882282354329;5931.940680593225;5959.404059594006;5973.223480947536;1481.4370539195252;1490.9105453672814;1493.8506149384975;1498.992505037468;1504.308018311589;909.5952301226023;928.5960607135918;934.1224139479694;935.9672411465702;961.6730311694058;5015.548600625962;5098.719570423588;5134.2800161945415;5135.589152867761;5160.92258616121;5318.867028324323;5321.255024296602;5442.510174084351;5472.261244731911;5485.890282194414;5034.6085609336005;5073.173657483303;5103.260027296022;5356.91964620531;5791.81450202387;3212.3254116635303;3224.5324427957817;3235.3044095519576;3240.8703651854134;3273.5744353234404;6037.3362888342535;6278.905816412757;6279.874402512016;6295.307516173218;6360.840978975562;6134.693265336805;6174.969125154345;6193.566450348432;6201.503879689614;6208.255009398811;6221.782237621752;6230.816144932448;6267.780627678009;6271.78048768291;6272.968635156795;5844.6785426801935;5982.880342393215;6029.487493563096;6052.394760523913;6091.847703807441;5985.700714964148;5990.430909063632;6007.579469437097;6013.955255213248;6037.9735444973585;6001.849953751016;6194.876102477835;6273.215848018997;6284.057391391328;6312.968435157794;4043.696722745747;4188.434561334181;4199.454070970754;4208.242516346964;4226.6618670506905;6117.990531562243;6127.84680382994;6131.264248290234;6134.202553668173;6152.692365381802;5801.883962320646;5854.063349864001;5963.4334738199805;5980.3421623622235;5995.16067750524;5866.882662346815;5884.146798714248;5885.764569417175;5889.440503152194;5895.9115613266695;5821.27234095738;5833.970830145822;5834.18321434991;5857.297124345106;5860.648361098348;5713.971430142823;5970.850728731816;5977.850553736192;5978.133170690313;6000.339962604023;5849.853753656193;5879.676617786063;5888.381719919518;5906.430702644363;5924.022536281465 11:56:00 INFO - PROCESS | 13146 | |5;yui.html;754.7848863074025;760.2093822424679;778.1207235823522;793.7499687598406;851.8424091543061;14675.119492830425;15293.617659558517;15337.07977521348;15348.6930261395;15394.461193858204;13259.138156019875;13358.064935454522;13368.799468007963;13369.933150334258;13393.665158371046;658.2101478226124;777.1529033353644;793.9364850811921;801.0547553886412;805.87508936115;790.3756032734133;800.3797057280595;805.4402190477621;806.9314108300802;807.2452257139594;843.8227972125861;853.2448782827212;854.8674955381925;857.9828403431927;859.0807835615893;844.0883845446903;844.1558441558411;848.5926755157498;850.1540966738104;850.7277671145235;628.4124343738619;628.7107930352043;629.5215636116538;629.6662768732579;631.0565704272143;13096.214227146307;13111.213327200303;13204;13235.801462978063;13246.933765331209;15323.846761532353;15353.232338383035;15370.154641494713;15375.615609609737;15490.690186196325;11780.352080635561;11853.822192667118;12035.879641203563;12065.457054432572;12607.432665530074;3833.5591406988274;3925.1757131002523;3997.920041599181;4093.97953010236;4095.508538975312;75547.62226188889;77085.22914770836;77296;77841.22158778396;78573;11674.824877626843;11803.40982950849;11873.881261187451;11947.283163010246;11978;22617.547649046926;22853.88573057124;22889.08443662235;22889.427764305692;22926.082956681545;8280.130586288473;8300.916990830136;8571.914280857236;8579.871301930476;8777.078406767325;4559.156556037144;4692.55583249509;4727.64542659302;4832.106060378771;4866.489018653061;3178.5867837181017;3278.131295206772;3278.950815737766;3287.506873968876;3290.226796702773;584.611233529698;588.2176704982363;591.5385998920849;599.8560345517044;604.9758009679651;755.7354925776044;787.4094429178116;788.2629741192004;795.2524626850858;813.385893650302;9598.376105553116;9825.852612210823;10043.19654427644;10065.748356291006;10558.04977552024;756.9924300757032;772.1969152081772;777.8949841771401;785.4501848705929;800.9879851802227;4684.484706682262;5123.154679477844;5125.794968201305;5203.9219411708855;5212.113940630026;109993.45003275093;112423;112477;112709.43645281722;116506.41746791212;100509;102275.4886225579;105030.47484762527;107426;108069;86210.56894715487;86338;87681.56159219163;89531.55234223788;89632;9531.142197202285;9708.75728106803;9783.46190959504;9806.85289720669;9817;53343.73328133334;54042.729786350814;54443.45556544384;55264.44735552593;56209.71895140498;76259;77178;79855;79996;82508;12560.74878502443;12820.61538153857;12865.421056052688;12868.099233053596;12916.935415322863;12957.093003489665;13104.672383190496;14044.157350558999;14434.855651443771;14447.855521445072;12683.492660293485;12767.553135640208;12788.424520896397;13088.087340246639;13096.476140954255;13231.66920826987;13360.657786219323;13426.86671493099;13465.192088474723;13471.932640336736;12668.556600518938;13015.284159370947;13115;13480.460781568627;13487.190768553919;9342.579583918605;9549.09283618055;9552.331336806357;9702.466364350028;9867.000453804134;9803.264755143251;10053.346532475365;10436.947815260875;10440.269181157246;10462.790744184922 11:56:00 INFO - PROCESS | 13146 | __end_tp_report 11:56:00 INFO - PROCESS | 13146 | __start_cc_report 11:56:00 INFO - PROCESS | 13146 | _x_x_mozilla_cycle_collect,372 11:56:00 INFO - PROCESS | 13146 | __end_cc_report 11:56:00 INFO - PROCESS | 13146 | __startTimestamp1469040960774__endTimestamp 11:56:00 INFO - PROCESS | 13146 | 11:56:00 INFO - PROCESS | 13146 | ------- Summary: start ------- 11:56:00 INFO - PROCESS | 13146 | Number of tests: 6 11:56:00 INFO - PROCESS | 13146 | 11:56:00 INFO - PROCESS | 13146 | [#0] dojo.html Cycles:165 Average:5427.44 Median:5644.29 stddev:622.74 (11.0%) stddev-sans-first:596.92 11:56:00 INFO - PROCESS | 13146 | Values: 3084.9 3085.4 3099.3 3110.8 3119.0 5412.9 5472.8 5501.2 5503.7 5524.6 5317.1 5359.5 5383.2 5425.2 5433.9 4961.0 4978.0 5008.0 5023.2 5083.2 4906.1 5080.6 5113.5 5125.9 5140.7 4880.2 4944.6 4960.1 5008.5 5010.9 4994.6 4997.5 4999.6 5000.9 5027.0 4935.5 4950.6 4992.7 4993.1 5022.2 5406.8 5417.1 5443.0 5488.2 5556.6 5862.7 5867.1 5868.2 5877.1 5878.3 5894.4 5896.1 5903.9 5929.1 5929.9 5337.3 5386.4 5398.4 5399.9 5455.2 5934.9 5937.1 5938.1 5942.2 5960.4 5698.8 5703.9 5722.9 5730.6 5738.0 5622.8 5659.2 5692.9 5711.9 5753.2 5600.3 5644.3 5669.6 5711.2 5814.9 5725.7 5769.0 5776.8 5800.4 5807.6 4311.7 4416.6 4420.1 4439.0 4482.4 3932.0 3947.4 3965.2 3982.5 4012.1 5482.2 5618.0 5647.5 5658.3 5696.6 5675.6 5873.4 5913.2 5929.9 5936.0 5520.9 5568.4 5587.3 5617.6 5641.0 4992.2 5037.8 5066.9 5069.7 5077.7 5835.5 6034.5 6059.2 6067.4 6069.0 5819.1 5857.8 5859.2 5966.8 5972.6 6091.4 6096.4 6098.6 6112.0 6132.7 5781.6 5821.5 5833.0 5834.4 5854.7 5684.0 5797.9 5820.0 5838.2 5925.4 5743.5 5768.6 5779.5 5788.5 5793.3 5705.0 5713.8 5714.5 5717.7 5742.8 5486.9 5589.8 5636.0 5650.1 5747.6 5745.0 5752.8 5787.7 5788.9 5792.2 5596.7 5608.8 5610.2 5612.8 5638.5 11:56:00 INFO - PROCESS | 13146 | 11:56:00 INFO - PROCESS | 13146 | [#1] ext.html Cycles:180 Average:62812.50 Median:4263.14 stddev:130645.42 (3064.5%) stddev-sans-first:130928.29 11:56:00 INFO - PROCESS | 13146 | Values: 555.2 591.2 596.9 606.3 636.7 40118.2 44264.0 44382.3 44411.3 44460.3 43947.8 44394.1 44888.8 44941.0 45106.0 8824.6 8974.5 9026.4 9029.5 9031.9 8838.3 8918.9 8952.3 8953.4 8954.5 8965.2 9004.4 9011.0 9012.8 9027.2 8904.1 8910.9 8936.4 8936.5 8977.4 8886.9 8893.6 8895.1 8954.1 8957.9 42524.4 42863.1 42930.8 42977.6 42989.8 3771.2 3818.1 3835.2 4012.3 4338.1 33393.0 33933.7 34012.0 34149.5 34950.8 4154.2 4251.4 4255.7 4270.5 4273.0 351850.0 355349.0 356004.0 356587.0 356965.2 31078.2 31858.5 60258.1 60278.7 60410.0 37365.0 37632.8 37638.3 37648.6 37848.4 15243.8 15292.8 15371.8 15388.8 15390.4 12464.8 12491.8 12505.9 12513.6 12516.3 8299.4 8389.7 8401.9 8427.2 8495.9 3203.5 3216.8 3244.4 3261.5 3271.1 994.4 1073.4 1137.5 1182.8 1183.3 33745.8 33989.7 34117.3 34190.1 34387.5 1055.0 1080.2 1103.5 1140.4 1211.5 16510.1 17416.1 17423.8 17461.4 17479.5 581666.0 589052.0 592535.0 592966.0 595540.0 60002.1 60150.4 60786.0 60791.7 60808.0 1309.3 1343.8 1368.6 1373.5 1377.0 31041.0 31711.7 31886.4 32407.2 32673.0 52125.5 52382.2 52713.5 52829.2 52837.5 492891.0 496813.0 496831.0 496960.0 497852.0 25141.2 25423.2 25483.9 25554.5 25770.5 49542.5 51225.7 51271.2 51332.5 51537.5 41241.6 41934.4 43471.0 43972.8 46184.5 44241.3 44540.6 45210.3 45267.3 46046.0 35823.8 41326.6 41421.8 41683.8 43456.1 37741.8 39711.4 40095.8 40121.8 40400.8 29156.4 29394.8 29541.0 29579.9 29949.9 11:56:00 INFO - PROCESS | 13146 | 11:56:00 INFO - PROCESS | 13146 | [#2] jquery.html Cycles:180 Average:28594.73 Median:364.48 stddev:80733.12 (22150.3%) stddev-sans-first:80931.73 11:56:00 INFO - PROCESS | 13146 | Values: 342.9 362.5 366.5 371.7 379.8 17905.6 17968.5 18931.9 18968.0 19310.7 17931.9 18260.5 18296.1 18323.3 18714.5 5476.6 5621.7 5623.0 5645.1 5649.8 5474.8 5484.9 5486.1 5505.8 5575.0 5583.1 5600.8 5605.5 5610.0 5627.3 5537.4 5551.0 5564.7 5597.1 5620.4 4901.7 4902.5 4917.9 4933.6 4948.4 20765.8 21714.5 22007.9 22091.8 22434.6 2140.5 2319.3 2371.2 2667.8 2754.0 9419.0 9883.5 10018.3 11984.4 13606.0 1883.9 1884.2 1942.3 1982.2 1994.5 77467.6 77836.0 78392.2 79124.2 81043.6 10186.7 10269.9 10342.4 10408.6 10709.9 13887.3 14113.8 14155.3 14235.5 14323.8 7548.7 7734.1 7937.0 8037.5 8056.2 7685.5 7708.2 7750.3 7936.3 7953.7 4294.8 4394.2 4410.8 4485.6 4534.0 1774.2 1788.9 1790.7 1824.4 1831.5 918.7 926.4 959.5 980.2 1039.9 17448.7 18988.1 18999.2 19065.7 19115.9 883.7 951.2 959.5 968.4 995.6 10283.5 10484.9 10542.3 10647.8 10648.6 482718.0 485736.0 491794.0 495028.0 495419.0 87587.6 88542.0 89638.0 89685.6 90021.5 971.1 984.5 999.4 1011.3 1011.8 15649.5 16095.9 16682.9 17080.8 17285.8 38890.6 40116.6 40654.0 41228.2 41789.2 55537.0 56369.7 56741.7 57018.4 57845.7 7668.7 7722.5 7859.3 7946.7 8059.2 10497.5 12955.4 13034.5 13325.9 13604.7 11191.2 11299.7 11320.4 11411.7 11586.7 11289.0 11311.4 11469.2 11561.5 11807.2 11199.3 11551.2 11585.0 11694.9 11839.8 7926.9 8142.3 11740.2 11935.6 12581.5 11285.5 11922.0 11968.5 11988.5 12508.5 11:56:00 INFO - PROCESS | 13146 | 11:56:00 INFO - PROCESS | 13146 | [#3] mootools.html Cycles:180 Average:5651.92 Median:4873.66 stddev:3219.75 (66.1%) stddev-sans-first:3213.50 11:56:00 INFO - PROCESS | 13146 | Values: 1477.4 1512.2 1663.8 1752.1 1788.7 7234.4 7968.3 8492.6 9066.5 9085.5 8695.0 8908.0 8912.2 8994.5 8999.0 2279.4 2324.3 2324.6 2325.1 2326.5 2238.4 2287.1 2326.8 2327.4 2328.0 2230.3 2242.0 2256.5 2282.9 2286.9 2175.4 2178.5 2186.0 2190.3 2215.5 2200.7 2226.8 2246.5 2250.0 2255.4 8927.7 8976.1 8980.6 9006.7 9012.9 5031.9 5117.9 5136.4 5154.9 5162.2 3099.9 3127.9 3197.0 3262.5 3294.0 1081.7 1084.9 1102.5 1106.4 1124.4 12326.1 12332.0 12392.8 12482.9 12495.9 4283.4 4311.5 4459.2 4479.6 4556.0 10462.9 10473.6 10478.3 10501.5 10523.2 5053.9 5088.9 5091.9 5094.7 5094.9 3929.7 4595.4 4676.8 4695.8 4715.4 3640.5 3831.8 3897.1 3935.6 3989.9 1194.8 1212.9 1216.3 1246.8 1247.6 882.4 942.6 970.7 1000.1 1021.3 5810.2 5931.8 5962.3 5985.0 6022.8 428.1 437.6 440.3 441.6 443.3 3996.7 4029.5 4043.6 4051.7 4074.8 9708.5 10214.2 10220.3 10258.2 10266.5 10119.3 10172.7 10188.5 10201.7 10219.5 7804.1 7874.3 7884.4 7896.3 7907.6 5499.9 5503.6 5553.6 5588.3 5683.9 9285.4 9381.3 9428.9 9437.9 9534.0 9250.8 9480.9 9510.5 9747.2 9758.6 6750.0 7428.1 7572.5 7584.1 7753.5 8328.5 8405.0 8452.5 8456.5 8492.3 7119.8 7296.4 7301.6 7356.2 7393.7 7126.9 7244.0 7282.0 7408.7 7413.7 7171.7 7225.2 7296.6 7309.5 7326.7 5361.7 5429.1 5442.4 5575.6 5686.3 5448.0 5551.0 5551.3 5603.2 5643.9 11:56:00 INFO - PROCESS | 13146 | 11:56:00 INFO - PROCESS | 13146 | [#4] prototype.html Cycles:180 Average:4883.15 Median:5541.18 stddev:1471.17 (26.5%) stddev-sans-first:1434.41 11:56:00 INFO - PROCESS | 13146 | Values: 294.6 313.3 313.5 315.2 316.8 5462.0 5537.5 5620.8 5696.6 5774.5 5532.2 5564.3 5582.0 5592.9 5602.8 4290.2 4310.3 4331.9 4340.6 4365.5 4027.5 4238.6 4263.8 4376.6 4399.2 4205.5 4209.7 4214.4 4214.9 4221.2 4192.2 4229.3 4240.2 4257.0 4266.3 3554.1 3661.8 3677.9 3678.3 3683.5 5404.7 5422.5 5438.5 5480.8 5544.9 4921.9 4951.6 4959.6 4965.6 4967.3 5577.6 5785.3 5788.0 5814.9 5818.0 4128.7 4135.4 4146.4 4182.3 4191.3 6025.8 6061.8 6086.0 6106.8 6114.9 4049.7 4092.5 4125.1 4127.6 4155.7 4180.2 4181.6 4181.9 4190.7 4202.1 4868.9 4890.6 4897.4 4902.9 4925.0 5604.6 5885.9 5931.9 5959.4 5973.2 1481.4 1490.9 1493.9 1499.0 1504.3 909.6 928.6 934.1 936.0 961.7 5015.5 5098.7 5134.3 5135.6 5160.9 5318.9 5321.3 5442.5 5472.3 5485.9 5034.6 5073.2 5103.3 5356.9 5791.8 3212.3 3224.5 3235.3 3240.9 3273.6 6037.3 6278.9 6279.9 6295.3 6360.8 6134.7 6175.0 6193.6 6201.5 6208.3 6221.8 6230.8 6267.8 6271.8 6273.0 5844.7 5982.9 6029.5 6052.4 6091.8 5985.7 5990.4 6007.6 6014.0 6038.0 6001.8 6194.9 6273.2 6284.1 6313.0 4043.7 4188.4 4199.5 4208.2 4226.7 6118.0 6127.8 6131.3 6134.2 6152.7 5801.9 5854.1 5963.4 5980.3 5995.2 5866.9 5884.1 5885.8 5889.4 5895.9 5821.3 5834.0 5834.2 5857.3 5860.6 5714.0 5970.9 5977.9 5978.1 6000.3 5849.9 5879.7 5888.4 5906.4 5924.0 11:56:00 INFO - PROCESS | 13146 | 11:56:00 INFO - PROCESS | 13146 | [#5] yui.html Cycles:180 Average:21065.63 Median:4779.88 stddev:30691.40 (642.1%) stddev-sans-first:30739.61 11:56:00 INFO - PROCESS | 13146 | Values: 754.8 760.2 778.1 793.7 851.8 14675.1 15293.6 15337.1 15348.7 15394.5 13259.1 13358.1 13368.8 13369.9 13393.7 658.2 777.2 793.9 801.1 805.9 790.4 800.4 805.4 806.9 807.2 843.8 853.2 854.9 858.0 859.1 844.1 844.2 848.6 850.2 850.7 628.4 628.7 629.5 629.7 631.1 13096.2 13111.2 13204.0 13235.8 13246.9 15323.8 15353.2 15370.2 15375.6 15490.7 11780.4 11853.8 12035.9 12065.5 12607.4 3833.6 3925.2 3997.9 4094.0 4095.5 75547.6 77085.2 77296.0 77841.2 78573.0 11674.8 11803.4 11873.9 11947.3 11978.0 22617.5 22853.9 22889.1 22889.4 22926.1 8280.1 8300.9 8571.9 8579.9 8777.1 4559.2 4692.6 4727.6 4832.1 4866.5 3178.6 3278.1 3279.0 3287.5 3290.2 584.6 588.2 591.5 599.9 605.0 755.7 787.4 788.3 795.3 813.4 9598.4 9825.9 10043.2 10065.7 10558.0 757.0 772.2 777.9 785.5 801.0 4684.5 5123.2 5125.8 5203.9 5212.1 109993.5 112423.0 112477.0 112709.4 116506.4 100509.0 102275.5 105030.5 107426.0 108069.0 86210.6 86338.0 87681.6 89531.6 89632.0 9531.1 9708.8 9783.5 9806.9 9817.0 53343.7 54042.7 54443.5 55264.4 56209.7 76259.0 77178.0 79855.0 79996.0 82508.0 12560.7 12820.6 12865.4 12868.1 12916.9 12957.1 13104.7 14044.2 14434.9 14447.9 12683.5 12767.6 12788.4 13088.1 13096.5 13231.7 13360.7 13426.9 13465.2 13471.9 12668.6 13015.3 13115.0 13480.5 13487.2 9342.6 9549.1 9552.3 9702.5 9867.0 9803.3 10053.3 10436.9 10440.3 10462.8 11:56:00 INFO - PROCESS | 13146 | -------- Summary: end -------- 11:56:00 INFO - PROCESS | 13146 | 11:56:01 INFO - TEST-INFO | 13146: exit 0 11:56:01 INFO - TEST-OK | dromaeo_css | took 1112395ms 11:56:01 INFO - TEST-START | kraken 11:56:01 INFO - operating with platform_type : linux_ 11:56:01 INFO - Initialising browser for kraken test... 11:56:01 INFO - TEST-INFO | started process 13389 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpGrp4Gn/profile http://localhost:41443/getInfo.html) 11:56:06 INFO - PROCESS | 13389 | __metrics Screen width/height:1600/1200 11:56:06 INFO - PROCESS | 13389 | colorDepth:24 11:56:06 INFO - PROCESS | 13389 | Browser inner width/height: 1024/697 11:56:06 INFO - PROCESS | 13389 | __metrics 11:56:06 ERROR - PROCESS | 13389 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2967: TypeError: this.tabs is undefined 11:56:07 INFO - TEST-INFO | 13389: exit 0 11:56:07 INFO - Browser initialized. 11:56:07 INFO - Running cycle 1/1 for kraken test... 11:56:07 INFO - TEST-INFO | started process 13512 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpGrp4Gn/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:56:19 INFO - PROCESS | 13512 | RSS: Main: 167530496 11:56:19 INFO - PROCESS | 13512 | 11:56:22 INFO - PROCESS | 13512 | Cycle 1(1): loaded http://localhost:41443/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41443/tests/kraken/driver.html?testName=audio-beat-detection) 11:56:22 INFO - PROCESS | 13512 | RSS: Main: 173096960 11:56:22 INFO - PROCESS | 13512 | 11:56:25 INFO - PROCESS | 13512 | Cycle 1(1): loaded http://localhost:41443/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41443/tests/kraken/driver.html?testName=audio-dft) 11:56:26 INFO - PROCESS | 13512 | RSS: Main: 171991040 11:56:26 INFO - PROCESS | 13512 | 11:56:29 INFO - PROCESS | 13512 | Cycle 1(1): loaded http://localhost:41443/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41443/tests/kraken/driver.html?testName=audio-fft) 11:56:29 INFO - PROCESS | 13512 | RSS: Main: 168574976 11:56:29 INFO - PROCESS | 13512 | 11:56:31 INFO - PROCESS | 13512 | Cycle 1(1): loaded http://localhost:41443/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41443/tests/kraken/driver.html?testName=audio-oscillator) 11:56:32 INFO - PROCESS | 13512 | RSS: Main: 169091072 11:56:32 INFO - PROCESS | 13512 | 11:56:34 INFO - PROCESS | 13512 | Cycle 1(1): loaded http://localhost:41443/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41443/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:56:35 INFO - PROCESS | 13512 | RSS: Main: 169517056 11:56:35 INFO - PROCESS | 13512 | 11:56:38 INFO - PROCESS | 13512 | Cycle 1(1): loaded http://localhost:41443/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41443/tests/kraken/driver.html?testName=imaging-darkroom) 11:56:39 INFO - PROCESS | 13512 | RSS: Main: 169943040 11:56:39 INFO - PROCESS | 13512 | 11:56:42 INFO - PROCESS | 13512 | Cycle 1(1): loaded http://localhost:41443/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41443/tests/kraken/driver.html?testName=imaging-desaturate) 11:56:43 INFO - PROCESS | 13512 | RSS: Main: 166977536 11:56:43 INFO - PROCESS | 13512 | 11:56:46 INFO - PROCESS | 13512 | Cycle 1(1): loaded http://localhost:41443/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41443/tests/kraken/driver.html?testName=json-parse-financial) 11:56:46 INFO - PROCESS | 13512 | RSS: Main: 168656896 11:56:46 INFO - PROCESS | 13512 | 11:56:48 INFO - PROCESS | 13512 | Cycle 1(1): loaded http://localhost:41443/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41443/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:56:48 INFO - PROCESS | 13512 | RSS: Main: 168648704 11:56:48 INFO - PROCESS | 13512 | 11:56:50 INFO - PROCESS | 13512 | Cycle 1(1): loaded http://localhost:41443/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41443/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:56:51 INFO - PROCESS | 13512 | RSS: Main: 169332736 11:56:51 INFO - PROCESS | 13512 | 11:56:53 INFO - PROCESS | 13512 | Cycle 1(1): loaded http://localhost:41443/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41443/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:56:54 INFO - PROCESS | 13512 | RSS: Main: 169648128 11:56:54 INFO - PROCESS | 13512 | 11:56:56 INFO - PROCESS | 13512 | Cycle 1(1): loaded http://localhost:41443/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41443/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:56:57 INFO - PROCESS | 13512 | RSS: Main: 169795584 11:56:57 INFO - PROCESS | 13512 | 11:57:00 INFO - PROCESS | 13512 | Cycle 1(1): loaded http://localhost:41443/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41443/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:57:00 INFO - PROCESS | 13512 | RSS: Main: 169582592 11:57:00 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | Cycle 1(1): loaded http://localhost:41443/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41443/tests/kraken/driver.html?testName=ai-astar) 11:57:02 INFO - PROCESS | 13512 | RSS: Main: 170438656 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | __start_tp_report 11:57:02 INFO - PROCESS | 13512 | _x_x_mozilla_page_load 11:57:02 INFO - PROCESS | 13512 | _x_x_mozilla_page_load_details 11:57:02 INFO - PROCESS | 13512 | |i|pagename|runs| 11:57:02 INFO - PROCESS | 13512 | |0;ai-astar;103;113;107;113;112;114;114;123;112;112 11:57:02 INFO - PROCESS | 13512 | |1;audio-beat-detection;149;116;146;177;117;142;146;122;179;118 11:57:02 INFO - PROCESS | 13512 | |2;audio-dft;164;163;163;162;164;173;167;163;162;163 11:57:02 INFO - PROCESS | 13512 | |3;audio-fft;75;75;75;164;77;75;76;84;176;77 11:57:02 INFO - PROCESS | 13512 | |4;audio-oscillator;84;83;145;84;83;84;145;84;85;155 11:57:02 INFO - PROCESS | 13512 | |5;imaging-gaussian-blur;119;118;117;118;117;117;117;117;118;118 11:57:02 INFO - PROCESS | 13512 | |6;imaging-darkroom;147;148;147;147;149;148;147;147;147;147 11:57:02 INFO - PROCESS | 13512 | |7;imaging-desaturate;96;99;95;95;95;96;96;96;96;96 11:57:02 INFO - PROCESS | 13512 | |8;json-parse-financial;54;52;52;53;52;53;52;51;52;51 11:57:02 INFO - PROCESS | 13512 | |9;json-stringify-tinderbox;63;62;62;62;64;63;62;64;63;64 11:57:02 INFO - PROCESS | 13512 | |10;stanford-crypto-aes;76;76;74;81;82;77;80;75;80;75 11:57:02 INFO - PROCESS | 13512 | |11;stanford-crypto-ccm;122;134;126;124;122;131;127;137;166;122 11:57:02 INFO - PROCESS | 13512 | |12;stanford-crypto-pbkdf2;162;159;164;161;157;156;157;162;161;154 11:57:02 INFO - PROCESS | 13512 | |13;stanford-crypto-sha256-iterative;65;66;63;64;63;64;64;63;69;62 11:57:02 INFO - PROCESS | 13512 | __end_tp_report 11:57:02 INFO - PROCESS | 13512 | __start_cc_report 11:57:02 INFO - PROCESS | 13512 | _x_x_mozilla_cycle_collect,920 11:57:02 INFO - PROCESS | 13512 | __end_cc_report 11:57:02 INFO - PROCESS | 13512 | __startTimestamp1469041022615__endTimestamp 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | ------- Summary: start ------- 11:57:02 INFO - PROCESS | 13512 | Number of tests: 14 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | [#0] ai-astar Cycles:10 Average:112.30 Median:113.00 stddev:5.12 (4.5%) stddev-sans-first:4.18 11:57:02 INFO - PROCESS | 13512 | Values: 103.0 113.0 107.0 113.0 112.0 114.0 114.0 123.0 112.0 112.0 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | [#1] audio-beat-detection Cycles:10 Average:141.20 Median:146.00 stddev:23.44 (16.1%) stddev-sans-first:24.69 11:57:02 INFO - PROCESS | 13512 | Values: 149.0 116.0 146.0 177.0 117.0 142.0 146.0 122.0 179.0 118.0 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | [#2] audio-dft Cycles:10 Average:164.40 Median:163.50 stddev:3.34 (2.0%) stddev-sans-first:3.54 11:57:02 INFO - PROCESS | 13512 | Values: 164.0 163.0 163.0 162.0 164.0 173.0 167.0 163.0 162.0 163.0 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | [#3] audio-fft Cycles:10 Average:95.40 Median:75.50 stddev:39.51 (52.3%) stddev-sans-first:41.21 11:57:02 INFO - PROCESS | 13512 | Values: 75.0 75.0 75.0 164.0 77.0 75.0 76.0 84.0 176.0 77.0 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | [#4] audio-oscillator Cycles:10 Average:103.20 Median:84.00 stddev:31.27 (37.2%) stddev-sans-first:32.38 11:57:02 INFO - PROCESS | 13512 | Values: 84.0 83.0 145.0 84.0 83.0 84.0 145.0 84.0 85.0 155.0 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | [#5] imaging-gaussian-blur Cycles:10 Average:117.60 Median:118.00 stddev:0.70 (0.6%) stddev-sans-first:0.53 11:57:02 INFO - PROCESS | 13512 | Values: 119.0 118.0 117.0 118.0 117.0 117.0 117.0 117.0 118.0 118.0 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | [#6] imaging-darkroom Cycles:10 Average:147.40 Median:147.00 stddev:0.70 (0.5%) stddev-sans-first:0.73 11:57:02 INFO - PROCESS | 13512 | Values: 147.0 148.0 147.0 147.0 149.0 148.0 147.0 147.0 147.0 147.0 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | [#7] imaging-desaturate Cycles:10 Average:96.00 Median:96.00 stddev:1.15 (1.2%) stddev-sans-first:1.22 11:57:02 INFO - PROCESS | 13512 | Values: 96.0 99.0 95.0 95.0 95.0 96.0 96.0 96.0 96.0 96.0 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | [#8] json-parse-financial Cycles:10 Average:52.20 Median:52.00 stddev:0.92 (1.8%) stddev-sans-first:0.71 11:57:02 INFO - PROCESS | 13512 | Values: 54.0 52.0 52.0 53.0 52.0 53.0 52.0 51.0 52.0 51.0 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | [#9] json-stringify-tinderbox Cycles:10 Average:62.90 Median:63.00 stddev:0.88 (1.4%) stddev-sans-first:0.93 11:57:02 INFO - PROCESS | 13512 | Values: 63.0 62.0 62.0 62.0 64.0 63.0 62.0 64.0 63.0 64.0 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | [#10] stanford-crypto-aes Cycles:10 Average:77.60 Median:78.50 stddev:2.88 (3.7%) stddev-sans-first:2.99 11:57:02 INFO - PROCESS | 13512 | Values: 76.0 76.0 74.0 81.0 82.0 77.0 80.0 75.0 80.0 75.0 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | [#11] stanford-crypto-ccm Cycles:10 Average:131.10 Median:129.00 stddev:13.35 (10.3%) stddev-sans-first:13.74 11:57:02 INFO - PROCESS | 13512 | Values: 122.0 134.0 126.0 124.0 122.0 131.0 127.0 137.0 166.0 122.0 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:159.30 Median:161.00 stddev:3.20 (2.0%) stddev-sans-first:3.24 11:57:02 INFO - PROCESS | 13512 | Values: 162.0 159.0 164.0 161.0 157.0 156.0 157.0 162.0 161.0 154.0 11:57:02 INFO - PROCESS | 13512 | 11:57:02 INFO - PROCESS | 13512 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.30 Median:64.00 stddev:2.00 (3.1%) stddev-sans-first:2.11 11:57:02 INFO - PROCESS | 13512 | Values: 65.0 66.0 63.0 64.0 63.0 64.0 64.0 63.0 69.0 62.0 11:57:02 INFO - PROCESS | 13512 | -------- Summary: end -------- 11:57:02 INFO - PROCESS | 13512 | 11:57:03 INFO - TEST-INFO | 13512: exit 0 11:57:03 INFO - TEST-OK | kraken | took 62035ms 11:57:03 INFO - SUITE-END | took 1174s 11:57:03 INFO - Completed test suite (00:19:34) 11:57:03 INFO - javascript benchmark 11:57:03 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7190.365948508762, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3084.9228769280758, 3085.398347322273, 3099.3336432666974, 3110.8133511989267, 3119.0330997390824, 5412.864678383043, 5472.808451704186, 5501.229827824103, 5503.724813759316, 5524.640898341605, 5317.149256119022, 5359.517643412092, 5383.219433182187, 5425.240466334716, 5433.918491222625, 4961.0, 4977.975110124454, 5008.023435430093, 5023.171176755831, 5083.212102124176, 4906.1414252505665, 5080.618953578478, 5113.539781419671, 5125.871853203663, 5140.7172605506685, 4880.2435622478215, 4944.60443164546, 4960.082384758831, 5008.499150084999, 5010.924836127461, 4994.550490455877, 4997.475265097149, 4999.625028122869, 5000.924986125211, 5027.0, 4935.457099719028, 4950.603951683856, 4992.725400102993, 4993.101241776479, 5022.17134172861, 5406.756695948692, 5417.079096553556, 5443.047466693313, 5488.204210389511, 5556.583256255797, 5862.677552734598, 5867.11993201019, 5868.178455016258, 5877.089051197071, 5878.294604647427, 5894.410558944114, 5896.1450589664255, 5903.911441328383, 5929.110633404981, 5929.940700592982, 5337.332833395825, 5386.407495175527, 5398.379186393576, 5399.946000539983, 5455.1544510600925, 5934.881302374015, 5937.139114828412, 5938.138969849348, 5942.168096466498, 5960.403959604005, 5698.8290351289525, 5703.914441283384, 5722.914156287659, 5730.598858079894, 5738.0, 5622.803201887996, 5659.207710920475, 5692.943070569324, 5711.914321285184, 5753.165790960371, 5600.27196464457, 5644.294463192101, 5669.574781891375, 5711.228984087178, 5814.854628634318, 5725.742341594639, 5768.971155144198, 5776.768929242868, 5800.419958004166, 5807.5644326675665, 4311.676624253194, 4416.624586910084, 4420.093880754438, 4438.955610443919, 4482.439695038121, 3932.036651020518, 3947.3684210526176, 3965.206958608232, 3982.5220973482787, 4012.0772222389014, 5482.150266708666, 5617.9719101404235, 5647.519960803295, 5658.321001479767, 5696.572757043238, 5675.631083979528, 5873.412658734178, 5913.172155898178, 5929.851753706192, 5935.970320148372, 5520.91718624221, 5568.443155684399, 5587.329520457572, 5617.634853734494, 5641.0, 4992.151334273182, 5037.79848806051, 5066.898662026812, 5069.695818250917, 5077.720725360066, 5835.503982161479, 6034.547408944347, 6059.182010428536, 6067.423594758491, 6069.0, 5819.127130930395, 5857.824265272048, 5859.238299021271, 5966.76132954677, 5972.611780234271, 6091.42131497507, 6096.420840020191, 6098.603590766586, 6111.969440152949, 6132.6627035513475, 5781.595288329777, 5821.505172060253, 5833.037548804569, 5834.445727655866, 5854.736536855767, 5684.033714268667, 5797.9420205797405, 5820.0, 5838.1826544282985, 5925.4370834770625, 5743.511801496752, 5768.596198266081, 5779.479846813807, 5788.450097240924, 5793.304803423616, 5705.030144875298, 5713.771449141987, 5714.514266287412, 5717.7141142941855, 5742.7702891883855, 5486.917696234639, 5589.77640894376, 5636.041872881702, 5650.124230744241, 5747.597668163188, 5744.971275143597, 5752.827415177551, 5787.681677507778, 5788.942110578841, 5792.160136780228, 5596.692181930033, 5608.831735047955, 5610.158476228598, 5612.7754889803955, 5638.548916086621], "value": 5384.399657034141, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [555.2082769347384, 591.1694069831885, 596.895543279926, 606.2633899811727, 636.6530241018651, 40118.1976360473, 44263.99999999992, 44382.33426498605, 44411.333829992574, 44460.3330950036, 43947.78026109865, 44394.11211775763, 44888.77555612226, 44941.0, 45106.0, 8824.647014119444, 8974.461532308082, 9026.413283136575, 9029.503377314279, 9031.864522032174, 8838.33712471564, 8918.910810891874, 8952.328575356842, 8953.418027828204, 8954.462732236087, 8965.193132618064, 9004.414713043663, 9011.0, 9012.819743605123, 9027.187553120219, 8904.065073167321, 8910.86633700495, 8936.374453788238, 8936.463812171225, 8977.371583989057, 8886.866696999485, 8893.599788009555, 8895.110488951053, 8954.05982371848, 8957.910420895772, 42524.36213456801, 42863.1427371454, 42930.78534607307, 42977.57022429767, 42989.78505107454, 3771.17034252464, 3818.102745854722, 3835.2137811748526, 4012.297847876639, 4338.089001309729, 33393.0, 33933.660663393544, 34012.0, 34149.48775768365, 34950.825245873864, 4154.210699966997, 4251.426057482231, 4255.74465532066, 4270.530241673413, 4273.0, 351850.0, 355349.0, 356004.0, 356587.0, 356965.21517392504, 31078.22304442362, 31858.522122168186, 60258.09612855811, 60278.69860650756, 60410.0, 37365.0, 37632.81183594119, 37638.306276217634, 37648.62351376506, 37848.43227351592, 15243.771343429857, 15292.847071529364, 15371.846281537266, 15388.769168462482, 15390.384384624713, 12464.756343858193, 12491.750164996649, 12505.874941250471, 12513.624591262276, 12516.311602861748, 8299.419040667217, 8389.706360277361, 8401.873971890427, 8427.241548260687, 8495.872561911576, 3203.4554125798672, 3216.790908590934, 3244.3511297740547, 3261.5107733840114, 3271.0677456924664, 994.4232345239743, 1073.388049214388, 1137.4653912661036, 1182.822576613515, 1183.2900259844025, 33745.83127084349, 33989.66010339915, 34117.31765364679, 34190.14524636904, 34387.4841877372, 1054.9683509494728, 1080.189857606795, 1103.5034234594464, 1140.3955903371227, 1211.4548453196096, 16510.05304735341, 17416.129193540273, 17423.825761742475, 17461.38885139014, 17479.47561573155, 581666.0, 589052.0, 592535.0, 592966.0, 595540.0, 60002.09996850051, 60150.398496015354, 60786.0, 60791.696041520394, 60808.0, 1309.2537253765454, 1343.7715588350004, 1368.62362850215, 1373.4849431463401, 1377.0498356134235, 31041.0, 31711.682883170874, 31886.36227275395, 32407.189820254684, 32673.0, 52125.478745212065, 52382.21426678527, 52713.47286527086, 52829.207561885836, 52837.47162528326, 492891.0, 496813.0, 496831.0, 496960.0, 497852.0, 25141.24576262715, 25423.23730288094, 25483.872580636977, 25554.488910222062, 25770.484590308464, 49542.50457495379, 51225.74387128041, 51271.23093153531, 51332.48667513277, 51537.48462515477, 41241.58758412497, 41934.37098443587, 43471.0, 43972.780136099114, 46184.53815461802, 44241.33637995368, 44540.55459445364, 45210.321845173006, 45267.32099018452, 46046.0, 35823.82088089543, 41326.586734132274, 41421.79289103535, 41683.7915810419, 43456.13087738291, 37741.81129094337, 39711.40432893451, 40095.799521002205, 40121.79939100286, 40400.79799600983, 29156.416871662874, 29394.806940676328, 29541.0, 29579.852100739357, 29949.850250749478], "value": 19325.029349665245, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [342.9331280400323, 362.45269642839315, 366.50338790938275, 371.711923259474, 379.83201654911153, 17905.641887162266, 17968.460946171603, 18931.86408815472, 18968.0, 19310.710339344885, 17931.91034044831, 18260.543486412847, 18296.085195740226, 18323.26706931721, 18714.53213669659, 5476.616636835423, 5621.718914054301, 5623.044082505963, 5645.125005624135, 5649.774009039654, 5474.808381706641, 5484.862878428051, 5486.1222204447295, 5505.807296744615, 5575.0, 5583.106702927533, 5600.8319750407345, 5605.467480589337, 5609.971950140243, 5627.2684551008515, 5537.363203231619, 5550.972245138769, 5564.721763911788, 5597.104463285896, 5620.437956204388, 4901.681390709628, 4902.460729319772, 4917.877053073666, 4933.605311575101, 4948.406191257036, 20765.792342076536, 21714.457138571503, 22007.889960550256, 22091.779082209134, 22434.55130897373, 2140.464883779055, 2319.3158018384615, 2371.1819422299277, 2667.773239274664, 2754.0085569195076, 9419.0, 9883.505824708807, 10018.3488073275, 11984.400779961054, 13606.0, 1883.8587105967108, 1884.1897983866932, 1942.3298961858136, 1982.1773963805003, 1994.4714650617598, 77467.61266193689, 77836.0, 78392.21607783964, 79124.20875791226, 81043.59478202571, 10186.694399168036, 10269.948650256702, 10342.431166285776, 10408.553989812388, 10709.892901071045, 13887.305634718223, 14113.78829317561, 14155.29223538819, 14235.50175743844, 14323.78514322286, 7548.66031028605, 7734.149243583314, 7937.0, 8037.477563958441, 8056.194380561897, 7685.4620176587105, 7708.152103268748, 7750.263724946121, 7936.2857342839425, 7953.6818527258265, 4294.7852607369505, 4394.1651086293505, 4410.80151393188, 4485.618722408566, 4534.0, 1774.1750086209975, 1788.910554472271, 1790.6776780179694, 1824.3614734842963, 1831.505493516743, 918.6922381002305, 926.3515539122641, 959.5490119643756, 980.1717548671361, 1039.9012093851072, 17448.738268925976, 18988.14553345103, 18999.15012748099, 19065.747556023867, 19115.904420478088, 883.6862913665685, 951.2485136742034, 959.5154447004218, 968.404431274775, 995.6117114325419, 10283.53724082418, 10484.895151048544, 10542.26204165701, 10647.84028239577, 10648.627298044532, 482718.0, 485736.0, 491794.0, 495028.0, 495419.0, 87587.56206219055, 88542.0, 89638.0, 89685.55157224172, 90021.54989225011, 971.1017308989298, 984.5126662302206, 999.3803841618243, 1011.3173607814696, 1011.7571782772081, 15649.452269170524, 16095.919520402791, 16682.916585416995, 17080.829191707922, 17285.827141728423, 38890.61109388983, 40116.59883401245, 40654.0, 41228.1754364917, 41789.164216716104, 55537.0, 56369.71815140898, 56741.71629141828, 57018.42981570131, 57845.710771445876, 7668.731594394169, 7722.498037627536, 7859.292663660298, 7946.682132714626, 8059.233519062235, 10497.52761125736, 12955.352232388532, 13034.543790967271, 13325.933370333087, 13604.727905442034, 11191.216614836883, 11299.661010169708, 11320.433978301216, 11411.714707132389, 11586.652400428, 11289.0, 11311.434428278388, 11469.19715619932, 11561.537538498365, 11807.23252988553, 11199.272047316897, 11551.191416600757, 11585.0, 11694.88305116972, 11839.82240266414, 7926.920730792618, 8142.307903828241, 11740.178187526792, 11935.582254621047, 12581.496740130659, 11285.492152852978, 11922.0, 11968.521259149536, 11988.520459181535, 12508.499660013498], "value": 8987.907215471141, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1477.409036385446, 1512.2438780609696, 1663.7504374343855, 1752.0538908989147, 1788.651213013462, 7234.385077268438, 7968.282854543105, 8492.617832197551, 9066.546672666365, 9085.454872707642, 8695.043545210037, 8907.955460222705, 8912.197902188802, 8994.460332380062, 8999.0, 2279.350385140231, 2324.3143272734583, 2324.6280595104786, 2325.139698311627, 2326.4765427778784, 2238.418011317061, 2287.1194590082773, 2326.8371214015024, 2327.394877331889, 2328.0105954969154, 2230.275160572812, 2241.9775802241934, 2256.548690261954, 2282.9086836526517, 2286.8513546619415, 2175.423512769117, 2178.4662757624483, 2186.0272178880405, 2190.288156349193, 2215.4682876109778, 2200.7139071920546, 2226.821854251656, 2246.5057687308768, 2250.032486031006, 2255.4474153832252, 8927.732168034969, 8976.147266009719, 8980.550972451416, 9006.684766033157, 9012.909870901272, 5031.949680503185, 5117.897642047138, 5136.409312929024, 5154.871128221787, 5162.22566615007, 3099.9070027898974, 3127.9218019549694, 3197.0, 3262.526933594639, 3294.0, 1081.7241603391085, 1084.8860869608657, 1102.5314241447434, 1106.435717783936, 1124.3984468309416, 12326.075544334211, 12332.0, 12392.752144957141, 12482.937585312015, 12495.93752031234, 4283.400323954649, 4311.547287534827, 4459.152760975404, 4479.55204479556, 4556.0, 10462.895371046345, 10473.581056757797, 10478.318909270873, 10501.47492625381, 10523.158147348347, 5053.8736531587, 5088.898222035538, 5091.9236211456855, 5094.694318340911, 5094.872628184251, 3929.724919255682, 4595.356650068993, 4676.812927482931, 4695.765211739399, 4715.363425937523, 3640.4539319102346, 3831.7892515911894, 3897.0841852164717, 3935.5670876203594, 3989.940150897739, 1194.767020431025, 1212.8969037631723, 1216.2763155922212, 1246.812978053281, 1247.5945317771761, 882.3735148044832, 942.6229508196639, 970.7476056225291, 1000.1348833259324, 1021.2646894236138, 5810.157527158538, 5931.762729490858, 5962.25471816023, 5984.970075149597, 6022.819315420545, 428.0625430307616, 437.64550713921824, 440.26475785438396, 441.58932193060764, 443.255331043843, 3996.660283875903, 4029.49631296088, 4043.636072753466, 4051.736637118578, 4074.7555146691293, 9708.514574271258, 10214.182865370753, 10220.335678180894, 10258.230632702576, 10266.538005789758, 10119.342242754197, 10172.745681358025, 10188.541515631814, 10201.744956376002, 10219.540120694437, 7804.102528209329, 7874.330681891989, 7884.369250459949, 7896.289333959971, 7907.644156012993, 5499.890002199853, 5503.587230957614, 5553.583481239004, 5588.273524441796, 5683.914741278967, 9285.350025498421, 9381.296402769956, 9428.858567121635, 9437.858432123387, 9533.952330238304, 9250.814983700422, 9480.857787133336, 9510.47692376926, 9747.171490423394, 9758.609655613696, 6749.966250168718, 7428.145763237297, 7572.4699271050495, 7584.12782529994, 7753.4960227585025, 8328.500869843487, 8405.0, 8452.450590711584, 8456.534890580831, 8492.278156356531, 7119.822004449723, 7296.379807716404, 7301.561906285639, 7356.154042285206, 7393.704251830081, 7126.857462850818, 7243.963780181065, 7282.0, 7408.666610002455, 7413.740519082022, 7171.748988785367, 7225.24134965821, 7296.635168241461, 7309.488335816442, 7326.7435639754485, 5361.731913404392, 5429.077056900415, 5442.401335853132, 5575.553955683617, 5686.317641883001, 5447.96488667152, 5551.028570000153, 5551.25058117149, 5603.243562119062, 5643.915341269802], "value": 4451.468160050071, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [294.5875773916518, 313.34979916672904, 313.49840255591045, 315.20725375680183, 316.8289123873109, 5462.0, 5537.501624853762, 5620.8313750587495, 5696.601237913348, 5774.451427114428, 5532.170174473831, 5564.33228012638, 5582.0, 5592.86017849554, 5602.7758889644365, 4290.227759003378, 4310.331898555729, 4331.891702707426, 4340.631046361063, 4365.454318210223, 4027.496562929634, 4238.5588899774075, 4263.765492897889, 4376.606105450509, 4399.228486053782, 4205.465005273084, 4209.663226941852, 4214.431051808013, 4214.873553793391, 4221.197972385237, 4192.161567686459, 4229.281022226229, 4240.236757383655, 4257.0, 4266.296061149907, 3554.111472131967, 3661.7802931824176, 3677.889663310105, 3678.282734866702, 3683.465897444882, 5404.703001224464, 5422.511973922326, 5438.483344082306, 5480.808171713971, 5544.86137846553, 4921.876953076166, 4951.613548206508, 4959.553640172366, 4965.577925876305, 4967.329410529568, 5577.581681373873, 5785.27684039495, 5787.971060144714, 5814.883702325972, 5818.0, 4128.731632443882, 4135.400366946776, 4146.357314616239, 4182.330827067654, 4191.3293872980485, 6025.849353766147, 6061.818145455643, 6086.0, 6106.786262480792, 6114.877702445926, 4049.6760259179196, 4092.5293591237387, 4125.133721918431, 4127.607877251657, 4155.688323375759, 4180.163967206571, 4181.644560212355, 4181.91636167281, 4190.706650534434, 4202.117555313418, 4868.853934381974, 4890.608751299887, 4897.436794768647, 4902.852914412573, 4925.014997000542, 5604.618037334117, 5885.882282354329, 5931.940680593225, 5959.404059594006, 5973.223480947536, 1481.4370539195252, 1490.9105453672814, 1493.8506149384975, 1498.992505037468, 1504.308018311589, 909.5952301226023, 928.5960607135918, 934.1224139479694, 935.9672411465702, 961.6730311694058, 5015.548600625962, 5098.719570423588, 5134.2800161945415, 5135.589152867761, 5160.92258616121, 5318.867028324323, 5321.255024296602, 5442.510174084351, 5472.261244731911, 5485.890282194414, 5034.6085609336005, 5073.173657483303, 5103.260027296022, 5356.91964620531, 5791.81450202387, 3212.3254116635303, 3224.5324427957817, 3235.3044095519576, 3240.8703651854134, 3273.5744353234404, 6037.3362888342535, 6278.905816412757, 6279.874402512016, 6295.307516173218, 6360.840978975562, 6134.693265336805, 6174.969125154345, 6193.566450348432, 6201.503879689614, 6208.255009398811, 6221.782237621752, 6230.816144932448, 6267.780627678009, 6271.78048768291, 6272.968635156795, 5844.6785426801935, 5982.880342393215, 6029.487493563096, 6052.394760523913, 6091.847703807441, 5985.700714964148, 5990.430909063632, 6007.579469437097, 6013.955255213248, 6037.9735444973585, 6001.849953751016, 6194.876102477835, 6273.215848018997, 6284.057391391328, 6312.968435157794, 4043.696722745747, 4188.434561334181, 4199.454070970754, 4208.242516346964, 4226.6618670506905, 6117.990531562243, 6127.84680382994, 6131.264248290234, 6134.202553668173, 6152.692365381802, 5801.883962320646, 5854.063349864001, 5963.4334738199805, 5980.3421623622235, 5995.16067750524, 5866.882662346815, 5884.146798714248, 5885.764569417175, 5889.440503152194, 5895.9115613266695, 5821.27234095738, 5833.970830145822, 5834.18321434991, 5857.297124345106, 5860.648361098348, 5713.971430142823, 5970.850728731816, 5977.850553736192, 5978.133170690313, 6000.339962604023, 5849.853753656193, 5879.676617786063, 5888.381719919518, 5906.430702644363, 5924.022536281465], "value": 4401.542909391807, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [754.7848863074025, 760.2093822424679, 778.1207235823522, 793.7499687598406, 851.8424091543061, 14675.119492830425, 15293.617659558517, 15337.07977521348, 15348.6930261395, 15394.461193858204, 13259.138156019875, 13358.064935454522, 13368.799468007963, 13369.933150334258, 13393.665158371046, 658.2101478226124, 777.1529033353644, 793.9364850811921, 801.0547553886412, 805.87508936115, 790.3756032734133, 800.3797057280595, 805.4402190477621, 806.9314108300802, 807.2452257139594, 843.8227972125861, 853.2448782827212, 854.8674955381925, 857.9828403431927, 859.0807835615893, 844.0883845446903, 844.1558441558411, 848.5926755157498, 850.1540966738104, 850.7277671145235, 628.4124343738619, 628.7107930352043, 629.5215636116538, 629.6662768732579, 631.0565704272143, 13096.214227146307, 13111.213327200303, 13204.0, 13235.801462978063, 13246.933765331209, 15323.846761532353, 15353.232338383035, 15370.154641494713, 15375.615609609737, 15490.690186196325, 11780.352080635561, 11853.822192667118, 12035.879641203563, 12065.457054432572, 12607.432665530074, 3833.5591406988274, 3925.1757131002523, 3997.920041599181, 4093.97953010236, 4095.508538975312, 75547.62226188889, 77085.22914770836, 77296.0, 77841.22158778396, 78573.0, 11674.824877626843, 11803.40982950849, 11873.881261187451, 11947.283163010246, 11978.0, 22617.547649046926, 22853.88573057124, 22889.08443662235, 22889.427764305692, 22926.082956681545, 8280.130586288473, 8300.916990830136, 8571.914280857236, 8579.871301930476, 8777.078406767325, 4559.156556037144, 4692.55583249509, 4727.64542659302, 4832.106060378771, 4866.489018653061, 3178.5867837181017, 3278.131295206772, 3278.950815737766, 3287.506873968876, 3290.226796702773, 584.611233529698, 588.2176704982363, 591.5385998920849, 599.8560345517044, 604.9758009679651, 755.7354925776044, 787.4094429178116, 788.2629741192004, 795.2524626850858, 813.385893650302, 9598.376105553116, 9825.852612210823, 10043.19654427644, 10065.748356291006, 10558.04977552024, 756.9924300757032, 772.1969152081772, 777.8949841771401, 785.4501848705929, 800.9879851802227, 4684.484706682262, 5123.154679477844, 5125.794968201305, 5203.9219411708855, 5212.113940630026, 109993.45003275093, 112423.0, 112477.0, 112709.43645281722, 116506.41746791212, 100509.0, 102275.4886225579, 105030.47484762527, 107426.0, 108069.0, 86210.56894715487, 86338.0, 87681.56159219163, 89531.55234223788, 89632.0, 9531.142197202285, 9708.75728106803, 9783.46190959504, 9806.85289720669, 9817.0, 53343.73328133334, 54042.729786350814, 54443.45556544384, 55264.44735552593, 56209.71895140498, 76259.0, 77178.0, 79855.0, 79996.0, 82508.0, 12560.74878502443, 12820.61538153857, 12865.421056052688, 12868.099233053596, 12916.935415322863, 12957.093003489665, 13104.672383190496, 14044.157350558999, 14434.855651443771, 14447.855521445072, 12683.492660293485, 12767.553135640208, 12788.424520896397, 13088.087340246639, 13096.476140954255, 13231.66920826987, 13360.657786219323, 13426.86671493099, 13465.192088474723, 13471.932640336736, 12668.556600518938, 13015.284159370947, 13115.0, 13480.460781568627, 13487.190768553919, 9342.579583918605, 9549.09283618055, 9552.331336806357, 9702.466364350028, 9867.000453804134, 9803.264755143251, 10053.346532475365, 10436.947815260875, 10440.269181157246, 10462.790744184922], "value": 7541.172227103146, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1524.8999999999999, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 113.0, 107.0, 113.0, 112.0, 114.0, 114.0, 123.0, 112.0, 112.0], "value": 112.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 116.0, 146.0, 177.0, 117.0, 142.0, 146.0, 122.0, 179.0, 118.0], "value": 141.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 163.0, 163.0, 162.0, 164.0, 173.0, 167.0, 163.0, 162.0, 163.0], "value": 164.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 75.0, 164.0, 77.0, 75.0, 76.0, 84.0, 176.0, 77.0], "value": 95.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 83.0, 145.0, 84.0, 83.0, 84.0, 145.0, 84.0, 85.0, 155.0], "value": 103.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [119.0, 118.0, 117.0, 118.0, 117.0, 117.0, 117.0, 117.0, 118.0, 118.0], "value": 117.6, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 148.0, 147.0, 147.0, 149.0, 148.0, 147.0, 147.0, 147.0, 147.0], "value": 147.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 99.0, 95.0, 95.0, 95.0, 96.0, 96.0, 96.0, 96.0, 96.0], "value": 96.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 52.0, 52.0, 53.0, 52.0, 53.0, 52.0, 51.0, 52.0, 51.0], "value": 52.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 62.0, 62.0, 62.0, 64.0, 63.0, 62.0, 64.0, 63.0, 64.0], "value": 62.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 76.0, 74.0, 81.0, 82.0, 77.0, 80.0, 75.0, 80.0, 75.0], "value": 77.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [122.0, 134.0, 126.0, 124.0, 122.0, 131.0, 127.0, 137.0, 166.0, 122.0], "value": 131.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 159.0, 164.0, 161.0, 157.0, 156.0, 157.0, 162.0, 161.0, 154.0], "value": 159.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 66.0, 63.0, 64.0, 63.0, 64.0, 64.0, 63.0, 69.0, 62.0], "value": 64.3, "unit": "score"}]}]} 11:57:03 INFO - Return code: 0 11:57:03 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 11:57:03 ERROR - # TBPL SUCCESS # 11:57:03 INFO - Running post-action listener: _resource_record_post_action 11:57:03 INFO - [mozharness: 2016-07-20 18:57:03.925050Z] Finished run-tests step (success) 11:57:03 INFO - Running post-run listener: _resource_record_post_run 11:57:04 INFO - Total resource usage - Wall time: 1192s; CPU: 13.0%; Read bytes: 4096; Write bytes: 554094592; Read time: 24; Write time: 631652 11:57:04 INFO - TinderboxPrint: CPU usage
13.4% 11:57:04 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 24 11:57:04 INFO - TinderboxPrint: I/O write bytes / time
554,094,592 / 631,652 11:57:04 INFO - TinderboxPrint: CPU idle
8,239.0 (86.6%) 11:57:04 INFO - TinderboxPrint: CPU user
1,213.0 (12.8%) 11:57:04 INFO - TinderboxPrint: Swap in / out
0 / 0 11:57:04 INFO - install - Wall time: 18s; CPU: 15.0%; Read bytes: 0; Write bytes: 258277376; Read time: 0; Write time: 399228 11:57:04 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 0; Write bytes: 295817216; Read time: 0; Write time: 232424 11:57:04 INFO - Running post-run listener: _upload_blobber_files 11:57:04 INFO - Blob upload gear active. 11:57:04 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:57:04 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:57:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 11:57:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 11:57:05 INFO - (blobuploader) - INFO - Open directory for files ... 11:57:05 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 11:57:05 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:57:05 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:57:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 11:57:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:57:05 INFO - (blobuploader) - INFO - Done attempting. 11:57:05 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 11:57:05 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:57:05 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:57:24 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 11:57:24 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:57:24 INFO - (blobuploader) - INFO - Done attempting. 11:57:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 11:57:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:57:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:57:25 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 11:57:25 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:57:25 INFO - (blobuploader) - INFO - Done attempting. 11:57:25 INFO - (blobuploader) - INFO - Iteration through files over. 11:57:25 INFO - Return code: 0 11:57:25 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:57:25 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:57:25 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a0f5a75e6546d60a8f2bc4105fe30abcf39a09fa6c4739b172567fdd8cbe083f1e9065ee156812038601979cc5a59e09102c12c83a600bfddb7e24c7ed7b8722", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2c5ed15bedda5414f377b514ab49d585f743939153ae156ac55bb3f47a244422e59fad78c5f18dc458e113ca624c1c9e0dcdef3109934ba6db7c25b7eb3c509c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7ce919fc9038307ce7c6f5e00d8323a2b7184d110fb34464ca65a8d0ecd170e607474123b67ecd53e1ae2c10f8aba9409f7e9d90099ab26436845fa533687489"} 11:57:25 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:57:25 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:57:25 INFO - Contents: 11:57:25 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a0f5a75e6546d60a8f2bc4105fe30abcf39a09fa6c4739b172567fdd8cbe083f1e9065ee156812038601979cc5a59e09102c12c83a600bfddb7e24c7ed7b8722", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2c5ed15bedda5414f377b514ab49d585f743939153ae156ac55bb3f47a244422e59fad78c5f18dc458e113ca624c1c9e0dcdef3109934ba6db7c25b7eb3c509c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7ce919fc9038307ce7c6f5e00d8323a2b7184d110fb34464ca65a8d0ecd170e607474123b67ecd53e1ae2c10f8aba9409f7e9d90099ab26436845fa533687489"} 11:57:25 INFO - Running post-run listener: copy_logs_to_upload_dir 11:57:25 INFO - Copying logs to upload dir... 11:57:25 INFO - mkdir: /builds/slave/test/build/upload/logs 11:57:25 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1245.694307 ========= master_lag: -0.00 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 45 secs) (at 2016-07-20 11:57:25.469791) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-20 11:57:25.473696) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/a0f5a75e6546d60a8f2bc4105fe30abcf39a09fa6c4739b172567fdd8cbe083f1e9065ee156812038601979cc5a59e09102c12c83a600bfddb7e24c7ed7b8722", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2c5ed15bedda5414f377b514ab49d585f743939153ae156ac55bb3f47a244422e59fad78c5f18dc458e113ca624c1c9e0dcdef3109934ba6db7c25b7eb3c509c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7ce919fc9038307ce7c6f5e00d8323a2b7184d110fb34464ca65a8d0ecd170e607474123b67ecd53e1ae2c10f8aba9409f7e9d90099ab26436845fa533687489"} build_url:https://queue.taskcluster.net/v1/task/aSHHpg6kSrGMPQRWU7olkQ/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011287 build_url: 'https://queue.taskcluster.net/v1/task/aSHHpg6kSrGMPQRWU7olkQ/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/sha512/a0f5a75e6546d60a8f2bc4105fe30abcf39a09fa6c4739b172567fdd8cbe083f1e9065ee156812038601979cc5a59e09102c12c83a600bfddb7e24c7ed7b8722", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2c5ed15bedda5414f377b514ab49d585f743939153ae156ac55bb3f47a244422e59fad78c5f18dc458e113ca624c1c9e0dcdef3109934ba6db7c25b7eb3c509c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/7ce919fc9038307ce7c6f5e00d8323a2b7184d110fb34464ca65a8d0ecd170e607474123b67ecd53e1ae2c10f8aba9409f7e9d90099ab26436845fa533687489"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-20 11:57:25.503498) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-20 11:57:25.504274) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=82c74bd3bc9a11c5833d2010000001e6-1469039798.276754-1092000004 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004457 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-20 11:57:25.587912) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-20 11:57:25.588669) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-20 11:57:25.589294) ========= ========= Total master_lag: 0.15 =========