builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-069 starttime: 1470850294.79 results: success (0) buildid: 20160810092520 builduid: 9aadc95d0aa54a4aa1ec842d0d63a8d7 revision: 4caf18e4aaca92756f79b2cba666073fe76eabb7 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-10 10:31:34.790587) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-10 10:31:34.791073) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-10 10:31:34.791365) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-10 10:31:34.822721) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:31:34.823134) ========= 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=05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-08-10 10:31:35-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 41.7M=0s 2016-08-10 10:31:35 (41.7 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.125279 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:31:34.962606) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:31:34.962939) ========= 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=05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017467 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:31:35.012251) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-10 10:31:35.012652) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 4caf18e4aaca92756f79b2cba666073fe76eabb7 --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 4caf18e4aaca92756f79b2cba666073fe76eabb7 --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=05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-08-10 10:31:35,904 truncating revision to first 12 chars 2016-08-10 10:31:35,904 Setting DEBUG logging. 2016-08-10 10:31:35,904 attempt 1/10 2016-08-10 10:31:35,904 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/4caf18e4aaca?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-10 10:31:37,382 unpacking tar archive at: fx-team-4caf18e4aaca/testing/mozharness/ program finished with exit code 0 elapsedTime=1.834528 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-10 10:31:36.861393) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-10 10:31:36.861717) ========= script_repo_revision: 4caf18e4aaca92756f79b2cba666073fe76eabb7 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-10 10:31:36.862129) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-10 10:31:36.862414) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-10 10:31:36.872932) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 39 secs) (at 2016-08-10 10:31:36.873333) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 10:31:37 INFO - MultiFileLogger online at 20160810 10:31:37 in /builds/slave/test 10:31:37 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 10:31:37 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:31:37 INFO - {'append_to_log': False, 10:31:37 INFO - 'base_work_dir': '/builds/slave/test', 10:31:37 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 10:31:37 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:31:37 INFO - 'branch': 'Fx-Team-Non-PGO', 10:31:37 INFO - 'buildbot_json_path': 'buildprops.json', 10:31:37 INFO - 'config_files': ('talos/linux_config.py',), 10:31:37 INFO - 'default_actions': ('clobber', 10:31:37 INFO - 'read-buildbot-config', 10:31:37 INFO - 'download-and-extract', 10:31:37 INFO - 'populate-webroot', 10:31:37 INFO - 'create-virtualenv', 10:31:37 INFO - 'install', 10:31:37 INFO - 'run-tests'), 10:31:37 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:31:37 INFO - 'download_minidump_stackwalk': True, 10:31:37 INFO - 'download_symbols': 'ondemand', 10:31:37 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:31:37 INFO - 'tooltool.py': '/tools/tooltool.py', 10:31:37 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:31:37 INFO - '/tools/misc-python/virtualenv.py')}, 10:31:37 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:31:37 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:31:37 INFO - 'installer_path': 'installer.exe', 10:31:37 INFO - 'log_level': 'info', 10:31:37 INFO - 'log_name': 'talos', 10:31:37 INFO - 'log_to_console': True, 10:31:37 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 10:31:37 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 10:31:37 INFO - 'opt_config_files': (), 10:31:37 INFO - 'pip_index': False, 10:31:37 INFO - 'sps_profile': False, 10:31:37 INFO - 'sps_profile_interval': 0, 10:31:37 INFO - 'suite': 'dromaeojs-e10s', 10:31:37 INFO - 'system_bits': '32', 10:31:37 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:31:37 INFO - 'title': 'talos-linux64-ix-069', 10:31:37 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:31:37 INFO - 'use_talos_json': True, 10:31:37 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:31:37 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:31:37 INFO - 'work_dir': 'build'} 10:31:37 INFO - [mozharness: 2016-08-10 17:31:37.861340Z] Running clobber step. 10:31:37 INFO - Running pre-action listener: _resource_record_pre_action 10:31:37 INFO - Running main action method: clobber 10:31:37 INFO - rmtree: /builds/slave/test/build 10:31:37 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:31:38 INFO - Running post-action listener: _resource_record_post_action 10:31:38 INFO - [mozharness: 2016-08-10 17:31:38.841735Z] Finished clobber step (success) 10:31:38 INFO - [mozharness: 2016-08-10 17:31:38.841834Z] Running read-buildbot-config step. 10:31:38 INFO - Running pre-action listener: _resource_record_pre_action 10:31:38 INFO - Running main action method: read_buildbot_config 10:31:38 INFO - Using buildbot properties: 10:31:38 INFO - { 10:31:38 INFO - "project": "", 10:31:38 INFO - "product": "firefox", 10:31:38 INFO - "script_repo_revision": "production", 10:31:38 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 10:31:38 INFO - "repository": "", 10:31:38 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 10:31:38 INFO - "buildid": "20160810092520", 10:31:38 INFO - "pgo_build": "False", 10:31:38 INFO - "basedir": "/builds/slave/test", 10:31:38 INFO - "buildnumber": 1523, 10:31:38 INFO - "slavename": "talos-linux64-ix-069", 10:31:38 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 10:31:38 INFO - "platform": "ubuntu64_hw", 10:31:38 INFO - "scheduler": "tests-fx-team-linux64-talos-7-3600", 10:31:38 INFO - "branch": "fx-team", 10:31:38 INFO - "repo_path": "integration/fx-team", 10:31:38 INFO - "revision": "4caf18e4aaca92756f79b2cba666073fe76eabb7", 10:31:38 INFO - "stage_platform": "linux64", 10:31:38 INFO - "builduid": "9aadc95d0aa54a4aa1ec842d0d63a8d7", 10:31:38 INFO - "slavebuilddir": "test" 10:31:38 INFO - } 10:31:38 INFO - Found installer url https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 10:31:38 INFO - Running post-action listener: _resource_record_post_action 10:31:38 INFO - [mozharness: 2016-08-10 17:31:38.844311Z] Finished read-buildbot-config step (success) 10:31:38 INFO - [mozharness: 2016-08-10 17:31:38.844401Z] Running download-and-extract step. 10:31:38 INFO - Running pre-action listener: _resource_record_pre_action 10:31:38 INFO - Running main action method: download_and_extract 10:31:38 INFO - mkdir: /builds/slave/test/build/tests 10:31:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:38 INFO - trying https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 10:31:38 INFO - Downloading https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 10:31:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 10:31:39 INFO - Downloaded 1361 bytes. 10:31:39 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 10:31:39 INFO - Using the following test package requirements: 10:31:39 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 10:31:39 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:39 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 10:31:39 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:39 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 10:31:39 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:39 INFO - u'jsshell-linux-x86_64.zip'], 10:31:39 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:39 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 10:31:39 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 10:31:39 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:39 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 10:31:39 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:39 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 10:31:39 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:39 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 10:31:39 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:31:39 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 10:31:39 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 10:31:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:39 INFO - trying https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 10:31:39 INFO - Downloading https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 10:31:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:31:40 INFO - Downloaded 20259477 bytes. 10:31:40 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:31:40 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 10:31:41 INFO - Return code: 0 10:31:41 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 10:31:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:41 INFO - trying https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 10:31:41 INFO - Downloading https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 10:31:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:31:42 INFO - Downloaded 20259477 bytes. 10:31:42 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:31:42 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 10:31:43 INFO - Return code: 0 10:31: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:43 INFO - trying https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 10:31:43 INFO - Downloading https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 10:31:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 10:31:44 INFO - Downloaded 14413719 bytes. 10:31:44 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:31:44 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 10:31:44 INFO - Return code: 0 10:31:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:44 INFO - trying https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:31:44 INFO - Downloading https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:31:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 10:31:46 INFO - Downloaded 55619283 bytes. 10:31:46 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:31:46 INFO - mkdir: /builds/slave/test/properties 10:31:46 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:31:46 INFO - Writing to file /builds/slave/test/properties/build_url 10:31:46 INFO - Contents: 10:31:46 INFO - build_url:https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:31:46 INFO - Running post-action listener: _resource_record_post_action 10:31:46 INFO - Running post-action listener: set_extra_try_arguments 10:31:46 INFO - [mozharness: 2016-08-10 17:31:46.750824Z] Finished download-and-extract step (success) 10:31:46 INFO - [mozharness: 2016-08-10 17:31:46.751057Z] Running populate-webroot step. 10:31:46 INFO - Running pre-action listener: _resource_record_pre_action 10:31:46 INFO - Running main action method: populate_webroot 10:31:46 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:31:46 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:31:46 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:31:46 INFO - '--tppagecycles', 10:31:46 INFO - '7'], 10:31:46 INFO - 'tests': ['tsvgm']}}, 10:31:46 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 10:31:46 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:31:46 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 10:31:46 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 10:31:46 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:31:46 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 10:31:46 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:31:46 INFO - 'talos_options': ['--disable-e10s'], 10:31:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:31:46 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:31:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:31:46 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:31:46 INFO - 'talos_options': ['--disable-e10s'], 10:31:46 INFO - 'tests': ['damp', 'tps']}, 10:31:46 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:31:46 INFO - 'tests': ['damp', 'tps']}, 10:31:46 INFO - 'g3': {'talos_options': ['--disable-e10s'], 10:31:46 INFO - 'tests': ['dromaeo_dom']}, 10:31:46 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:31:46 INFO - 'g4': {'talos_options': ['--disable-e10s'], 10:31:46 INFO - 'tests': ['basic_compositor_video']}, 10:31:46 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 10:31:46 INFO - 'other': {'talos_options': ['--disable-e10s'], 10:31:46 INFO - 'tests': ['a11yr', 10:31:46 INFO - 'ts_paint', 10:31:46 INFO - 'tpaint', 10:31:46 INFO - 'sessionrestore', 10:31:46 INFO - 'sessionrestore_no_auto_restore', 10:31:46 INFO - 'tabpaint']}, 10:31:46 INFO - 'other-e10s': {'tests': ['a11yr', 10:31:46 INFO - 'ts_paint', 10:31:46 INFO - 'tpaint', 10:31:46 INFO - 'sessionrestore', 10:31:46 INFO - 'sessionrestore_no_auto_restore', 10:31:46 INFO - 'tabpaint']}, 10:31:46 INFO - 'other-e10s_l64': {'tests': ['a11yr', 10:31:46 INFO - 'ts_paint', 10:31:46 INFO - 'tpaint', 10:31:46 INFO - 'sessionrestore', 10:31:46 INFO - 'sessionrestore_no_auto_restore', 10:31:46 INFO - 'tabpaint']}, 10:31:46 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 10:31:46 INFO - 'ts_paint', 10:31:46 INFO - 'tpaint', 10:31:46 INFO - 'sessionrestore', 10:31:46 INFO - 'sessionrestore_no_auto_restore', 10:31:46 INFO - 'tabpaint']}, 10:31:46 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 10:31:46 INFO - 'tests': ['a11yr', 10:31:46 INFO - 'ts_paint', 10:31:46 INFO - 'tpaint', 10:31:46 INFO - 'sessionrestore', 10:31:46 INFO - 'sessionrestore_no_auto_restore', 10:31:46 INFO - 'tabpaint']}, 10:31:46 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 10:31:46 INFO - 'tests': ['a11yr', 10:31:46 INFO - 'ts_paint', 10:31:46 INFO - 'tpaint', 10:31:46 INFO - 'sessionrestore', 10:31:46 INFO - 'sessionrestore_no_auto_restore', 10:31:46 INFO - 'tabpaint']}, 10:31:46 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 10:31:46 INFO - 'tests': ['tsvgx', 10:31:46 INFO - 'tsvgr_opacity', 10:31:46 INFO - 'tart', 10:31:46 INFO - 'tscrollx', 10:31:46 INFO - 'cart']}, 10:31:46 INFO - 'svgr-e10s': {'tests': ['tsvgx', 10:31:46 INFO - 'tsvgr_opacity', 10:31:46 INFO - 'tart', 10:31:46 INFO - 'tscrollx', 10:31:46 INFO - 'cart']}, 10:31:46 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:31:46 INFO - 'talos_options': ['--disable-e10s'], 10:31:46 INFO - 'tests': ['tp5o']}, 10:31:46 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:31:46 INFO - 'tests': ['tp5o']}, 10:31:46 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:31:46 INFO - 'talos_options': ['--disable-e10s', 10:31:46 INFO - '--xperf_path', 10:31:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:31:46 INFO - 'tests': ['tp5n']}, 10:31:46 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:31:46 INFO - 'talos_options': ['--xperf_path', 10:31:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:31:46 INFO - 'tests': ['tp5n']}}, 10:31:46 INFO - 'talos.zip': {'path': '', 10:31:46 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:31:46 INFO - Running post-action listener: _resource_record_post_action 10:31:46 INFO - [mozharness: 2016-08-10 17:31:46.772399Z] Finished populate-webroot step (success) 10:31:46 INFO - [mozharness: 2016-08-10 17:31:46.772488Z] Running create-virtualenv step. 10:31:46 INFO - Running pre-action listener: _resource_record_pre_action 10:31:46 INFO - Running main action method: create_virtualenv 10:31:46 INFO - Creating virtualenv /builds/slave/test/build/venv 10:31:46 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 10:31:46 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:31:46 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:31:46 INFO - Using real prefix '/usr' 10:31:46 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:31:47 INFO - Installing distribute.............................................................................................................................................................................................done. 10:31:49 INFO - Installing pip.................done. 10:31:49 INFO - Return code: 0 10:31:49 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:31:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:31:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:31:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:31:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:31:49 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 0x12e0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14438a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x150f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159e570>, '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 0x159f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x159f900>, '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': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', '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 10:31:49 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 10:31:49 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 10:31:49 INFO - Using env: {'DISPLAY': ':0', 10:31:49 INFO - 'HOME': '/home/cltbld', 10:31:49 INFO - 'LANG': 'en_US.UTF-8', 10:31:49 INFO - 'LANGUAGE': 'en_US:en', 10:31:49 INFO - 'LOGNAME': 'cltbld', 10:31:49 INFO - 'MAIL': '/var/mail/cltbld', 10:31:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:31:49 INFO - 'MOZ_NO_REMOTE': '1', 10:31:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:31:49 INFO - 'NO_EM_RESTART': '1', 10:31:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:31:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:31:49 INFO - 'PWD': '/builds/slave/test', 10:31:49 INFO - 'SHELL': '/bin/bash', 10:31:49 INFO - 'SHLVL': '1', 10:31:49 INFO - 'TERM': 'linux', 10:31:49 INFO - 'TMOUT': '86400', 10:31:49 INFO - 'USER': 'cltbld', 10:31:49 INFO - 'XDG_SESSION_COOKIE': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', 10:31:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:31:49 INFO - '_': '/tools/buildbot/bin/python'} 10:31:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:31:49 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 10:31:49 INFO - Cleaning up... 10:31:49 INFO - Return code: 0 10:31:49 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 10:31:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:31:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:31:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:31:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:31:49 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 0x12e0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14438a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x150f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159e570>, '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 0x159f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x159f900>, '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': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', '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 10:31:49 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 10:31:49 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 10:31:49 INFO - Using env: {'DISPLAY': ':0', 10:31:49 INFO - 'HOME': '/home/cltbld', 10:31:49 INFO - 'LANG': 'en_US.UTF-8', 10:31:49 INFO - 'LANGUAGE': 'en_US:en', 10:31:49 INFO - 'LOGNAME': 'cltbld', 10:31:49 INFO - 'MAIL': '/var/mail/cltbld', 10:31:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:31:49 INFO - 'MOZ_NO_REMOTE': '1', 10:31:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:31:49 INFO - 'NO_EM_RESTART': '1', 10:31:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:31:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:31:49 INFO - 'PWD': '/builds/slave/test', 10:31:49 INFO - 'SHELL': '/bin/bash', 10:31:49 INFO - 'SHLVL': '1', 10:31:49 INFO - 'TERM': 'linux', 10:31:49 INFO - 'TMOUT': '86400', 10:31:49 INFO - 'USER': 'cltbld', 10:31:49 INFO - 'XDG_SESSION_COOKIE': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', 10:31:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:31:49 INFO - '_': '/tools/buildbot/bin/python'} 10:31:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:31:49 INFO - Downloading/unpacking psutil>=3.1.1 10:31:49 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 10:31:49 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 10:31:49 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 10:31:49 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 10:31:49 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 10:31:49 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 10:31:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:31:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:31:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:31:51 INFO - Installing collected packages: psutil 10:31:51 INFO - Running setup.py install for psutil 10:31:51 INFO - building 'psutil._psutil_linux' extension 10:31:51 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 10:31:52 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 10:31:52 INFO - building 'psutil._psutil_posix' extension 10:31:52 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 10:31:52 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 10:31:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:31:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:31:52 INFO - Successfully installed psutil 10:31:52 INFO - Cleaning up... 10:31:52 INFO - Return code: 0 10:31:52 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 10:31: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:31:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:31: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:31:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:31: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', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12e0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14438a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x150f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159e570>, '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 0x159f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x159f900>, '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': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', '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 10:31: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', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 10:31: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 mozsystemmonitor==0.3 10:31:52 INFO - Using env: {'DISPLAY': ':0', 10:31:52 INFO - 'HOME': '/home/cltbld', 10:31:52 INFO - 'LANG': 'en_US.UTF-8', 10:31:52 INFO - 'LANGUAGE': 'en_US:en', 10:31:52 INFO - 'LOGNAME': 'cltbld', 10:31:52 INFO - 'MAIL': '/var/mail/cltbld', 10:31:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:31:52 INFO - 'MOZ_NO_REMOTE': '1', 10:31:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:31:52 INFO - 'NO_EM_RESTART': '1', 10:31:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:31:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:31:52 INFO - 'PWD': '/builds/slave/test', 10:31:52 INFO - 'SHELL': '/bin/bash', 10:31:52 INFO - 'SHLVL': '1', 10:31:52 INFO - 'TERM': 'linux', 10:31:52 INFO - 'TMOUT': '86400', 10:31:52 INFO - 'USER': 'cltbld', 10:31:52 INFO - 'XDG_SESSION_COOKIE': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', 10:31:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:31:52 INFO - '_': '/tools/buildbot/bin/python'} 10:31:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:31:52 INFO - Downloading/unpacking mozsystemmonitor==0.3 10:31: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 10:31: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 10:31: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 10:31: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 10:31: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 10:31: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 10:31:54 INFO - Downloading mozsystemmonitor-0.3.tar.gz 10:31:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:31:54 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 10:31:54 INFO - Installing collected packages: mozsystemmonitor 10:31:54 INFO - Running setup.py install for mozsystemmonitor 10:31:54 INFO - Successfully installed mozsystemmonitor 10:31:54 INFO - Cleaning up... 10:31:54 INFO - Return code: 0 10:31:54 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 10:31:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:31:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:31:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:31:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:31:54 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 0x12e0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14438a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x150f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159e570>, '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 0x159f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x159f900>, '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': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', '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 10:31:54 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 10:31:54 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 10:31:54 INFO - Using env: {'DISPLAY': ':0', 10:31:54 INFO - 'HOME': '/home/cltbld', 10:31:54 INFO - 'LANG': 'en_US.UTF-8', 10:31:54 INFO - 'LANGUAGE': 'en_US:en', 10:31:54 INFO - 'LOGNAME': 'cltbld', 10:31:54 INFO - 'MAIL': '/var/mail/cltbld', 10:31:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:31:54 INFO - 'MOZ_NO_REMOTE': '1', 10:31:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:31:54 INFO - 'NO_EM_RESTART': '1', 10:31:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:31:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:31:54 INFO - 'PWD': '/builds/slave/test', 10:31:54 INFO - 'SHELL': '/bin/bash', 10:31:54 INFO - 'SHLVL': '1', 10:31:54 INFO - 'TERM': 'linux', 10:31:54 INFO - 'TMOUT': '86400', 10:31:54 INFO - 'USER': 'cltbld', 10:31:54 INFO - 'XDG_SESSION_COOKIE': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', 10:31:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:31:54 INFO - '_': '/tools/buildbot/bin/python'} 10:31:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:31:54 INFO - Downloading/unpacking jsonschema==2.5.1 10:31:54 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 10:31:54 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 10:31:54 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 10:31:54 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 10:31:54 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 10:31:54 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 10:31:56 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:31:56 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 10:31:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:31:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:31:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:31:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:31:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:31:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:31:56 INFO - Downloading functools32-3.2.3-2.tar.gz 10:31:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:31:57 INFO - warning: no files found matching '*.txt' 10:31:57 INFO - no previously-included directories found matching 'build' 10:31:57 INFO - no previously-included directories found matching 'dist' 10:31:57 INFO - no previously-included directories found matching '.git*' 10:31:57 INFO - Installing collected packages: jsonschema, functools32 10:31:57 INFO - Running setup.py install for functools32 10:31:57 INFO - warning: no files found matching '*.txt' 10:31:57 INFO - no previously-included directories found matching 'build' 10:31:57 INFO - no previously-included directories found matching 'dist' 10:31:57 INFO - no previously-included directories found matching '.git*' 10:31:57 INFO - Successfully installed jsonschema functools32 10:31:57 INFO - Cleaning up... 10:31:57 INFO - Return code: 0 10:31:57 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 10:31:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:31:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:31:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:31:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:31: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', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12e0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14438a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x150f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159e570>, '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 0x159f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x159f900>, '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': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', '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 10:31: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', 'functools32==3.2.3-2'] in /builds/slave/test/build 10:31: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 functools32==3.2.3-2 10:31:57 INFO - Using env: {'DISPLAY': ':0', 10:31:57 INFO - 'HOME': '/home/cltbld', 10:31:57 INFO - 'LANG': 'en_US.UTF-8', 10:31:57 INFO - 'LANGUAGE': 'en_US:en', 10:31:57 INFO - 'LOGNAME': 'cltbld', 10:31:57 INFO - 'MAIL': '/var/mail/cltbld', 10:31:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:31:57 INFO - 'MOZ_NO_REMOTE': '1', 10:31:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:31:57 INFO - 'NO_EM_RESTART': '1', 10:31:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:31:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:31:57 INFO - 'PWD': '/builds/slave/test', 10:31:57 INFO - 'SHELL': '/bin/bash', 10:31:57 INFO - 'SHLVL': '1', 10:31:57 INFO - 'TERM': 'linux', 10:31:57 INFO - 'TMOUT': '86400', 10:31:57 INFO - 'USER': 'cltbld', 10:31:57 INFO - 'XDG_SESSION_COOKIE': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', 10:31:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:31:57 INFO - '_': '/tools/buildbot/bin/python'} 10:31:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:31:57 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 10:31:57 INFO - Cleaning up... 10:31:57 INFO - Return code: 0 10:31:57 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:31:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:31:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:31:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:31:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:31:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:31: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', '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 0x12e0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14438a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x150f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159e570>, '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 0x159f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x159f900>, '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': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', '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 10:31: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', 'blobuploader==1.2.4'] in /builds/slave/test/build 10:31: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 blobuploader==1.2.4 10:31:57 INFO - Using env: {'DISPLAY': ':0', 10:31:57 INFO - 'HOME': '/home/cltbld', 10:31:57 INFO - 'LANG': 'en_US.UTF-8', 10:31:57 INFO - 'LANGUAGE': 'en_US:en', 10:31:57 INFO - 'LOGNAME': 'cltbld', 10:31:57 INFO - 'MAIL': '/var/mail/cltbld', 10:31:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:31:57 INFO - 'MOZ_NO_REMOTE': '1', 10:31:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:31:57 INFO - 'NO_EM_RESTART': '1', 10:31:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:31:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:31:57 INFO - 'PWD': '/builds/slave/test', 10:31:57 INFO - 'SHELL': '/bin/bash', 10:31:57 INFO - 'SHLVL': '1', 10:31:57 INFO - 'TERM': 'linux', 10:31:57 INFO - 'TMOUT': '86400', 10:31:57 INFO - 'USER': 'cltbld', 10:31:57 INFO - 'XDG_SESSION_COOKIE': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', 10:31:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:31:57 INFO - '_': '/tools/buildbot/bin/python'} 10:31:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:31:57 INFO - Downloading/unpacking blobuploader==1.2.4 10:31: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 10:31: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 10:31: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 10:31: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 10:31: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 10:31: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 10:31:59 INFO - Downloading blobuploader-1.2.4.tar.gz 10:31:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:31:59 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:31: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 10:31: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 10:31: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 10:31: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 10:31: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 10:31: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 10:31:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:32:00 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:32: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 10:32: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 10:32: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 10:32: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 10:32: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 10:32: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 10:32:00 INFO - Downloading docopt-0.6.1.tar.gz 10:32:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:32:00 INFO - Installing collected packages: blobuploader, requests, docopt 10:32:00 INFO - Running setup.py install for blobuploader 10:32:00 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:32:00 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:32:00 INFO - Running setup.py install for requests 10:32:00 INFO - Running setup.py install for docopt 10:32:00 INFO - Successfully installed blobuploader requests docopt 10:32:00 INFO - Cleaning up... 10:32:00 INFO - Return code: 0 10:32:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:32:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:32:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:32:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:00 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 0x12e0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14438a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x150f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159e570>, '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 0x159f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x159f900>, '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': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', '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 10:32:00 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 10:32:00 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 10:32:00 INFO - Using env: {'DISPLAY': ':0', 10:32:00 INFO - 'HOME': '/home/cltbld', 10:32:00 INFO - 'LANG': 'en_US.UTF-8', 10:32:00 INFO - 'LANGUAGE': 'en_US:en', 10:32:00 INFO - 'LOGNAME': 'cltbld', 10:32:00 INFO - 'MAIL': '/var/mail/cltbld', 10:32:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:00 INFO - 'MOZ_NO_REMOTE': '1', 10:32:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:00 INFO - 'NO_EM_RESTART': '1', 10:32:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:00 INFO - 'PWD': '/builds/slave/test', 10:32:00 INFO - 'SHELL': '/bin/bash', 10:32:00 INFO - 'SHLVL': '1', 10:32:00 INFO - 'TERM': 'linux', 10:32:00 INFO - 'TMOUT': '86400', 10:32:00 INFO - 'USER': 'cltbld', 10:32:00 INFO - 'XDG_SESSION_COOKIE': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', 10:32:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:00 INFO - '_': '/tools/buildbot/bin/python'} 10:32:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:32:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:32:01 INFO - Running setup.py (path:/tmp/pip-qDrYrq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:32:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:32:01 INFO - Running setup.py (path:/tmp/pip-kdM1cz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:32:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:32:01 INFO - Running setup.py (path:/tmp/pip-kltm1j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:32:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:32:01 INFO - Running setup.py (path:/tmp/pip-jSv2mp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:32:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:32:01 INFO - Running setup.py (path:/tmp/pip-4DayjF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:32:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:32:01 INFO - Running setup.py (path:/tmp/pip-Ygoe0J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:32:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:32:01 INFO - Running setup.py (path:/tmp/pip-oGwH_z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:32:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:32:01 INFO - Running setup.py (path:/tmp/pip-uUcnsM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:32:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:32:01 INFO - Running setup.py (path:/tmp/pip-GBvPRe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:32:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:32:01 INFO - Running setup.py (path:/tmp/pip-5zI70i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:32:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:32:01 INFO - Running setup.py (path:/tmp/pip-z7LO_L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:32:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:32:01 INFO - Running setup.py (path:/tmp/pip-ST3Qtt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:32:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:32:02 INFO - Running setup.py (path:/tmp/pip-rQqQ7K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:32:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:32:02 INFO - Running setup.py (path:/tmp/pip-XxCdYO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:32:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:32:02 INFO - Running setup.py (path:/tmp/pip-tUjE4J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:32:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:32:02 INFO - Running setup.py (path:/tmp/pip-Nuze2S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:32:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:32:02 INFO - Running setup.py (path:/tmp/pip-PqKqtO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:32:02 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:32:02 INFO - Running setup.py install for manifestparser 10:32:02 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:32:02 INFO - Running setup.py install for mozcrash 10:32:02 INFO - Running setup.py install for mozdebug 10:32:02 INFO - Running setup.py install for mozdevice 10:32:02 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:32:02 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:32:02 INFO - Running setup.py install for mozfile 10:32:02 INFO - Running setup.py install for mozhttpd 10:32:02 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:32:02 INFO - Running setup.py install for mozinfo 10:32:03 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:32:03 INFO - Running setup.py install for mozInstall 10:32:03 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:32:03 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:32:03 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:32:03 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:32:03 INFO - Running setup.py install for mozleak 10:32:03 INFO - Running setup.py install for mozlog 10:32:03 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:32:03 INFO - Running setup.py install for moznetwork 10:32:03 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:32:03 INFO - Running setup.py install for mozprocess 10:32:03 INFO - Running setup.py install for mozprofile 10:32:03 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:32:03 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:32:03 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:32:03 INFO - Running setup.py install for mozrunner 10:32:03 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:32:03 INFO - Running setup.py install for mozscreenshot 10:32:03 INFO - Running setup.py install for moztest 10:32:04 INFO - Running setup.py install for mozversion 10:32:04 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:32:04 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:32:04 INFO - Cleaning up... 10:32:04 INFO - Return code: 0 10:32:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:32:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:32:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:32:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:04 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 0x12e0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14438a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x150f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159e570>, '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 0x159f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x159f900>, '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': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', '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 10:32:04 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 10:32:04 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 10:32:04 INFO - Using env: {'DISPLAY': ':0', 10:32:04 INFO - 'HOME': '/home/cltbld', 10:32:04 INFO - 'LANG': 'en_US.UTF-8', 10:32:04 INFO - 'LANGUAGE': 'en_US:en', 10:32:04 INFO - 'LOGNAME': 'cltbld', 10:32:04 INFO - 'MAIL': '/var/mail/cltbld', 10:32:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:04 INFO - 'MOZ_NO_REMOTE': '1', 10:32:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:04 INFO - 'NO_EM_RESTART': '1', 10:32:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:04 INFO - 'PWD': '/builds/slave/test', 10:32:04 INFO - 'SHELL': '/bin/bash', 10:32:04 INFO - 'SHLVL': '1', 10:32:04 INFO - 'TERM': 'linux', 10:32:04 INFO - 'TMOUT': '86400', 10:32:04 INFO - 'USER': 'cltbld', 10:32:04 INFO - 'XDG_SESSION_COOKIE': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', 10:32:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:04 INFO - '_': '/tools/buildbot/bin/python'} 10:32:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:32:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:32:04 INFO - Running setup.py (path:/tmp/pip-bRsU3l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:32:04 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)) 10:32:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:32:04 INFO - Running setup.py (path:/tmp/pip-D3AEgA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:32:04 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)) 10:32:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:32:04 INFO - Running setup.py (path:/tmp/pip-S5sc51-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:32:04 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)) 10:32:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:32:04 INFO - Running setup.py (path:/tmp/pip-IK2urB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:32:04 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)) 10:32:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:32:04 INFO - Running setup.py (path:/tmp/pip-PpyMxV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:32:04 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)) 10:32:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:32:04 INFO - Running setup.py (path:/tmp/pip-WGu13W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:32:04 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)) 10:32:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:32:04 INFO - Running setup.py (path:/tmp/pip-EvAk2W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:32:04 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)) 10:32:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:32:04 INFO - Running setup.py (path:/tmp/pip-eYzQrl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:32:04 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)) 10:32:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:32:04 INFO - Running setup.py (path:/tmp/pip-hkeJ5D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:32:05 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)) 10:32:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:32:05 INFO - Running setup.py (path:/tmp/pip-m_Guas-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:32:05 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)) 10:32:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:32:05 INFO - Running setup.py (path:/tmp/pip-q46ZlG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:32:05 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)) 10:32:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:32:05 INFO - Running setup.py (path:/tmp/pip-CTUEKb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:32:05 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)) 10:32:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:32:05 INFO - Running setup.py (path:/tmp/pip-2oksyL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:32:05 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)) 10:32:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:32:05 INFO - Running setup.py (path:/tmp/pip-cbjcDP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:32:05 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)) 10:32:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:32:05 INFO - Running setup.py (path:/tmp/pip-XGMibV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:32:05 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)) 10:32:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:32:05 INFO - Running setup.py (path:/tmp/pip-35Qlx5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:32:05 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)) 10:32:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:32:05 INFO - Running setup.py (path:/tmp/pip-4VQdLr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:32:05 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)) 10:32:05 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)) 10:32:05 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)) 10:32:05 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)) 10:32:05 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)) 10:32:05 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)) 10:32:05 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:32:05 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 10:32:05 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 10:32:05 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 10:32:05 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 10:32:05 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 10:32:05 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 10:32:07 INFO - Downloading blessings-1.6.tar.gz 10:32:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:32:07 INFO - Installing collected packages: blessings 10:32:07 INFO - Running setup.py install for blessings 10:32:07 INFO - Successfully installed blessings 10:32:07 INFO - Cleaning up... 10:32:07 INFO - Return code: 0 10:32:07 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:32:07 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:32:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:32:07 INFO - Reading from file tmpfile_stdout 10:32:07 INFO - Current package versions: 10:32:07 INFO - argparse == 1.2.1 10:32:07 INFO - blessings == 1.6 10:32:07 INFO - blobuploader == 1.2.4 10:32:07 INFO - docopt == 0.6.1 10:32:07 INFO - functools32 == 3.2.3-2 10:32:07 INFO - jsonschema == 2.5.1 10:32:07 INFO - manifestparser == 1.1 10:32:07 INFO - mozInstall == 1.12 10:32:07 INFO - mozcrash == 0.17 10:32:07 INFO - mozdebug == 0.1 10:32:07 INFO - mozdevice == 0.48 10:32:07 INFO - mozfile == 1.2 10:32:07 INFO - mozhttpd == 0.7 10:32:07 INFO - mozinfo == 0.9 10:32:07 INFO - mozleak == 0.1 10:32:07 INFO - mozlog == 3.3 10:32:07 INFO - moznetwork == 0.27 10:32:07 INFO - mozprocess == 0.23 10:32:07 INFO - mozprofile == 0.28 10:32:07 INFO - mozrunner == 6.12 10:32:07 INFO - mozscreenshot == 0.1 10:32:07 INFO - mozsystemmonitor == 0.3 10:32:07 INFO - moztest == 0.7 10:32:07 INFO - mozversion == 1.4 10:32:07 INFO - psutil == 3.1.1 10:32:07 INFO - requests == 1.2.3 10:32:07 INFO - wsgiref == 0.1.2 10:32:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:32: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:32:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:32:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:07 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 0x12e0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14438a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x150f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159e570>, '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 0x159f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x159f900>, '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': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', '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 10:32:07 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 10:32:07 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 10:32:07 INFO - Using env: {'DISPLAY': ':0', 10:32:07 INFO - 'HOME': '/home/cltbld', 10:32:07 INFO - 'LANG': 'en_US.UTF-8', 10:32:07 INFO - 'LANGUAGE': 'en_US:en', 10:32:07 INFO - 'LOGNAME': 'cltbld', 10:32:07 INFO - 'MAIL': '/var/mail/cltbld', 10:32:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:07 INFO - 'MOZ_NO_REMOTE': '1', 10:32:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:07 INFO - 'NO_EM_RESTART': '1', 10:32:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:07 INFO - 'PWD': '/builds/slave/test', 10:32:07 INFO - 'SHELL': '/bin/bash', 10:32:07 INFO - 'SHLVL': '1', 10:32:07 INFO - 'TERM': 'linux', 10:32:07 INFO - 'TMOUT': '86400', 10:32:07 INFO - 'USER': 'cltbld', 10:32:07 INFO - 'XDG_SESSION_COOKIE': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', 10:32:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:07 INFO - '_': '/tools/buildbot/bin/python'} 10:32:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:32:08 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)) 10:32:08 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)) 10:32:08 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)) 10:32:08 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)) 10:32:08 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)) 10:32:08 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)) 10:32:08 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)) 10:32:08 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)) 10:32:08 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)) 10:32:08 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)) 10:32:08 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)) 10:32:08 INFO - Cleaning up... 10:32:08 INFO - Return code: 0 10:32:08 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:32:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:32:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:32:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:32:08 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12e0030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14438a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x150f400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159e570>, '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 0x159f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x159f900>, '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': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', '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 10:32:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 10:32:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 10:32:08 INFO - Using env: {'DISPLAY': ':0', 10:32:08 INFO - 'HOME': '/home/cltbld', 10:32:08 INFO - 'LANG': 'en_US.UTF-8', 10:32:08 INFO - 'LANGUAGE': 'en_US:en', 10:32:08 INFO - 'LOGNAME': 'cltbld', 10:32:08 INFO - 'MAIL': '/var/mail/cltbld', 10:32:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:08 INFO - 'MOZ_NO_REMOTE': '1', 10:32:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:08 INFO - 'NO_EM_RESTART': '1', 10:32:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:08 INFO - 'PWD': '/builds/slave/test', 10:32:08 INFO - 'SHELL': '/bin/bash', 10:32:08 INFO - 'SHLVL': '1', 10:32:08 INFO - 'TERM': 'linux', 10:32:08 INFO - 'TMOUT': '86400', 10:32:08 INFO - 'USER': 'cltbld', 10:32:08 INFO - 'XDG_SESSION_COOKIE': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', 10:32:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:08 INFO - '_': '/tools/buildbot/bin/python'} 10:32:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:32:08 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 10:32:08 INFO - Cleaning up... 10:32:08 INFO - Return code: 0 10:32:08 INFO - Running post-action listener: _resource_record_post_action 10:32:08 INFO - Running post-action listener: _start_resource_monitoring 10:32:08 INFO - Starting resource monitoring. 10:32:08 INFO - [mozharness: 2016-08-10 17:32:08.439617Z] Finished create-virtualenv step (success) 10:32:08 INFO - [mozharness: 2016-08-10 17:32:08.440265Z] Running install step. 10:32:08 INFO - Running pre-action listener: _resource_record_pre_action 10:32:08 INFO - Running main action method: install 10:32:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:32:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:32:08 INFO - Reading from file tmpfile_stdout 10:32:08 INFO - Detecting whether we're running mozinstall >=1.0... 10:32:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:32:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:32:08 INFO - Reading from file tmpfile_stdout 10:32:08 INFO - Output received: 10:32:08 INFO - Usage: mozinstall [options] installer 10:32:08 INFO - Options: 10:32:08 INFO - -h, --help show this help message and exit 10:32:08 INFO - -d DEST, --destination=DEST 10:32:08 INFO - Directory to install application into. [default: 10:32:08 INFO - "/builds/slave/test"] 10:32:08 INFO - --app=APP Application being installed. [default: firefox] 10:32:08 INFO - mkdir: /builds/slave/test/build/application 10:32:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 10:32:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 10:32:24 INFO - Reading from file tmpfile_stdout 10:32:24 INFO - Output received: 10:32:24 INFO - /builds/slave/test/build/application/firefox/firefox 10:32:24 INFO - Running post-action listener: _resource_record_post_action 10:32:24 INFO - [mozharness: 2016-08-10 17:32:24.794366Z] Finished install step (success) 10:32:24 INFO - [mozharness: 2016-08-10 17:32:24.794612Z] Running run-tests step. 10:32:24 INFO - Running pre-action listener: _resource_record_pre_action 10:32:24 INFO - Running main action method: run_tests 10:32:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:32:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:32:24 INFO - Python 2.7.3 10:32:24 INFO - Return code: 0 10:32:24 INFO - grabbing minidump binary from tooltool 10:32:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:32:24 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 0x159e570>, '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 0x159f470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x159f900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:32:24 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 10:32:24 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 10:32:24 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 10:32:24 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:32:24 INFO - Return code: 0 10:32:24 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 10:32:24 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:32:24 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:32:24 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 10:32:24 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:32:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-069', '--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 10:32:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-069 --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 10:32:24 INFO - Using env: {'DISPLAY': ':0', 10:32:24 INFO - 'HOME': '/home/cltbld', 10:32:24 INFO - 'LANG': 'en_US.UTF-8', 10:32:24 INFO - 'LANGUAGE': 'en_US:en', 10:32:24 INFO - 'LOGNAME': 'cltbld', 10:32:24 INFO - 'MAIL': '/var/mail/cltbld', 10:32:24 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:32:24 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 10:32:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:32:24 INFO - 'MOZ_NO_REMOTE': '1', 10:32:24 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:32:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:32:24 INFO - 'NO_EM_RESTART': '1', 10:32:24 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:32:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:32:24 INFO - 'PWD': '/builds/slave/test', 10:32:24 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:32:24 INFO - 'SHELL': '/bin/bash', 10:32:24 INFO - 'SHLVL': '1', 10:32:24 INFO - 'TERM': 'linux', 10:32:24 INFO - 'TMOUT': '86400', 10:32:24 INFO - 'USER': 'cltbld', 10:32:24 INFO - 'XDG_SESSION_COOKIE': '05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468', 10:32:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:32:24 INFO - '_': '/tools/buildbot/bin/python'} 10:32:24 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-069', '--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 10:32:25 INFO - mozversion application_buildid: 20160810092520 10:32:25 INFO - mozversion application_changeset: 4caf18e4aaca92756f79b2cba666073fe76eabb7 10:32:25 INFO - mozversion application_display_name: Nightly 10:32:25 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:32:25 INFO - mozversion application_name: Firefox 10:32:25 INFO - mozversion application_remotingname: firefox 10:32:25 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 10:32:25 INFO - mozversion application_vendor: Mozilla 10:32:25 INFO - mozversion application_version: 51.0a1 10:32:25 INFO - mozversion platform_buildid: 20160810092520 10:32:25 INFO - mozversion platform_changeset: 4caf18e4aaca92756f79b2cba666073fe76eabb7 10:32:25 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 10:32:25 INFO - mozversion platform_version: 51.0a1 10:32:25 INFO - using testdate: 1470850345 10:32:25 INFO - actual date: 1470850345 10:32:25 INFO - starting webserver on 'localhost:41734' 10:32:25 INFO - SUITE-START | Running 2 tests 10:32:25 INFO - TEST-START | dromaeo_css 10:32:25 INFO - operating with platform_type : linux_ 10:32:25 INFO - Initialising browser for dromaeo_css test... 10:32:25 INFO - TEST-INFO | started process 32132 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmppPUr_C/profile http://localhost:41734/getInfo.html) 10:32:29 INFO - PROCESS | 32132 | __metrics Screen width/height:1600/1200 10:32:29 INFO - PROCESS | 32132 | colorDepth:24 10:32:29 INFO - PROCESS | 32132 | Browser inner width/height: 1024/697 10:32:29 INFO - PROCESS | 32132 | __metrics 10:32:30 ERROR - PROCESS | 32132 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 10:32:31 INFO - TEST-INFO | 32132: exit 0 10:32:31 INFO - Browser initialized. 10:32:31 INFO - Running cycle 1/1 for dromaeo_css test... 10:32:31 INFO - TEST-INFO | started process 32254 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmppPUr_C/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:32:43 INFO - PROCESS | 32254 | RSS: Main: 164061184 10:32:43 INFO - PROCESS | 32254 | 10:33:32 INFO - PROCESS | 32254 | 1470850412971 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] 10:35:45 INFO - PROCESS | 32254 | Cycle 1(1): loaded http://localhost:41734/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41734/tests/dromaeo/cssquery-ext.html) 10:35:46 INFO - PROCESS | 32254 | RSS: Main: 165531648 10:35:46 INFO - PROCESS | 32254 | 10:38:49 INFO - PROCESS | 32254 | Cycle 1(1): loaded http://localhost:41734/tests/dromaeo/cssquery-ext.html (next: http://localhost:41734/tests/dromaeo/cssquery-jquery.html) 10:38:49 INFO - PROCESS | 32254 | RSS: Main: 165797888 10:38:49 INFO - PROCESS | 32254 | 10:41:51 INFO - PROCESS | 32254 | Cycle 1(1): loaded http://localhost:41734/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41734/tests/dromaeo/cssquery-mootools.html) 10:41:52 INFO - PROCESS | 32254 | RSS: Main: 168742912 10:41:52 INFO - PROCESS | 32254 | 10:44:54 INFO - PROCESS | 32254 | Cycle 1(1): loaded http://localhost:41734/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41734/tests/dromaeo/cssquery-prototype.html) 10:44:55 INFO - PROCESS | 32254 | RSS: Main: 162926592 10:44:55 INFO - PROCESS | 32254 | 10:47:57 INFO - PROCESS | 32254 | Cycle 1(1): loaded http://localhost:41734/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41734/tests/dromaeo/cssquery-yui.html) 10:47:58 INFO - PROCESS | 32254 | RSS: Main: 164831232 10:47:58 INFO - PROCESS | 32254 | 10:51:01 INFO - PROCESS | 32254 | Cycle 1(1): loaded http://localhost:41734/tests/dromaeo/cssquery-yui.html (next: http://localhost:41734/tests/dromaeo/cssquery-dojo.html) 10:51:01 INFO - PROCESS | 32254 | RSS: Main: 168955904 10:51:01 INFO - PROCESS | 32254 | 10:51:01 INFO - PROCESS | 32254 | __start_tp_report 10:51:01 INFO - PROCESS | 32254 | _x_x_mozilla_page_load 10:51:01 INFO - PROCESS | 32254 | _x_x_mozilla_page_load_details 10:51:01 INFO - PROCESS | 32254 | |i|pagename|runs| 10:51:01 INFO - PROCESS | 32254 | |0;dojo.html;2676.5316069687824;2682.9134200648737;2704.9188524344263;2708.0927889157133;2717.864106794661;4648.3027545868135;4844.539768721975;4874.244492103725;4881.951180488194;4909.779059942302;4785.5214478552125;4837.226043832988;4868.221084626461;4886.584640305578;4920.557149856512;4313.223619748444;4391.297392417214;4414.315781053926;4458.554144585548;4499.932501012488;4171.979140104295;4455.487618923833;4506.098780243948;4528.298113792351;4551.385562948993;4263.211305908417;4393.714408563433;4439.489458712257;4466.642668586505;4476.060027394251;4466.642668586505;4475.082608065339;4485;4517.819287228507;4522.072975040109;4443.466783985942;4459.44256967879;4464.754438505881;4465.240909045438;4506.864794056183;4641.048585040058;4708.0819240248165;4777.092352453057;4818.229083346683;4879.487653796371;5166.457521960216;5172.793088276464;5175.120229560984;5182.870428239286;5217.843464696065;5207.713575753332;5209.53114219722;5214.426413094557;5222.686638801684;5256.237845512379;4521.773911304422;4798.880027999328;4828.324034635154;4848.0546293472435;4859.22252439615;5355.544778693855;5356.705381204071;5384.9461505385225;5412;5425;5112.616553758408;5114.897702045938;5118.966825022997;5127.41034781005;5170.1469257572835;4988.226824842155;5081.59347252219;5086.9745651271505;5213.035588416155;5229.241759944863;5065.164247899129;5065.822696205615;5076;5086.364204474441;5108.106081435734;5002.74986250686;5041.59667226621;5042.9747851261245;5072.721000344943;5111.437741848394;4159.708820382544;4287.656987440997;4301.5698430156735;4349.478062632505;4384.758838263862;3789.242151569697;3793.279276937373;3825.5409350877517;3829.9234015320094;3854.9614503855164;4405.955940440619;4410.558944105628;4418.028033832552;4419.359192917073;4425.247707889666;5002.224655178453;5093.1087059764395;5108.7190204538365;5121.231815227746;5145.485451454824;4429.180601588717;4473.753943533137;4493.1013797240685;4506.729596224237;4513.345564893072;4624.745638989821;4628.699134556243;4636.4899861015265;4643.837465688753;4671.976640116845;4708.458527269408;4842.7820748065715;4894.241392584155;4897.14299997499;4909.95090049095;5174.068667639861;5182.378114626118;5196.9740151299;5228.1112210923475;5236.869078272921;4899.951000489949;4904.068227036852;4905.90188196227;4906.852794416173;4955.4301255356095;4853.466118726867;4950.084234416644;4995.17579599362;5145.948540514547;5149.48505149482;5049.091163590589;5068.391792984866;5082.288479612783;5087.109755792648;5121.180611102206;4930.728809915489;4947.3073769671555;4949.529794669501;4950.98504806521;4959.082569724613;4720.976395118002;4904.5095490452095;4917.213245880785;4961.627877909244;4970.3290055842;4861.562459378673;4880.658353915192;4905.068037072945;4930.654854160174;4946.1097002538445;5015.648904576645;5015.673981191211;5035.899282014412;5044.369453818273;5066.82266120684;4682.2040253156365;4899.559039686445;4914.901701966012;4940.8764780880765;4961.801527938842 10:51:01 INFO - PROCESS | 32254 | |1;ext.html;551.7792882846861;558.5447859994107;561.9297587801524;562.6342877129865;600.4265926040632;34358;38972.22055558891;39035.80482097593;39107.413388799156;39112.21775564487;39292.214155716865;39798.60201397985;39834.60165398345;39842.203155936935;39881;7628.771136865889;7810.687572497093;7834.56909869957;7843.176466471024;7850.646720897574;7651.502652327608;7781.805454863617;7782.9610851945945;7805.4536182467255;7829.17793631669;7768.106667733198;7846.372290216769;7848.529088254723;7848.921510784905;7888.881666774974;7758.650860711254;7789.7273595423885;7793.2596403341595;7821.608919554028;7826.5695386753705;7661.889026091186;7681.615919204018;7733.265339792711;7733.535987840747;7741.729039483591;36256.274874502626;36470.63529364699;36475.08812279688;36634.8168259157;36658.63341366606;2237.686723858661;2693.8114331996767;2887.3070463088916;2953.4536110819354;3187.15540381799;28132.578011329846;28278.151655450165;28589.857050714614;28690.426191476054;28697.56953645697;3430.3139372125424;3470.1876633145944;3548.449990251515;3662.359087159736;3665.120371110941;255386;255498;255750;256203;257444;27437.58843617347;28471;51839;52214.477855221725;52244.21633675498;31957.52063719046;32189.678103219136;32325;32446.188845279055;32448.83775581107;12365.814512782315;12511.186772859735;12530.561430350077;12532.436040378205;12540.937295313464;10359.948200259101;10485.528151233213;10561.735956600993;10561.841572376421;10579.206559508068;7686.538807671557;7744.2642948919765;7771.727989520453;7796.4932279401655;7827.334676552443;2996.194832562633;3077.2614572502885;3092.8608212630484;3103.7827352085137;3124.656287808339;949.5442187749919;958.2669258017622;964.9662261820803;1018.9439580822977;1052.6368402900987;26886.731132688816;27404.451910962067;27455.86272068627;27489.725102749115;27556.44887102247;976.2239019979133;989.7426669065951;1031.200819364998;1034.7464871106627;1101.4437708956925;14042.36809343582;14788.704225915422;14918.17950012738;15042.849571504365;15107.848921510644;308715;309880;310596;311618;311653;45459.54540454553;45514.77242613766;45937.31094033592;46058.53941460609;46289.5371046292;1159.6173262823247;1180.397997021508;1195.521791283511;1197.808350663907;1208.5890797129018;25330.746692532837;26935;27160.321271507863;27312.863435682695;27436.588451173648;38928.41607375948;39431.80284098561;39433.80283098566;39497;39505.407418888164;260043;262014;263040;263834;263878;23930.64104038406;24058.51882962366;24384.756152438957;24389.63415548804;24456.755432445447;39301.41047884341;39405;39465.40801887916;39925;40358;35596.82201589079;36325.27349453049;37011.6298837019;40390;40862.18275634411;35902.64097359098;36218.818905905304;36667;36831.263374732895;37390;35615;35858.28283434369;36459.45310820287;36637.450438242915;36876.446853296686;31197.688023119477;33111.29890142646;33512;33602.66397335995;33624.1593960153;26035.609465858408;26036.8698156508;26078.34804129912;26217;26646.20061398161 10:51:01 INFO - PROCESS | 32254 | |2;jquery.html;340.93351796399696;343.7816986213754;355.9697425718814;372.68135743938916;379.14502796194574;15876.285567149476;16883.24025418856;17811.64376712465;17835.375761848354;18028.18873150708;15969;16204.432844850433;16488.505344839676;16560.75158872618;16575.585610359747;4782.593479554242;4961.8015279388965;4965.205567109263;4982.17794063979;4982.750862456881;3683.060819491026;5213.973930130344;5904.527637788967;6185.6597887116195;6209.813705588839;6151.87696246077;6233.750649973996;6243.750249989995;6258.874822503547;6277.905831412532;6203.658798766066;6243.250809902818;6244.250689917194;6256.499480041632;6265.780697675559;4625.32932724753;4848.5636292733825;5497.47773961473;5501.614886957915;5511.862203444906;10583.523741431654;10627.14982801374;10730.570777168903;10793.622223222228;10809.081228095622;1785.0539214216356;1934.64209121313;1970.231609672229;2374.169040835711;2406.795422389099;9065.546722663907;9110.59002344896;9128;9161;9482.95258523703;1593.529908676943;1618.935242590295;1683.1500092453355;1687.2323092992658;1691.2812054876629;62527.37472625261;63365.68317158385;68499.65750171218;69884.65057674679;70934.2906570938;9362.625494980124;9448.385854919547;9612.66355677548;9747.805043899083;9858.80282394348;12924.353782310847;12951.093423460456;12951.963842892546;12964;12985.220886746636;6889.517733758589;6979.651017449107;7008.334208250208;7269.345758881726;7282.053333066668;6748.426383757337;6767.763128290486;6972.477064220204;6973.51185417026;6990.126234220723;4162.1259535497275;4162.396452514429;4167.124903770182;4195.475565554306;4198.727082739612;1700.200905574378;1721.6470623522148;1794.3850534518776;1823.726441033829;1845.6216475622466;883.0948278015086;883.2183517586853;939.9201067909304;968.7481254873643;970.3741086998846;16507.257173427224;17030.97814131156;17184.656306873792;17297.481075567754;17483.388081417088;848.7241646464801;862.3489265604428;896.8699538566872;936.3585943628636;950.8478643417159;9340.299477539213;9491.525423728786;9610.471424071604;9815.607375705034;9820.558074886647;382011;385337;385840;385911;405969;46854;52152;72185.27814721786;77573.22426775773;78052.60973695095;876.4741155306892;905.4024343933104;908.3459908865606;909.0500427053745;916.8716379706847;14853.645263877796;15460.690786184437;15541.378344866078;15574.299156537756;15874.603134921257;34553;34934.30131397307;35206.29587408289;38204.6179538201;38512.6148738509;45950.54049459463;51517.742411289204;51947.74026129845;52210.73894630503;54749.72625136849;6868.347506986828;7350.889736654061;7376.077990251219;7529.096508419025;7611.695532178873;6418.6469744164515;10284.948575257076;10687.946560267148;12278.693032673897;12303.384830758605;10204.489775511343;10455.477226138815;10462.947685261524;10556.261061725605;11038;10073.395596264247;10375.740606484898;10499.317544359592;10593.523291452057;10740.624078157227;10215.182785377003;10705.839412408664;10716.51775670081;10822.080123189617;10961.068309193808;7555.206703296075;7651.732189373345;7661.693532258647;7819.8436031277915;7918.683252669829;8440.282575980866;10348.689539313833;10513.316634418738;10542.26204165701;11062.336259824437 10:51:01 INFO - PROCESS | 32254 | |3;mootools.html;1365.2968721108628;1396.1483495068007;1516.8786497080227;1695.2540882011922;1729.5848996240898;6731.831704207398;7625.389968802497;7677.270659287359;8292.419530632858;8296.79258018549;7784.104827944774;8023.237792409712;8047.436679432442;8055.315298199645;8072.3945704072285;2170.272958558881;2209.2267706302746;2215.324326080545;2218.267971569378;2235.0612742648127;2184.912603495858;2188.901499432521;2233.2853486884205;2238.1271304191378;2239.2050821958214;2221.5445833604153;2233.653783663535;2240.932772016842;2243.887805609721;2255.8984845681985;2143.057054895841;2148.387709502784;2159.7948194921455;2166.808255459491;2167.7073595064703;2095.3190213180624;2104.168853302937;2111.788821117891;2115.5874604452138;2115.7989990950837;8011.198880111942;8148.266656000929;8155.632996515171;8158.061822890384;8162.632681529345;4474.865754027384;4613.700109492872;4620.3069539569;4621.006483606041;4624.121416930772;2909.8254104753782;2969.2576855786056;2989.2676294308035;3044.451998640244;3064.9233769155726;927.6289484206304;960.490939801906;962.9662961796373;963.4949132256078;969.3602222533094;10847.51186196623;10890.40102794346;10902.291351062155;10922.29005114665;10932.234743568033;3938.212357528506;4064.2887494688903;4169.041120542292;4224.366345048267;4227.492700875914;9292.070792920655;9325.440473571607;9325.533723313807;9332.113449222314;9333.953330233306;4576.58810707038;4587.197240482902;4620.306953956933;4622.630189584893;4630.398048253705;3432.742544309137;4072.9796351018053;4171.791410429466;4206.116715489781;4214.072903961123;3618.457231415256;3625.495419400972;3737.0657335666083;3755.399136138205;3790.5451345838123;1154.7748189103045;1164.5516476156572;1168;1170.4674373160192;1172.0623501199007;763.2367632367632;793.1711361627114;798.648594618366;799.7560743973028;806.7055524733547;5224;5262;5280.683159010395;5292.073887069748;5342.118550439134;377.76200993374;380.69544364508283;382.99042523936566;395.18197331524044;396.81548080142295;3660.670539651444;3667.064898450878;3667.853285868589;3674.0814796300924;3853.6917046636204;9669.468179250209;9912.752181195528;9973.202143828476;9975.401475911469;9995.450250236161;9851.556679949419;9869;9874.901250987397;9901.108900199017;9925.851112233178;7217.8917316240295;7526.811829704301;7587.430942679322;7596.08846938371;7633.6564854580565;5359.678419294854;5455.181722741462;5463.972680136574;5508.504234618743;5520.641158324696;8858.95570522169;9044.547772611475;9186.081391861027;9303.906960930304;9316.20812230968;8976.461412315282;9351.39215950961;9492.762680932756;9535.094166054214;9544.904550954401;6918.861622767416;6956.2000369958105;6956.304369563003;7036.331548502884;7040.8591828162125;7474;7525.811854703457;7598.468107232441;7598.734044308423;7614.238576142341;6734.9326506734305;6746.527743057939;6789.1852977643;6844.076049733421;6936;6737.461003119641;6740.966295168493;6781.084553585203;6831.248562658005;6832.692528836114;6216.689165541795;6220.626762394271;6231.657258850807;6278.434940855345;6316.905246421399;4416.977915110404;4573.81704731807;4606.484008295942;4637.721736695809;4705.341252224623;4520.88697782558;4551.931721024121;4562.977185114186;4671.369365135663;4743.430788305287 10:51:01 INFO - PROCESS | 32254 | |4;prototype.html;270.7171006298418;278.34311025978695;282.2224770756565;282.4294924253009;288.1470846294966;4847.442544107429;4910.975445122769;5000.624953128517;5075.923861142086;5085.847424577264;4908.705477671333;4949.911019575697;4960.131976904046;4965.801367945278;4974.776135073921;3909.863154789583;3912.452256684059;3925.685945124383;3929.2534418460546;3931.6264954829244;3641.4887821554025;3930.489036425275;3933.8426462941447;3934.9803250983705;3942.2115576884594;3796.5633952095586;3798.8670396536127;3799.1072098056934;3800.448934904437;3807.8286477108595;3787.6591106800383;3798.525184351956;3805.885823425274;3809.9619003809885;3810.371288737355;3183.936321273585;3299.7195238404765;3301.9339613207603;3302.7357811375273;3303.4549299365576;4844.031193761261;4873.926891096637;4887.462379138292;4906.350570691822;4906.828261010884;4379.401518445744;4380.233459144669;4388.780560971939;4394.78026098697;4395.648348132142;4874.612144559533;5173.844784656466;5208.088584497697;5274.340707411574;5301.310829592167;3584.982075089608;3592.7844329340323;3600.39782296878;3608.5128507651393;3614.4216925291826;5443.727813609344;5509.752061157257;5522.806701765459;5524;5543;3599.586047604559;3603.1532589841368;3614.584322802911;3619.0952261934517;3631.5642122945414;3539.185987222953;3702.500162478031;3720.5907350191455;3730.925381492355;3731.533558305212;4310.374995625617;4315.4605674290715;4315.870523884289;4318.1363727254675;4351.73889566627;5221.843344699665;5232.3459567554055;5234.97382513085;5272.393674727378;5277.894442111213;1184.656449629615;1248.1637303007008;1279.2644229568036;1281.1992504684572;1293.0819118425834;830.730012745848;841.1210285251926;851.7274472168847;854.3165467625874;857.8412993596205;4540.409746732904;4540.523245059288;4553.225951588238;4564.794584243717;4568.743595511261;5313.388960269618;5327.174287985368;5333.333333333333;5347.51872331492;5350.357957045102;4570.925832429376;4583.037562111927;4586.1057093866375;4587.678862479661;4589.1051245007575;2732.426190500017;2863.3271181272385;2871.7128287171117;2875.3817929145334;2887.45138423703;5077.746112694351;5080.872978175501;5089.465606111379;5089.872753181126;5093.261477085802;5269.710165940834;5469.507744303032;5491.258680078218;5502.899420115993;5524.696141712245;5060.974695126501;5060.974695126574;5061.215511595708;5066.923996140061;5099.3370861787735;5362.597805164551;5365.919511207257;5392.004958165504;5401.73059331049;5404.83785486436;5005.5745261653165;5210.921836172536;5217.478252174752;5235.842924712265;5247.239150323106;5042.445331013659;5048.545630893237;5054.772535235997;5078.97460512695;5124.666896651705;3667.8176484991386;3667.8532858685353;3677.282929828658;3677.705783537257;3679.8712045078296;5152.149895267239;5244.396894357198;5300.284461597635;5338.199270109515;5340.0921843287515;5088.516590923857;5151.754394731295;5166.922496162636;5178.818741344035;5189.5069968354455;5174.404943431554;5181.885894532694;5189.844304670866;5199.2980947573105;5213.843584692465;4986.750662466935;5063.772130254221;5101.158308879142;5101.362329708786;5143.948560514347;5189;5197.766100525561;5205.401378841481;5213.374395072616;5219.08665983459;5106.565941894981;5123.948760512496;5125.154349532286;5126.923096153486;5129.9743501282255 10:51:01 INFO - PROCESS | 32254 | |5;yui.html;628.4846425930737;717.6411794102949;737.933585977262;741.6254791330377;747.3946103656035;12289.938550307246;13114.47542098316;13229.735405291889;13241.735165296688;13291.069625126232;12326.32205228712;12646.873531264684;12770.744585108292;12803.35983200841;12863.035272354564;759.2938567132564;781.6756046240803;785.5954183595453;785.8546168958733;786.712849809821;636.1761518833122;759.7644730133649;778.9805254868645;785.2304741353448;787.9684812607518;820.4420993724265;820.9327873764083;822.3256929317962;822.7161629237903;823.9340852731797;806.8265322955592;809.9838003239961;818.2431251092745;818.8198596308803;822.0628483528782;598.5331441475612;598.7215944585745;598.8742364103543;600.2736688606791;600.7657013764635;12065;12103.092268079841;12104.031677465782;12117.39413029345;12147.088968327322;13227.404766785517;13478.19130852152;13719.931400343034;13745;13967.092139010932;10299.588016479407;10316.58733650653;10448.634297799541;10503.212259080523;10604.840927386096;3265.9346813063607;3273.688999545039;3318.7013168814924;3320.6181289151814;3330.0509354834;66812;67421.32578674199;67618.66190669064;68530.65734671344;69461.99999999949;10418.739531511774;10680.145588352912;10714.357138571711;10833.512491937881;11021.504032318566;20085.297014604712;20200.191992320437;20264;20296.49258768513;20319.593608127754;6860.312797713508;6967.407770339578;6979.965100174467;7036.859262814715;7104.360607545345;3770.245950809849;3819.809009549567;3826.3686491728554;3832.291026160169;3951.8814435566405;2802.5936239245193;2874.870630821618;2886.8845246189917;2888.9133326000256;2893.1899068260923;481.2056931098315;490.9533594308535;505.36071869085634;513.7662363624542;514.1105886815755;610.124471383566;631.260330167068;634.3688030409771;639.8912184928573;646.679893452744;8161.5919204039565;8331.500109993298;8399.95800020996;8793.648254069765;8910.55447227649;606.2785285510316;611.6880391000622;618.7277597856929;636.6752955992384;642.9871402571922;4040.919181616351;4292.527821939584;4355.564443555682;4362.214801335726;4403.207422663887;83742;87412;102174.48912755388;110137;110161;70480.64759676169;71225.2877471229;72268.63865680744;90451;97941.51029244809;68629.65685171542;70844.64577677079;72832.63583682048;74467.62766186135;75109;8438.451500652438;8863.24662403677;8869.334799890163;9005.639774409212;9067.229285510806;44313.11373772442;44958.325625114994;44964.77517612391;45419.772901135286;46594.534054659016;55944.72027639836;60458.39541604528;67781.66109169423;67800.3219967794;69190.65404672944;12289.893909548184;12903.41934612926;13031.804522932352;13043.934780326037;13179.802302965272;13060.151090179108;13253.933730331286;13752.518661846787;13875.930620346833;14229.288535573387;12373.505059797868;12650.620481385573;12797.29614871191;12854.357282135668;13027.544035958696;11920.403979801149;12061.974732147866;12162.635120946386;12643.810342845049;12713.491460341484;11968.281903085843;12422.937885310515;12442;12515.87484125147;12668;10191.490425478845;10203.897961020295;10493.632722854663;10582.894171058499;10702;9599;10676.83984740214;10884.346939183675;10961.451927403758;10963.451827408438 10:51:01 INFO - PROCESS | 32254 | __end_tp_report 10:51:01 INFO - PROCESS | 32254 | __start_cc_report 10:51:01 INFO - PROCESS | 32254 | _x_x_mozilla_cycle_collect,374 10:51:01 INFO - PROCESS | 32254 | __end_cc_report 10:51:01 INFO - PROCESS | 32254 | __startTimestamp1470851461337__endTimestamp 10:51:01 INFO - PROCESS | 32254 | 10:51:01 INFO - PROCESS | 32254 | ------- Summary: start ------- 10:51:01 INFO - PROCESS | 32254 | Number of tests: 6 10:51:01 INFO - PROCESS | 32254 | 10:51:01 INFO - PROCESS | 32254 | [#0] dojo.html Cycles:165 Average:4751.80 Median:4899.56 stddev:497.45 (10.2%) stddev-sans-first:471.59 10:51:01 INFO - PROCESS | 32254 | Values: 2676.5 2682.9 2704.9 2708.1 2717.9 4648.3 4844.5 4874.2 4882.0 4909.8 4785.5 4837.2 4868.2 4886.6 4920.6 4313.2 4391.3 4414.3 4458.6 4499.9 4172.0 4455.5 4506.1 4528.3 4551.4 4263.2 4393.7 4439.5 4466.6 4476.1 4466.6 4475.1 4485.0 4517.8 4522.1 4443.5 4459.4 4464.8 4465.2 4506.9 4641.0 4708.1 4777.1 4818.2 4879.5 5166.5 5172.8 5175.1 5182.9 5217.8 5207.7 5209.5 5214.4 5222.7 5256.2 4521.8 4798.9 4828.3 4848.1 4859.2 5355.5 5356.7 5384.9 5412.0 5425.0 5112.6 5114.9 5119.0 5127.4 5170.1 4988.2 5081.6 5087.0 5213.0 5229.2 5065.2 5065.8 5076.0 5086.4 5108.1 5002.7 5041.6 5043.0 5072.7 5111.4 4159.7 4287.7 4301.6 4349.5 4384.8 3789.2 3793.3 3825.5 3829.9 3855.0 4406.0 4410.6 4418.0 4419.4 4425.2 5002.2 5093.1 5108.7 5121.2 5145.5 4429.2 4473.8 4493.1 4506.7 4513.3 4624.7 4628.7 4636.5 4643.8 4672.0 4708.5 4842.8 4894.2 4897.1 4910.0 5174.1 5182.4 5197.0 5228.1 5236.9 4900.0 4904.1 4905.9 4906.9 4955.4 4853.5 4950.1 4995.2 5145.9 5149.5 5049.1 5068.4 5082.3 5087.1 5121.2 4930.7 4947.3 4949.5 4951.0 4959.1 4721.0 4904.5 4917.2 4961.6 4970.3 4861.6 4880.7 4905.1 4930.7 4946.1 5015.6 5015.7 5035.9 5044.4 5066.8 4682.2 4899.6 4914.9 4940.9 4961.8 10:51:01 INFO - PROCESS | 32254 | 10:51:01 INFO - PROCESS | 32254 | [#1] ext.html Cycles:180 Average:42160.84 Median:19572.64 stddev:72684.92 (371.4%) stddev-sans-first:72821.68 10:51:01 INFO - PROCESS | 32254 | Values: 551.8 558.5 561.9 562.6 600.4 34358.0 38972.2 39035.8 39107.4 39112.2 39292.2 39798.6 39834.6 39842.2 39881.0 7628.8 7810.7 7834.6 7843.2 7850.6 7651.5 7781.8 7783.0 7805.5 7829.2 7768.1 7846.4 7848.5 7848.9 7888.9 7758.7 7789.7 7793.3 7821.6 7826.6 7661.9 7681.6 7733.3 7733.5 7741.7 36256.3 36470.6 36475.1 36634.8 36658.6 2237.7 2693.8 2887.3 2953.5 3187.2 28132.6 28278.2 28589.9 28690.4 28697.6 3430.3 3470.2 3548.4 3662.4 3665.1 255386.0 255498.0 255750.0 256203.0 257444.0 27437.6 28471.0 51839.0 52214.5 52244.2 31957.5 32189.7 32325.0 32446.2 32448.8 12365.8 12511.2 12530.6 12532.4 12540.9 10359.9 10485.5 10561.7 10561.8 10579.2 7686.5 7744.3 7771.7 7796.5 7827.3 2996.2 3077.3 3092.9 3103.8 3124.7 949.5 958.3 965.0 1018.9 1052.6 26886.7 27404.5 27455.9 27489.7 27556.4 976.2 989.7 1031.2 1034.7 1101.4 14042.4 14788.7 14918.2 15042.8 15107.8 308715.0 309880.0 310596.0 311618.0 311653.0 45459.5 45514.8 45937.3 46058.5 46289.5 1159.6 1180.4 1195.5 1197.8 1208.6 25330.7 26935.0 27160.3 27312.9 27436.6 38928.4 39431.8 39433.8 39497.0 39505.4 260043.0 262014.0 263040.0 263834.0 263878.0 23930.6 24058.5 24384.8 24389.6 24456.8 39301.4 39405.0 39465.4 39925.0 40358.0 35596.8 36325.3 37011.6 40390.0 40862.2 35902.6 36218.8 36667.0 36831.3 37390.0 35615.0 35858.3 36459.5 36637.5 36876.4 31197.7 33111.3 33512.0 33602.7 33624.2 26035.6 26036.9 26078.3 26217.0 26646.2 10:51:01 INFO - PROCESS | 32254 | 10:51:01 INFO - PROCESS | 32254 | [#2] jquery.html Cycles:180 Average:23594.61 Median:25739.66 stddev:64052.82 (248.8%) stddev-sans-first:64208.71 10:51:01 INFO - PROCESS | 32254 | Values: 340.9 343.8 356.0 372.7 379.1 15876.3 16883.2 17811.6 17835.4 18028.2 15969.0 16204.4 16488.5 16560.8 16575.6 4782.6 4961.8 4965.2 4982.2 4982.8 3683.1 5214.0 5904.5 6185.7 6209.8 6151.9 6233.8 6243.8 6258.9 6277.9 6203.7 6243.3 6244.3 6256.5 6265.8 4625.3 4848.6 5497.5 5501.6 5511.9 10583.5 10627.1 10730.6 10793.6 10809.1 1785.1 1934.6 1970.2 2374.2 2406.8 9065.5 9110.6 9128.0 9161.0 9483.0 1593.5 1618.9 1683.2 1687.2 1691.3 62527.4 63365.7 68499.7 69884.7 70934.3 9362.6 9448.4 9612.7 9747.8 9858.8 12924.4 12951.1 12952.0 12964.0 12985.2 6889.5 6979.7 7008.3 7269.3 7282.1 6748.4 6767.8 6972.5 6973.5 6990.1 4162.1 4162.4 4167.1 4195.5 4198.7 1700.2 1721.6 1794.4 1823.7 1845.6 883.1 883.2 939.9 968.7 970.4 16507.3 17031.0 17184.7 17297.5 17483.4 848.7 862.3 896.9 936.4 950.8 9340.3 9491.5 9610.5 9815.6 9820.6 382011.0 385337.0 385840.0 385911.0 405969.0 46854.0 52152.0 72185.3 77573.2 78052.6 876.5 905.4 908.3 909.1 916.9 14853.6 15460.7 15541.4 15574.3 15874.6 34553.0 34934.3 35206.3 38204.6 38512.6 45950.5 51517.7 51947.7 52210.7 54749.7 6868.3 7350.9 7376.1 7529.1 7611.7 6418.6 10284.9 10687.9 12278.7 12303.4 10204.5 10455.5 10462.9 10556.3 11038.0 10073.4 10375.7 10499.3 10593.5 10740.6 10215.2 10705.8 10716.5 10822.1 10961.1 7555.2 7651.7 7661.7 7819.8 7918.7 8440.3 10348.7 10513.3 10542.3 11062.3 10:51:01 INFO - PROCESS | 32254 | 10:51:01 INFO - PROCESS | 32254 | [#3] mootools.html Cycles:180 Average:5215.19 Median:5243.00 stddev:2986.73 (57.0%) stddev-sans-first:2981.10 10:51:01 INFO - PROCESS | 32254 | Values: 1365.3 1396.1 1516.9 1695.3 1729.6 6731.8 7625.4 7677.3 8292.4 8296.8 7784.1 8023.2 8047.4 8055.3 8072.4 2170.3 2209.2 2215.3 2218.3 2235.1 2184.9 2188.9 2233.3 2238.1 2239.2 2221.5 2233.7 2240.9 2243.9 2255.9 2143.1 2148.4 2159.8 2166.8 2167.7 2095.3 2104.2 2111.8 2115.6 2115.8 8011.2 8148.3 8155.6 8158.1 8162.6 4474.9 4613.7 4620.3 4621.0 4624.1 2909.8 2969.3 2989.3 3044.5 3064.9 927.6 960.5 963.0 963.5 969.4 10847.5 10890.4 10902.3 10922.3 10932.2 3938.2 4064.3 4169.0 4224.4 4227.5 9292.1 9325.4 9325.5 9332.1 9334.0 4576.6 4587.2 4620.3 4622.6 4630.4 3432.7 4073.0 4171.8 4206.1 4214.1 3618.5 3625.5 3737.1 3755.4 3790.5 1154.8 1164.6 1168.0 1170.5 1172.1 763.2 793.2 798.6 799.8 806.7 5224.0 5262.0 5280.7 5292.1 5342.1 377.8 380.7 383.0 395.2 396.8 3660.7 3667.1 3667.9 3674.1 3853.7 9669.5 9912.8 9973.2 9975.4 9995.5 9851.6 9869.0 9874.9 9901.1 9925.9 7217.9 7526.8 7587.4 7596.1 7633.7 5359.7 5455.2 5464.0 5508.5 5520.6 8859.0 9044.5 9186.1 9303.9 9316.2 8976.5 9351.4 9492.8 9535.1 9544.9 6918.9 6956.2 6956.3 7036.3 7040.9 7474.0 7525.8 7598.5 7598.7 7614.2 6734.9 6746.5 6789.2 6844.1 6936.0 6737.5 6741.0 6781.1 6831.2 6832.7 6216.7 6220.6 6231.7 6278.4 6316.9 4417.0 4573.8 4606.5 4637.7 4705.3 4520.9 4551.9 4563.0 4671.4 4743.4 10:51:01 INFO - PROCESS | 32254 | 10:51:01 INFO - PROCESS | 32254 | [#4] prototype.html Cycles:180 Average:4296.75 Median:4962.97 stddev:1276.89 (25.7%) stddev-sans-first:1244.20 10:51:01 INFO - PROCESS | 32254 | Values: 270.7 278.3 282.2 282.4 288.1 4847.4 4911.0 5000.6 5075.9 5085.8 4908.7 4949.9 4960.1 4965.8 4974.8 3909.9 3912.5 3925.7 3929.3 3931.6 3641.5 3930.5 3933.8 3935.0 3942.2 3796.6 3798.9 3799.1 3800.4 3807.8 3787.7 3798.5 3805.9 3810.0 3810.4 3183.9 3299.7 3301.9 3302.7 3303.5 4844.0 4873.9 4887.5 4906.4 4906.8 4379.4 4380.2 4388.8 4394.8 4395.6 4874.6 5173.8 5208.1 5274.3 5301.3 3585.0 3592.8 3600.4 3608.5 3614.4 5443.7 5509.8 5522.8 5524.0 5543.0 3599.6 3603.2 3614.6 3619.1 3631.6 3539.2 3702.5 3720.6 3730.9 3731.5 4310.4 4315.5 4315.9 4318.1 4351.7 5221.8 5232.3 5235.0 5272.4 5277.9 1184.7 1248.2 1279.3 1281.2 1293.1 830.7 841.1 851.7 854.3 857.8 4540.4 4540.5 4553.2 4564.8 4568.7 5313.4 5327.2 5333.3 5347.5 5350.4 4570.9 4583.0 4586.1 4587.7 4589.1 2732.4 2863.3 2871.7 2875.4 2887.5 5077.7 5080.9 5089.5 5089.9 5093.3 5269.7 5469.5 5491.3 5502.9 5524.7 5061.0 5061.0 5061.2 5066.9 5099.3 5362.6 5365.9 5392.0 5401.7 5404.8 5005.6 5210.9 5217.5 5235.8 5247.2 5042.4 5048.5 5054.8 5079.0 5124.7 3667.8 3667.9 3677.3 3677.7 3679.9 5152.1 5244.4 5300.3 5338.2 5340.1 5088.5 5151.8 5166.9 5178.8 5189.5 5174.4 5181.9 5189.8 5199.3 5213.8 4986.8 5063.8 5101.2 5101.4 5143.9 5189.0 5197.8 5205.4 5213.4 5219.1 5106.6 5123.9 5125.2 5126.9 5130.0 10:51:01 INFO - PROCESS | 32254 | 10:51:01 INFO - PROCESS | 32254 | [#5] yui.html Cycles:180 Average:18105.54 Median:4382.71 stddev:25532.82 (582.6%) stddev-sans-first:25570.72 10:51:01 INFO - PROCESS | 32254 | Values: 628.5 717.6 737.9 741.6 747.4 12289.9 13114.5 13229.7 13241.7 13291.1 12326.3 12646.9 12770.7 12803.4 12863.0 759.3 781.7 785.6 785.9 786.7 636.2 759.8 779.0 785.2 788.0 820.4 820.9 822.3 822.7 823.9 806.8 810.0 818.2 818.8 822.1 598.5 598.7 598.9 600.3 600.8 12065.0 12103.1 12104.0 12117.4 12147.1 13227.4 13478.2 13719.9 13745.0 13967.1 10299.6 10316.6 10448.6 10503.2 10604.8 3265.9 3273.7 3318.7 3320.6 3330.1 66812.0 67421.3 67618.7 68530.7 69462.0 10418.7 10680.1 10714.4 10833.5 11021.5 20085.3 20200.2 20264.0 20296.5 20319.6 6860.3 6967.4 6980.0 7036.9 7104.4 3770.2 3819.8 3826.4 3832.3 3951.9 2802.6 2874.9 2886.9 2888.9 2893.2 481.2 491.0 505.4 513.8 514.1 610.1 631.3 634.4 639.9 646.7 8161.6 8331.5 8400.0 8793.6 8910.6 606.3 611.7 618.7 636.7 643.0 4040.9 4292.5 4355.6 4362.2 4403.2 83742.0 87412.0 102174.5 110137.0 110161.0 70480.6 71225.3 72268.6 90451.0 97941.5 68629.7 70844.6 72832.6 74467.6 75109.0 8438.5 8863.2 8869.3 9005.6 9067.2 44313.1 44958.3 44964.8 45419.8 46594.5 55944.7 60458.4 67781.7 67800.3 69190.7 12289.9 12903.4 13031.8 13043.9 13179.8 13060.2 13253.9 13752.5 13875.9 14229.3 12373.5 12650.6 12797.3 12854.4 13027.5 11920.4 12062.0 12162.6 12643.8 12713.5 11968.3 12422.9 12442.0 12515.9 12668.0 10191.5 10203.9 10493.6 10582.9 10702.0 9599.0 10676.8 10884.3 10961.5 10963.5 10:51:01 INFO - PROCESS | 32254 | -------- Summary: end -------- 10:51:01 INFO - PROCESS | 32254 | 10:51:02 INFO - TEST-INFO | 32254: exit 0 10:51:02 INFO - TEST-OK | dromaeo_css | took 1117104ms 10:51:02 INFO - TEST-START | kraken 10:51:02 INFO - operating with platform_type : linux_ 10:51:02 INFO - Initialising browser for kraken test... 10:51:02 INFO - TEST-INFO | started process 32500 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpVU8gVi/profile http://localhost:41734/getInfo.html) 10:51:07 INFO - PROCESS | 32500 | __metrics Screen width/height:1600/1200 10:51:07 INFO - PROCESS | 32500 | colorDepth:24 10:51:07 INFO - PROCESS | 32500 | Browser inner width/height: 1024/697 10:51:07 INFO - PROCESS | 32500 | __metrics 10:51:07 ERROR - PROCESS | 32500 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 10:51:08 INFO - TEST-INFO | 32500: exit 0 10:51:08 INFO - Browser initialized. 10:51:08 INFO - Running cycle 1/1 for kraken test... 10:51:08 INFO - TEST-INFO | started process 32622 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpVU8gVi/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:51:20 INFO - PROCESS | 32622 | RSS: Main: 164384768 10:51:20 INFO - PROCESS | 32622 | 10:51:23 INFO - PROCESS | 32622 | Cycle 1(1): loaded http://localhost:41734/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41734/tests/kraken/driver.html?testName=audio-beat-detection) 10:51:24 INFO - PROCESS | 32622 | RSS: Main: 169541632 10:51:24 INFO - PROCESS | 32622 | 10:51:26 INFO - PROCESS | 32622 | Cycle 1(1): loaded http://localhost:41734/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41734/tests/kraken/driver.html?testName=audio-dft) 10:51:27 INFO - PROCESS | 32622 | RSS: Main: 168685568 10:51:27 INFO - PROCESS | 32622 | 10:51:30 INFO - PROCESS | 32622 | Cycle 1(1): loaded http://localhost:41734/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41734/tests/kraken/driver.html?testName=audio-fft) 10:51:31 INFO - PROCESS | 32622 | RSS: Main: 164806656 10:51:31 INFO - PROCESS | 32622 | 10:51:33 INFO - PROCESS | 32622 | Cycle 1(1): loaded http://localhost:41734/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41734/tests/kraken/driver.html?testName=audio-oscillator) 10:51:33 INFO - PROCESS | 32622 | RSS: Main: 165478400 10:51:33 INFO - PROCESS | 32622 | 10:51:36 INFO - PROCESS | 32622 | Cycle 1(1): loaded http://localhost:41734/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41734/tests/kraken/driver.html?testName=imaging-gaussian-blur) 10:51:36 INFO - PROCESS | 32622 | RSS: Main: 165695488 10:51:36 INFO - PROCESS | 32622 | 10:51:40 INFO - PROCESS | 32622 | Cycle 1(1): loaded http://localhost:41734/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41734/tests/kraken/driver.html?testName=imaging-darkroom) 10:51:40 INFO - PROCESS | 32622 | RSS: Main: 165830656 10:51:40 INFO - PROCESS | 32622 | 10:51:44 INFO - PROCESS | 32622 | Cycle 1(1): loaded http://localhost:41734/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41734/tests/kraken/driver.html?testName=imaging-desaturate) 10:51:44 INFO - PROCESS | 32622 | RSS: Main: 163291136 10:51:44 INFO - PROCESS | 32622 | 10:51:47 INFO - PROCESS | 32622 | Cycle 1(1): loaded http://localhost:41734/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41734/tests/kraken/driver.html?testName=json-parse-financial) 10:51:48 INFO - PROCESS | 32622 | RSS: Main: 164802560 10:51:48 INFO - PROCESS | 32622 | 10:51:50 INFO - PROCESS | 32622 | Cycle 1(1): loaded http://localhost:41734/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41734/tests/kraken/driver.html?testName=json-stringify-tinderbox) 10:51:50 INFO - PROCESS | 32622 | RSS: Main: 164970496 10:51:50 INFO - PROCESS | 32622 | 10:51:52 INFO - PROCESS | 32622 | Cycle 1(1): loaded http://localhost:41734/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41734/tests/kraken/driver.html?testName=stanford-crypto-aes) 10:51:53 INFO - PROCESS | 32622 | RSS: Main: 165027840 10:51:53 INFO - PROCESS | 32622 | 10:51:55 INFO - PROCESS | 32622 | Cycle 1(1): loaded http://localhost:41734/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41734/tests/kraken/driver.html?testName=stanford-crypto-ccm) 10:51:56 INFO - PROCESS | 32622 | RSS: Main: 165679104 10:51:56 INFO - PROCESS | 32622 | 10:51:59 INFO - PROCESS | 32622 | Cycle 1(1): loaded http://localhost:41734/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41734/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 10:51:59 INFO - PROCESS | 32622 | RSS: Main: 165863424 10:51:59 INFO - PROCESS | 32622 | 10:52:02 INFO - PROCESS | 32622 | Cycle 1(1): loaded http://localhost:41734/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41734/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 10:52:03 INFO - PROCESS | 32622 | RSS: Main: 166137856 10:52:03 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | Cycle 1(1): loaded http://localhost:41734/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41734/tests/kraken/driver.html?testName=ai-astar) 10:52:05 INFO - PROCESS | 32622 | RSS: Main: 166817792 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | __start_tp_report 10:52:05 INFO - PROCESS | 32622 | _x_x_mozilla_page_load 10:52:05 INFO - PROCESS | 32622 | _x_x_mozilla_page_load_details 10:52:05 INFO - PROCESS | 32622 | |i|pagename|runs| 10:52:05 INFO - PROCESS | 32622 | |0;ai-astar;107;115;110;115;114;116;116;115;115;115 10:52:05 INFO - PROCESS | 32622 | |1;audio-beat-detection;152;123;149;191;137;149;149;127;186;130 10:52:05 INFO - PROCESS | 32622 | |2;audio-dft;162;162;164;177;163;164;163;162;165;162 10:52:05 INFO - PROCESS | 32622 | |3;audio-fft;76;77;78;173;77;91;76;75;164;77 10:52:05 INFO - PROCESS | 32622 | |4;audio-oscillator;86;86;159;87;86;86;138;85;87;129 10:52:05 INFO - PROCESS | 32622 | |5;imaging-gaussian-blur;117;118;117;119;118;118;119;118;118;118 10:52:05 INFO - PROCESS | 32622 | |6;imaging-darkroom;149;147;148;148;147;149;147;149;147;146 10:52:05 INFO - PROCESS | 32622 | |7;imaging-desaturate;96;97;95;96;95;96;96;96;96;95 10:52:05 INFO - PROCESS | 32622 | |8;json-parse-financial;64;63;66;63;65;63;64;63;66;64 10:52:05 INFO - PROCESS | 32622 | |9;json-stringify-tinderbox;66;66;66;65;66;67;66;65;66;66 10:52:05 INFO - PROCESS | 32622 | |10;stanford-crypto-aes;81;81;81;81;90;80;80;88;85;82 10:52:05 INFO - PROCESS | 32622 | |11;stanford-crypto-ccm;139;134;137;137;141;136;138;141;164;144 10:52:05 INFO - PROCESS | 32622 | |12;stanford-crypto-pbkdf2;174;171;174;172;171;180;176;168;178;176 10:52:05 INFO - PROCESS | 32622 | |13;stanford-crypto-sha256-iterative;69;69;73;68;71;73;71;69;68;69 10:52:05 INFO - PROCESS | 32622 | __end_tp_report 10:52:05 INFO - PROCESS | 32622 | __start_cc_report 10:52:05 INFO - PROCESS | 32622 | _x_x_mozilla_cycle_collect,954 10:52:05 INFO - PROCESS | 32622 | __end_cc_report 10:52:05 INFO - PROCESS | 32622 | __startTimestamp1470851525451__endTimestamp 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | ------- Summary: start ------- 10:52:05 INFO - PROCESS | 32622 | Number of tests: 14 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | [#0] ai-astar Cycles:10 Average:113.80 Median:115.00 stddev:2.94 (2.6%) stddev-sans-first:1.81 10:52:05 INFO - PROCESS | 32622 | Values: 107.0 115.0 110.0 115.0 114.0 116.0 116.0 115.0 115.0 115.0 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | [#1] audio-beat-detection Cycles:10 Average:149.30 Median:149.00 stddev:23.11 (15.5%) stddev-sans-first:24.49 10:52:05 INFO - PROCESS | 32622 | Values: 152.0 123.0 149.0 191.0 137.0 149.0 149.0 127.0 186.0 130.0 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | [#2] audio-dft Cycles:10 Average:164.40 Median:163.50 stddev:4.55 (2.8%) stddev-sans-first:4.74 10:52:05 INFO - PROCESS | 32622 | Values: 162.0 162.0 164.0 177.0 163.0 164.0 163.0 162.0 165.0 162.0 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | [#3] audio-fft Cycles:10 Average:96.40 Median:77.00 stddev:38.33 (49.8%) stddev-sans-first:39.94 10:52:05 INFO - PROCESS | 32622 | Values: 76.0 77.0 78.0 173.0 77.0 91.0 76.0 75.0 164.0 77.0 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | [#4] audio-oscillator Cycles:10 Average:102.90 Median:86.00 stddev:27.95 (32.5%) stddev-sans-first:28.96 10:52:05 INFO - PROCESS | 32622 | Values: 86.0 86.0 159.0 87.0 86.0 86.0 138.0 85.0 87.0 129.0 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | [#5] imaging-gaussian-blur Cycles:10 Average:118.00 Median:118.00 stddev:0.67 (0.6%) stddev-sans-first:0.60 10:52:05 INFO - PROCESS | 32622 | Values: 117.0 118.0 117.0 119.0 118.0 118.0 119.0 118.0 118.0 118.0 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | [#6] imaging-darkroom Cycles:10 Average:147.70 Median:148.00 stddev:1.06 (0.7%) stddev-sans-first:1.01 10:52:05 INFO - PROCESS | 32622 | Values: 149.0 147.0 148.0 148.0 147.0 149.0 147.0 149.0 147.0 146.0 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | [#7] imaging-desaturate Cycles:10 Average:95.80 Median:96.00 stddev:0.63 (0.7%) stddev-sans-first:0.67 10:52:05 INFO - PROCESS | 32622 | Values: 96.0 97.0 95.0 96.0 95.0 96.0 96.0 96.0 96.0 95.0 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | [#8] json-parse-financial Cycles:10 Average:64.10 Median:64.00 stddev:1.20 (1.9%) stddev-sans-first:1.27 10:52:05 INFO - PROCESS | 32622 | Values: 64.0 63.0 66.0 63.0 65.0 63.0 64.0 63.0 66.0 64.0 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | [#9] json-stringify-tinderbox Cycles:10 Average:65.90 Median:66.00 stddev:0.57 (0.9%) stddev-sans-first:0.60 10:52:05 INFO - PROCESS | 32622 | Values: 66.0 66.0 66.0 65.0 66.0 67.0 66.0 65.0 66.0 66.0 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | [#10] stanford-crypto-aes Cycles:10 Average:82.90 Median:81.50 stddev:3.54 (4.3%) stddev-sans-first:3.69 10:52:05 INFO - PROCESS | 32622 | Values: 81.0 81.0 81.0 81.0 90.0 80.0 80.0 88.0 85.0 82.0 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | [#11] stanford-crypto-ccm Cycles:10 Average:141.10 Median:140.00 stddev:8.54 (6.1%) stddev-sans-first:9.03 10:52:05 INFO - PROCESS | 32622 | Values: 139.0 134.0 137.0 137.0 141.0 136.0 138.0 141.0 164.0 144.0 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:174.00 Median:175.00 stddev:3.62 (2.1%) stddev-sans-first:3.84 10:52:05 INFO - PROCESS | 32622 | Values: 174.0 171.0 174.0 172.0 171.0 180.0 176.0 168.0 178.0 176.0 10:52:05 INFO - PROCESS | 32622 | 10:52:05 INFO - PROCESS | 32622 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.00 Median:70.00 stddev:1.89 (2.7%) stddev-sans-first:1.96 10:52:05 INFO - PROCESS | 32622 | Values: 69.0 69.0 73.0 68.0 71.0 73.0 71.0 69.0 68.0 69.0 10:52:05 INFO - PROCESS | 32622 | -------- Summary: end -------- 10:52:05 INFO - PROCESS | 32622 | 10:52:06 INFO - TEST-INFO | 32622: exit 0 10:52:06 INFO - TEST-OK | kraken | took 64438ms 10:52:06 INFO - SUITE-END | took 1181s 10:52:06 INFO - Completed test suite (00:19:41) 10:52:06 INFO - javascript benchmark 10:52:06 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6343.287333817887, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2676.5316069687824, 2682.9134200648737, 2704.9188524344263, 2708.0927889157133, 2717.864106794661, 4648.3027545868135, 4844.539768721975, 4874.244492103725, 4881.951180488194, 4909.779059942302, 4785.5214478552125, 4837.226043832988, 4868.221084626461, 4886.584640305578, 4920.557149856512, 4313.223619748444, 4391.297392417214, 4414.315781053926, 4458.554144585548, 4499.932501012488, 4171.979140104295, 4455.487618923833, 4506.098780243948, 4528.298113792351, 4551.385562948993, 4263.211305908417, 4393.714408563433, 4439.489458712257, 4466.642668586505, 4476.060027394251, 4466.642668586505, 4475.082608065339, 4485.0, 4517.819287228507, 4522.072975040109, 4443.466783985942, 4459.44256967879, 4464.754438505881, 4465.240909045438, 4506.864794056183, 4641.048585040058, 4708.0819240248165, 4777.092352453057, 4818.229083346683, 4879.487653796371, 5166.457521960216, 5172.793088276464, 5175.120229560984, 5182.870428239286, 5217.843464696065, 5207.713575753332, 5209.53114219722, 5214.426413094557, 5222.686638801684, 5256.237845512379, 4521.773911304422, 4798.880027999328, 4828.324034635154, 4848.0546293472435, 4859.22252439615, 5355.544778693855, 5356.705381204071, 5384.9461505385225, 5412.0, 5425.0, 5112.616553758408, 5114.897702045938, 5118.966825022997, 5127.41034781005, 5170.1469257572835, 4988.226824842155, 5081.59347252219, 5086.9745651271505, 5213.035588416155, 5229.241759944863, 5065.164247899129, 5065.822696205615, 5076.0, 5086.364204474441, 5108.106081435734, 5002.74986250686, 5041.59667226621, 5042.9747851261245, 5072.721000344943, 5111.437741848394, 4159.708820382544, 4287.656987440997, 4301.5698430156735, 4349.478062632505, 4384.758838263862, 3789.242151569697, 3793.279276937373, 3825.5409350877517, 3829.9234015320094, 3854.9614503855164, 4405.955940440619, 4410.558944105628, 4418.028033832552, 4419.359192917073, 4425.247707889666, 5002.224655178453, 5093.1087059764395, 5108.7190204538365, 5121.231815227746, 5145.485451454824, 4429.180601588717, 4473.753943533137, 4493.1013797240685, 4506.729596224237, 4513.345564893072, 4624.745638989821, 4628.699134556243, 4636.4899861015265, 4643.837465688753, 4671.976640116845, 4708.458527269408, 4842.7820748065715, 4894.241392584155, 4897.14299997499, 4909.95090049095, 5174.068667639861, 5182.378114626118, 5196.9740151299, 5228.1112210923475, 5236.869078272921, 4899.951000489949, 4904.068227036852, 4905.90188196227, 4906.852794416173, 4955.4301255356095, 4853.466118726867, 4950.084234416644, 4995.17579599362, 5145.948540514547, 5149.48505149482, 5049.091163590589, 5068.391792984866, 5082.288479612783, 5087.109755792648, 5121.180611102206, 4930.728809915489, 4947.3073769671555, 4949.529794669501, 4950.98504806521, 4959.082569724613, 4720.976395118002, 4904.5095490452095, 4917.213245880785, 4961.627877909244, 4970.3290055842, 4861.562459378673, 4880.658353915192, 4905.068037072945, 4930.654854160174, 4946.1097002538445, 5015.648904576645, 5015.673981191211, 5035.899282014412, 5044.369453818273, 5066.82266120684, 4682.2040253156365, 4899.559039686445, 4914.901701966012, 4940.8764780880765, 4961.801527938842], "value": 4720.39864341372, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [551.7792882846861, 558.5447859994107, 561.9297587801524, 562.6342877129865, 600.4265926040632, 34358.0, 38972.22055558891, 39035.80482097593, 39107.413388799156, 39112.21775564487, 39292.214155716865, 39798.60201397985, 39834.60165398345, 39842.203155936935, 39881.0, 7628.771136865889, 7810.687572497093, 7834.56909869957, 7843.176466471024, 7850.646720897574, 7651.502652327608, 7781.805454863617, 7782.9610851945945, 7805.4536182467255, 7829.17793631669, 7768.106667733198, 7846.372290216769, 7848.529088254723, 7848.921510784905, 7888.881666774974, 7758.650860711254, 7789.7273595423885, 7793.2596403341595, 7821.608919554028, 7826.5695386753705, 7661.889026091186, 7681.615919204018, 7733.265339792711, 7733.535987840747, 7741.729039483591, 36256.274874502626, 36470.63529364699, 36475.08812279688, 36634.8168259157, 36658.63341366606, 2237.686723858661, 2693.8114331996767, 2887.3070463088916, 2953.4536110819354, 3187.15540381799, 28132.578011329846, 28278.151655450165, 28589.857050714614, 28690.426191476054, 28697.56953645697, 3430.3139372125424, 3470.1876633145944, 3548.449990251515, 3662.359087159736, 3665.120371110941, 255386.0, 255498.0, 255750.0, 256203.0, 257444.0, 27437.58843617347, 28471.0, 51839.0, 52214.477855221725, 52244.21633675498, 31957.52063719046, 32189.678103219136, 32325.0, 32446.188845279055, 32448.83775581107, 12365.814512782315, 12511.186772859735, 12530.561430350077, 12532.436040378205, 12540.937295313464, 10359.948200259101, 10485.528151233213, 10561.735956600993, 10561.841572376421, 10579.206559508068, 7686.538807671557, 7744.2642948919765, 7771.727989520453, 7796.4932279401655, 7827.334676552443, 2996.194832562633, 3077.2614572502885, 3092.8608212630484, 3103.7827352085137, 3124.656287808339, 949.5442187749919, 958.2669258017622, 964.9662261820803, 1018.9439580822977, 1052.6368402900987, 26886.731132688816, 27404.451910962067, 27455.86272068627, 27489.725102749115, 27556.44887102247, 976.2239019979133, 989.7426669065951, 1031.200819364998, 1034.7464871106627, 1101.4437708956925, 14042.36809343582, 14788.704225915422, 14918.17950012738, 15042.849571504365, 15107.848921510644, 308715.0, 309880.0, 310596.0, 311618.0, 311653.0, 45459.54540454553, 45514.77242613766, 45937.31094033592, 46058.53941460609, 46289.5371046292, 1159.6173262823247, 1180.397997021508, 1195.521791283511, 1197.808350663907, 1208.5890797129018, 25330.746692532837, 26935.0, 27160.321271507863, 27312.863435682695, 27436.588451173648, 38928.41607375948, 39431.80284098561, 39433.80283098566, 39497.0, 39505.407418888164, 260043.0, 262014.0, 263040.0, 263834.0, 263878.0, 23930.64104038406, 24058.51882962366, 24384.756152438957, 24389.63415548804, 24456.755432445447, 39301.41047884341, 39405.0, 39465.40801887916, 39925.0, 40358.0, 35596.82201589079, 36325.27349453049, 37011.6298837019, 40390.0, 40862.18275634411, 35902.64097359098, 36218.818905905304, 36667.0, 36831.263374732895, 37390.0, 35615.0, 35858.28283434369, 36459.45310820287, 36637.450438242915, 36876.446853296686, 31197.688023119477, 33111.29890142646, 33512.0, 33602.66397335995, 33624.1593960153, 26035.609465858408, 26036.8698156508, 26078.34804129912, 26217.0, 26646.20061398161], "value": 16007.28350474934, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [340.93351796399696, 343.7816986213754, 355.9697425718814, 372.68135743938916, 379.14502796194574, 15876.285567149476, 16883.24025418856, 17811.64376712465, 17835.375761848354, 18028.18873150708, 15969.0, 16204.432844850433, 16488.505344839676, 16560.75158872618, 16575.585610359747, 4782.593479554242, 4961.8015279388965, 4965.205567109263, 4982.17794063979, 4982.750862456881, 3683.060819491026, 5213.973930130344, 5904.527637788967, 6185.6597887116195, 6209.813705588839, 6151.87696246077, 6233.750649973996, 6243.750249989995, 6258.874822503547, 6277.905831412532, 6203.658798766066, 6243.250809902818, 6244.250689917194, 6256.499480041632, 6265.780697675559, 4625.32932724753, 4848.5636292733825, 5497.47773961473, 5501.614886957915, 5511.862203444906, 10583.523741431654, 10627.14982801374, 10730.570777168903, 10793.622223222228, 10809.081228095622, 1785.0539214216356, 1934.64209121313, 1970.231609672229, 2374.169040835711, 2406.795422389099, 9065.546722663907, 9110.59002344896, 9128.0, 9161.0, 9482.95258523703, 1593.529908676943, 1618.935242590295, 1683.1500092453355, 1687.2323092992658, 1691.2812054876629, 62527.37472625261, 63365.68317158385, 68499.65750171218, 69884.65057674679, 70934.2906570938, 9362.625494980124, 9448.385854919547, 9612.66355677548, 9747.805043899083, 9858.80282394348, 12924.353782310847, 12951.093423460456, 12951.963842892546, 12964.0, 12985.220886746636, 6889.517733758589, 6979.651017449107, 7008.334208250208, 7269.345758881726, 7282.053333066668, 6748.426383757337, 6767.763128290486, 6972.477064220204, 6973.51185417026, 6990.126234220723, 4162.1259535497275, 4162.396452514429, 4167.124903770182, 4195.475565554306, 4198.727082739612, 1700.200905574378, 1721.6470623522148, 1794.3850534518776, 1823.726441033829, 1845.6216475622466, 883.0948278015086, 883.2183517586853, 939.9201067909304, 968.7481254873643, 970.3741086998846, 16507.257173427224, 17030.97814131156, 17184.656306873792, 17297.481075567754, 17483.388081417088, 848.7241646464801, 862.3489265604428, 896.8699538566872, 936.3585943628636, 950.8478643417159, 9340.299477539213, 9491.525423728786, 9610.471424071604, 9815.607375705034, 9820.558074886647, 382011.0, 385337.0, 385840.0, 385911.0, 405969.0, 46854.0, 52152.0, 72185.27814721786, 77573.22426775773, 78052.60973695095, 876.4741155306892, 905.4024343933104, 908.3459908865606, 909.0500427053745, 916.8716379706847, 14853.645263877796, 15460.690786184437, 15541.378344866078, 15574.299156537756, 15874.603134921257, 34553.0, 34934.30131397307, 35206.29587408289, 38204.6179538201, 38512.6148738509, 45950.54049459463, 51517.742411289204, 51947.74026129845, 52210.73894630503, 54749.72625136849, 6868.347506986828, 7350.889736654061, 7376.077990251219, 7529.096508419025, 7611.695532178873, 6418.6469744164515, 10284.948575257076, 10687.946560267148, 12278.693032673897, 12303.384830758605, 10204.489775511343, 10455.477226138815, 10462.947685261524, 10556.261061725605, 11038.0, 10073.395596264247, 10375.740606484898, 10499.317544359592, 10593.523291452057, 10740.624078157227, 10215.182785377003, 10705.839412408664, 10716.51775670081, 10822.080123189617, 10961.068309193808, 7555.206703296075, 7651.732189373345, 7661.693532258647, 7819.8436031277915, 7918.683252669829, 8440.282575980866, 10348.689539313833, 10513.316634418738, 10542.26204165701, 11062.336259824437], "value": 8027.059192985601, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1365.2968721108628, 1396.1483495068007, 1516.8786497080227, 1695.2540882011922, 1729.5848996240898, 6731.831704207398, 7625.389968802497, 7677.270659287359, 8292.419530632858, 8296.79258018549, 7784.104827944774, 8023.237792409712, 8047.436679432442, 8055.315298199645, 8072.3945704072285, 2170.272958558881, 2209.2267706302746, 2215.324326080545, 2218.267971569378, 2235.0612742648127, 2184.912603495858, 2188.901499432521, 2233.2853486884205, 2238.1271304191378, 2239.2050821958214, 2221.5445833604153, 2233.653783663535, 2240.932772016842, 2243.887805609721, 2255.8984845681985, 2143.057054895841, 2148.387709502784, 2159.7948194921455, 2166.808255459491, 2167.7073595064703, 2095.3190213180624, 2104.168853302937, 2111.788821117891, 2115.5874604452138, 2115.7989990950837, 8011.198880111942, 8148.266656000929, 8155.632996515171, 8158.061822890384, 8162.632681529345, 4474.865754027384, 4613.700109492872, 4620.3069539569, 4621.006483606041, 4624.121416930772, 2909.8254104753782, 2969.2576855786056, 2989.2676294308035, 3044.451998640244, 3064.9233769155726, 927.6289484206304, 960.490939801906, 962.9662961796373, 963.4949132256078, 969.3602222533094, 10847.51186196623, 10890.40102794346, 10902.291351062155, 10922.29005114665, 10932.234743568033, 3938.212357528506, 4064.2887494688903, 4169.041120542292, 4224.366345048267, 4227.492700875914, 9292.070792920655, 9325.440473571607, 9325.533723313807, 9332.113449222314, 9333.953330233306, 4576.58810707038, 4587.197240482902, 4620.306953956933, 4622.630189584893, 4630.398048253705, 3432.742544309137, 4072.9796351018053, 4171.791410429466, 4206.116715489781, 4214.072903961123, 3618.457231415256, 3625.495419400972, 3737.0657335666083, 3755.399136138205, 3790.5451345838123, 1154.7748189103045, 1164.5516476156572, 1168.0, 1170.4674373160192, 1172.0623501199007, 763.2367632367632, 793.1711361627114, 798.648594618366, 799.7560743973028, 806.7055524733547, 5224.0, 5262.0, 5280.683159010395, 5292.073887069748, 5342.118550439134, 377.76200993374, 380.69544364508283, 382.99042523936566, 395.18197331524044, 396.81548080142295, 3660.670539651444, 3667.064898450878, 3667.853285868589, 3674.0814796300924, 3853.6917046636204, 9669.468179250209, 9912.752181195528, 9973.202143828476, 9975.401475911469, 9995.450250236161, 9851.556679949419, 9869.0, 9874.901250987397, 9901.108900199017, 9925.851112233178, 7217.8917316240295, 7526.811829704301, 7587.430942679322, 7596.08846938371, 7633.6564854580565, 5359.678419294854, 5455.181722741462, 5463.972680136574, 5508.504234618743, 5520.641158324696, 8858.95570522169, 9044.547772611475, 9186.081391861027, 9303.906960930304, 9316.20812230968, 8976.461412315282, 9351.39215950961, 9492.762680932756, 9535.094166054214, 9544.904550954401, 6918.861622767416, 6956.2000369958105, 6956.304369563003, 7036.331548502884, 7040.8591828162125, 7474.0, 7525.811854703457, 7598.468107232441, 7598.734044308423, 7614.238576142341, 6734.9326506734305, 6746.527743057939, 6789.1852977643, 6844.076049733421, 6936.0, 6737.461003119641, 6740.966295168493, 6781.084553585203, 6831.248562658005, 6832.692528836114, 6216.689165541795, 6220.626762394271, 6231.657258850807, 6278.434940855345, 6316.905246421399, 4416.977915110404, 4573.81704731807, 4606.484008295942, 4637.721736695809, 4705.341252224623, 4520.88697782558, 4551.931721024121, 4562.977185114186, 4671.369365135663, 4743.430788305287], "value": 4099.019281892136, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [270.7171006298418, 278.34311025978695, 282.2224770756565, 282.4294924253009, 288.1470846294966, 4847.442544107429, 4910.975445122769, 5000.624953128517, 5075.923861142086, 5085.847424577264, 4908.705477671333, 4949.911019575697, 4960.131976904046, 4965.801367945278, 4974.776135073921, 3909.863154789583, 3912.452256684059, 3925.685945124383, 3929.2534418460546, 3931.6264954829244, 3641.4887821554025, 3930.489036425275, 3933.8426462941447, 3934.9803250983705, 3942.2115576884594, 3796.5633952095586, 3798.8670396536127, 3799.1072098056934, 3800.448934904437, 3807.8286477108595, 3787.6591106800383, 3798.525184351956, 3805.885823425274, 3809.9619003809885, 3810.371288737355, 3183.936321273585, 3299.7195238404765, 3301.9339613207603, 3302.7357811375273, 3303.4549299365576, 4844.031193761261, 4873.926891096637, 4887.462379138292, 4906.350570691822, 4906.828261010884, 4379.401518445744, 4380.233459144669, 4388.780560971939, 4394.78026098697, 4395.648348132142, 4874.612144559533, 5173.844784656466, 5208.088584497697, 5274.340707411574, 5301.310829592167, 3584.982075089608, 3592.7844329340323, 3600.39782296878, 3608.5128507651393, 3614.4216925291826, 5443.727813609344, 5509.752061157257, 5522.806701765459, 5524.0, 5543.0, 3599.586047604559, 3603.1532589841368, 3614.584322802911, 3619.0952261934517, 3631.5642122945414, 3539.185987222953, 3702.500162478031, 3720.5907350191455, 3730.925381492355, 3731.533558305212, 4310.374995625617, 4315.4605674290715, 4315.870523884289, 4318.1363727254675, 4351.73889566627, 5221.843344699665, 5232.3459567554055, 5234.97382513085, 5272.393674727378, 5277.894442111213, 1184.656449629615, 1248.1637303007008, 1279.2644229568036, 1281.1992504684572, 1293.0819118425834, 830.730012745848, 841.1210285251926, 851.7274472168847, 854.3165467625874, 857.8412993596205, 4540.409746732904, 4540.523245059288, 4553.225951588238, 4564.794584243717, 4568.743595511261, 5313.388960269618, 5327.174287985368, 5333.333333333333, 5347.51872331492, 5350.357957045102, 4570.925832429376, 4583.037562111927, 4586.1057093866375, 4587.678862479661, 4589.1051245007575, 2732.426190500017, 2863.3271181272385, 2871.7128287171117, 2875.3817929145334, 2887.45138423703, 5077.746112694351, 5080.872978175501, 5089.465606111379, 5089.872753181126, 5093.261477085802, 5269.710165940834, 5469.507744303032, 5491.258680078218, 5502.899420115993, 5524.696141712245, 5060.974695126501, 5060.974695126574, 5061.215511595708, 5066.923996140061, 5099.3370861787735, 5362.597805164551, 5365.919511207257, 5392.004958165504, 5401.73059331049, 5404.83785486436, 5005.5745261653165, 5210.921836172536, 5217.478252174752, 5235.842924712265, 5247.239150323106, 5042.445331013659, 5048.545630893237, 5054.772535235997, 5078.97460512695, 5124.666896651705, 3667.8176484991386, 3667.8532858685353, 3677.282929828658, 3677.705783537257, 3679.8712045078296, 5152.149895267239, 5244.396894357198, 5300.284461597635, 5338.199270109515, 5340.0921843287515, 5088.516590923857, 5151.754394731295, 5166.922496162636, 5178.818741344035, 5189.5069968354455, 5174.404943431554, 5181.885894532694, 5189.844304670866, 5199.2980947573105, 5213.843584692465, 4986.750662466935, 5063.772130254221, 5101.158308879142, 5101.362329708786, 5143.948560514347, 5189.0, 5197.766100525561, 5205.401378841481, 5213.374395072616, 5219.08665983459, 5106.565941894981, 5123.948760512496, 5125.154349532286, 5126.923096153486, 5129.9743501282255], "value": 3879.134291916253, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [628.4846425930737, 717.6411794102949, 737.933585977262, 741.6254791330377, 747.3946103656035, 12289.938550307246, 13114.47542098316, 13229.735405291889, 13241.735165296688, 13291.069625126232, 12326.32205228712, 12646.873531264684, 12770.744585108292, 12803.35983200841, 12863.035272354564, 759.2938567132564, 781.6756046240803, 785.5954183595453, 785.8546168958733, 786.712849809821, 636.1761518833122, 759.7644730133649, 778.9805254868645, 785.2304741353448, 787.9684812607518, 820.4420993724265, 820.9327873764083, 822.3256929317962, 822.7161629237903, 823.9340852731797, 806.8265322955592, 809.9838003239961, 818.2431251092745, 818.8198596308803, 822.0628483528782, 598.5331441475612, 598.7215944585745, 598.8742364103543, 600.2736688606791, 600.7657013764635, 12065.0, 12103.092268079841, 12104.031677465782, 12117.39413029345, 12147.088968327322, 13227.404766785517, 13478.19130852152, 13719.931400343034, 13745.0, 13967.092139010932, 10299.588016479407, 10316.58733650653, 10448.634297799541, 10503.212259080523, 10604.840927386096, 3265.9346813063607, 3273.688999545039, 3318.7013168814924, 3320.6181289151814, 3330.0509354834, 66812.0, 67421.32578674199, 67618.66190669064, 68530.65734671344, 69461.99999999949, 10418.739531511774, 10680.145588352912, 10714.357138571711, 10833.512491937881, 11021.504032318566, 20085.297014604712, 20200.191992320437, 20264.0, 20296.49258768513, 20319.593608127754, 6860.312797713508, 6967.407770339578, 6979.965100174467, 7036.859262814715, 7104.360607545345, 3770.245950809849, 3819.809009549567, 3826.3686491728554, 3832.291026160169, 3951.8814435566405, 2802.5936239245193, 2874.870630821618, 2886.8845246189917, 2888.9133326000256, 2893.1899068260923, 481.2056931098315, 490.9533594308535, 505.36071869085634, 513.7662363624542, 514.1105886815755, 610.124471383566, 631.260330167068, 634.3688030409771, 639.8912184928573, 646.679893452744, 8161.5919204039565, 8331.500109993298, 8399.95800020996, 8793.648254069765, 8910.55447227649, 606.2785285510316, 611.6880391000622, 618.7277597856929, 636.6752955992384, 642.9871402571922, 4040.919181616351, 4292.527821939584, 4355.564443555682, 4362.214801335726, 4403.207422663887, 83742.0, 87412.0, 102174.48912755388, 110137.0, 110161.0, 70480.64759676169, 71225.2877471229, 72268.63865680744, 90451.0, 97941.51029244809, 68629.65685171542, 70844.64577677079, 72832.63583682048, 74467.62766186135, 75109.0, 8438.451500652438, 8863.24662403677, 8869.334799890163, 9005.639774409212, 9067.229285510806, 44313.11373772442, 44958.325625114994, 44964.77517612391, 45419.772901135286, 46594.534054659016, 55944.72027639836, 60458.39541604528, 67781.66109169423, 67800.3219967794, 69190.65404672944, 12289.893909548184, 12903.41934612926, 13031.804522932352, 13043.934780326037, 13179.802302965272, 13060.151090179108, 13253.933730331286, 13752.518661846787, 13875.930620346833, 14229.288535573387, 12373.505059797868, 12650.620481385573, 12797.29614871191, 12854.357282135668, 13027.544035958696, 11920.403979801149, 12061.974732147866, 12162.635120946386, 12643.810342845049, 12713.491460341484, 11968.281903085843, 12422.937885310515, 12442.0, 12515.87484125147, 12668.0, 10191.490425478845, 10203.897961020295, 10493.632722854663, 10582.894171058499, 10702.0, 9599.0, 10676.83984740214, 10884.346939183675, 10961.451927403758, 10963.451827408438], "value": 6754.202996005819, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1586.3, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [107.0, 115.0, 110.0, 115.0, 114.0, 116.0, 116.0, 115.0, 115.0, 115.0], "value": 113.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 123.0, 149.0, 191.0, 137.0, 149.0, 149.0, 127.0, 186.0, 130.0], "value": 149.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 162.0, 164.0, 177.0, 163.0, 164.0, 163.0, 162.0, 165.0, 162.0], "value": 164.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 77.0, 78.0, 173.0, 77.0, 91.0, 76.0, 75.0, 164.0, 77.0], "value": 96.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 86.0, 159.0, 87.0, 86.0, 86.0, 138.0, 85.0, 87.0, 129.0], "value": 102.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 118.0, 117.0, 119.0, 118.0, 118.0, 119.0, 118.0, 118.0, 118.0], "value": 118.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 147.0, 148.0, 148.0, 147.0, 149.0, 147.0, 149.0, 147.0, 146.0], "value": 147.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 97.0, 95.0, 96.0, 95.0, 96.0, 96.0, 96.0, 96.0, 95.0], "value": 95.8, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 63.0, 66.0, 63.0, 65.0, 63.0, 64.0, 63.0, 66.0, 64.0], "value": 64.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 66.0, 66.0, 65.0, 66.0, 67.0, 66.0, 65.0, 66.0, 66.0], "value": 65.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 81.0, 81.0, 81.0, 90.0, 80.0, 80.0, 88.0, 85.0, 82.0], "value": 82.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [139.0, 134.0, 137.0, 137.0, 141.0, 136.0, 138.0, 141.0, 164.0, 144.0], "value": 141.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [174.0, 171.0, 174.0, 172.0, 171.0, 180.0, 176.0, 168.0, 178.0, 176.0], "value": 174.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 69.0, 73.0, 68.0, 71.0, 73.0, 71.0, 69.0, 68.0, 69.0], "value": 70.0, "unit": "score"}]}]} 10:52:06 INFO - Return code: 0 10:52:06 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 10:52:06 ERROR - # TBPL SUCCESS # 10:52:06 INFO - Running post-action listener: _resource_record_post_action 10:52:06 INFO - [mozharness: 2016-08-10 17:52:06.732887Z] Finished run-tests step (success) 10:52:06 INFO - Running post-run listener: _resource_record_post_run 10:52:06 INFO - Total resource usage - Wall time: 1198s; CPU: 13.0%; Read bytes: 0; Write bytes: 539889664; Read time: 0; Write time: 827300 10:52:06 INFO - TinderboxPrint: CPU usage
13.4% 10:52:06 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 10:52:06 INFO - TinderboxPrint: I/O write bytes / time
539,889,664 / 827,300 10:52:06 INFO - TinderboxPrint: CPU idle
8,281.3 (86.6%) 10:52:06 INFO - TinderboxPrint: CPU user
1,220.4 (12.8%) 10:52:06 INFO - TinderboxPrint: Swap in / out
0 / 0 10:52:06 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 240840704; Read time: 0; Write time: 400184 10:52:06 INFO - run-tests - Wall time: 1182s; CPU: 13.0%; Read bytes: 0; Write bytes: 298770432; Read time: 0; Write time: 427088 10:52:07 INFO - Running post-run listener: _upload_blobber_files 10:52:07 INFO - Blob upload gear active. 10:52:07 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 10:52:07 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 10:52:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 10:52:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 10:52:07 INFO - (blobuploader) - INFO - Open directory for files ... 10:52:07 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 10:52:07 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:52:07 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:52:08 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 10:52:08 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:52:08 INFO - (blobuploader) - INFO - Done attempting. 10:52:08 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 10:52:08 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:52:08 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:52:16 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 10:52:16 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:52:16 INFO - (blobuploader) - INFO - Done attempting. 10:52:16 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 10:52:16 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:52:16 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:52:17 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 10:52:17 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:52:17 INFO - (blobuploader) - INFO - Done attempting. 10:52:17 INFO - (blobuploader) - INFO - Iteration through files over. 10:52:17 INFO - Return code: 0 10:52:17 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 10:52:17 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 10:52:17 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/1c392398e5c4c814df48c536844bb0a75d72a8a648625c4cf0721843aa7369f4c3eb636c099dd7acae0478f0be5772af03639f77b413e344e56645f86b9c0dc6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/e543ef5c32f7261827d779174129e7ed4125213171604567d495fe10e451a58eb31b75efdab2025e666bdafa3e279c6c4e0a491d3afd996c4b640364a41578bc", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/b044d09bc1c7e89fe8f446de46a647a45f9d3a28fe1955b4ecf614306db319e400d046778130de63cd256599ce97f3e980f0c29619fa5dd3ba351971c1c0219a"} 10:52:17 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 10:52:17 INFO - Writing to file /builds/slave/test/properties/blobber_files 10:52:17 INFO - Contents: 10:52:17 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/1c392398e5c4c814df48c536844bb0a75d72a8a648625c4cf0721843aa7369f4c3eb636c099dd7acae0478f0be5772af03639f77b413e344e56645f86b9c0dc6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/e543ef5c32f7261827d779174129e7ed4125213171604567d495fe10e451a58eb31b75efdab2025e666bdafa3e279c6c4e0a491d3afd996c4b640364a41578bc", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/b044d09bc1c7e89fe8f446de46a647a45f9d3a28fe1955b4ecf614306db319e400d046778130de63cd256599ce97f3e980f0c29619fa5dd3ba351971c1c0219a"} 10:52:17 INFO - Running post-run listener: copy_logs_to_upload_dir 10:52:17 INFO - Copying logs to upload dir... 10:52:17 INFO - mkdir: /builds/slave/test/build/upload/logs 10:52:17 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1239.590614 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 39 secs) (at 2016-08-10 10:52:16.470522) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-10 10:52:16.473912) ========= 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=05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/1c392398e5c4c814df48c536844bb0a75d72a8a648625c4cf0721843aa7369f4c3eb636c099dd7acae0478f0be5772af03639f77b413e344e56645f86b9c0dc6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/e543ef5c32f7261827d779174129e7ed4125213171604567d495fe10e451a58eb31b75efdab2025e666bdafa3e279c6c4e0a491d3afd996c4b640364a41578bc", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/b044d09bc1c7e89fe8f446de46a647a45f9d3a28fe1955b4ecf614306db319e400d046778130de63cd256599ce97f3e980f0c29619fa5dd3ba351971c1c0219a"} build_url:https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011211 build_url: 'https://queue.taskcluster.net/v1/task/OOBr1E49SVCaZrWIFCKuCQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/1c392398e5c4c814df48c536844bb0a75d72a8a648625c4cf0721843aa7369f4c3eb636c099dd7acae0478f0be5772af03639f77b413e344e56645f86b9c0dc6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/e543ef5c32f7261827d779174129e7ed4125213171604567d495fe10e451a58eb31b75efdab2025e666bdafa3e279c6c4e0a491d3afd996c4b640364a41578bc", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/b044d09bc1c7e89fe8f446de46a647a45f9d3a28fe1955b4ecf614306db319e400d046778130de63cd256599ce97f3e980f0c29619fa5dd3ba351971c1c0219a"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-10 10:52:16.499422) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:52:16.499771) ========= 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=05b19d94dfa9f3ce7b6e62cc000001f7-1470850294.882849-622913468 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004477 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:52:16.584082) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-10 10:52:16.584573) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-10 10:52:16.584915) ========= ========= Total master_lag: 0.16 =========