builder: autoland_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-002 starttime: 1471880575.11 results: success (0) buildid: 20160822065314 builduid: 31a4fe2815984a58ab5b907af5e116e5 revision: 5aea87afc510f2b64c9ca3617fd27b78af95f4af ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-22 08:42:55.107035) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-22 08:42:55.107500) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-22 08:42:55.107786) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-22 08:42:55.126746) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-22 08:42:55.127099) ========= 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=a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-08-22 08:42:55-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 213M=0s 2016-08-22 08:42:55 (213 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.130592 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-22 08:42:55.271489) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-22 08:42:55.271831) ========= 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=a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016057 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-22 08:42:55.321642) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-22 08:42:55.322014) ========= bash -c 'python archiver_client.py mozharness --repo integration/autoland --rev 5aea87afc510f2b64c9ca3617fd27b78af95f4af --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/autoland --rev 5aea87afc510f2b64c9ca3617fd27b78af95f4af --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=a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-08-22 08:42:55,799 truncating revision to first 12 chars 2016-08-22 08:42:55,799 Setting DEBUG logging. 2016-08-22 08:42:55,799 attempt 1/10 2016-08-22 08:42:55,799 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/5aea87afc510?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-22 08:42:56,139 unpacking tar archive at: autoland-5aea87afc510/testing/mozharness/ program finished with exit code 0 elapsedTime=0.636374 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-22 08:42:55.972182) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-22 08:42:55.972513) ========= script_repo_revision: 5aea87afc510f2b64c9ca3617fd27b78af95f4af ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-22 08:42:55.972954) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-22 08:42:55.973217) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-22 08:42:55.981886) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 54 secs) (at 2016-08-22 08:42:55.982190) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Autoland-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland-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', 'Autoland-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Autoland-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=a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:42:56 INFO - MultiFileLogger online at 20160822 08:42:56 in /builds/slave/test 08:42:56 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Autoland-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland-Non-PGO 08:42:56 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:42:56 INFO - {'append_to_log': False, 08:42:56 INFO - 'base_work_dir': '/builds/slave/test', 08:42:56 INFO - 'blob_upload_branch': 'Autoland-Non-PGO', 08:42:56 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:42:56 INFO - 'branch': 'Autoland-Non-PGO', 08:42:56 INFO - 'buildbot_json_path': 'buildprops.json', 08:42:56 INFO - 'config_files': ('talos/linux_config.py',), 08:42:56 INFO - 'default_actions': ('clobber', 08:42:56 INFO - 'read-buildbot-config', 08:42:56 INFO - 'download-and-extract', 08:42:56 INFO - 'populate-webroot', 08:42:56 INFO - 'create-virtualenv', 08:42:56 INFO - 'install', 08:42:56 INFO - 'run-tests'), 08:42:56 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:42:56 INFO - 'download_minidump_stackwalk': True, 08:42:56 INFO - 'download_symbols': 'ondemand', 08:42:56 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:42:56 INFO - 'tooltool.py': '/tools/tooltool.py', 08:42:56 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:42:56 INFO - '/tools/misc-python/virtualenv.py')}, 08:42:56 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:42:56 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:42:56 INFO - 'installer_path': 'installer.exe', 08:42:56 INFO - 'log_level': 'info', 08:42:56 INFO - 'log_name': 'talos', 08:42:56 INFO - 'log_to_console': True, 08:42:56 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:42:56 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:42:56 INFO - 'opt_config_files': (), 08:42:56 INFO - 'pip_index': False, 08:42:56 INFO - 'sps_profile': False, 08:42:56 INFO - 'sps_profile_interval': 0, 08:42:56 INFO - 'suite': 'dromaeojs-e10s', 08:42:56 INFO - 'system_bits': '32', 08:42:56 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:42:56 INFO - 'title': 'talos-linux64-ix-002', 08:42:56 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:42:56 INFO - 'use_talos_json': True, 08:42:56 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:42:56 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:42:56 INFO - 'work_dir': 'build'} 08:42:56 INFO - [mozharness: 2016-08-22 15:42:56.547627Z] Running clobber step. 08:42:56 INFO - Running pre-action listener: _resource_record_pre_action 08:42:56 INFO - Running main action method: clobber 08:42:56 INFO - rmtree: /builds/slave/test/build 08:42:56 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:42:57 INFO - Running post-action listener: _resource_record_post_action 08:42:57 INFO - [mozharness: 2016-08-22 15:42:57.004847Z] Finished clobber step (success) 08:42:57 INFO - [mozharness: 2016-08-22 15:42:57.004947Z] Running read-buildbot-config step. 08:42:57 INFO - Running pre-action listener: _resource_record_pre_action 08:42:57 INFO - Running main action method: read_buildbot_config 08:42:57 INFO - Using buildbot properties: 08:42:57 INFO - { 08:42:57 INFO - "project": "", 08:42:57 INFO - "product": "firefox", 08:42:57 INFO - "script_repo_revision": "production", 08:42:57 INFO - "builddir": "autoland_ubuntu64_hw_test-dromaeojs-e10s", 08:42:57 INFO - "repository": "", 08:42:57 INFO - "buildername": "Ubuntu HW 12.04 x64 autoland talos dromaeojs-e10s", 08:42:57 INFO - "buildid": "20160822065314", 08:42:57 INFO - "pgo_build": "False", 08:42:57 INFO - "basedir": "/builds/slave/test", 08:42:57 INFO - "buildnumber": 362, 08:42:57 INFO - "slavename": "talos-linux64-ix-002", 08:42:57 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 08:42:57 INFO - "platform": "ubuntu64_hw", 08:42:57 INFO - "scheduler": "tests-autoland-linux64-talos-7-3600", 08:42:57 INFO - "branch": "autoland", 08:42:57 INFO - "repo_path": "integration/autoland", 08:42:57 INFO - "revision": "5aea87afc510f2b64c9ca3617fd27b78af95f4af", 08:42:57 INFO - "stage_platform": "linux64", 08:42:57 INFO - "builduid": "31a4fe2815984a58ab5b907af5e116e5", 08:42:57 INFO - "slavebuilddir": "test" 08:42:57 INFO - } 08:42:57 INFO - Found installer url https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 08:42:57 INFO - Running post-action listener: _resource_record_post_action 08:42:57 INFO - [mozharness: 2016-08-22 15:42:57.007385Z] Finished read-buildbot-config step (success) 08:42:57 INFO - [mozharness: 2016-08-22 15:42:57.007474Z] Running download-and-extract step. 08:42:57 INFO - Running pre-action listener: _resource_record_pre_action 08:42:57 INFO - Running main action method: download_and_extract 08:42:57 INFO - mkdir: /builds/slave/test/build/tests 08:42: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')]} 08:42:57 INFO - trying https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 08:42:57 INFO - Downloading https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/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 08:42:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/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 08:42:57 INFO - Downloaded 1361 bytes. 08:42:57 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 08:42:57 INFO - Using the following test package requirements: 08:42:57 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 08:42:57 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:42:57 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 08:42:57 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:42:57 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 08:42:57 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:42:57 INFO - u'jsshell-linux-x86_64.zip'], 08:42:57 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:42:57 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 08:42:57 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 08:42:57 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:42:57 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 08:42:57 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:42:57 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 08:42:57 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:42:57 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 08:42:57 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 08:42:57 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 08:42:57 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 08:42: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')]} 08:42:57 INFO - trying https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 08:42:57 INFO - Downloading https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/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 08:42:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/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 08:42:58 INFO - Downloaded 20331017 bytes. 08:42:58 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/tests 08:43:02 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 08:43:02 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')]} 08:43:02 INFO - trying https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 08:43:02 INFO - Downloading https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/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 08:43:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/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 08:43:03 INFO - Downloaded 20331017 bytes. 08:43:03 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/tests 08:43: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')]} 08:43:07 INFO - trying https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 08:43:07 INFO - Downloading https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/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 08:43:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/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 08:43:08 INFO - Downloaded 14413981 bytes. 08:43:08 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/tests 08:43:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:43:09 INFO - trying https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 08:43:09 INFO - Downloading https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/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 08:43:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/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 08:43:10 INFO - Downloaded 55759216 bytes. 08:43:10 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 08:43:10 INFO - mkdir: /builds/slave/test/properties 08:43:10 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:43:10 INFO - Writing to file /builds/slave/test/properties/build_url 08:43:10 INFO - Contents: 08:43:10 INFO - build_url:https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 08:43:10 INFO - Running post-action listener: _resource_record_post_action 08:43:10 INFO - Running post-action listener: set_extra_try_arguments 08:43:10 INFO - [mozharness: 2016-08-22 15:43:10.799569Z] Finished download-and-extract step (success) 08:43:10 INFO - [mozharness: 2016-08-22 15:43:10.799793Z] Running populate-webroot step. 08:43:10 INFO - Running pre-action listener: _resource_record_pre_action 08:43:10 INFO - Running main action method: populate_webroot 08:43:10 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:43:10 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:43:10 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:43:10 INFO - '--tppagecycles', 08:43:10 INFO - '7'], 08:43:10 INFO - 'tests': ['tsvgm']}}, 08:43:10 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:43:10 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:43:10 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:43:10 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:43:10 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:43:10 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:43:10 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:43:10 INFO - 'talos_options': ['--disable-e10s'], 08:43:10 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:43:10 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:43:10 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:43:10 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:43:10 INFO - 'talos_options': ['--disable-e10s'], 08:43:10 INFO - 'tests': ['damp', 'tps']}, 08:43:10 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:43:10 INFO - 'tests': ['damp', 'tps']}, 08:43:10 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:43:10 INFO - 'tests': ['dromaeo_dom']}, 08:43:10 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:43:10 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:43:10 INFO - 'tests': ['basic_compositor_video']}, 08:43:10 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:43:10 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:43:10 INFO - 'tests': ['a11yr', 08:43:10 INFO - 'ts_paint', 08:43:10 INFO - 'tpaint', 08:43:10 INFO - 'sessionrestore', 08:43:10 INFO - 'sessionrestore_no_auto_restore', 08:43:10 INFO - 'tabpaint']}, 08:43:10 INFO - 'other-e10s': {'tests': ['a11yr', 08:43:10 INFO - 'ts_paint', 08:43:10 INFO - 'tpaint', 08:43:10 INFO - 'sessionrestore', 08:43:10 INFO - 'sessionrestore_no_auto_restore', 08:43:10 INFO - 'tabpaint']}, 08:43:10 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:43:10 INFO - 'ts_paint', 08:43:10 INFO - 'tpaint', 08:43:10 INFO - 'sessionrestore', 08:43:10 INFO - 'sessionrestore_no_auto_restore', 08:43:10 INFO - 'tabpaint']}, 08:43:10 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:43:10 INFO - 'ts_paint', 08:43:10 INFO - 'tpaint', 08:43:10 INFO - 'sessionrestore', 08:43:10 INFO - 'sessionrestore_no_auto_restore', 08:43:10 INFO - 'tabpaint']}, 08:43:10 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:43:10 INFO - 'tests': ['a11yr', 08:43:10 INFO - 'ts_paint', 08:43:10 INFO - 'tpaint', 08:43:10 INFO - 'sessionrestore', 08:43:10 INFO - 'sessionrestore_no_auto_restore', 08:43:10 INFO - 'tabpaint']}, 08:43:10 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:43:10 INFO - 'tests': ['a11yr', 08:43:10 INFO - 'ts_paint', 08:43:10 INFO - 'tpaint', 08:43:10 INFO - 'sessionrestore', 08:43:10 INFO - 'sessionrestore_no_auto_restore', 08:43:10 INFO - 'tabpaint']}, 08:43:10 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:43:10 INFO - 'tests': ['tsvgx', 08:43:10 INFO - 'tsvgr_opacity', 08:43:10 INFO - 'tart', 08:43:10 INFO - 'tscrollx', 08:43:10 INFO - 'cart']}, 08:43:10 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:43:10 INFO - 'tsvgr_opacity', 08:43:10 INFO - 'tart', 08:43:10 INFO - 'tscrollx', 08:43:10 INFO - 'cart']}, 08:43:10 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:43:10 INFO - 'talos_options': ['--disable-e10s'], 08:43:10 INFO - 'tests': ['tp5o']}, 08:43:10 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:43:10 INFO - 'tests': ['tp5o']}, 08:43:10 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:43:10 INFO - 'talos_options': ['--disable-e10s', 08:43:10 INFO - '--xperf_path', 08:43:10 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:43:10 INFO - 'tests': ['tp5n']}, 08:43:10 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:43:10 INFO - 'talos_options': ['--xperf_path', 08:43:10 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:43:10 INFO - 'tests': ['tp5n']}}, 08:43:10 INFO - 'talos.zip': {'path': '', 08:43:10 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:43:10 INFO - Running post-action listener: _resource_record_post_action 08:43:10 INFO - [mozharness: 2016-08-22 15:43:10.821712Z] Finished populate-webroot step (success) 08:43:10 INFO - [mozharness: 2016-08-22 15:43:10.821800Z] Running create-virtualenv step. 08:43:10 INFO - Running pre-action listener: _resource_record_pre_action 08:43:10 INFO - Running main action method: create_virtualenv 08:43:10 INFO - Creating virtualenv /builds/slave/test/build/venv 08:43:10 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 08:43:10 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:43:10 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:43:10 INFO - Using real prefix '/usr' 08:43:10 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:43:11 INFO - Installing distribute.............................................................................................................................................................................................done. 08:43:13 INFO - Installing pip.................done. 08:43:13 INFO - Return code: 0 08:43:13 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:43:13 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')]} 08:43:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:43:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:13 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')]} 08:43:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:43:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:13 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 0x7fc406143f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a65230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a5f090>, '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 0x2a629b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a62e40>, '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': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', '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 08:43:13 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 08:43:13 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 08:43:13 INFO - Using env: {'DISPLAY': ':0', 08:43:13 INFO - 'HOME': '/home/cltbld', 08:43:13 INFO - 'LANG': 'en_US.UTF-8', 08:43:13 INFO - 'LANGUAGE': 'en_US:en', 08:43:13 INFO - 'LOGNAME': 'cltbld', 08:43:13 INFO - 'MAIL': '/var/mail/cltbld', 08:43:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:13 INFO - 'MOZ_NO_REMOTE': '1', 08:43:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:13 INFO - 'NO_EM_RESTART': '1', 08:43:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:13 INFO - 'PWD': '/builds/slave/test', 08:43:13 INFO - 'SHELL': '/bin/bash', 08:43:13 INFO - 'SHLVL': '1', 08:43:13 INFO - 'TERM': 'linux', 08:43:13 INFO - 'TMOUT': '86400', 08:43:13 INFO - 'USER': 'cltbld', 08:43:13 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', 08:43:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:13 INFO - '_': '/tools/buildbot/bin/python'} 08:43:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:43:13 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 08:43:13 INFO - Cleaning up... 08:43:13 INFO - Return code: 0 08:43:13 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:43:13 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')]} 08:43:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:43:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:13 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')]} 08:43:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:43:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:13 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 0x7fc406143f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a65230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a5f090>, '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 0x2a629b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a62e40>, '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': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', '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 08:43:13 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 08:43:13 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 08:43:13 INFO - Using env: {'DISPLAY': ':0', 08:43:13 INFO - 'HOME': '/home/cltbld', 08:43:13 INFO - 'LANG': 'en_US.UTF-8', 08:43:13 INFO - 'LANGUAGE': 'en_US:en', 08:43:13 INFO - 'LOGNAME': 'cltbld', 08:43:13 INFO - 'MAIL': '/var/mail/cltbld', 08:43:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:13 INFO - 'MOZ_NO_REMOTE': '1', 08:43:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:13 INFO - 'NO_EM_RESTART': '1', 08:43:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:13 INFO - 'PWD': '/builds/slave/test', 08:43:13 INFO - 'SHELL': '/bin/bash', 08:43:13 INFO - 'SHLVL': '1', 08:43:13 INFO - 'TERM': 'linux', 08:43:13 INFO - 'TMOUT': '86400', 08:43:13 INFO - 'USER': 'cltbld', 08:43:13 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', 08:43:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:13 INFO - '_': '/tools/buildbot/bin/python'} 08:43:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:43:13 INFO - Downloading/unpacking psutil>=3.1.1 08:43:13 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 08:43:13 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 08:43:13 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 08:43:13 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 08:43:13 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 08:43:13 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 08:43:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:43:15 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:43:15 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:43:15 INFO - Installing collected packages: psutil 08:43:15 INFO - Running setup.py install for psutil 08:43:15 INFO - building 'psutil._psutil_linux' extension 08:43:15 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 08:43:16 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 08:43:16 INFO - building 'psutil._psutil_posix' extension 08:43:16 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 08:43:16 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 08:43:16 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:43:16 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:43:16 INFO - Successfully installed psutil 08:43:16 INFO - Cleaning up... 08:43:16 INFO - Return code: 0 08:43:16 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:43:16 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')]} 08:43:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:43:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:16 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')]} 08:43:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:43:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:16 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 0x7fc406143f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a65230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a5f090>, '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 0x2a629b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a62e40>, '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': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', '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 08:43:16 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 08:43:16 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 08:43:16 INFO - Using env: {'DISPLAY': ':0', 08:43:16 INFO - 'HOME': '/home/cltbld', 08:43:16 INFO - 'LANG': 'en_US.UTF-8', 08:43:16 INFO - 'LANGUAGE': 'en_US:en', 08:43:16 INFO - 'LOGNAME': 'cltbld', 08:43:16 INFO - 'MAIL': '/var/mail/cltbld', 08:43:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:16 INFO - 'MOZ_NO_REMOTE': '1', 08:43:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:16 INFO - 'NO_EM_RESTART': '1', 08:43:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:16 INFO - 'PWD': '/builds/slave/test', 08:43:16 INFO - 'SHELL': '/bin/bash', 08:43:16 INFO - 'SHLVL': '1', 08:43:16 INFO - 'TERM': 'linux', 08:43:16 INFO - 'TMOUT': '86400', 08:43:16 INFO - 'USER': 'cltbld', 08:43:16 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', 08:43:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:16 INFO - '_': '/tools/buildbot/bin/python'} 08:43:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:43:16 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:43:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:43:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:43:16 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:43:16 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:43:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:43:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:43:18 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:43:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:43:18 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:43:18 INFO - Installing collected packages: mozsystemmonitor 08:43:18 INFO - Running setup.py install for mozsystemmonitor 08:43:18 INFO - Successfully installed mozsystemmonitor 08:43:18 INFO - Cleaning up... 08:43:18 INFO - Return code: 0 08:43:18 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:43:18 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')]} 08:43:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:43:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:18 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')]} 08:43:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:43:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:18 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 0x7fc406143f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a65230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a5f090>, '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 0x2a629b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a62e40>, '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': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', '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 08:43:18 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 08:43:18 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 08:43:18 INFO - Using env: {'DISPLAY': ':0', 08:43:18 INFO - 'HOME': '/home/cltbld', 08:43:18 INFO - 'LANG': 'en_US.UTF-8', 08:43:18 INFO - 'LANGUAGE': 'en_US:en', 08:43:18 INFO - 'LOGNAME': 'cltbld', 08:43:18 INFO - 'MAIL': '/var/mail/cltbld', 08:43:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:18 INFO - 'MOZ_NO_REMOTE': '1', 08:43:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:18 INFO - 'NO_EM_RESTART': '1', 08:43:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:18 INFO - 'PWD': '/builds/slave/test', 08:43:18 INFO - 'SHELL': '/bin/bash', 08:43:18 INFO - 'SHLVL': '1', 08:43:18 INFO - 'TERM': 'linux', 08:43:18 INFO - 'TMOUT': '86400', 08:43:18 INFO - 'USER': 'cltbld', 08:43:18 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', 08:43:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:18 INFO - '_': '/tools/buildbot/bin/python'} 08:43:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:43:18 INFO - Downloading/unpacking jsonschema==2.5.1 08:43:18 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 08:43:18 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 08:43:18 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 08:43:18 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 08:43:18 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 08:43:18 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 08:43:20 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:43:20 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:43:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:43:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:43:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:43:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:43:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:43:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:43:20 INFO - Downloading functools32-3.2.3-2.tar.gz 08:43:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:43:21 INFO - warning: no files found matching '*.txt' 08:43:21 INFO - no previously-included directories found matching 'build' 08:43:21 INFO - no previously-included directories found matching 'dist' 08:43:21 INFO - no previously-included directories found matching '.git*' 08:43:21 INFO - Installing collected packages: jsonschema, functools32 08:43:21 INFO - Running setup.py install for functools32 08:43:21 INFO - warning: no files found matching '*.txt' 08:43:21 INFO - no previously-included directories found matching 'build' 08:43:21 INFO - no previously-included directories found matching 'dist' 08:43:21 INFO - no previously-included directories found matching '.git*' 08:43:21 INFO - Successfully installed jsonschema functools32 08:43:21 INFO - Cleaning up... 08:43:21 INFO - Return code: 0 08:43:21 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:43:21 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')]} 08:43:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:43:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:21 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')]} 08:43:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:43:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:21 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 0x7fc406143f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a65230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a5f090>, '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 0x2a629b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a62e40>, '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': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', '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 08:43:21 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 08:43:21 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 08:43:21 INFO - Using env: {'DISPLAY': ':0', 08:43:21 INFO - 'HOME': '/home/cltbld', 08:43:21 INFO - 'LANG': 'en_US.UTF-8', 08:43:21 INFO - 'LANGUAGE': 'en_US:en', 08:43:21 INFO - 'LOGNAME': 'cltbld', 08:43:21 INFO - 'MAIL': '/var/mail/cltbld', 08:43:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:21 INFO - 'MOZ_NO_REMOTE': '1', 08:43:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:21 INFO - 'NO_EM_RESTART': '1', 08:43:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:21 INFO - 'PWD': '/builds/slave/test', 08:43:21 INFO - 'SHELL': '/bin/bash', 08:43:21 INFO - 'SHLVL': '1', 08:43:21 INFO - 'TERM': 'linux', 08:43:21 INFO - 'TMOUT': '86400', 08:43:21 INFO - 'USER': 'cltbld', 08:43:21 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', 08:43:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:21 INFO - '_': '/tools/buildbot/bin/python'} 08:43:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:43:21 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:43:21 INFO - Cleaning up... 08:43:21 INFO - Return code: 0 08:43:21 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:43:21 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')]} 08:43:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:43:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:21 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')]} 08:43:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:43:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:21 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 0x7fc406143f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a65230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a5f090>, '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 0x2a629b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a62e40>, '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': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', '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 08:43:21 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 08:43:21 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 08:43:21 INFO - Using env: {'DISPLAY': ':0', 08:43:21 INFO - 'HOME': '/home/cltbld', 08:43:21 INFO - 'LANG': 'en_US.UTF-8', 08:43:21 INFO - 'LANGUAGE': 'en_US:en', 08:43:21 INFO - 'LOGNAME': 'cltbld', 08:43:21 INFO - 'MAIL': '/var/mail/cltbld', 08:43:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:21 INFO - 'MOZ_NO_REMOTE': '1', 08:43:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:21 INFO - 'NO_EM_RESTART': '1', 08:43:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:21 INFO - 'PWD': '/builds/slave/test', 08:43:21 INFO - 'SHELL': '/bin/bash', 08:43:21 INFO - 'SHLVL': '1', 08:43:21 INFO - 'TERM': 'linux', 08:43:21 INFO - 'TMOUT': '86400', 08:43:21 INFO - 'USER': 'cltbld', 08:43:21 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', 08:43:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:21 INFO - '_': '/tools/buildbot/bin/python'} 08:43:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:43:21 INFO - Downloading/unpacking blobuploader==1.2.4 08:43:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:43:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:43:21 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:43:21 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:43:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:43:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:43:23 INFO - Downloading blobuploader-1.2.4.tar.gz 08:43:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:43:23 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:43:23 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 08:43:23 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 08:43:23 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 08:43:23 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 08:43:23 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 08:43:23 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 08:43:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:43:24 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:43:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:43:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:43:24 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:43:24 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:43:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:43:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:43:24 INFO - Downloading docopt-0.6.1.tar.gz 08:43:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:43:24 INFO - Installing collected packages: blobuploader, requests, docopt 08:43:24 INFO - Running setup.py install for blobuploader 08:43:24 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:43:24 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:43:24 INFO - Running setup.py install for requests 08:43:24 INFO - Running setup.py install for docopt 08:43:24 INFO - Successfully installed blobuploader requests docopt 08:43:24 INFO - Cleaning up... 08:43:24 INFO - Return code: 0 08:43:24 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:43: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')]} 08:43:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:43:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43: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')]} 08:43:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:43:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:24 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 0x7fc406143f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a65230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a5f090>, '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 0x2a629b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a62e40>, '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': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', '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 08:43:24 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 08:43:24 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 08:43:24 INFO - Using env: {'DISPLAY': ':0', 08:43:24 INFO - 'HOME': '/home/cltbld', 08:43:24 INFO - 'LANG': 'en_US.UTF-8', 08:43:24 INFO - 'LANGUAGE': 'en_US:en', 08:43:24 INFO - 'LOGNAME': 'cltbld', 08:43:24 INFO - 'MAIL': '/var/mail/cltbld', 08:43:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:24 INFO - 'MOZ_NO_REMOTE': '1', 08:43:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:24 INFO - 'NO_EM_RESTART': '1', 08:43:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:24 INFO - 'PWD': '/builds/slave/test', 08:43:24 INFO - 'SHELL': '/bin/bash', 08:43:24 INFO - 'SHLVL': '1', 08:43:24 INFO - 'TERM': 'linux', 08:43:24 INFO - 'TMOUT': '86400', 08:43:24 INFO - 'USER': 'cltbld', 08:43:24 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', 08:43:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:24 INFO - '_': '/tools/buildbot/bin/python'} 08:43:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:43:25 INFO - Running setup.py (path:/tmp/pip-X2cZpT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:43:25 INFO - Running setup.py (path:/tmp/pip-yczibR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:43:25 INFO - Running setup.py (path:/tmp/pip-m_Zk6N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:43:25 INFO - Running setup.py (path:/tmp/pip-DnIHfr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:43:25 INFO - Running setup.py (path:/tmp/pip-Jm3B8k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:43:25 INFO - Running setup.py (path:/tmp/pip-0EuSVD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:43:25 INFO - Running setup.py (path:/tmp/pip-NI7Vbz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:43:25 INFO - Running setup.py (path:/tmp/pip-LNAZsw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:43:25 INFO - Running setup.py (path:/tmp/pip-5KesrF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:43:25 INFO - Running setup.py (path:/tmp/pip-RZiZoB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:43:25 INFO - Running setup.py (path:/tmp/pip-JhLZ8g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:43:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:43:25 INFO - Running setup.py (path:/tmp/pip-VqnENo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:43:26 INFO - Running setup.py (path:/tmp/pip-QtWjdM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:43:26 INFO - Running setup.py (path:/tmp/pip-Sv4Foq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:43:26 INFO - Running setup.py (path:/tmp/pip-qfMVKB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:43:26 INFO - Running setup.py (path:/tmp/pip-adi_dY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:43:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:43:26 INFO - Running setup.py (path:/tmp/pip-PuoeBu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:43:26 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:43:26 INFO - Running setup.py install for manifestparser 08:43:26 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:43:26 INFO - Running setup.py install for mozcrash 08:43:26 INFO - Running setup.py install for mozdebug 08:43:26 INFO - Running setup.py install for mozdevice 08:43:26 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:43:26 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:43:26 INFO - Running setup.py install for mozfile 08:43:26 INFO - Running setup.py install for mozhttpd 08:43:26 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:43:26 INFO - Running setup.py install for mozinfo 08:43:27 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:43:27 INFO - Running setup.py install for mozInstall 08:43:27 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:43:27 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:43:27 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:43:27 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:43:27 INFO - Running setup.py install for mozleak 08:43:27 INFO - Running setup.py install for mozlog 08:43:27 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:43:27 INFO - Running setup.py install for moznetwork 08:43:27 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:43:27 INFO - Running setup.py install for mozprocess 08:43:27 INFO - Running setup.py install for mozprofile 08:43:27 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:43:27 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:43:27 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:43:27 INFO - Running setup.py install for mozrunner 08:43:27 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:43:27 INFO - Running setup.py install for mozscreenshot 08:43:27 INFO - Running setup.py install for moztest 08:43:28 INFO - Running setup.py install for mozversion 08:43:28 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:43:28 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:43:28 INFO - Cleaning up... 08:43:28 INFO - Return code: 0 08:43:28 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:43:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:43:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:43:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:43:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:43:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:28 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 0x7fc406143f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a65230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a5f090>, '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 0x2a629b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a62e40>, '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': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', '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 08:43:28 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 08:43:28 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 08:43:28 INFO - Using env: {'DISPLAY': ':0', 08:43:28 INFO - 'HOME': '/home/cltbld', 08:43:28 INFO - 'LANG': 'en_US.UTF-8', 08:43:28 INFO - 'LANGUAGE': 'en_US:en', 08:43:28 INFO - 'LOGNAME': 'cltbld', 08:43:28 INFO - 'MAIL': '/var/mail/cltbld', 08:43:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:28 INFO - 'MOZ_NO_REMOTE': '1', 08:43:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:28 INFO - 'NO_EM_RESTART': '1', 08:43:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:28 INFO - 'PWD': '/builds/slave/test', 08:43:28 INFO - 'SHELL': '/bin/bash', 08:43:28 INFO - 'SHLVL': '1', 08:43:28 INFO - 'TERM': 'linux', 08:43:28 INFO - 'TMOUT': '86400', 08:43:28 INFO - 'USER': 'cltbld', 08:43:28 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', 08:43:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:28 INFO - '_': '/tools/buildbot/bin/python'} 08:43:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:43:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:43:28 INFO - Running setup.py (path:/tmp/pip-l2Fk6H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:43:28 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)) 08:43:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:43:28 INFO - Running setup.py (path:/tmp/pip-mqkwCH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:43:28 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)) 08:43:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:43:28 INFO - Running setup.py (path:/tmp/pip-A2_rKc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:43:28 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)) 08:43:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:43:28 INFO - Running setup.py (path:/tmp/pip-PVWDC4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:43:28 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)) 08:43:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:43:28 INFO - Running setup.py (path:/tmp/pip-UMrysc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:43:28 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)) 08:43:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:43:28 INFO - Running setup.py (path:/tmp/pip-3t8PjO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:43:28 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)) 08:43:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:43:28 INFO - Running setup.py (path:/tmp/pip-xAePTX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:43:28 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)) 08:43:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:43:28 INFO - Running setup.py (path:/tmp/pip-QtsAM5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:43:29 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)) 08:43:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:43:29 INFO - Running setup.py (path:/tmp/pip-ppE2I7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:43:29 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)) 08:43:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:43:29 INFO - Running setup.py (path:/tmp/pip-EeA5Ou-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:43:29 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)) 08:43:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:43:29 INFO - Running setup.py (path:/tmp/pip-vA5SZN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:43:29 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)) 08:43:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:43:29 INFO - Running setup.py (path:/tmp/pip-UGkUlK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:43:29 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)) 08:43:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:43:29 INFO - Running setup.py (path:/tmp/pip-5bB57I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:43:29 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)) 08:43:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:43:29 INFO - Running setup.py (path:/tmp/pip-WqMEEw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:43:29 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)) 08:43:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:43:29 INFO - Running setup.py (path:/tmp/pip-Cknn9P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:43:29 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)) 08:43:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:43:29 INFO - Running setup.py (path:/tmp/pip-PvJgDp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:43:29 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)) 08:43:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:43:29 INFO - Running setup.py (path:/tmp/pip-Ff4hGF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:43:29 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)) 08:43:29 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)) 08:43:29 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)) 08:43:29 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)) 08:43:29 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)) 08:43:29 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)) 08:43:29 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:43:29 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 08:43:29 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 08:43:29 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 08:43:29 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 08:43:29 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 08:43:29 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 08:43:31 INFO - Downloading blessings-1.6.tar.gz 08:43:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:43:31 INFO - Installing collected packages: blessings 08:43:31 INFO - Running setup.py install for blessings 08:43:31 INFO - Successfully installed blessings 08:43:31 INFO - Cleaning up... 08:43:31 INFO - Return code: 0 08:43:31 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:43:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:43:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:43:32 INFO - Reading from file tmpfile_stdout 08:43:32 INFO - Current package versions: 08:43:32 INFO - argparse == 1.2.1 08:43:32 INFO - blessings == 1.6 08:43:32 INFO - blobuploader == 1.2.4 08:43:32 INFO - docopt == 0.6.1 08:43:32 INFO - functools32 == 3.2.3-2 08:43:32 INFO - jsonschema == 2.5.1 08:43:32 INFO - manifestparser == 1.1 08:43:32 INFO - mozInstall == 1.12 08:43:32 INFO - mozcrash == 0.17 08:43:32 INFO - mozdebug == 0.1 08:43:32 INFO - mozdevice == 0.48 08:43:32 INFO - mozfile == 1.2 08:43:32 INFO - mozhttpd == 0.7 08:43:32 INFO - mozinfo == 0.9 08:43:32 INFO - mozleak == 0.1 08:43:32 INFO - mozlog == 3.3 08:43:32 INFO - moznetwork == 0.27 08:43:32 INFO - mozprocess == 0.23 08:43:32 INFO - mozprofile == 0.28 08:43:32 INFO - mozrunner == 6.12 08:43:32 INFO - mozscreenshot == 0.1 08:43:32 INFO - mozsystemmonitor == 0.3 08:43:32 INFO - moztest == 0.7 08:43:32 INFO - mozversion == 1.4 08:43:32 INFO - psutil == 3.1.1 08:43:32 INFO - requests == 1.2.3 08:43:32 INFO - wsgiref == 0.1.2 08:43:32 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:43:32 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')]} 08:43:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:43:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:32 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')]} 08:43:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:43:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:32 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 0x7fc406143f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a65230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a5f090>, '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 0x2a629b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a62e40>, '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': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', '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 08:43:32 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 08:43:32 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 08:43:32 INFO - Using env: {'DISPLAY': ':0', 08:43:32 INFO - 'HOME': '/home/cltbld', 08:43:32 INFO - 'LANG': 'en_US.UTF-8', 08:43:32 INFO - 'LANGUAGE': 'en_US:en', 08:43:32 INFO - 'LOGNAME': 'cltbld', 08:43:32 INFO - 'MAIL': '/var/mail/cltbld', 08:43:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:32 INFO - 'MOZ_NO_REMOTE': '1', 08:43:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:32 INFO - 'NO_EM_RESTART': '1', 08:43:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:32 INFO - 'PWD': '/builds/slave/test', 08:43:32 INFO - 'SHELL': '/bin/bash', 08:43:32 INFO - 'SHLVL': '1', 08:43:32 INFO - 'TERM': 'linux', 08:43:32 INFO - 'TMOUT': '86400', 08:43:32 INFO - 'USER': 'cltbld', 08:43:32 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', 08:43:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:32 INFO - '_': '/tools/buildbot/bin/python'} 08:43:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:43:32 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)) 08:43:32 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)) 08:43:32 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)) 08:43:32 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)) 08:43:32 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)) 08:43:32 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)) 08:43:32 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)) 08:43:32 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)) 08:43:32 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)) 08:43:32 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)) 08:43:32 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)) 08:43:32 INFO - Cleaning up... 08:43:32 INFO - Return code: 0 08:43:32 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:43:32 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')]} 08:43:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:43:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:32 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')]} 08:43:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:43:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:43:32 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 0x7fc406143f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29968a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a65230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a5f090>, '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 0x2a629b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a62e40>, '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': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', '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 08:43:32 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 08:43:32 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 08:43:32 INFO - Using env: {'DISPLAY': ':0', 08:43:32 INFO - 'HOME': '/home/cltbld', 08:43:32 INFO - 'LANG': 'en_US.UTF-8', 08:43:32 INFO - 'LANGUAGE': 'en_US:en', 08:43:32 INFO - 'LOGNAME': 'cltbld', 08:43:32 INFO - 'MAIL': '/var/mail/cltbld', 08:43:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:32 INFO - 'MOZ_NO_REMOTE': '1', 08:43:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:32 INFO - 'NO_EM_RESTART': '1', 08:43:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:32 INFO - 'PWD': '/builds/slave/test', 08:43:32 INFO - 'SHELL': '/bin/bash', 08:43:32 INFO - 'SHLVL': '1', 08:43:32 INFO - 'TERM': 'linux', 08:43:32 INFO - 'TMOUT': '86400', 08:43:32 INFO - 'USER': 'cltbld', 08:43:32 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', 08:43:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:32 INFO - '_': '/tools/buildbot/bin/python'} 08:43:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:43:32 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:43:32 INFO - Cleaning up... 08:43:32 INFO - Return code: 0 08:43:32 INFO - Running post-action listener: _resource_record_post_action 08:43:32 INFO - Running post-action listener: _start_resource_monitoring 08:43:32 INFO - Starting resource monitoring. 08:43:32 INFO - [mozharness: 2016-08-22 15:43:32.515129Z] Finished create-virtualenv step (success) 08:43:32 INFO - [mozharness: 2016-08-22 15:43:32.515594Z] Running install step. 08:43:32 INFO - Running pre-action listener: _resource_record_pre_action 08:43:32 INFO - Running main action method: install 08:43:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:43:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:43:32 INFO - Reading from file tmpfile_stdout 08:43:32 INFO - Detecting whether we're running mozinstall >=1.0... 08:43:32 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:43:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:43:32 INFO - Reading from file tmpfile_stdout 08:43:32 INFO - Output received: 08:43:32 INFO - Usage: mozinstall [options] installer 08:43:32 INFO - Options: 08:43:32 INFO - -h, --help show this help message and exit 08:43:32 INFO - -d DEST, --destination=DEST 08:43:32 INFO - Directory to install application into. [default: 08:43:32 INFO - "/builds/slave/test"] 08:43:32 INFO - --app=APP Application being installed. [default: firefox] 08:43:32 INFO - mkdir: /builds/slave/test/build/application 08:43:32 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'] 08:43:32 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 08:43:48 INFO - Reading from file tmpfile_stdout 08:43:48 INFO - Output received: 08:43:48 INFO - /builds/slave/test/build/application/firefox/firefox 08:43:48 INFO - Running post-action listener: _resource_record_post_action 08:43:48 INFO - [mozharness: 2016-08-22 15:43:48.911534Z] Finished install step (success) 08:43:48 INFO - [mozharness: 2016-08-22 15:43:48.911781Z] Running run-tests step. 08:43:48 INFO - Running pre-action listener: _resource_record_pre_action 08:43:48 INFO - Running main action method: run_tests 08:43:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:43:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:43:48 INFO - Python 2.7.3 08:43:48 INFO - Return code: 0 08:43:48 INFO - grabbing minidump binary from tooltool 08:43:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:43:48 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 0x2a5f090>, '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 0x2a629b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a62e40>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:43:48 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 08:43:48 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 08:43:48 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 08:43:48 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:43:48 INFO - Return code: 0 08:43:48 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:43:48 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:43:48 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:43:48 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:43:48 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:43:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--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 08:43:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Autoland-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-002 --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 08:43:48 INFO - Using env: {'DISPLAY': ':0', 08:43:48 INFO - 'HOME': '/home/cltbld', 08:43:48 INFO - 'LANG': 'en_US.UTF-8', 08:43:48 INFO - 'LANGUAGE': 'en_US:en', 08:43:48 INFO - 'LOGNAME': 'cltbld', 08:43:48 INFO - 'MAIL': '/var/mail/cltbld', 08:43:48 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:43:48 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:43:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:43:48 INFO - 'MOZ_NO_REMOTE': '1', 08:43:48 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:43:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:43:48 INFO - 'NO_EM_RESTART': '1', 08:43:48 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:43:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:43:48 INFO - 'PWD': '/builds/slave/test', 08:43:48 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:43:48 INFO - 'SHELL': '/bin/bash', 08:43:48 INFO - 'SHLVL': '1', 08:43:48 INFO - 'TERM': 'linux', 08:43:48 INFO - 'TMOUT': '86400', 08:43:48 INFO - 'USER': 'cltbld', 08:43:48 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438', 08:43:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:43:48 INFO - '_': '/tools/buildbot/bin/python'} 08:43:48 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--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 08:43:49 INFO - mozversion application_buildid: 20160822065314 08:43:49 INFO - mozversion application_changeset: 5aea87afc510f2b64c9ca3617fd27b78af95f4af 08:43:49 INFO - mozversion application_display_name: Nightly 08:43:49 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:43:49 INFO - mozversion application_name: Firefox 08:43:49 INFO - mozversion application_remotingname: firefox 08:43:49 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland 08:43:49 INFO - mozversion application_vendor: Mozilla 08:43:49 INFO - mozversion application_version: 51.0a1 08:43:49 INFO - mozversion platform_buildid: 20160822065314 08:43:49 INFO - mozversion platform_changeset: 5aea87afc510f2b64c9ca3617fd27b78af95f4af 08:43:49 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland 08:43:49 INFO - mozversion platform_version: 51.0a1 08:43:49 INFO - using testdate: 1471880629 08:43:49 INFO - actual date: 1471880629 08:43:49 INFO - starting webserver on 'localhost:46159' 08:43:49 INFO - SUITE-START | Running 2 tests 08:43:49 INFO - TEST-START | dromaeo_css 08:43:49 INFO - operating with platform_type : linux_ 08:43:49 INFO - Initialising browser for dromaeo_css test... 08:43:49 INFO - TEST-INFO | started process 4952 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpj0wOk6/profile http://localhost:46159/getInfo.html) 08:43:54 INFO - PROCESS | 4952 | __metrics Screen width/height:1600/1200 08:43:54 INFO - PROCESS | 4952 | colorDepth:24 08:43:54 INFO - PROCESS | 4952 | Browser inner width/height: 1024/697 08:43:54 INFO - PROCESS | 4952 | __metrics 08:43:54 ERROR - PROCESS | 4952 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2993: TypeError: this.tabs is undefined 08:43:55 INFO - TEST-INFO | 4952: exit 0 08:43:55 INFO - Browser initialized. 08:43:55 INFO - Running cycle 1/1 for dromaeo_css test... 08:43:55 INFO - TEST-INFO | started process 5074 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpj0wOk6/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:44:08 INFO - PROCESS | 5074 | RSS: Main: 187809792 08:44:08 INFO - PROCESS | 5074 | 08:44:57 INFO - PROCESS | 5074 | 1471880697873 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] 08:47:10 INFO - PROCESS | 5074 | Cycle 1(1): loaded http://localhost:46159/tests/dromaeo/cssquery-dojo.html (next: http://localhost:46159/tests/dromaeo/cssquery-ext.html) 08:47:11 INFO - PROCESS | 5074 | RSS: Main: 199450624 08:47:11 INFO - PROCESS | 5074 | 08:50:13 INFO - PROCESS | 5074 | Cycle 1(1): loaded http://localhost:46159/tests/dromaeo/cssquery-ext.html (next: http://localhost:46159/tests/dromaeo/cssquery-jquery.html) 08:50:14 INFO - PROCESS | 5074 | RSS: Main: 197963776 08:50:14 INFO - PROCESS | 5074 | 08:53:16 INFO - PROCESS | 5074 | Cycle 1(1): loaded http://localhost:46159/tests/dromaeo/cssquery-jquery.html (next: http://localhost:46159/tests/dromaeo/cssquery-mootools.html) 08:53:16 INFO - PROCESS | 5074 | RSS: Main: 199507968 08:53:16 INFO - PROCESS | 5074 | 08:56:18 INFO - PROCESS | 5074 | Cycle 1(1): loaded http://localhost:46159/tests/dromaeo/cssquery-mootools.html (next: http://localhost:46159/tests/dromaeo/cssquery-prototype.html) 08:56:19 INFO - PROCESS | 5074 | RSS: Main: 196886528 08:56:19 INFO - PROCESS | 5074 | 08:59:22 INFO - PROCESS | 5074 | Cycle 1(1): loaded http://localhost:46159/tests/dromaeo/cssquery-prototype.html (next: http://localhost:46159/tests/dromaeo/cssquery-yui.html) 08:59:23 INFO - PROCESS | 5074 | RSS: Main: 198692864 08:59:23 INFO - PROCESS | 5074 | 09:02:25 INFO - PROCESS | 5074 | Cycle 1(1): loaded http://localhost:46159/tests/dromaeo/cssquery-yui.html (next: http://localhost:46159/tests/dromaeo/cssquery-dojo.html) 09:02:26 INFO - PROCESS | 5074 | RSS: Main: 199663616 09:02:26 INFO - PROCESS | 5074 | 09:02:26 INFO - PROCESS | 5074 | __start_tp_report 09:02:26 INFO - PROCESS | 5074 | _x_x_mozilla_page_load 09:02:26 INFO - PROCESS | 5074 | _x_x_mozilla_page_load_details 09:02:26 INFO - PROCESS | 5074 | |i|pagename|runs| 09:02:26 INFO - PROCESS | 5074 | |0;dojo.html;2624.4882247961646;2637.617545455909;2653.747893950075;2662.2013395981226;2666.9866650666745;4633.768311584416;4662.696924699896;4741.976290118549;4760.738159401231;4784.521547845214;4662.836800711976;4672.509386514418;4735.171345014617;4762.833300834472;4769;4214.620684138427;4339.197248509028;4416.933745993812;4461.665375096864;4463.107378524308;4401;4413.6027757501815;4448.088141930896;4449.354843547683;4455.8217671293105;4163.292240319122;4246.681498887596;4271.466066741657;4307.892302692458;4316.460442444694;4220.957790422118;4274.658027357804;4283.05772730002;4288.378185163165;4293.313069908831;4261.637760790337;4283.850065247701;4296.334068219431;4322.135572885435;4331.891702707426;4550.954490455119;4586.059857729158;4639.257718764981;4650.697704649187;4664.253719404879;4995.000999800054;5023.246513023039;5028.421731500887;5037.29477873098;5037.345145131109;4940.752962351904;5071.467495912912;5076.695398276115;5092.898142037138;5108.948910510884;4657.4876763555985;4712.387389639325;4728.59806916416;4734.124187025412;4767.904641907143;5120.4111527174855;5158.767855446514;5191;5204.4535323791215;5209.661372010807;4897.191963326082;4954.331165292711;4955.578775804025;4956.553910148104;4971.925421118686;4807.134715751198;4995.350604421402;5052.5705315048635;5056.241563765391;5060.924086138711;5065.772040258197;5072.797088116507;5075.467075957045;5075.619328550373;5087.058894104603;4831.347768051268;5047.772850221749;5056.469070747518;5064.873378165502;5076.6192535559985;4209.389638502461;4254.851080212177;4256.723312984646;4305.913881722348;4312;3714.68425183857;3725.068732816796;3726.2361215950664;3734.327820992193;3737.757045792069;4335.804888780012;4444.599986001275;4452.131834292347;4455.799489023002;4456.197884380843;4986.501349865057;5038.521340472649;5062.594992400599;5069.898602028013;5077.644564880497;4372.103718737651;4424.093060922503;4427.645788336926;4429.80065897029;4438.733675979452;4543.727376357429;4544.727316361029;4554.658400619901;4558.293464513005;4605.723656580616;4852.830150944841;4894.95105048945;4895.485973972682;4898.559129678275;4937.0372777308085;5118.334616499831;5129.589632829439;5131.153359695609;5143.048536020848;5165.922511162411;4738.170820106537;4787.353707249476;4828.855134345835;4893.657443979029;4907.754612269444;4986.825461108844;4987.077390682735;5001.64988450805;5005.049040682259;5011;5073.441921388718;5092.745362731775;5102;5106.310648062464;5133.922991155061;4743.83396581118;4746.7863946121815;4801.327814106098;4807.302941073594;4944.554990050912;4752.192127338291;4815.061063092803;4834.395700537433;4835.274708793709;4860.1251774680895;4789.401324834395;4808.27875818616;4810.326554282473;4813.78337974799;4831.541003604652;4817.445993710769;4858.854234372974;4877.048975449753;4944.851654450372;4956.6530342877095;4840.854774356775;4861.611071114232;4874.95125048745;4875;4876.073546026244 09:02:26 INFO - PROCESS | 5074 | |1;ext.html;540.3353874734076;549.7388740348335;554.5646667366116;558.2380051230069;586.4956137721562;34355.65644343559;38767.612323876754;38850.417243741365;38900;39090.80454597727;38249.8087509562;38812.805935970355;38952;38982.22035559287;39009.8049509752;7531.924680753191;7689.115751688571;7694.384449244075;7699.653515591812;7704.46068775186;7596.316331530161;7650.693972241132;7676.347510461617;7688.115866675348;7693.7307194248215;7667;7711.922880771204;7716.6913323467;7716.729914452995;7719.112302085276;7671.079470463552;7679.2704693054075;7698.461107722462;7707;7711.807204819868;7347.742829001013;7401;7416.629168541605;7420.851582968365;7441.479096463249;36718.26563468716;36829;36998.63001370006;36999.81500092509;37142.81428592867;2834.574813777929;2908.3601607646283;2923.532234842415;2952.35048289376;3217.517372394136;28298.46486229332;28820.279493012633;28970.42059158826;29606.114991026454;29702.405951881057;3474.2877710069374;3481.1819222482695;3559.697425718817;3726.441033844918;3726.4782930389765;249900;249977;250260;251017;251261;51064.74467627712;51780;52002;52092;52161;53280.467195327554;53555.19667204995;53613.73193134087;53623.731881341126;53842.46157538453;12635.810462843065;13128.934355328161;13143.211407315592;13579.796303055462;13583.45666173342;10874;10937.398443085547;10951.45242737876;10964.232503724663;10965.451727413598;17381.304747809947;17507.912460437616;17553.64892702139;17647.64704705899;17853.642927141384;6858.078918848738;6879.6216208108035;6910.792676219721;6989.7553585624255;7176.210616832144;794.7973266816924;802.3781569283735;927.6660402255183;947.0151042915429;995.8356871116184;26148.34629134287;27862.442751144863;27997;28275.858620707175;28509.71490285112;946.3517490519016;964.4454438697777;988;1001.62439085343;1028;14812.70374592502;14858.925705371621;14910.403583856742;14934.10395376281;15025.323860426308;378462;383555;385427;386384;387579;48632.27051594229;48923.51076489189;49092.26361604579;49119;49153.50846491489;1154.549725607014;1182.018924292835;1204.7831390349645;1207.8309036734863;1218.3360068762545;25087.87456062708;26073.348166295993;27137.05020324358;27511.449771004067;27640.170794876187;41565.168696626504;42414;42472.15055698807;42477.5752242486;42490;343581;344923;345147;345765;345813;22822.771772282063;22974.540509190057;23046.884765576735;23058.847057647385;23107;41393.688787843996;41678;41987;42279.943001425214;42989.57010429856;36669.44995825118;36765.63234367622;36970;37161.4425783608;37400.812995934844;35944.64055359413;36270;36326.235836134976;37593.43609845909;37608.230518506934;34860.12849678778;35396.82301588476;35454.290914182086;35928.82035589805;36394.8180259097;27904.44191116126;29119;29141.56287655729;29372.706272937852;29445.411091778475;23143.421414464774;23305.18431854877;23342.416439589146;23603.173888913807;23795.167169148997 09:02:26 INFO - PROCESS | 5074 | |2;jquery.html;356.28742514970077;373.47526724951445;377.6167190301843;380.64599922072495;386.455098311381;15799.684006319882;16134.354625814967;16994.5751356216;17105.0592217428;17114.31542738289;15882.126483043428;16038.518844434686;16119.597010074755;16352.509424717247;16472.505824825246;4964.652474326789;5194.480551944795;5203.9219411708855;5208.609354298443;5213.478652134794;4951.158303088466;5096.235564665293;5125.3080834087295;5134.7432628368615;5169.819056333029;5084.288199652052;5101.4133374662015;5111.182210846266;5116.616253780962;5131.050755610206;4928.236123400879;5102.948970510284;5105.693658380491;5121.974390128044;5135.74321283938;4494.595486406207;4508.2336002879265;4531.43357080365;4548.113117942003;4557.635389168891;19809.009549522467;20660.483487912923;20682.482937926674;20707.27524536649;20914.5817083659;1956.5891162855817;2051.9076641551164;2074.284371891695;2084.3121769815925;2389.3429306940557;13348.466061357534;13359.265240411774;13432.731345373135;13460.663483412894;13648;1755.736639504072;1815.6459490399377;1827.2416946967126;1828.2138680367436;1839.7148441991512;67779.66110169418;67844.3215567843;68449.9999999995;68450.31549684539;70723.64638176828;9400.435973841591;9511.429314241168;9658.227341812639;9841.311108222499;10093.596256149673;13377.331133443484;13392.330383480787;13406.195628262336;13407.128536645087;13440.260785656883;7069.222385537587;7183.89224161638;7198.388137008413;7364.668589913466;7403.259674032553;6651.368120028589;6683.131192944886;6848.212455567574;6921.342472465209;6924.376806087476;5971.313298970587;5983.491403230687;6104.847378815476;6154.630722156685;6196.411340922605;1758.9208485618178;1818.4453741608672;1820.7724034495689;1823.452964110788;1854.3973208707225;871.655696000089;894.5661354243186;895.5566994337714;898.4025622960658;948.5399581203111;16886.831131688527;17190.10082126613;17654.823451765576;17833.46499605014;18038.639227215383;867.119873328572;888.8977767556685;894.6689724801865;917.7659696777279;921.4195057113975;9430;10339.172866170687;10351.689449316533;10468.162546996222;10470.685879423629;392314;411465.2547584397;411793;413396;413923;64051.679741601925;66788.6660566694;67742.32257677459;67747.66126169337;69222.3077769226;879.068187721005;902.4269588811152;922.6540047482194;930.2465003347311;931.4225180388203;14010.719785604435;15114.848851511784;15512.457064002705;15598.766018509958;15799.21003949775;33904.83047584746;34176.65823341735;34258.287085646116;34856.2115030802;35125.48745125467;44247.11505769802;44309;44458;44985;45305.546944530135;4488.68579199466;5453.15476101205;5712.34308054579;7360.411167106511;7471.738489152854;10980.615678451215;11024.393658348547;11070.059044981266;11485.253458525169;11511.654650360502;10073.294869359075;10149.39103653783;10246.333988290737;10303.330283531546;10468.319559228627;10048.145907597644;10061.943495933114;10090.495475226357;10193.898061019592;10243.795124097625;9841.507924603884;10207.693769186937;10376.740581485523;10405.947970260404;10450.58197672115;7282.635868206675;7363.521371110861;7593.848123037398;7599.962000189964;7741.419393545394;9838.212942964688;9893.752656183653;9995;10167.7458063549;10269.229807764597 09:02:26 INFO - PROCESS | 5074 | |3;mootools.html;1138.2146319039862;1151.3609946479705;1281.3721276574477;1689.653621007693;1698.422536337645;6392.712327945242;7120.145582530091;7231.638418079095;7788.182240864706;7817.609119544021;7217.855642887139;7490.88763668544;7498.775036748906;7505.962470187641;7509.737159199429;2121.596896589643;2178.6187417202004;2179.945501362463;2182.4871155278574;2190.759016508183;2169.327508472371;2173.5435558532727;2201.680756290337;2202.1411649456645;2202.570498752744;2166.729158855143;2177.9128834846665;2189.343197040889;2197.121151539389;2199.571083638691;2166.631672615659;2170.750363708178;2175.912963481475;2178.575177840322;2179.063002908749;2112.2712664131004;2120.575884823026;2133.5626196629655;2151.6449785785326;2153.3432303147533;7664.3102120808835;7685.769426917202;7753.340966017895;7763.184865589088;7770.728024519171;4302.634276086505;4429.867103986886;4432.180046691373;4433.733975961452;4433.911321773547;2922.284040410092;2997.4454725875785;3049.085274417688;3057.6025116734904;3063.877444902201;956.9856452153223;1014.4319181258519;1025.6205204074465;1031.3657100882979;1034.9223808214338;10575.206859485492;10585.629502967437;10586.788264234749;10678.038976492153;10774.784504310026;3859.4403811447182;4012.959870401317;4145.97927010363;4154.335306350969;4167.8958026049595;9077.727668169966;9142.131497507726;9150.86273705895;9169.541522923828;9172.03693612161;4551.158035763328;4563.748993805372;4565.56627120423;4568.063546972862;4574.428196475441;3703.5926048134684;4029.315016447211;4125.793710314472;4142.834286628501;4159.939215500089;3646.726495512847;3731.477593136963;3778.6599206071587;3780.584135745066;3831.5210598675167;1235.2526721333643;1240.3302216802826;1265.1966001589058;1266.993665031669;1269.8730126987227;584.2142318581501;682.1950098883365;722.357102179061;735.7645553422853;737.7639155470198;4798.304245884327;4804.879878003008;4972.453030166679;5058.1654027085115;5105.795768169306;390.9971419498224;400.087799816419;402.8992751812047;403.12722954802524;408.3058800039944;3416;3451.87918422854;3484.8083355415188;3513.648635136466;3600.1179710970455;9363.4381937084;9609.90390096104;9644.421334719798;9688.70933871985;9689.90310096904;9522.523873806282;9528.380655257386;9574.664886728931;9588.280878934107;9608;6885.931140688629;7254.238304978006;7314.341709246193;7368.8894666580045;7376.631168441557;5248.343957005374;5324.494173053554;5325.281087053353;5378.623496355218;5561.610687251854;8667.349948753743;8867.955660221658;8892.911070889208;8939.59771810257;8956.149165829236;8942.46345219289;9057.864132037894;9136.406133601295;9142.817143656957;9245.214156796748;5540.501354878081;6139.201903752483;6308.27454842699;6436.324185960407;6468.741250349934;7576.7348142814735;7673.271039251262;7680.8094745314565;7685.807854803675;7698.384129269757;6564.146660934048;6654.933450665431;6700.195976482853;6758.121444212417;7020.613866237406;6712.53012289135;6752.93247067523;6907.792766217021;6942.097527321416;6965.930340696731;5975.970120149372;6026.15633811258;6091.177691011657;6098.847528811638;6100.908486372797;4332.978335108304;4336.111097224998;4405.559444055697;4413.933790993074;4449.399331090391;4213.873583792491;4347.760873152007;4357.237483440449;4412.757298348622;4426.75652839097 09:02:26 INFO - PROCESS | 5074 | |4;prototype.html;297.14274318590867;305.242997366531;309.9054788289572;312.5983111701464;313.29664902294354;4971.477994810547;4975.925361119586;4991.351124353833;4992.252711550956;5003.524665156813;4926.753662316888;4938.333325001124;4976.900461990758;4979.153543897537;4990.351254336932;3714.182879766454;3776.1503661676043;3841.558220804601;3879.5926427725108;3892.727509074352;3892.727509074366;3895.2014836958356;3905.453236546886;3906.394508851118;3913.2369188008206;3881.4954055972826;3884.3008258513596;3915.804209789513;3917.8236979335998;3940.7438516496336;3826.4260360945805;3835.42468629705;3876.2247550490015;3926.0773718176206;3935.4096885467266;3407.761456698032;3415.9658403416147;3429.0741499795167;3438.985499277719;3448.81031543265;4762.809487620491;4785.545373189576;4810.374651295344;4811.75941202942;4825.638077144228;4368.541303163154;4450.532694067108;4455.443069616298;4459.799309031101;4483.125790470859;5072;5105.897882042338;5112.744362781846;5113.411957624883;5161.767720452589;3705.4617586953023;3764.9834544672785;3780.4707340972286;3780.9054773630605;3804.5352539272303;5377;5390.946090539083;5397.892042159135;5411.808217671849;5423.376311724123;3729.738918275749;3790.5261842269715;3794.1842503861803;3816.37029890065;3823.2735780201674;3862.748921320105;3864.840547835638;3870.3226935286775;3872.8257228424786;3920.098377373163;4460.1525710114975;4461.353103799931;4465.620422264079;4471.754053527087;4472.798724057425;5104.438511763703;5167.328247327823;5195.870103247449;5248.9737551312;5284.445133261029;1344.2203521957242;1350.6960933790015;1360.0751488987582;1362.2779926638898;1365.9317034148253;844.6536919862826;875;888.2494292322976;896.188949001155;899.2805755395657;4358.3244597087505;4425.22558552252;4554.693781744231;4582.656300777388;4598.724076555417;5338.652987555796;5353.4646535346155;5358.383785864676;5365.248865158881;5374.6506477078865;4609.556934824482;4611.339917629651;4616.938104236045;4631.9536804631525;4661.95338046622;2679.6650418697664;2832.27776916889;2852.001799370204;2853.215365774429;2863.3128049268444;5129.742913118291;5130.615203859726;5141.069590333474;5148.304978827885;5155.304033955443;5212.661177023481;5455;5469.371022332482;5469.753861076261;5501.944980550144;5112.897742045213;5114.3862736471865;5116.130257856174;5116.2116646427785;5144.4855514449;5360.973195133999;5362.812301569426;5373.382061063028;5383.973080134574;5388;4921.6062714982;5231.293775340432;5282.8943421132135;5302.2046692996355;5305;5108;5113.897722045613;5119.0017946500075;5138.845834624967;5144.511271429208;3748.156664750409;3814.732968692165;3816.332141875105;3816.6183381661613;3823.2162406706;5134.922976155286;5349.304590403222;5362.70505122222;5440.347158341025;5442.428545002717;5209.869753256199;5226.817061402832;5261.447548007557;5281.577473802164;5283.630145889751;5224.477552244745;5225.372955245395;5248.947510524846;5265.341832270966;5295.25866378715;5037.19404895215;5102.4642412546145;5104.927965127216;5151.871203219949;5174.120399532164;5013.548780609763;5136.30659860929;5183.371639852043;5228.790848366023;5255.240998475831;5095.796168153381;5100.132977393778;5101.413337466239;5105.566026887607;5164.32863727713 09:02:26 INFO - PROCESS | 5074 | |5;yui.html;589.145441561533;604.3442864492026;612.6048698589407;687.9828004299892;689.386446063004;12702;14528.564143075711;15201.087934723924;15206.847931520682;15858.20708964553;15048.623784405396;15133.54599362021;15136.01615894966;15290.847091529082;15318.693626127471;612.7365232949829;720.4956530428694;753.1677496366518;779.5011192836589;785.8035491127218;763.2596381509954;776.3595034096865;778.9182135875736;779.8362343907786;780.9297163255305;820.228984754332;824.1181935329171;825.63671984327;826.0789220019665;826.305903041445;804.2761514636816;806.6491076381793;810.0198759501011;811.5333683132193;812.0093485947135;591.1989254560095;591.7189335065809;593.4510577715639;595.0776296740079;599.3197720587121;14307.356168972421;14533.27333633314;14569.05301155432;14601.78097328541;14633.926830365886;12938.611841644766;13146.737065258736;13224.27266500342;13243.668908277274;13544.45822167112;10137.594496220216;10390.27268091234;10414.114800241989;10471.371717696886;10603.628872989408;3245.2698142917657;3255.886043988449;3272.8199949002797;3277.5411442398085;3317.2370354818286;68171.31828681749;68364.65817670879;69119.3088069118;69510.65244673744;70331.64834175796;9533.666321678707;9717;9856.408615482951;9884.110430061186;9956.80086398268;19331.130099145572;19342;19420.902895485433;19445.222191112196;19662.803371966384;6419.486441084702;6512.869742605121;6560.507961902877;6580;6746.325367463312;3472.350448890347;3527.9118022049656;3570.071781336871;3572.142685755452;3593.065802891267;2734.6308248386213;2809.269589906639;2826.2651710555406;2833.334166470878;2839.929001774972;490.9435414927258;491.76566817288864;491.8081948040267;498.6833360815908;502.07868561189895;480.4666819829986;554.6117717597617;573.4924591736343;578.3637998201945;584.9824505264849;7767.5339479630275;7874.0551133863155;8138.267555919995;8301.916980830236;8325.209105135002;501.74411050364574;528.2604353904565;532.8827657915252;556.5603173492976;563.7688547695425;3555.822208889545;3575.76757510761;3793.905152371213;3821.808909554511;3898.064464528493;95539;99415.50292248493;106323.46838265914;109478;109495.45252273687;88837.55581222053;90482.04697483272;91149.54425227831;91345.54327228322;91716.54141729248;62950.37049629536;63154.68422657949;64013;81975;88369.55815220883;8138.959305203436;8430.536320502431;8496.91503084986;8750.649974001224;8772.210501054935;38827.6117238824;38833.417498738105;42453.363199551415;43197;46055.53944460512;39545.20909581735;52837.20744188764;52894;61636.69181654063;61996;10408.777260548632;10857.565697372016;10903.127749780157;11175.55297788112;11227.550897964316;12266.693332666398;12387.876121238673;12871.549495767604;13179.802302965272;13255.734885302432;10996.28524145928;11122.61070862516;11306.604268850551;11665.708357290796;11935.283882967049;10826.133909287395;10973.615923442641;11015.83476247841;11074.169437292074;11427.828582571101;11017.944910275397;11214.102871770076;11306.876071667937;11663.475143618387;11765.529378825093;9934.801303973736;9934.850977235203;9961.452120133463;10384.42885641297;10397.48012599352;9328.253739700944;9755.707328780149;9969.45168015737;9987.750306242402;9988.450635215133 09:02:26 INFO - PROCESS | 5074 | __end_tp_report 09:02:26 INFO - PROCESS | 5074 | __start_cc_report 09:02:26 INFO - PROCESS | 5074 | _x_x_mozilla_cycle_collect,387 09:02:26 INFO - PROCESS | 5074 | __end_cc_report 09:02:26 INFO - PROCESS | 5074 | __startTimestamp1471881746068__endTimestamp 09:02:26 INFO - PROCESS | 5074 | 09:02:26 INFO - PROCESS | 5074 | ------- Summary: start ------- 09:02:26 INFO - PROCESS | 5074 | Number of tests: 6 09:02:26 INFO - PROCESS | 5074 | 09:02:26 INFO - PROCESS | 5074 | [#0] dojo.html Cycles:165 Average:4665.83 Median:4807.13 stddev:488.48 (10.2%) stddev-sans-first:462.99 09:02:26 INFO - PROCESS | 5074 | Values: 2624.5 2637.6 2653.7 2662.2 2667.0 4633.8 4662.7 4742.0 4760.7 4784.5 4662.8 4672.5 4735.2 4762.8 4769.0 4214.6 4339.2 4416.9 4461.7 4463.1 4401.0 4413.6 4448.1 4449.4 4455.8 4163.3 4246.7 4271.5 4307.9 4316.5 4221.0 4274.7 4283.1 4288.4 4293.3 4261.6 4283.9 4296.3 4322.1 4331.9 4551.0 4586.1 4639.3 4650.7 4664.3 4995.0 5023.2 5028.4 5037.3 5037.3 4940.8 5071.5 5076.7 5092.9 5108.9 4657.5 4712.4 4728.6 4734.1 4767.9 5120.4 5158.8 5191.0 5204.5 5209.7 4897.2 4954.3 4955.6 4956.6 4971.9 4807.1 4995.4 5052.6 5056.2 5060.9 5065.8 5072.8 5075.5 5075.6 5087.1 4831.3 5047.8 5056.5 5064.9 5076.6 4209.4 4254.9 4256.7 4305.9 4312.0 3714.7 3725.1 3726.2 3734.3 3737.8 4335.8 4444.6 4452.1 4455.8 4456.2 4986.5 5038.5 5062.6 5069.9 5077.6 4372.1 4424.1 4427.6 4429.8 4438.7 4543.7 4544.7 4554.7 4558.3 4605.7 4852.8 4895.0 4895.5 4898.6 4937.0 5118.3 5129.6 5131.2 5143.0 5165.9 4738.2 4787.4 4828.9 4893.7 4907.8 4986.8 4987.1 5001.6 5005.0 5011.0 5073.4 5092.7 5102.0 5106.3 5133.9 4743.8 4746.8 4801.3 4807.3 4944.6 4752.2 4815.1 4834.4 4835.3 4860.1 4789.4 4808.3 4810.3 4813.8 4831.5 4817.4 4858.9 4877.0 4944.9 4956.7 4840.9 4861.6 4875.0 4875.0 4876.1 09:02:26 INFO - PROCESS | 5074 | 09:02:26 INFO - PROCESS | 5074 | [#1] ext.html Cycles:180 Average:47570.19 Median:37071.31 stddev:87369.32 (235.7%) stddev-sans-first:87543.06 09:02:26 INFO - PROCESS | 5074 | Values: 540.3 549.7 554.6 558.2 586.5 34355.7 38767.6 38850.4 38900.0 39090.8 38249.8 38812.8 38952.0 38982.2 39009.8 7531.9 7689.1 7694.4 7699.7 7704.5 7596.3 7650.7 7676.3 7688.1 7693.7 7667.0 7711.9 7716.7 7716.7 7719.1 7671.1 7679.3 7698.5 7707.0 7711.8 7347.7 7401.0 7416.6 7420.9 7441.5 36718.3 36829.0 36998.6 36999.8 37142.8 2834.6 2908.4 2923.5 2952.4 3217.5 28298.5 28820.3 28970.4 29606.1 29702.4 3474.3 3481.2 3559.7 3726.4 3726.5 249900.0 249977.0 250260.0 251017.0 251261.0 51064.7 51780.0 52002.0 52092.0 52161.0 53280.5 53555.2 53613.7 53623.7 53842.5 12635.8 13128.9 13143.2 13579.8 13583.5 10874.0 10937.4 10951.5 10964.2 10965.5 17381.3 17507.9 17553.6 17647.6 17853.6 6858.1 6879.6 6910.8 6989.8 7176.2 794.8 802.4 927.7 947.0 995.8 26148.3 27862.4 27997.0 28275.9 28509.7 946.4 964.4 988.0 1001.6 1028.0 14812.7 14858.9 14910.4 14934.1 15025.3 378462.0 383555.0 385427.0 386384.0 387579.0 48632.3 48923.5 49092.3 49119.0 49153.5 1154.5 1182.0 1204.8 1207.8 1218.3 25087.9 26073.3 27137.1 27511.4 27640.2 41565.2 42414.0 42472.2 42477.6 42490.0 343581.0 344923.0 345147.0 345765.0 345813.0 22822.8 22974.5 23046.9 23058.8 23107.0 41393.7 41678.0 41987.0 42279.9 42989.6 36669.4 36765.6 36970.0 37161.4 37400.8 35944.6 36270.0 36326.2 37593.4 37608.2 34860.1 35396.8 35454.3 35928.8 36394.8 27904.4 29119.0 29141.6 29372.7 29445.4 23143.4 23305.2 23342.4 23603.2 23795.2 09:02:26 INFO - PROCESS | 5074 | 09:02:26 INFO - PROCESS | 5074 | [#2] jquery.html Cycles:180 Average:24326.03 Median:229085.06 stddev:67076.09 (29.3%) stddev-sans-first:67240.11 09:02:26 INFO - PROCESS | 5074 | Values: 356.3 373.5 377.6 380.6 386.5 15799.7 16134.4 16994.6 17105.1 17114.3 15882.1 16038.5 16119.6 16352.5 16472.5 4964.7 5194.5 5203.9 5208.6 5213.5 4951.2 5096.2 5125.3 5134.7 5169.8 5084.3 5101.4 5111.2 5116.6 5131.1 4928.2 5102.9 5105.7 5122.0 5135.7 4494.6 4508.2 4531.4 4548.1 4557.6 19809.0 20660.5 20682.5 20707.3 20914.6 1956.6 2051.9 2074.3 2084.3 2389.3 13348.5 13359.3 13432.7 13460.7 13648.0 1755.7 1815.6 1827.2 1828.2 1839.7 67779.7 67844.3 68450.0 68450.3 70723.6 9400.4 9511.4 9658.2 9841.3 10093.6 13377.3 13392.3 13406.2 13407.1 13440.3 7069.2 7183.9 7198.4 7364.7 7403.3 6651.4 6683.1 6848.2 6921.3 6924.4 5971.3 5983.5 6104.8 6154.6 6196.4 1758.9 1818.4 1820.8 1823.5 1854.4 871.7 894.6 895.6 898.4 948.5 16886.8 17190.1 17654.8 17833.5 18038.6 867.1 888.9 894.7 917.8 921.4 9430.0 10339.2 10351.7 10468.2 10470.7 392314.0 411465.3 411793.0 413396.0 413923.0 64051.7 66788.7 67742.3 67747.7 69222.3 879.1 902.4 922.7 930.2 931.4 14010.7 15114.8 15512.5 15598.8 15799.2 33904.8 34176.7 34258.3 34856.2 35125.5 44247.1 44309.0 44458.0 44985.0 45305.5 4488.7 5453.2 5712.3 7360.4 7471.7 10980.6 11024.4 11070.1 11485.3 11511.7 10073.3 10149.4 10246.3 10303.3 10468.3 10048.1 10061.9 10090.5 10193.9 10243.8 9841.5 10207.7 10376.7 10405.9 10450.6 7282.6 7363.5 7593.8 7600.0 7741.4 9838.2 9893.8 9995.0 10167.7 10269.2 09:02:26 INFO - PROCESS | 5074 | 09:02:26 INFO - PROCESS | 5074 | [#3] mootools.html Cycles:180 Average:5058.18 Median:4564.66 stddev:2878.61 (63.1%) stddev-sans-first:2871.61 09:02:26 INFO - PROCESS | 5074 | Values: 1138.2 1151.4 1281.4 1689.7 1698.4 6392.7 7120.1 7231.6 7788.2 7817.6 7217.9 7490.9 7498.8 7506.0 7509.7 2121.6 2178.6 2179.9 2182.5 2190.8 2169.3 2173.5 2201.7 2202.1 2202.6 2166.7 2177.9 2189.3 2197.1 2199.6 2166.6 2170.8 2175.9 2178.6 2179.1 2112.3 2120.6 2133.6 2151.6 2153.3 7664.3 7685.8 7753.3 7763.2 7770.7 4302.6 4429.9 4432.2 4433.7 4433.9 2922.3 2997.4 3049.1 3057.6 3063.9 957.0 1014.4 1025.6 1031.4 1034.9 10575.2 10585.6 10586.8 10678.0 10774.8 3859.4 4013.0 4146.0 4154.3 4167.9 9077.7 9142.1 9150.9 9169.5 9172.0 4551.2 4563.7 4565.6 4568.1 4574.4 3703.6 4029.3 4125.8 4142.8 4159.9 3646.7 3731.5 3778.7 3780.6 3831.5 1235.3 1240.3 1265.2 1267.0 1269.9 584.2 682.2 722.4 735.8 737.8 4798.3 4804.9 4972.5 5058.2 5105.8 391.0 400.1 402.9 403.1 408.3 3416.0 3451.9 3484.8 3513.6 3600.1 9363.4 9609.9 9644.4 9688.7 9689.9 9522.5 9528.4 9574.7 9588.3 9608.0 6885.9 7254.2 7314.3 7368.9 7376.6 5248.3 5324.5 5325.3 5378.6 5561.6 8667.3 8868.0 8892.9 8939.6 8956.1 8942.5 9057.9 9136.4 9142.8 9245.2 5540.5 6139.2 6308.3 6436.3 6468.7 7576.7 7673.3 7680.8 7685.8 7698.4 6564.1 6654.9 6700.2 6758.1 7020.6 6712.5 6752.9 6907.8 6942.1 6965.9 5976.0 6026.2 6091.2 6098.8 6100.9 4333.0 4336.1 4405.6 4413.9 4449.4 4213.9 4347.8 4357.2 4412.8 4426.8 09:02:26 INFO - PROCESS | 5074 | 09:02:26 INFO - PROCESS | 5074 | [#4] prototype.html Cycles:180 Average:4334.25 Median:4978.03 stddev:1255.42 (25.2%) stddev-sans-first:1221.82 09:02:26 INFO - PROCESS | 5074 | Values: 297.1 305.2 309.9 312.6 313.3 4971.5 4975.9 4991.4 4992.3 5003.5 4926.8 4938.3 4976.9 4979.2 4990.4 3714.2 3776.2 3841.6 3879.6 3892.7 3892.7 3895.2 3905.5 3906.4 3913.2 3881.5 3884.3 3915.8 3917.8 3940.7 3826.4 3835.4 3876.2 3926.1 3935.4 3407.8 3416.0 3429.1 3439.0 3448.8 4762.8 4785.5 4810.4 4811.8 4825.6 4368.5 4450.5 4455.4 4459.8 4483.1 5072.0 5105.9 5112.7 5113.4 5161.8 3705.5 3765.0 3780.5 3780.9 3804.5 5377.0 5390.9 5397.9 5411.8 5423.4 3729.7 3790.5 3794.2 3816.4 3823.3 3862.7 3864.8 3870.3 3872.8 3920.1 4460.2 4461.4 4465.6 4471.8 4472.8 5104.4 5167.3 5195.9 5249.0 5284.4 1344.2 1350.7 1360.1 1362.3 1365.9 844.7 875.0 888.2 896.2 899.3 4358.3 4425.2 4554.7 4582.7 4598.7 5338.7 5353.5 5358.4 5365.2 5374.7 4609.6 4611.3 4616.9 4632.0 4662.0 2679.7 2832.3 2852.0 2853.2 2863.3 5129.7 5130.6 5141.1 5148.3 5155.3 5212.7 5455.0 5469.4 5469.8 5501.9 5112.9 5114.4 5116.1 5116.2 5144.5 5361.0 5362.8 5373.4 5384.0 5388.0 4921.6 5231.3 5282.9 5302.2 5305.0 5108.0 5113.9 5119.0 5138.8 5144.5 3748.2 3814.7 3816.3 3816.6 3823.2 5134.9 5349.3 5362.7 5440.3 5442.4 5209.9 5226.8 5261.4 5281.6 5283.6 5224.5 5225.4 5248.9 5265.3 5295.3 5037.2 5102.5 5104.9 5151.9 5174.1 5013.5 5136.3 5183.4 5228.8 5255.2 5095.8 5100.1 5101.4 5105.6 5164.3 09:02:26 INFO - PROCESS | 5074 | 09:02:26 INFO - PROCESS | 5074 | [#5] yui.html Cycles:180 Average:18023.52 Median:500.21 stddev:26274.11 (5252.6%) stddev-sans-first:26315.20 09:02:26 INFO - PROCESS | 5074 | Values: 589.1 604.3 612.6 688.0 689.4 12702.0 14528.6 15201.1 15206.8 15858.2 15048.6 15133.5 15136.0 15290.8 15318.7 612.7 720.5 753.2 779.5 785.8 763.3 776.4 778.9 779.8 780.9 820.2 824.1 825.6 826.1 826.3 804.3 806.6 810.0 811.5 812.0 591.2 591.7 593.5 595.1 599.3 14307.4 14533.3 14569.1 14601.8 14633.9 12938.6 13146.7 13224.3 13243.7 13544.5 10137.6 10390.3 10414.1 10471.4 10603.6 3245.3 3255.9 3272.8 3277.5 3317.2 68171.3 68364.7 69119.3 69510.7 70331.6 9533.7 9717.0 9856.4 9884.1 9956.8 19331.1 19342.0 19420.9 19445.2 19662.8 6419.5 6512.9 6560.5 6580.0 6746.3 3472.4 3527.9 3570.1 3572.1 3593.1 2734.6 2809.3 2826.3 2833.3 2839.9 490.9 491.8 491.8 498.7 502.1 480.5 554.6 573.5 578.4 585.0 7767.5 7874.1 8138.3 8301.9 8325.2 501.7 528.3 532.9 556.6 563.8 3555.8 3575.8 3793.9 3821.8 3898.1 95539.0 99415.5 106323.5 109478.0 109495.5 88837.6 90482.0 91149.5 91345.5 91716.5 62950.4 63154.7 64013.0 81975.0 88369.6 8139.0 8430.5 8496.9 8750.6 8772.2 38827.6 38833.4 42453.4 43197.0 46055.5 39545.2 52837.2 52894.0 61636.7 61996.0 10408.8 10857.6 10903.1 11175.6 11227.6 12266.7 12387.9 12871.5 13179.8 13255.7 10996.3 11122.6 11306.6 11665.7 11935.3 10826.1 10973.6 11015.8 11074.2 11427.8 11017.9 11214.1 11306.9 11663.5 11765.5 9934.8 9934.9 9961.5 10384.4 10397.5 9328.3 9755.7 9969.5 9987.8 9988.5 09:02:26 INFO - PROCESS | 5074 | -------- Summary: end -------- 09:02:26 INFO - PROCESS | 5074 | 09:02:27 INFO - TEST-INFO | 5074: exit 0 09:02:27 INFO - TEST-OK | dromaeo_css | took 1117960ms 09:02:27 INFO - TEST-START | kraken 09:02:27 INFO - operating with platform_type : linux_ 09:02:27 INFO - Initialising browser for kraken test... 09:02:27 INFO - TEST-INFO | started process 5437 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFyDPaa/profile http://localhost:46159/getInfo.html) 09:02:32 INFO - PROCESS | 5437 | __metrics Screen width/height:1600/1200 09:02:32 INFO - PROCESS | 5437 | colorDepth:24 09:02:32 INFO - PROCESS | 5437 | Browser inner width/height: 1024/697 09:02:32 INFO - PROCESS | 5437 | __metrics 09:02:32 ERROR - PROCESS | 5437 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2993: TypeError: this.tabs is undefined 09:02:33 INFO - TEST-INFO | 5437: exit 0 09:02:33 INFO - Browser initialized. 09:02:33 INFO - Running cycle 1/1 for kraken test... 09:02:33 INFO - TEST-INFO | started process 5557 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFyDPaa/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:02:45 INFO - PROCESS | 5557 | RSS: Main: 187555840 09:02:45 INFO - PROCESS | 5557 | 09:02:48 INFO - PROCESS | 5557 | Cycle 1(1): loaded http://localhost:46159/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:46159/tests/kraken/driver.html?testName=audio-beat-detection) 09:02:49 INFO - PROCESS | 5557 | RSS: Main: 196243456 09:02:49 INFO - PROCESS | 5557 | 09:02:52 INFO - PROCESS | 5557 | Cycle 1(1): loaded http://localhost:46159/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:46159/tests/kraken/driver.html?testName=audio-dft) 09:02:53 INFO - PROCESS | 5557 | RSS: Main: 199028736 09:02:53 INFO - PROCESS | 5557 | 09:02:56 INFO - PROCESS | 5557 | Cycle 1(1): loaded http://localhost:46159/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:46159/tests/kraken/driver.html?testName=audio-fft) 09:02:56 INFO - PROCESS | 5557 | RSS: Main: 195637248 09:02:56 INFO - PROCESS | 5557 | 09:02:58 INFO - PROCESS | 5557 | Cycle 1(1): loaded http://localhost:46159/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:46159/tests/kraken/driver.html?testName=audio-oscillator) 09:02:59 INFO - PROCESS | 5557 | RSS: Main: 196378624 09:02:59 INFO - PROCESS | 5557 | 09:03:01 INFO - PROCESS | 5557 | Cycle 1(1): loaded http://localhost:46159/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:46159/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:03:02 INFO - PROCESS | 5557 | RSS: Main: 196091904 09:03:02 INFO - PROCESS | 5557 | 09:03:05 INFO - PROCESS | 5557 | Cycle 1(1): loaded http://localhost:46159/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:46159/tests/kraken/driver.html?testName=imaging-darkroom) 09:03:06 INFO - PROCESS | 5557 | RSS: Main: 196751360 09:03:06 INFO - PROCESS | 5557 | 09:03:09 INFO - PROCESS | 5557 | Cycle 1(1): loaded http://localhost:46159/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:46159/tests/kraken/driver.html?testName=imaging-desaturate) 09:03:10 INFO - PROCESS | 5557 | RSS: Main: 194519040 09:03:10 INFO - PROCESS | 5557 | 09:03:13 INFO - PROCESS | 5557 | Cycle 1(1): loaded http://localhost:46159/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:46159/tests/kraken/driver.html?testName=json-parse-financial) 09:03:14 INFO - PROCESS | 5557 | RSS: Main: 195960832 09:03:14 INFO - PROCESS | 5557 | 09:03:16 INFO - PROCESS | 5557 | Cycle 1(1): loaded http://localhost:46159/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:46159/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:03:16 INFO - PROCESS | 5557 | RSS: Main: 195866624 09:03:16 INFO - PROCESS | 5557 | 09:03:18 INFO - PROCESS | 5557 | Cycle 1(1): loaded http://localhost:46159/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:46159/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:03:19 INFO - PROCESS | 5557 | RSS: Main: 196005888 09:03:19 INFO - PROCESS | 5557 | 09:03:21 INFO - PROCESS | 5557 | Cycle 1(1): loaded http://localhost:46159/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:46159/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:03:22 INFO - PROCESS | 5557 | RSS: Main: 196800512 09:03:22 INFO - PROCESS | 5557 | 09:03:25 INFO - PROCESS | 5557 | Cycle 1(1): loaded http://localhost:46159/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:46159/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:03:25 INFO - PROCESS | 5557 | RSS: Main: 196911104 09:03:25 INFO - PROCESS | 5557 | 09:03:28 INFO - PROCESS | 5557 | Cycle 1(1): loaded http://localhost:46159/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:46159/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:03:29 INFO - PROCESS | 5557 | RSS: Main: 196493312 09:03:29 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | Cycle 1(1): loaded http://localhost:46159/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:46159/tests/kraken/driver.html?testName=ai-astar) 09:03:31 INFO - PROCESS | 5557 | RSS: Main: 198868992 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | __start_tp_report 09:03:31 INFO - PROCESS | 5557 | _x_x_mozilla_page_load 09:03:31 INFO - PROCESS | 5557 | _x_x_mozilla_page_load_details 09:03:31 INFO - PROCESS | 5557 | |i|pagename|runs| 09:03:31 INFO - PROCESS | 5557 | |0;ai-astar;108;117;111;116;115;116;123;116;116;114 09:03:31 INFO - PROCESS | 5557 | |1;audio-beat-detection;154;125;157;179;124;165;151;126;187;130 09:03:31 INFO - PROCESS | 5557 | |2;audio-dft;170;175;166;165;165;166;163;166;165;164 09:03:31 INFO - PROCESS | 5557 | |3;audio-fft;85;78;83;181;88;90;77;78;159;80 09:03:31 INFO - PROCESS | 5557 | |4;audio-oscillator;87;87;142;88;88;90;132;88;87;142 09:03:31 INFO - PROCESS | 5557 | |5;imaging-gaussian-blur;119;118;120;118;119;118;119;119;118;118 09:03:31 INFO - PROCESS | 5557 | |6;imaging-darkroom;149;149;151;149;148;150;148;149;149;151 09:03:31 INFO - PROCESS | 5557 | |7;imaging-desaturate;95;95;97;96;96;95;96;96;95;95 09:03:31 INFO - PROCESS | 5557 | |8;json-parse-financial;66;66;66;66;68;71;73;73;68;71 09:03:31 INFO - PROCESS | 5557 | |9;json-stringify-tinderbox;66;66;67;66;66;68;65;68;66;65 09:03:31 INFO - PROCESS | 5557 | |10;stanford-crypto-aes;84;84;91;86;85;90;86;83;88;85 09:03:31 INFO - PROCESS | 5557 | |11;stanford-crypto-ccm;151;144;146;145;157;165;140;139;163;150 09:03:31 INFO - PROCESS | 5557 | |12;stanford-crypto-pbkdf2;178;175;176;177;184;177;181;181;175;176 09:03:31 INFO - PROCESS | 5557 | |13;stanford-crypto-sha256-iterative;71;72;69;72;76;73;79;68;78;70 09:03:31 INFO - PROCESS | 5557 | __end_tp_report 09:03:31 INFO - PROCESS | 5557 | __start_cc_report 09:03:31 INFO - PROCESS | 5557 | _x_x_mozilla_cycle_collect,954 09:03:31 INFO - PROCESS | 5557 | __end_cc_report 09:03:31 INFO - PROCESS | 5557 | __startTimestamp1471881811514__endTimestamp 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | ------- Summary: start ------- 09:03:31 INFO - PROCESS | 5557 | Number of tests: 14 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | [#0] ai-astar Cycles:10 Average:115.20 Median:116.00 stddev:3.91 (3.4%) stddev-sans-first:3.16 09:03:31 INFO - PROCESS | 5557 | Values: 108.0 117.0 111.0 116.0 115.0 116.0 123.0 116.0 116.0 114.0 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | [#1] audio-beat-detection Cycles:10 Average:149.80 Median:155.50 stddev:23.04 (14.8%) stddev-sans-first:24.39 09:03:31 INFO - PROCESS | 5557 | Values: 154.0 125.0 157.0 179.0 124.0 165.0 151.0 126.0 187.0 130.0 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | [#2] audio-dft Cycles:10 Average:166.50 Median:166.00 stddev:3.50 (2.1%) stddev-sans-first:3.48 09:03:31 INFO - PROCESS | 5557 | Values: 170.0 175.0 166.0 165.0 165.0 166.0 163.0 166.0 165.0 164.0 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | [#3] audio-fft Cycles:10 Average:99.90 Median:81.50 stddev:37.56 (46.1%) stddev-sans-first:39.45 09:03:31 INFO - PROCESS | 5557 | Values: 85.0 78.0 83.0 181.0 88.0 90.0 77.0 78.0 159.0 80.0 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | [#4] audio-oscillator Cycles:10 Average:103.10 Median:87.50 stddev:24.71 (28.2%) stddev-sans-first:25.51 09:03:31 INFO - PROCESS | 5557 | Values: 87.0 87.0 142.0 88.0 88.0 90.0 132.0 88.0 87.0 142.0 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | [#5] imaging-gaussian-blur Cycles:10 Average:118.60 Median:119.00 stddev:0.70 (0.6%) stddev-sans-first:0.73 09:03:31 INFO - PROCESS | 5557 | Values: 119.0 118.0 120.0 118.0 119.0 118.0 119.0 119.0 118.0 118.0 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | [#6] imaging-darkroom Cycles:10 Average:149.30 Median:149.00 stddev:1.06 (0.7%) stddev-sans-first:1.12 09:03:31 INFO - PROCESS | 5557 | Values: 149.0 149.0 151.0 149.0 148.0 150.0 148.0 149.0 149.0 151.0 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.70 (0.7%) stddev-sans-first:0.71 09:03:31 INFO - PROCESS | 5557 | Values: 95.0 95.0 97.0 96.0 96.0 95.0 96.0 96.0 95.0 95.0 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | [#8] json-parse-financial Cycles:10 Average:68.80 Median:69.50 stddev:2.94 (4.2%) stddev-sans-first:2.93 09:03:31 INFO - PROCESS | 5557 | Values: 66.0 66.0 66.0 66.0 68.0 71.0 73.0 73.0 68.0 71.0 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | [#9] json-stringify-tinderbox Cycles:10 Average:66.30 Median:66.00 stddev:1.06 (1.6%) stddev-sans-first:1.12 09:03:31 INFO - PROCESS | 5557 | Values: 66.0 66.0 67.0 66.0 66.0 68.0 65.0 68.0 66.0 65.0 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | [#10] stanford-crypto-aes Cycles:10 Average:86.20 Median:86.00 stddev:2.66 (3.1%) stddev-sans-first:2.70 09:03:31 INFO - PROCESS | 5557 | Values: 84.0 84.0 91.0 86.0 85.0 90.0 86.0 83.0 88.0 85.0 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | [#11] stanford-crypto-ccm Cycles:10 Average:150.00 Median:150.50 stddev:9.08 (6.0%) stddev-sans-first:9.62 09:03:31 INFO - PROCESS | 5557 | Values: 151.0 144.0 146.0 145.0 157.0 165.0 140.0 139.0 163.0 150.0 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:178.00 Median:177.50 stddev:3.02 (1.7%) stddev-sans-first:3.20 09:03:31 INFO - PROCESS | 5557 | Values: 178.0 175.0 176.0 177.0 184.0 177.0 181.0 181.0 175.0 176.0 09:03:31 INFO - PROCESS | 5557 | 09:03:31 INFO - PROCESS | 5557 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:72.80 Median:72.50 stddev:3.74 (5.2%) stddev-sans-first:3.91 09:03:31 INFO - PROCESS | 5557 | Values: 71.0 72.0 69.0 72.0 76.0 73.0 79.0 68.0 78.0 70.0 09:03:31 INFO - PROCESS | 5557 | -------- Summary: end -------- 09:03:31 INFO - PROCESS | 5557 | 09:03:32 INFO - TEST-INFO | 5557: exit 0 09:03:32 INFO - TEST-OK | kraken | took 65441ms 09:03:32 INFO - SUITE-END | took 1183s 09:03:32 INFO - Completed test suite (00:19:43) 09:03:32 INFO - javascript benchmark 09:03:32 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6372.825376664508, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2624.4882247961646, 2637.617545455909, 2653.747893950075, 2662.2013395981226, 2666.9866650666745, 4633.768311584416, 4662.696924699896, 4741.976290118549, 4760.738159401231, 4784.521547845214, 4662.836800711976, 4672.509386514418, 4735.171345014617, 4762.833300834472, 4769.0, 4214.620684138427, 4339.197248509028, 4416.933745993812, 4461.665375096864, 4463.107378524308, 4401.0, 4413.6027757501815, 4448.088141930896, 4449.354843547683, 4455.8217671293105, 4163.292240319122, 4246.681498887596, 4271.466066741657, 4307.892302692458, 4316.460442444694, 4220.957790422118, 4274.658027357804, 4283.05772730002, 4288.378185163165, 4293.313069908831, 4261.637760790337, 4283.850065247701, 4296.334068219431, 4322.135572885435, 4331.891702707426, 4550.954490455119, 4586.059857729158, 4639.257718764981, 4650.697704649187, 4664.253719404879, 4995.000999800054, 5023.246513023039, 5028.421731500887, 5037.29477873098, 5037.345145131109, 4940.752962351904, 5071.467495912912, 5076.695398276115, 5092.898142037138, 5108.948910510884, 4657.4876763555985, 4712.387389639325, 4728.59806916416, 4734.124187025412, 4767.904641907143, 5120.4111527174855, 5158.767855446514, 5191.0, 5204.4535323791215, 5209.661372010807, 4897.191963326082, 4954.331165292711, 4955.578775804025, 4956.553910148104, 4971.925421118686, 4807.134715751198, 4995.350604421402, 5052.5705315048635, 5056.241563765391, 5060.924086138711, 5065.772040258197, 5072.797088116507, 5075.467075957045, 5075.619328550373, 5087.058894104603, 4831.347768051268, 5047.772850221749, 5056.469070747518, 5064.873378165502, 5076.6192535559985, 4209.389638502461, 4254.851080212177, 4256.723312984646, 4305.913881722348, 4312.0, 3714.68425183857, 3725.068732816796, 3726.2361215950664, 3734.327820992193, 3737.757045792069, 4335.804888780012, 4444.599986001275, 4452.131834292347, 4455.799489023002, 4456.197884380843, 4986.501349865057, 5038.521340472649, 5062.594992400599, 5069.898602028013, 5077.644564880497, 4372.103718737651, 4424.093060922503, 4427.645788336926, 4429.80065897029, 4438.733675979452, 4543.727376357429, 4544.727316361029, 4554.658400619901, 4558.293464513005, 4605.723656580616, 4852.830150944841, 4894.95105048945, 4895.485973972682, 4898.559129678275, 4937.0372777308085, 5118.334616499831, 5129.589632829439, 5131.153359695609, 5143.048536020848, 5165.922511162411, 4738.170820106537, 4787.353707249476, 4828.855134345835, 4893.657443979029, 4907.754612269444, 4986.825461108844, 4987.077390682735, 5001.64988450805, 5005.049040682259, 5011.0, 5073.441921388718, 5092.745362731775, 5102.0, 5106.310648062464, 5133.922991155061, 4743.83396581118, 4746.7863946121815, 4801.327814106098, 4807.302941073594, 4944.554990050912, 4752.192127338291, 4815.061063092803, 4834.395700537433, 4835.274708793709, 4860.1251774680895, 4789.401324834395, 4808.27875818616, 4810.326554282473, 4813.78337974799, 4831.541003604652, 4817.445993710769, 4858.854234372974, 4877.048975449753, 4944.851654450372, 4956.6530342877095, 4840.854774356775, 4861.611071114232, 4874.95125048745, 4875.0, 4876.073546026244], "value": 4634.75366196736, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [540.3353874734076, 549.7388740348335, 554.5646667366116, 558.2380051230069, 586.4956137721562, 34355.65644343559, 38767.612323876754, 38850.417243741365, 38900.0, 39090.80454597727, 38249.8087509562, 38812.805935970355, 38952.0, 38982.22035559287, 39009.8049509752, 7531.924680753191, 7689.115751688571, 7694.384449244075, 7699.653515591812, 7704.46068775186, 7596.316331530161, 7650.693972241132, 7676.347510461617, 7688.115866675348, 7693.7307194248215, 7667.0, 7711.922880771204, 7716.6913323467, 7716.729914452995, 7719.112302085276, 7671.079470463552, 7679.2704693054075, 7698.461107722462, 7707.0, 7711.807204819868, 7347.742829001013, 7401.0, 7416.629168541605, 7420.851582968365, 7441.479096463249, 36718.26563468716, 36829.0, 36998.63001370006, 36999.81500092509, 37142.81428592867, 2834.574813777929, 2908.3601607646283, 2923.532234842415, 2952.35048289376, 3217.517372394136, 28298.46486229332, 28820.279493012633, 28970.42059158826, 29606.114991026454, 29702.405951881057, 3474.2877710069374, 3481.1819222482695, 3559.697425718817, 3726.441033844918, 3726.4782930389765, 249900.0, 249977.0, 250260.0, 251017.0, 251261.0, 51064.74467627712, 51780.0, 52002.0, 52092.0, 52161.0, 53280.467195327554, 53555.19667204995, 53613.73193134087, 53623.731881341126, 53842.46157538453, 12635.810462843065, 13128.934355328161, 13143.211407315592, 13579.796303055462, 13583.45666173342, 10874.0, 10937.398443085547, 10951.45242737876, 10964.232503724663, 10965.451727413598, 17381.304747809947, 17507.912460437616, 17553.64892702139, 17647.64704705899, 17853.642927141384, 6858.078918848738, 6879.6216208108035, 6910.792676219721, 6989.7553585624255, 7176.210616832144, 794.7973266816924, 802.3781569283735, 927.6660402255183, 947.0151042915429, 995.8356871116184, 26148.34629134287, 27862.442751144863, 27997.0, 28275.858620707175, 28509.71490285112, 946.3517490519016, 964.4454438697777, 988.0, 1001.62439085343, 1028.0, 14812.70374592502, 14858.925705371621, 14910.403583856742, 14934.10395376281, 15025.323860426308, 378462.0, 383555.0, 385427.0, 386384.0, 387579.0, 48632.27051594229, 48923.51076489189, 49092.26361604579, 49119.0, 49153.50846491489, 1154.549725607014, 1182.018924292835, 1204.7831390349645, 1207.8309036734863, 1218.3360068762545, 25087.87456062708, 26073.348166295993, 27137.05020324358, 27511.449771004067, 27640.170794876187, 41565.168696626504, 42414.0, 42472.15055698807, 42477.5752242486, 42490.0, 343581.0, 344923.0, 345147.0, 345765.0, 345813.0, 22822.771772282063, 22974.540509190057, 23046.884765576735, 23058.847057647385, 23107.0, 41393.688787843996, 41678.0, 41987.0, 42279.943001425214, 42989.57010429856, 36669.44995825118, 36765.63234367622, 36970.0, 37161.4425783608, 37400.812995934844, 35944.64055359413, 36270.0, 36326.235836134976, 37593.43609845909, 37608.230518506934, 34860.12849678778, 35396.82301588476, 35454.290914182086, 35928.82035589805, 36394.8180259097, 27904.44191116126, 29119.0, 29141.56287655729, 29372.706272937852, 29445.411091778475, 23143.421414464774, 23305.18431854877, 23342.416439589146, 23603.173888913807, 23795.167169148997], "value": 17205.705872517152, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [356.28742514970077, 373.47526724951445, 377.6167190301843, 380.64599922072495, 386.455098311381, 15799.684006319882, 16134.354625814967, 16994.5751356216, 17105.0592217428, 17114.31542738289, 15882.126483043428, 16038.518844434686, 16119.597010074755, 16352.509424717247, 16472.505824825246, 4964.652474326789, 5194.480551944795, 5203.9219411708855, 5208.609354298443, 5213.478652134794, 4951.158303088466, 5096.235564665293, 5125.3080834087295, 5134.7432628368615, 5169.819056333029, 5084.288199652052, 5101.4133374662015, 5111.182210846266, 5116.616253780962, 5131.050755610206, 4928.236123400879, 5102.948970510284, 5105.693658380491, 5121.974390128044, 5135.74321283938, 4494.595486406207, 4508.2336002879265, 4531.43357080365, 4548.113117942003, 4557.635389168891, 19809.009549522467, 20660.483487912923, 20682.482937926674, 20707.27524536649, 20914.5817083659, 1956.5891162855817, 2051.9076641551164, 2074.284371891695, 2084.3121769815925, 2389.3429306940557, 13348.466061357534, 13359.265240411774, 13432.731345373135, 13460.663483412894, 13648.0, 1755.736639504072, 1815.6459490399377, 1827.2416946967126, 1828.2138680367436, 1839.7148441991512, 67779.66110169418, 67844.3215567843, 68449.9999999995, 68450.31549684539, 70723.64638176828, 9400.435973841591, 9511.429314241168, 9658.227341812639, 9841.311108222499, 10093.596256149673, 13377.331133443484, 13392.330383480787, 13406.195628262336, 13407.128536645087, 13440.260785656883, 7069.222385537587, 7183.89224161638, 7198.388137008413, 7364.668589913466, 7403.259674032553, 6651.368120028589, 6683.131192944886, 6848.212455567574, 6921.342472465209, 6924.376806087476, 5971.313298970587, 5983.491403230687, 6104.847378815476, 6154.630722156685, 6196.411340922605, 1758.9208485618178, 1818.4453741608672, 1820.7724034495689, 1823.452964110788, 1854.3973208707225, 871.655696000089, 894.5661354243186, 895.5566994337714, 898.4025622960658, 948.5399581203111, 16886.831131688527, 17190.10082126613, 17654.823451765576, 17833.46499605014, 18038.639227215383, 867.119873328572, 888.8977767556685, 894.6689724801865, 917.7659696777279, 921.4195057113975, 9430.0, 10339.172866170687, 10351.689449316533, 10468.162546996222, 10470.685879423629, 392314.0, 411465.2547584397, 411793.0, 413396.0, 413923.0, 64051.679741601925, 66788.6660566694, 67742.32257677459, 67747.66126169337, 69222.3077769226, 879.068187721005, 902.4269588811152, 922.6540047482194, 930.2465003347311, 931.4225180388203, 14010.719785604435, 15114.848851511784, 15512.457064002705, 15598.766018509958, 15799.21003949775, 33904.83047584746, 34176.65823341735, 34258.287085646116, 34856.2115030802, 35125.48745125467, 44247.11505769802, 44309.0, 44458.0, 44985.0, 45305.546944530135, 4488.68579199466, 5453.15476101205, 5712.34308054579, 7360.411167106511, 7471.738489152854, 10980.615678451215, 11024.393658348547, 11070.059044981266, 11485.253458525169, 11511.654650360502, 10073.294869359075, 10149.39103653783, 10246.333988290737, 10303.330283531546, 10468.319559228627, 10048.145907597644, 10061.943495933114, 10090.495475226357, 10193.898061019592, 10243.795124097625, 9841.507924603884, 10207.693769186937, 10376.740581485523, 10405.947970260404, 10450.58197672115, 7282.635868206675, 7363.521371110861, 7593.848123037398, 7599.962000189964, 7741.419393545394, 9838.212942964688, 9893.752656183653, 9995.0, 10167.7458063549, 10269.229807764597], "value": 8188.559777409189, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1138.2146319039862, 1151.3609946479705, 1281.3721276574477, 1689.653621007693, 1698.422536337645, 6392.712327945242, 7120.145582530091, 7231.638418079095, 7788.182240864706, 7817.609119544021, 7217.855642887139, 7490.88763668544, 7498.775036748906, 7505.962470187641, 7509.737159199429, 2121.596896589643, 2178.6187417202004, 2179.945501362463, 2182.4871155278574, 2190.759016508183, 2169.327508472371, 2173.5435558532727, 2201.680756290337, 2202.1411649456645, 2202.570498752744, 2166.729158855143, 2177.9128834846665, 2189.343197040889, 2197.121151539389, 2199.571083638691, 2166.631672615659, 2170.750363708178, 2175.912963481475, 2178.575177840322, 2179.063002908749, 2112.2712664131004, 2120.575884823026, 2133.5626196629655, 2151.6449785785326, 2153.3432303147533, 7664.3102120808835, 7685.769426917202, 7753.340966017895, 7763.184865589088, 7770.728024519171, 4302.634276086505, 4429.867103986886, 4432.180046691373, 4433.733975961452, 4433.911321773547, 2922.284040410092, 2997.4454725875785, 3049.085274417688, 3057.6025116734904, 3063.877444902201, 956.9856452153223, 1014.4319181258519, 1025.6205204074465, 1031.3657100882979, 1034.9223808214338, 10575.206859485492, 10585.629502967437, 10586.788264234749, 10678.038976492153, 10774.784504310026, 3859.4403811447182, 4012.959870401317, 4145.97927010363, 4154.335306350969, 4167.8958026049595, 9077.727668169966, 9142.131497507726, 9150.86273705895, 9169.541522923828, 9172.03693612161, 4551.158035763328, 4563.748993805372, 4565.56627120423, 4568.063546972862, 4574.428196475441, 3703.5926048134684, 4029.315016447211, 4125.793710314472, 4142.834286628501, 4159.939215500089, 3646.726495512847, 3731.477593136963, 3778.6599206071587, 3780.584135745066, 3831.5210598675167, 1235.2526721333643, 1240.3302216802826, 1265.1966001589058, 1266.993665031669, 1269.8730126987227, 584.2142318581501, 682.1950098883365, 722.357102179061, 735.7645553422853, 737.7639155470198, 4798.304245884327, 4804.879878003008, 4972.453030166679, 5058.1654027085115, 5105.795768169306, 390.9971419498224, 400.087799816419, 402.8992751812047, 403.12722954802524, 408.3058800039944, 3416.0, 3451.87918422854, 3484.8083355415188, 3513.648635136466, 3600.1179710970455, 9363.4381937084, 9609.90390096104, 9644.421334719798, 9688.70933871985, 9689.90310096904, 9522.523873806282, 9528.380655257386, 9574.664886728931, 9588.280878934107, 9608.0, 6885.931140688629, 7254.238304978006, 7314.341709246193, 7368.8894666580045, 7376.631168441557, 5248.343957005374, 5324.494173053554, 5325.281087053353, 5378.623496355218, 5561.610687251854, 8667.349948753743, 8867.955660221658, 8892.911070889208, 8939.59771810257, 8956.149165829236, 8942.46345219289, 9057.864132037894, 9136.406133601295, 9142.817143656957, 9245.214156796748, 5540.501354878081, 6139.201903752483, 6308.27454842699, 6436.324185960407, 6468.741250349934, 7576.7348142814735, 7673.271039251262, 7680.8094745314565, 7685.807854803675, 7698.384129269757, 6564.146660934048, 6654.933450665431, 6700.195976482853, 6758.121444212417, 7020.613866237406, 6712.53012289135, 6752.93247067523, 6907.792766217021, 6942.097527321416, 6965.930340696731, 5975.970120149372, 6026.15633811258, 6091.177691011657, 6098.847528811638, 6100.908486372797, 4332.978335108304, 4336.111097224998, 4405.559444055697, 4413.933790993074, 4449.399331090391, 4213.873583792491, 4347.760873152007, 4357.237483440449, 4412.757298348622, 4426.75652839097], "value": 3996.115505305421, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [297.14274318590867, 305.242997366531, 309.9054788289572, 312.5983111701464, 313.29664902294354, 4971.477994810547, 4975.925361119586, 4991.351124353833, 4992.252711550956, 5003.524665156813, 4926.753662316888, 4938.333325001124, 4976.900461990758, 4979.153543897537, 4990.351254336932, 3714.182879766454, 3776.1503661676043, 3841.558220804601, 3879.5926427725108, 3892.727509074352, 3892.727509074366, 3895.2014836958356, 3905.453236546886, 3906.394508851118, 3913.2369188008206, 3881.4954055972826, 3884.3008258513596, 3915.804209789513, 3917.8236979335998, 3940.7438516496336, 3826.4260360945805, 3835.42468629705, 3876.2247550490015, 3926.0773718176206, 3935.4096885467266, 3407.761456698032, 3415.9658403416147, 3429.0741499795167, 3438.985499277719, 3448.81031543265, 4762.809487620491, 4785.545373189576, 4810.374651295344, 4811.75941202942, 4825.638077144228, 4368.541303163154, 4450.532694067108, 4455.443069616298, 4459.799309031101, 4483.125790470859, 5072.0, 5105.897882042338, 5112.744362781846, 5113.411957624883, 5161.767720452589, 3705.4617586953023, 3764.9834544672785, 3780.4707340972286, 3780.9054773630605, 3804.5352539272303, 5377.0, 5390.946090539083, 5397.892042159135, 5411.808217671849, 5423.376311724123, 3729.738918275749, 3790.5261842269715, 3794.1842503861803, 3816.37029890065, 3823.2735780201674, 3862.748921320105, 3864.840547835638, 3870.3226935286775, 3872.8257228424786, 3920.098377373163, 4460.1525710114975, 4461.353103799931, 4465.620422264079, 4471.754053527087, 4472.798724057425, 5104.438511763703, 5167.328247327823, 5195.870103247449, 5248.9737551312, 5284.445133261029, 1344.2203521957242, 1350.6960933790015, 1360.0751488987582, 1362.2779926638898, 1365.9317034148253, 844.6536919862826, 875.0, 888.2494292322976, 896.188949001155, 899.2805755395657, 4358.3244597087505, 4425.22558552252, 4554.693781744231, 4582.656300777388, 4598.724076555417, 5338.652987555796, 5353.4646535346155, 5358.383785864676, 5365.248865158881, 5374.6506477078865, 4609.556934824482, 4611.339917629651, 4616.938104236045, 4631.9536804631525, 4661.95338046622, 2679.6650418697664, 2832.27776916889, 2852.001799370204, 2853.215365774429, 2863.3128049268444, 5129.742913118291, 5130.615203859726, 5141.069590333474, 5148.304978827885, 5155.304033955443, 5212.661177023481, 5455.0, 5469.371022332482, 5469.753861076261, 5501.944980550144, 5112.897742045213, 5114.3862736471865, 5116.130257856174, 5116.2116646427785, 5144.4855514449, 5360.973195133999, 5362.812301569426, 5373.382061063028, 5383.973080134574, 5388.0, 4921.6062714982, 5231.293775340432, 5282.8943421132135, 5302.2046692996355, 5305.0, 5108.0, 5113.897722045613, 5119.0017946500075, 5138.845834624967, 5144.511271429208, 3748.156664750409, 3814.732968692165, 3816.332141875105, 3816.6183381661613, 3823.2162406706, 5134.922976155286, 5349.304590403222, 5362.70505122222, 5440.347158341025, 5442.428545002717, 5209.869753256199, 5226.817061402832, 5261.447548007557, 5281.577473802164, 5283.630145889751, 5224.477552244745, 5225.372955245395, 5248.947510524846, 5265.341832270966, 5295.25866378715, 5037.19404895215, 5102.4642412546145, 5104.927965127216, 5151.871203219949, 5174.120399532164, 5013.548780609763, 5136.30659860929, 5183.371639852043, 5228.790848366023, 5255.240998475831, 5095.796168153381, 5100.132977393778, 5101.413337466239, 5105.566026887607, 5164.32863727713], "value": 3934.7485060581453, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [589.145441561533, 604.3442864492026, 612.6048698589407, 687.9828004299892, 689.386446063004, 12702.0, 14528.564143075711, 15201.087934723924, 15206.847931520682, 15858.20708964553, 15048.623784405396, 15133.54599362021, 15136.01615894966, 15290.847091529082, 15318.693626127471, 612.7365232949829, 720.4956530428694, 753.1677496366518, 779.5011192836589, 785.8035491127218, 763.2596381509954, 776.3595034096865, 778.9182135875736, 779.8362343907786, 780.9297163255305, 820.228984754332, 824.1181935329171, 825.63671984327, 826.0789220019665, 826.305903041445, 804.2761514636816, 806.6491076381793, 810.0198759501011, 811.5333683132193, 812.0093485947135, 591.1989254560095, 591.7189335065809, 593.4510577715639, 595.0776296740079, 599.3197720587121, 14307.356168972421, 14533.27333633314, 14569.05301155432, 14601.78097328541, 14633.926830365886, 12938.611841644766, 13146.737065258736, 13224.27266500342, 13243.668908277274, 13544.45822167112, 10137.594496220216, 10390.27268091234, 10414.114800241989, 10471.371717696886, 10603.628872989408, 3245.2698142917657, 3255.886043988449, 3272.8199949002797, 3277.5411442398085, 3317.2370354818286, 68171.31828681749, 68364.65817670879, 69119.3088069118, 69510.65244673744, 70331.64834175796, 9533.666321678707, 9717.0, 9856.408615482951, 9884.110430061186, 9956.80086398268, 19331.130099145572, 19342.0, 19420.902895485433, 19445.222191112196, 19662.803371966384, 6419.486441084702, 6512.869742605121, 6560.507961902877, 6580.0, 6746.325367463312, 3472.350448890347, 3527.9118022049656, 3570.071781336871, 3572.142685755452, 3593.065802891267, 2734.6308248386213, 2809.269589906639, 2826.2651710555406, 2833.334166470878, 2839.929001774972, 490.9435414927258, 491.76566817288864, 491.8081948040267, 498.6833360815908, 502.07868561189895, 480.4666819829986, 554.6117717597617, 573.4924591736343, 578.3637998201945, 584.9824505264849, 7767.5339479630275, 7874.0551133863155, 8138.267555919995, 8301.916980830236, 8325.209105135002, 501.74411050364574, 528.2604353904565, 532.8827657915252, 556.5603173492976, 563.7688547695425, 3555.822208889545, 3575.76757510761, 3793.905152371213, 3821.808909554511, 3898.064464528493, 95539.0, 99415.50292248493, 106323.46838265914, 109478.0, 109495.45252273687, 88837.55581222053, 90482.04697483272, 91149.54425227831, 91345.54327228322, 91716.54141729248, 62950.37049629536, 63154.68422657949, 64013.0, 81975.0, 88369.55815220883, 8138.959305203436, 8430.536320502431, 8496.91503084986, 8750.649974001224, 8772.210501054935, 38827.6117238824, 38833.417498738105, 42453.363199551415, 43197.0, 46055.53944460512, 39545.20909581735, 52837.20744188764, 52894.0, 61636.69181654063, 61996.0, 10408.777260548632, 10857.565697372016, 10903.127749780157, 11175.55297788112, 11227.550897964316, 12266.693332666398, 12387.876121238673, 12871.549495767604, 13179.802302965272, 13255.734885302432, 10996.28524145928, 11122.61070862516, 11306.604268850551, 11665.708357290796, 11935.283882967049, 10826.133909287395, 10973.615923442641, 11015.83476247841, 11074.169437292074, 11427.828582571101, 11017.944910275397, 11214.102871770076, 11306.876071667937, 11663.475143618387, 11765.529378825093, 9934.801303973736, 9934.850977235203, 9961.452120133463, 10384.42885641297, 10397.48012599352, 9328.253739700944, 9755.707328780149, 9969.45168015737, 9987.750306242402, 9988.450635215133], "value": 6523.515779507963, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1620.1000000000001, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [108.0, 117.0, 111.0, 116.0, 115.0, 116.0, 123.0, 116.0, 116.0, 114.0], "value": 115.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [154.0, 125.0, 157.0, 179.0, 124.0, 165.0, 151.0, 126.0, 187.0, 130.0], "value": 149.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [170.0, 175.0, 166.0, 165.0, 165.0, 166.0, 163.0, 166.0, 165.0, 164.0], "value": 166.5, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 78.0, 83.0, 181.0, 88.0, 90.0, 77.0, 78.0, 159.0, 80.0], "value": 99.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 87.0, 142.0, 88.0, 88.0, 90.0, 132.0, 88.0, 87.0, 142.0], "value": 103.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [119.0, 118.0, 120.0, 118.0, 119.0, 118.0, 119.0, 119.0, 118.0, 118.0], "value": 118.6, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 149.0, 151.0, 149.0, 148.0, 150.0, 148.0, 149.0, 149.0, 151.0], "value": 149.3, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 97.0, 96.0, 96.0, 95.0, 96.0, 96.0, 95.0, 95.0], "value": 95.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 66.0, 66.0, 66.0, 68.0, 71.0, 73.0, 73.0, 68.0, 71.0], "value": 68.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 66.0, 67.0, 66.0, 66.0, 68.0, 65.0, 68.0, 66.0, 65.0], "value": 66.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 91.0, 86.0, 85.0, 90.0, 86.0, 83.0, 88.0, 85.0], "value": 86.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 144.0, 146.0, 145.0, 157.0, 165.0, 140.0, 139.0, 163.0, 150.0], "value": 150.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [178.0, 175.0, 176.0, 177.0, 184.0, 177.0, 181.0, 181.0, 175.0, 176.0], "value": 178.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 72.0, 69.0, 72.0, 76.0, 73.0, 79.0, 68.0, 78.0, 70.0], "value": 72.8, "unit": "score"}]}]} 09:03:32 INFO - Return code: 0 09:03:32 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 09:03:32 ERROR - # TBPL SUCCESS # 09:03:32 INFO - Running post-action listener: _resource_record_post_action 09:03:32 INFO - [mozharness: 2016-08-22 16:03:32.836588Z] Finished run-tests step (success) 09:03:32 INFO - Running post-run listener: _resource_record_post_run 09:03:32 INFO - Total resource usage - Wall time: 1200s; CPU: 14.0%; Read bytes: 16384; Write bytes: 406573056; Read time: 208; Write time: 260776 09:03:32 INFO - TinderboxPrint: CPU usage
13.8% 09:03:32 INFO - TinderboxPrint: I/O read bytes / time
16,384 / 208 09:03:32 INFO - TinderboxPrint: I/O write bytes / time
406,573,056 / 260,776 09:03:32 INFO - TinderboxPrint: CPU idle
8,243.8 (86.1%) 09:03:32 INFO - TinderboxPrint: CPU user
1,230.6 (12.9%) 09:03:32 INFO - TinderboxPrint: Swap in / out
0 / 0 09:03:32 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 4096; Write bytes: 113516544; Read time: 108; Write time: 64564 09:03:32 INFO - run-tests - Wall time: 1184s; CPU: 14.0%; Read bytes: 8192; Write bytes: 293056512; Read time: 84; Write time: 196212 09:03:33 INFO - Running post-run listener: _upload_blobber_files 09:03:33 INFO - Blob upload gear active. 09:03:33 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 09:03:33 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 09:03:33 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', 'Autoland-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 09:03:33 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 Autoland-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 09:03:33 INFO - (blobuploader) - INFO - Open directory for files ... 09:03:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 09:03:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:03:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:03:34 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 09:03:34 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:03:34 INFO - (blobuploader) - INFO - Done attempting. 09:03:34 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 09:03:34 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:03:34 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:03:39 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 09:03:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:03:39 INFO - (blobuploader) - INFO - Done attempting. 09:03:39 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 09:03:39 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:03:39 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:03:40 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 09:03:40 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:03:40 INFO - (blobuploader) - INFO - Done attempting. 09:03:40 INFO - (blobuploader) - INFO - Iteration through files over. 09:03:41 INFO - Return code: 0 09:03:41 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 09:03:41 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 09:03:41 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/73362a8f0ecf4cb04f4ae427e3f640909968292759b8b93ed9cb5dc3148de6aa61471c20302bd8f09e02f8695e81d60a945fe03fc64616865aca1b5cf2a76eed", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/76d1c557cecdd3ef42be442bd3a006f7140996d284834456bd24cde02143bb9ba98f1f95e9ec9702ad10bf320b320d677af36457440a5c2de71017ca1b04d673", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/28f068d61ed1dcde8ddb3ef7029b918d7ab1c9ccdd24ac03c6c5a880974929c6664f86a8717da06fbe8991c88f93e0eb7fd42a1a6a374bfab07b30032e072f98"} 09:03:41 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 09:03:41 INFO - Writing to file /builds/slave/test/properties/blobber_files 09:03:41 INFO - Contents: 09:03:41 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/73362a8f0ecf4cb04f4ae427e3f640909968292759b8b93ed9cb5dc3148de6aa61471c20302bd8f09e02f8695e81d60a945fe03fc64616865aca1b5cf2a76eed", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/76d1c557cecdd3ef42be442bd3a006f7140996d284834456bd24cde02143bb9ba98f1f95e9ec9702ad10bf320b320d677af36457440a5c2de71017ca1b04d673", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/28f068d61ed1dcde8ddb3ef7029b918d7ab1c9ccdd24ac03c6c5a880974929c6664f86a8717da06fbe8991c88f93e0eb7fd42a1a6a374bfab07b30032e072f98"} 09:03:41 INFO - Running post-run listener: copy_logs_to_upload_dir 09:03:41 INFO - Copying logs to upload dir... 09:03:41 INFO - mkdir: /builds/slave/test/build/upload/logs 09:03:41 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1244.626019 ========= master_lag: 9.71 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 54 secs) (at 2016-08-22 09:03:50.318184) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 23 secs) (at 2016-08-22 09:03:50.322157) ========= 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=a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438 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/Autoland-Non-PGO/sha512/73362a8f0ecf4cb04f4ae427e3f640909968292759b8b93ed9cb5dc3148de6aa61471c20302bd8f09e02f8695e81d60a945fe03fc64616865aca1b5cf2a76eed", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/76d1c557cecdd3ef42be442bd3a006f7140996d284834456bd24cde02143bb9ba98f1f95e9ec9702ad10bf320b320d677af36457440a5c2de71017ca1b04d673", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/28f068d61ed1dcde8ddb3ef7029b918d7ab1c9ccdd24ac03c6c5a880974929c6664f86a8717da06fbe8991c88f93e0eb7fd42a1a6a374bfab07b30032e072f98"} build_url:https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010239 build_url: 'https://queue.taskcluster.net/v1/task/J7Qx8je7Qouq6bZ09FU-iA/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/Autoland-Non-PGO/sha512/73362a8f0ecf4cb04f4ae427e3f640909968292759b8b93ed9cb5dc3148de6aa61471c20302bd8f09e02f8695e81d60a945fe03fc64616865aca1b5cf2a76eed", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/76d1c557cecdd3ef42be442bd3a006f7140996d284834456bd24cde02143bb9ba98f1f95e9ec9702ad10bf320b320d677af36457440a5c2de71017ca1b04d673", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/28f068d61ed1dcde8ddb3ef7029b918d7ab1c9ccdd24ac03c6c5a880974929c6664f86a8717da06fbe8991c88f93e0eb7fd42a1a6a374bfab07b30032e072f98"}' ========= master_lag: 23.53 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 23 secs) (at 2016-08-22 09:04:13.864018) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-22 09:04:13.864392) ========= 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=a0d2d2de893abaa8702a9954000001a7-1471880574.517296-944558438 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004738 ========= master_lag: 0.06 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-22 09:04:13.930503) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-22 09:04:13.931676) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-22 09:04:13.932028) ========= ========= Total master_lag: 33.36 =========