builder: autoland_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-024 starttime: 1472535170.95 results: success (0) buildid: 20160829204421 builduid: 64b4e7fa4acf44ecaaece19bf9c22220 revision: ea97acdae9a6743452c44b7b8d7f79e7d3865f1b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-29 22:32:50.950759) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-29 22:32:50.951501) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-29 22:32:50.952023) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-29 22:32:51.028300) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-29 22:32:51.028646) ========= 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=41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-08-29 22:32:51-- 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% 220M=0s 2016-08-29 22:32:51 (220 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.093871 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-29 22:32:51.137907) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-29 22:32:51.138254) ========= 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=41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.021065 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-29 22:32:51.188134) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-29 22:32:51.188487) ========= bash -c 'python archiver_client.py mozharness --repo integration/autoland --rev ea97acdae9a6743452c44b7b8d7f79e7d3865f1b --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 ea97acdae9a6743452c44b7b8d7f79e7d3865f1b --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=41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-08-29 22:32:51,534 truncating revision to first 12 chars 2016-08-29 22:32:51,534 Setting DEBUG logging. 2016-08-29 22:32:51,535 attempt 1/10 2016-08-29 22:32:51,535 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/ea97acdae9a6?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-29 22:32:51,820 unpacking tar archive at: autoland-ea97acdae9a6/testing/mozharness/ program finished with exit code 0 elapsedTime=0.555617 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-29 22:32:51.757266) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-29 22:32:51.757558) ========= script_repo_revision: ea97acdae9a6743452c44b7b8d7f79e7d3865f1b ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-29 22:32:51.757932) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-29 22:32:51.758218) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-29 22:32:51.770689) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 45 secs) (at 2016-08-29 22:32:51.770955) ========= /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=41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 22:32:52 INFO - MultiFileLogger online at 20160829 22:32:52 in /builds/slave/test 22:32:52 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 22:32:52 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 22:32:52 INFO - {'append_to_log': False, 22:32:52 INFO - 'base_work_dir': '/builds/slave/test', 22:32:52 INFO - 'blob_upload_branch': 'Autoland-Non-PGO', 22:32:52 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 22:32:52 INFO - 'branch': 'Autoland-Non-PGO', 22:32:52 INFO - 'buildbot_json_path': 'buildprops.json', 22:32:52 INFO - 'config_files': ('talos/linux_config.py',), 22:32:52 INFO - 'default_actions': ('clobber', 22:32:52 INFO - 'read-buildbot-config', 22:32:52 INFO - 'download-and-extract', 22:32:52 INFO - 'populate-webroot', 22:32:52 INFO - 'create-virtualenv', 22:32:52 INFO - 'install', 22:32:52 INFO - 'run-tests'), 22:32:52 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 22:32:52 INFO - 'download_minidump_stackwalk': True, 22:32:52 INFO - 'download_symbols': 'ondemand', 22:32:52 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 22:32:52 INFO - 'tooltool.py': '/tools/tooltool.py', 22:32:52 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 22:32:52 INFO - '/tools/misc-python/virtualenv.py')}, 22:32:52 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 22:32:52 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 22:32:52 INFO - 'installer_path': 'installer.exe', 22:32:52 INFO - 'log_level': 'info', 22:32:52 INFO - 'log_name': 'talos', 22:32:52 INFO - 'log_to_console': True, 22:32:52 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 22:32:52 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 22:32:52 INFO - 'opt_config_files': (), 22:32:52 INFO - 'pip_index': False, 22:32:52 INFO - 'sps_profile': False, 22:32:52 INFO - 'sps_profile_interval': 0, 22:32:52 INFO - 'suite': 'dromaeojs-e10s', 22:32:52 INFO - 'system_bits': '32', 22:32:52 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 22:32:52 INFO - 'title': 'talos-linux64-ix-024', 22:32:52 INFO - 'tooltool_cache': '/builds/tooltool_cache', 22:32:52 INFO - 'use_talos_json': True, 22:32:52 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 22:32:52 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 22:32:52 INFO - 'work_dir': 'build'} 22:32:52 INFO - [mozharness: 2016-08-30 05:32:52.210265Z] Running clobber step. 22:32:52 INFO - Running pre-action listener: _resource_record_pre_action 22:32:52 INFO - Running main action method: clobber 22:32:52 INFO - rmtree: /builds/slave/test/build 22:32:52 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 22:32:52 INFO - Running post-action listener: _resource_record_post_action 22:32:52 INFO - [mozharness: 2016-08-30 05:32:52.674956Z] Finished clobber step (success) 22:32:52 INFO - [mozharness: 2016-08-30 05:32:52.675059Z] Running read-buildbot-config step. 22:32:52 INFO - Running pre-action listener: _resource_record_pre_action 22:32:52 INFO - Running main action method: read_buildbot_config 22:32:52 INFO - Using buildbot properties: 22:32:52 INFO - { 22:32:52 INFO - "project": "", 22:32:52 INFO - "product": "firefox", 22:32:52 INFO - "script_repo_revision": "production", 22:32:52 INFO - "builddir": "autoland_ubuntu64_hw_test-dromaeojs-e10s", 22:32:52 INFO - "repository": "", 22:32:52 INFO - "buildername": "Ubuntu HW 12.04 x64 autoland talos dromaeojs-e10s", 22:32:52 INFO - "buildid": "20160829204421", 22:32:52 INFO - "pgo_build": "False", 22:32:52 INFO - "basedir": "/builds/slave/test", 22:32:52 INFO - "buildnumber": 395, 22:32:52 INFO - "slavename": "talos-linux64-ix-024", 22:32:52 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 22:32:52 INFO - "platform": "ubuntu64_hw", 22:32:52 INFO - "scheduler": "tests-autoland-linux64-talos-7-3600", 22:32:52 INFO - "branch": "autoland", 22:32:52 INFO - "repo_path": "integration/autoland", 22:32:52 INFO - "revision": "ea97acdae9a6743452c44b7b8d7f79e7d3865f1b", 22:32:52 INFO - "stage_platform": "linux64", 22:32:52 INFO - "builduid": "64b4e7fa4acf44ecaaece19bf9c22220", 22:32:52 INFO - "slavebuilddir": "test" 22:32:52 INFO - } 22:32:52 INFO - Found installer url https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 22:32:52 INFO - Running post-action listener: _resource_record_post_action 22:32:52 INFO - [mozharness: 2016-08-30 05:32:52.678239Z] Finished read-buildbot-config step (success) 22:32:52 INFO - [mozharness: 2016-08-30 05:32:52.678330Z] Running download-and-extract step. 22:32:52 INFO - Running pre-action listener: _resource_record_pre_action 22:32:52 INFO - Running main action method: download_and_extract 22:32:52 INFO - mkdir: /builds/slave/test/build/tests 22:32:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:32:52 INFO - trying https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 22:32:52 INFO - Downloading https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/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 22:32:52 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/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 22:32:53 INFO - Downloaded 1361 bytes. 22:32:53 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 22:32:53 INFO - Using the following test package requirements: 22:32:53 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 22:32:53 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 22:32:53 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 22:32:53 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 22:32:53 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 22:32:53 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 22:32:53 INFO - u'jsshell-linux-x86_64.zip'], 22:32:53 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 22:32:53 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 22:32:53 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 22:32:53 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 22:32:53 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 22:32:53 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 22:32:53 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 22:32:53 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 22:32:53 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 22:32:53 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 22:32:53 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 22:32:53 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 22:32:53 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')]} 22:32:53 INFO - trying https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 22:32:53 INFO - Downloading https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/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 22:32:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/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 22:32:54 INFO - Downloaded 20316465 bytes. 22:32:54 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 22:32:58 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 22:32:58 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')]} 22:32:58 INFO - trying https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 22:32:58 INFO - Downloading https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/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 22:32:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/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 22:32:59 INFO - Downloaded 20316465 bytes. 22:32:59 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 22:33:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:33:03 INFO - trying https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 22:33:03 INFO - Downloading https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/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 22:33:03 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/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 22:33:04 INFO - Downloaded 14413998 bytes. 22:33:04 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 22:33:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:33:04 INFO - trying https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 22:33:04 INFO - Downloading https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/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 22:33:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/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 22:33:05 INFO - Downloaded 55849332 bytes. 22:33:05 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 22:33:05 INFO - mkdir: /builds/slave/test/properties 22:33:05 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 22:33:05 INFO - Writing to file /builds/slave/test/properties/build_url 22:33:05 INFO - Contents: 22:33:05 INFO - build_url:https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 22:33:06 INFO - Running post-action listener: _resource_record_post_action 22:33:06 INFO - Running post-action listener: set_extra_try_arguments 22:33:06 INFO - [mozharness: 2016-08-30 05:33:06.642341Z] Finished download-and-extract step (success) 22:33:06 INFO - [mozharness: 2016-08-30 05:33:06.642570Z] Running populate-webroot step. 22:33:06 INFO - Running pre-action listener: _resource_record_pre_action 22:33:06 INFO - Running main action method: populate_webroot 22:33:06 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 22:33:06 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 22:33:06 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 22:33:06 INFO - '--tppagecycles', 22:33:06 INFO - '7'], 22:33:06 INFO - 'tests': ['tsvgm']}}, 22:33:06 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 22:33:06 INFO - 'tests': ['tresize', 'tcanvasmark']}, 22:33:06 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 22:33:06 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 22:33:06 INFO - 'tests': ['dromaeo_css', 'kraken']}, 22:33:06 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 22:33:06 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:33:06 INFO - 'talos_options': ['--disable-e10s'], 22:33:06 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 22:33:06 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:33:06 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 22:33:06 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:33:06 INFO - 'talos_options': ['--disable-e10s'], 22:33:06 INFO - 'tests': ['damp', 'tps']}, 22:33:06 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:33:06 INFO - 'tests': ['damp', 'tps']}, 22:33:06 INFO - 'g3': {'talos_options': ['--disable-e10s'], 22:33:06 INFO - 'tests': ['dromaeo_dom']}, 22:33:06 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 22:33:06 INFO - 'g4': {'talos_options': ['--disable-e10s'], 22:33:06 INFO - 'tests': ['basic_compositor_video']}, 22:33:06 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 22:33:06 INFO - 'other': {'talos_options': ['--disable-e10s'], 22:33:06 INFO - 'tests': ['a11yr', 22:33:06 INFO - 'ts_paint', 22:33:06 INFO - 'tpaint', 22:33:06 INFO - 'sessionrestore', 22:33:06 INFO - 'sessionrestore_no_auto_restore', 22:33:06 INFO - 'tabpaint']}, 22:33:06 INFO - 'other-e10s': {'tests': ['a11yr', 22:33:06 INFO - 'ts_paint', 22:33:06 INFO - 'tpaint', 22:33:06 INFO - 'sessionrestore', 22:33:06 INFO - 'sessionrestore_no_auto_restore', 22:33:06 INFO - 'tabpaint']}, 22:33:06 INFO - 'other-e10s_l64': {'tests': ['a11yr', 22:33:06 INFO - 'ts_paint', 22:33:06 INFO - 'tpaint', 22:33:06 INFO - 'sessionrestore', 22:33:06 INFO - 'sessionrestore_no_auto_restore', 22:33:06 INFO - 'tabpaint']}, 22:33:06 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 22:33:06 INFO - 'ts_paint', 22:33:06 INFO - 'tpaint', 22:33:06 INFO - 'sessionrestore', 22:33:06 INFO - 'sessionrestore_no_auto_restore', 22:33:06 INFO - 'tabpaint']}, 22:33:06 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 22:33:06 INFO - 'tests': ['a11yr', 22:33:06 INFO - 'ts_paint', 22:33:06 INFO - 'tpaint', 22:33:06 INFO - 'sessionrestore', 22:33:06 INFO - 'sessionrestore_no_auto_restore', 22:33:06 INFO - 'tabpaint']}, 22:33:06 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 22:33:06 INFO - 'tests': ['a11yr', 22:33:06 INFO - 'ts_paint', 22:33:06 INFO - 'tpaint', 22:33:06 INFO - 'sessionrestore', 22:33:06 INFO - 'sessionrestore_no_auto_restore', 22:33:06 INFO - 'tabpaint']}, 22:33:06 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 22:33:06 INFO - 'tests': ['tsvgx', 22:33:06 INFO - 'tsvgr_opacity', 22:33:06 INFO - 'tart', 22:33:06 INFO - 'tscrollx', 22:33:06 INFO - 'cart']}, 22:33:06 INFO - 'svgr-e10s': {'tests': ['tsvgx', 22:33:06 INFO - 'tsvgr_opacity', 22:33:06 INFO - 'tart', 22:33:06 INFO - 'tscrollx', 22:33:06 INFO - 'cart']}, 22:33:06 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:33:06 INFO - 'talos_options': ['--disable-e10s'], 22:33:06 INFO - 'tests': ['tp5o']}, 22:33:06 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:33:06 INFO - 'tests': ['tp5o']}, 22:33:06 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:33:06 INFO - 'talos_options': ['--disable-e10s', 22:33:06 INFO - '--xperf_path', 22:33:06 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 22:33:06 INFO - 'tests': ['tp5n']}, 22:33:06 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:33:06 INFO - 'talos_options': ['--xperf_path', 22:33:06 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 22:33:06 INFO - 'tests': ['tp5n']}}, 22:33:06 INFO - 'talos.zip': {'path': '', 22:33:06 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 22:33:06 INFO - Running post-action listener: _resource_record_post_action 22:33:06 INFO - [mozharness: 2016-08-30 05:33:06.664481Z] Finished populate-webroot step (success) 22:33:06 INFO - [mozharness: 2016-08-30 05:33:06.664571Z] Running create-virtualenv step. 22:33:06 INFO - Running pre-action listener: _resource_record_pre_action 22:33:06 INFO - Running main action method: create_virtualenv 22:33:06 INFO - Creating virtualenv /builds/slave/test/build/venv 22:33:06 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 22:33:06 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 22:33:06 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 22:33:06 INFO - Using real prefix '/usr' 22:33:06 INFO - New python executable in /builds/slave/test/build/venv/bin/python 22:33:07 INFO - Installing distribute.............................................................................................................................................................................................done. 22:33:09 INFO - Installing pip.................done. 22:33:09 INFO - Return code: 0 22:33:09 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 22:33: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')]} 22:33:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:33:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33: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')]} 22:33:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:33:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:09 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 0x7f3b327b1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2071230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206b090>, '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 0x206e9b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206ee40>, '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': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', '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 22:33:09 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 22:33:09 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 22:33:09 INFO - Using env: {'DISPLAY': ':0', 22:33:09 INFO - 'HOME': '/home/cltbld', 22:33:09 INFO - 'LANG': 'en_US.UTF-8', 22:33:09 INFO - 'LANGUAGE': 'en_US:en', 22:33:09 INFO - 'LOGNAME': 'cltbld', 22:33:09 INFO - 'MAIL': '/var/mail/cltbld', 22:33:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:33:09 INFO - 'MOZ_NO_REMOTE': '1', 22:33:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:33:09 INFO - 'NO_EM_RESTART': '1', 22:33:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:33:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:33:09 INFO - 'PWD': '/builds/slave/test', 22:33:09 INFO - 'SHELL': '/bin/bash', 22:33:09 INFO - 'SHLVL': '1', 22:33:09 INFO - 'TERM': 'linux', 22:33:09 INFO - 'TMOUT': '86400', 22:33:09 INFO - 'USER': 'cltbld', 22:33:09 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', 22:33:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:33:09 INFO - '_': '/tools/buildbot/bin/python'} 22:33:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:33:09 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 22:33:09 INFO - Cleaning up... 22:33:09 INFO - Return code: 0 22:33:09 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 22:33: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')]} 22:33:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:33:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33: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')]} 22:33:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:33:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:09 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 0x7f3b327b1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2071230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206b090>, '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 0x206e9b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206ee40>, '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': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', '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 22:33:09 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 22:33:09 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 22:33:09 INFO - Using env: {'DISPLAY': ':0', 22:33:09 INFO - 'HOME': '/home/cltbld', 22:33:09 INFO - 'LANG': 'en_US.UTF-8', 22:33:09 INFO - 'LANGUAGE': 'en_US:en', 22:33:09 INFO - 'LOGNAME': 'cltbld', 22:33:09 INFO - 'MAIL': '/var/mail/cltbld', 22:33:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:33:09 INFO - 'MOZ_NO_REMOTE': '1', 22:33:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:33:09 INFO - 'NO_EM_RESTART': '1', 22:33:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:33:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:33:09 INFO - 'PWD': '/builds/slave/test', 22:33:09 INFO - 'SHELL': '/bin/bash', 22:33:09 INFO - 'SHLVL': '1', 22:33:09 INFO - 'TERM': 'linux', 22:33:09 INFO - 'TMOUT': '86400', 22:33:09 INFO - 'USER': 'cltbld', 22:33:09 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', 22:33:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:33:09 INFO - '_': '/tools/buildbot/bin/python'} 22:33:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:33:09 INFO - Downloading/unpacking psutil>=3.1.1 22:33:09 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 22:33:09 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 22:33:09 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 22:33:09 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 22:33:09 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 22:33:09 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 22:33:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 22:33:11 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 22:33:11 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 22:33:11 INFO - Installing collected packages: psutil 22:33:11 INFO - Running setup.py install for psutil 22:33:11 INFO - building 'psutil._psutil_linux' extension 22:33:11 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 22:33:11 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 22:33:11 INFO - building 'psutil._psutil_posix' extension 22:33:11 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 22:33:12 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 22:33:12 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 22:33:12 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 22:33:12 INFO - Successfully installed psutil 22:33:12 INFO - Cleaning up... 22:33:12 INFO - Return code: 0 22:33:12 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 22:33:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:33:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:33:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:33:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:33:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:12 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 0x7f3b327b1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2071230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206b090>, '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 0x206e9b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206ee40>, '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': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', '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 22:33:12 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 22:33:12 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 22:33:12 INFO - Using env: {'DISPLAY': ':0', 22:33:12 INFO - 'HOME': '/home/cltbld', 22:33:12 INFO - 'LANG': 'en_US.UTF-8', 22:33:12 INFO - 'LANGUAGE': 'en_US:en', 22:33:12 INFO - 'LOGNAME': 'cltbld', 22:33:12 INFO - 'MAIL': '/var/mail/cltbld', 22:33:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:33:12 INFO - 'MOZ_NO_REMOTE': '1', 22:33:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:33:12 INFO - 'NO_EM_RESTART': '1', 22:33:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:33:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:33:12 INFO - 'PWD': '/builds/slave/test', 22:33:12 INFO - 'SHELL': '/bin/bash', 22:33:12 INFO - 'SHLVL': '1', 22:33:12 INFO - 'TERM': 'linux', 22:33:12 INFO - 'TMOUT': '86400', 22:33:12 INFO - 'USER': 'cltbld', 22:33:12 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', 22:33:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:33:12 INFO - '_': '/tools/buildbot/bin/python'} 22:33:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:33:12 INFO - Downloading/unpacking mozsystemmonitor==0.3 22:33:12 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 22:33:12 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 22:33:12 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 22:33:12 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 22:33:12 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 22:33:12 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 22:33:14 INFO - Downloading mozsystemmonitor-0.3.tar.gz 22:33:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 22:33:14 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 22:33:14 INFO - Installing collected packages: mozsystemmonitor 22:33:14 INFO - Running setup.py install for mozsystemmonitor 22:33:14 INFO - Successfully installed mozsystemmonitor 22:33:14 INFO - Cleaning up... 22:33:14 INFO - Return code: 0 22:33:14 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 22:33:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:33:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:33:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:33:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:33:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f3b327b1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2071230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206b090>, '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 0x206e9b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206ee40>, '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': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', '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 22:33:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 22:33:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 22:33:14 INFO - Using env: {'DISPLAY': ':0', 22:33:14 INFO - 'HOME': '/home/cltbld', 22:33:14 INFO - 'LANG': 'en_US.UTF-8', 22:33:14 INFO - 'LANGUAGE': 'en_US:en', 22:33:14 INFO - 'LOGNAME': 'cltbld', 22:33:14 INFO - 'MAIL': '/var/mail/cltbld', 22:33:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:33:14 INFO - 'MOZ_NO_REMOTE': '1', 22:33:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:33:14 INFO - 'NO_EM_RESTART': '1', 22:33:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:33:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:33:14 INFO - 'PWD': '/builds/slave/test', 22:33:14 INFO - 'SHELL': '/bin/bash', 22:33:14 INFO - 'SHLVL': '1', 22:33:14 INFO - 'TERM': 'linux', 22:33:14 INFO - 'TMOUT': '86400', 22:33:14 INFO - 'USER': 'cltbld', 22:33:14 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', 22:33:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:33:14 INFO - '_': '/tools/buildbot/bin/python'} 22:33:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:33:14 INFO - Downloading/unpacking jsonschema==2.5.1 22:33:14 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 22:33:14 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 22:33:14 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 22:33:14 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 22:33:14 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 22:33:14 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 22:33:16 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 22:33:16 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 22:33: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 22:33: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 22:33: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 22:33: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 22:33: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 22:33: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 22:33:16 INFO - Downloading functools32-3.2.3-2.tar.gz 22:33:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 22:33:16 INFO - warning: no files found matching '*.txt' 22:33:16 INFO - no previously-included directories found matching 'build' 22:33:16 INFO - no previously-included directories found matching 'dist' 22:33:16 INFO - no previously-included directories found matching '.git*' 22:33:16 INFO - Installing collected packages: jsonschema, functools32 22:33:16 INFO - Running setup.py install for functools32 22:33:17 INFO - warning: no files found matching '*.txt' 22:33:17 INFO - no previously-included directories found matching 'build' 22:33:17 INFO - no previously-included directories found matching 'dist' 22:33:17 INFO - no previously-included directories found matching '.git*' 22:33:17 INFO - Successfully installed jsonschema functools32 22:33:17 INFO - Cleaning up... 22:33:17 INFO - Return code: 0 22:33:17 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 22:33:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:33:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:33:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:33:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:33:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:17 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f3b327b1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2071230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206b090>, '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 0x206e9b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206ee40>, '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': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', '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 22:33:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 22:33:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 22:33:17 INFO - Using env: {'DISPLAY': ':0', 22:33:17 INFO - 'HOME': '/home/cltbld', 22:33:17 INFO - 'LANG': 'en_US.UTF-8', 22:33:17 INFO - 'LANGUAGE': 'en_US:en', 22:33:17 INFO - 'LOGNAME': 'cltbld', 22:33:17 INFO - 'MAIL': '/var/mail/cltbld', 22:33:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:33:17 INFO - 'MOZ_NO_REMOTE': '1', 22:33:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:33:17 INFO - 'NO_EM_RESTART': '1', 22:33:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:33:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:33:17 INFO - 'PWD': '/builds/slave/test', 22:33:17 INFO - 'SHELL': '/bin/bash', 22:33:17 INFO - 'SHLVL': '1', 22:33:17 INFO - 'TERM': 'linux', 22:33:17 INFO - 'TMOUT': '86400', 22:33:17 INFO - 'USER': 'cltbld', 22:33:17 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', 22:33:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:33:17 INFO - '_': '/tools/buildbot/bin/python'} 22:33:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:33:17 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 22:33:17 INFO - Cleaning up... 22:33:17 INFO - Return code: 0 22:33:17 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 22:33:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:33:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:33:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:33:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:33:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:17 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7f3b327b1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2071230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206b090>, '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 0x206e9b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206ee40>, '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': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', '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 22:33:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 22:33:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 22:33:17 INFO - Using env: {'DISPLAY': ':0', 22:33:17 INFO - 'HOME': '/home/cltbld', 22:33:17 INFO - 'LANG': 'en_US.UTF-8', 22:33:17 INFO - 'LANGUAGE': 'en_US:en', 22:33:17 INFO - 'LOGNAME': 'cltbld', 22:33:17 INFO - 'MAIL': '/var/mail/cltbld', 22:33:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:33:17 INFO - 'MOZ_NO_REMOTE': '1', 22:33:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:33:17 INFO - 'NO_EM_RESTART': '1', 22:33:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:33:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:33:17 INFO - 'PWD': '/builds/slave/test', 22:33:17 INFO - 'SHELL': '/bin/bash', 22:33:17 INFO - 'SHLVL': '1', 22:33:17 INFO - 'TERM': 'linux', 22:33:17 INFO - 'TMOUT': '86400', 22:33:17 INFO - 'USER': 'cltbld', 22:33:17 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', 22:33:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:33:17 INFO - '_': '/tools/buildbot/bin/python'} 22:33:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:33:17 INFO - Downloading/unpacking blobuploader==1.2.4 22:33:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 22:33:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 22:33:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 22:33:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 22:33:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 22:33:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 22:33:19 INFO - Downloading blobuploader-1.2.4.tar.gz 22:33:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 22:33:19 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 22:33:19 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 22:33:19 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 22:33:19 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 22:33:19 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 22:33:19 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 22:33:19 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 22:33:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 22:33:19 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 22:33:19 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 22:33:19 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 22:33:19 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 22:33:19 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 22:33:19 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 22:33:19 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 22:33:20 INFO - Downloading docopt-0.6.1.tar.gz 22:33:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 22:33:20 INFO - Installing collected packages: blobuploader, requests, docopt 22:33:20 INFO - Running setup.py install for blobuploader 22:33:20 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 22:33:20 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 22:33:20 INFO - Running setup.py install for requests 22:33:20 INFO - Running setup.py install for docopt 22:33:20 INFO - Successfully installed blobuploader requests docopt 22:33:20 INFO - Cleaning up... 22:33:20 INFO - Return code: 0 22:33:20 INFO - Installing None into virtualenv /builds/slave/test/build/venv 22:33:20 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')]} 22:33:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:33:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:20 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')]} 22:33:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:33:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:20 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 0x7f3b327b1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2071230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206b090>, '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 0x206e9b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206ee40>, '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': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', '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 22:33:20 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 22:33:20 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 22:33:20 INFO - Using env: {'DISPLAY': ':0', 22:33:20 INFO - 'HOME': '/home/cltbld', 22:33:20 INFO - 'LANG': 'en_US.UTF-8', 22:33:20 INFO - 'LANGUAGE': 'en_US:en', 22:33:20 INFO - 'LOGNAME': 'cltbld', 22:33:20 INFO - 'MAIL': '/var/mail/cltbld', 22:33:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:33:20 INFO - 'MOZ_NO_REMOTE': '1', 22:33:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:33:20 INFO - 'NO_EM_RESTART': '1', 22:33:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:33:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:33:20 INFO - 'PWD': '/builds/slave/test', 22:33:20 INFO - 'SHELL': '/bin/bash', 22:33:20 INFO - 'SHLVL': '1', 22:33:20 INFO - 'TERM': 'linux', 22:33:20 INFO - 'TMOUT': '86400', 22:33:20 INFO - 'USER': 'cltbld', 22:33:20 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', 22:33:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:33:20 INFO - '_': '/tools/buildbot/bin/python'} 22:33:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:33:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 22:33:20 INFO - Running setup.py (path:/tmp/pip-8SWB_h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 22:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 22:33:21 INFO - Running setup.py (path:/tmp/pip-BXZeB6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 22:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 22:33:21 INFO - Running setup.py (path:/tmp/pip-52i30i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 22:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 22:33:21 INFO - Running setup.py (path:/tmp/pip-fTcpwv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 22:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 22:33:21 INFO - Running setup.py (path:/tmp/pip-vi8IXk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 22:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 22:33:21 INFO - Running setup.py (path:/tmp/pip-Cv4wQy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 22:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 22:33:21 INFO - Running setup.py (path:/tmp/pip-bjd2nU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 22:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 22:33:21 INFO - Running setup.py (path:/tmp/pip-KF5QzT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 22:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 22:33:21 INFO - Running setup.py (path:/tmp/pip-NR7GWT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 22:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 22:33:21 INFO - Running setup.py (path:/tmp/pip-A7P4xs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 22:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 22:33:21 INFO - Running setup.py (path:/tmp/pip-jLWlQW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 22:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 22:33:21 INFO - Running setup.py (path:/tmp/pip-SdYMw9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 22:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 22:33:21 INFO - Running setup.py (path:/tmp/pip-bKzhl9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 22:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 22:33:21 INFO - Running setup.py (path:/tmp/pip-LJ67fi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 22:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 22:33:21 INFO - Running setup.py (path:/tmp/pip-kwcvim-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 22:33:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 22:33:22 INFO - Running setup.py (path:/tmp/pip-bXC015-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 22:33:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 22:33:22 INFO - Running setup.py (path:/tmp/pip-K3JKcn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 22:33:22 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 22:33:22 INFO - Running setup.py install for manifestparser 22:33:22 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 22:33:22 INFO - Running setup.py install for mozcrash 22:33:22 INFO - Running setup.py install for mozdebug 22:33:22 INFO - Running setup.py install for mozdevice 22:33:22 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 22:33:22 INFO - Installing dm script to /builds/slave/test/build/venv/bin 22:33:22 INFO - Running setup.py install for mozfile 22:33:22 INFO - Running setup.py install for mozhttpd 22:33:22 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 22:33:22 INFO - Running setup.py install for mozinfo 22:33:22 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 22:33:22 INFO - Running setup.py install for mozInstall 22:33:23 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 22:33:23 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 22:33:23 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 22:33:23 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 22:33:23 INFO - Running setup.py install for mozleak 22:33:23 INFO - Running setup.py install for mozlog 22:33:23 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 22:33:23 INFO - Running setup.py install for moznetwork 22:33:23 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 22:33:23 INFO - Running setup.py install for mozprocess 22:33:23 INFO - Running setup.py install for mozprofile 22:33:23 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 22:33:23 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 22:33:23 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 22:33:23 INFO - Running setup.py install for mozrunner 22:33:23 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 22:33:23 INFO - Running setup.py install for mozscreenshot 22:33:23 INFO - Running setup.py install for moztest 22:33:23 INFO - Running setup.py install for mozversion 22:33:23 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 22:33:23 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 22:33:23 INFO - Cleaning up... 22:33:24 INFO - Return code: 0 22:33:24 INFO - Installing None into virtualenv /builds/slave/test/build/venv 22:33: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')]} 22:33:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:33:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33: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')]} 22:33:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:33:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:24 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 0x7f3b327b1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2071230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206b090>, '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 0x206e9b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206ee40>, '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': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', '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 22:33:24 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 22:33:24 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 22:33:24 INFO - Using env: {'DISPLAY': ':0', 22:33:24 INFO - 'HOME': '/home/cltbld', 22:33:24 INFO - 'LANG': 'en_US.UTF-8', 22:33:24 INFO - 'LANGUAGE': 'en_US:en', 22:33:24 INFO - 'LOGNAME': 'cltbld', 22:33:24 INFO - 'MAIL': '/var/mail/cltbld', 22:33:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:33:24 INFO - 'MOZ_NO_REMOTE': '1', 22:33:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:33:24 INFO - 'NO_EM_RESTART': '1', 22:33:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:33:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:33:24 INFO - 'PWD': '/builds/slave/test', 22:33:24 INFO - 'SHELL': '/bin/bash', 22:33:24 INFO - 'SHLVL': '1', 22:33:24 INFO - 'TERM': 'linux', 22:33:24 INFO - 'TMOUT': '86400', 22:33:24 INFO - 'USER': 'cltbld', 22:33:24 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', 22:33:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:33:24 INFO - '_': '/tools/buildbot/bin/python'} 22:33:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:33:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 22:33:24 INFO - Running setup.py (path:/tmp/pip-JZpklX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 22:33:24 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)) 22:33:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 22:33:24 INFO - Running setup.py (path:/tmp/pip-vEh6ap-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 22:33:24 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)) 22:33:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 22:33:24 INFO - Running setup.py (path:/tmp/pip-pOIeUQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 22:33:24 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)) 22:33:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 22:33:24 INFO - Running setup.py (path:/tmp/pip-HaiQqg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 22:33:24 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)) 22:33:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 22:33:24 INFO - Running setup.py (path:/tmp/pip-Fv9eDH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 22:33:24 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)) 22:33:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 22:33:24 INFO - Running setup.py (path:/tmp/pip-6RWEB0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 22:33:24 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)) 22:33:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 22:33:24 INFO - Running setup.py (path:/tmp/pip-M1lDCU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 22:33:24 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)) 22:33:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 22:33:24 INFO - Running setup.py (path:/tmp/pip-F9rbLE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 22:33:24 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)) 22:33:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 22:33:24 INFO - Running setup.py (path:/tmp/pip-3W3E5P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 22:33:24 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)) 22:33:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 22:33:24 INFO - Running setup.py (path:/tmp/pip-PGKw25-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 22:33:24 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)) 22:33:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 22:33:24 INFO - Running setup.py (path:/tmp/pip-HSChIt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 22:33:25 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)) 22:33:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 22:33:25 INFO - Running setup.py (path:/tmp/pip-Gqy8K4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 22:33:25 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)) 22:33:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 22:33:25 INFO - Running setup.py (path:/tmp/pip-0XdQU6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 22:33:25 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)) 22:33:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 22:33:25 INFO - Running setup.py (path:/tmp/pip-YJLegY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 22:33:25 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)) 22:33:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 22:33:25 INFO - Running setup.py (path:/tmp/pip-YrPcmC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 22:33:25 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)) 22:33:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 22:33:25 INFO - Running setup.py (path:/tmp/pip-P3AJ0c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 22:33:25 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)) 22:33:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 22:33:25 INFO - Running setup.py (path:/tmp/pip-3kFCD1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 22:33:25 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)) 22:33:25 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)) 22:33:25 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)) 22:33:25 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)) 22:33:25 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)) 22:33:25 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)) 22:33:25 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 22:33:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 22:33:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 22:33:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 22:33:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 22:33:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 22:33:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 22:33:27 INFO - Downloading blessings-1.6.tar.gz 22:33:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 22:33:27 INFO - Installing collected packages: blessings 22:33:27 INFO - Running setup.py install for blessings 22:33:27 INFO - Successfully installed blessings 22:33:27 INFO - Cleaning up... 22:33:27 INFO - Return code: 0 22:33:27 INFO - Done creating virtualenv /builds/slave/test/build/venv. 22:33:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 22:33:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 22:33:28 INFO - Reading from file tmpfile_stdout 22:33:28 INFO - Current package versions: 22:33:28 INFO - argparse == 1.2.1 22:33:28 INFO - blessings == 1.6 22:33:28 INFO - blobuploader == 1.2.4 22:33:28 INFO - docopt == 0.6.1 22:33:28 INFO - functools32 == 3.2.3-2 22:33:28 INFO - jsonschema == 2.5.1 22:33:28 INFO - manifestparser == 1.1 22:33:28 INFO - mozInstall == 1.12 22:33:28 INFO - mozcrash == 0.17 22:33:28 INFO - mozdebug == 0.1 22:33:28 INFO - mozdevice == 0.48 22:33:28 INFO - mozfile == 1.2 22:33:28 INFO - mozhttpd == 0.7 22:33:28 INFO - mozinfo == 0.9 22:33:28 INFO - mozleak == 0.1 22:33:28 INFO - mozlog == 3.3 22:33:28 INFO - moznetwork == 0.27 22:33:28 INFO - mozprocess == 0.23 22:33:28 INFO - mozprofile == 0.28 22:33:28 INFO - mozrunner == 6.12 22:33:28 INFO - mozscreenshot == 0.1 22:33:28 INFO - mozsystemmonitor == 0.3 22:33:28 INFO - moztest == 0.7 22:33:28 INFO - mozversion == 1.4 22:33:28 INFO - psutil == 3.1.1 22:33:28 INFO - requests == 1.2.3 22:33:28 INFO - wsgiref == 0.1.2 22:33:28 INFO - Installing None into virtualenv /builds/slave/test/build/venv 22:33: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')]} 22:33:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:33:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33: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')]} 22:33:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:33:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:28 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 0x7f3b327b1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2071230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206b090>, '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 0x206e9b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206ee40>, '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': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', '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 22:33:28 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 22:33:28 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 22:33:28 INFO - Using env: {'DISPLAY': ':0', 22:33:28 INFO - 'HOME': '/home/cltbld', 22:33:28 INFO - 'LANG': 'en_US.UTF-8', 22:33:28 INFO - 'LANGUAGE': 'en_US:en', 22:33:28 INFO - 'LOGNAME': 'cltbld', 22:33:28 INFO - 'MAIL': '/var/mail/cltbld', 22:33:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:33:28 INFO - 'MOZ_NO_REMOTE': '1', 22:33:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:33:28 INFO - 'NO_EM_RESTART': '1', 22:33:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:33:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:33:28 INFO - 'PWD': '/builds/slave/test', 22:33:28 INFO - 'SHELL': '/bin/bash', 22:33:28 INFO - 'SHLVL': '1', 22:33:28 INFO - 'TERM': 'linux', 22:33:28 INFO - 'TMOUT': '86400', 22:33:28 INFO - 'USER': 'cltbld', 22:33:28 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', 22:33:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:33:28 INFO - '_': '/tools/buildbot/bin/python'} 22:33:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:33:28 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)) 22:33:28 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)) 22:33:28 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)) 22:33:28 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)) 22:33:28 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)) 22:33:28 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)) 22:33:28 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)) 22:33:28 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)) 22:33:28 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)) 22:33:28 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)) 22:33:28 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)) 22:33:28 INFO - Cleaning up... 22:33:28 INFO - Return code: 0 22:33:28 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 22:33: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')]} 22:33:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:33:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33: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')]} 22:33:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:33:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:33:28 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 0x7f3b327b1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2071230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206b090>, '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 0x206e9b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206ee40>, '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': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', '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 22:33:28 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 22:33:28 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 22:33:28 INFO - Using env: {'DISPLAY': ':0', 22:33:28 INFO - 'HOME': '/home/cltbld', 22:33:28 INFO - 'LANG': 'en_US.UTF-8', 22:33:28 INFO - 'LANGUAGE': 'en_US:en', 22:33:28 INFO - 'LOGNAME': 'cltbld', 22:33:28 INFO - 'MAIL': '/var/mail/cltbld', 22:33:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:33:28 INFO - 'MOZ_NO_REMOTE': '1', 22:33:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:33:28 INFO - 'NO_EM_RESTART': '1', 22:33:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:33:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:33:28 INFO - 'PWD': '/builds/slave/test', 22:33:28 INFO - 'SHELL': '/bin/bash', 22:33:28 INFO - 'SHLVL': '1', 22:33:28 INFO - 'TERM': 'linux', 22:33:28 INFO - 'TMOUT': '86400', 22:33:28 INFO - 'USER': 'cltbld', 22:33:28 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', 22:33:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:33:28 INFO - '_': '/tools/buildbot/bin/python'} 22:33:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:33:28 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 22:33:28 INFO - Cleaning up... 22:33:28 INFO - Return code: 0 22:33:28 INFO - Running post-action listener: _resource_record_post_action 22:33:28 INFO - Running post-action listener: _start_resource_monitoring 22:33:28 INFO - Starting resource monitoring. 22:33:28 INFO - [mozharness: 2016-08-30 05:33:28.502310Z] Finished create-virtualenv step (success) 22:33:28 INFO - [mozharness: 2016-08-30 05:33:28.502817Z] Running install step. 22:33:28 INFO - Running pre-action listener: _resource_record_pre_action 22:33:28 INFO - Running main action method: install 22:33:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 22:33:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 22:33:28 INFO - Reading from file tmpfile_stdout 22:33:28 INFO - Detecting whether we're running mozinstall >=1.0... 22:33:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 22:33:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 22:33:28 INFO - Reading from file tmpfile_stdout 22:33:28 INFO - Output received: 22:33:28 INFO - Usage: mozinstall [options] installer 22:33:28 INFO - Options: 22:33:28 INFO - -h, --help show this help message and exit 22:33:28 INFO - -d DEST, --destination=DEST 22:33:28 INFO - Directory to install application into. [default: 22:33:28 INFO - "/builds/slave/test"] 22:33:28 INFO - --app=APP Application being installed. [default: firefox] 22:33:28 INFO - mkdir: /builds/slave/test/build/application 22:33:28 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'] 22:33:28 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 22:33:44 INFO - Reading from file tmpfile_stdout 22:33:44 INFO - Output received: 22:33:44 INFO - /builds/slave/test/build/application/firefox/firefox 22:33:44 INFO - Running post-action listener: _resource_record_post_action 22:33:44 INFO - [mozharness: 2016-08-30 05:33:44.946992Z] Finished install step (success) 22:33:44 INFO - [mozharness: 2016-08-30 05:33:44.947276Z] Running run-tests step. 22:33:44 INFO - Running pre-action listener: _resource_record_pre_action 22:33:44 INFO - Running main action method: run_tests 22:33:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 22:33:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 22:33:44 INFO - Python 2.7.3 22:33:44 INFO - Return code: 0 22:33:44 INFO - grabbing minidump binary from tooltool 22:33:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 22:33:44 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 0x206b090>, '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 0x206e9b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206ee40>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 22:33:44 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 22:33:44 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 22:33:44 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 22:33:45 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 22:33:45 INFO - Return code: 0 22:33:45 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 22:33:45 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 22:33:45 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 22:33:45 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 22:33:45 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 22:33:45 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/FEnUjWZ3SUuxjMvvql5dOg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-024', '--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 22:33:45 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/FEnUjWZ3SUuxjMvvql5dOg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-024 --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 22:33:45 INFO - Using env: {'DISPLAY': ':0', 22:33:45 INFO - 'HOME': '/home/cltbld', 22:33:45 INFO - 'LANG': 'en_US.UTF-8', 22:33:45 INFO - 'LANGUAGE': 'en_US:en', 22:33:45 INFO - 'LOGNAME': 'cltbld', 22:33:45 INFO - 'MAIL': '/var/mail/cltbld', 22:33:45 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 22:33:45 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 22:33:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:33:45 INFO - 'MOZ_NO_REMOTE': '1', 22:33:45 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 22:33:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:33:45 INFO - 'NO_EM_RESTART': '1', 22:33:45 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:33:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:33:45 INFO - 'PWD': '/builds/slave/test', 22:33:45 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 22:33:45 INFO - 'SHELL': '/bin/bash', 22:33:45 INFO - 'SHLVL': '1', 22:33:45 INFO - 'TERM': 'linux', 22:33:45 INFO - 'TMOUT': '86400', 22:33:45 INFO - 'USER': 'cltbld', 22:33:45 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033', 22:33:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:33:45 INFO - '_': '/tools/buildbot/bin/python'} 22:33:45 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/FEnUjWZ3SUuxjMvvql5dOg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-024', '--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 22:33:45 INFO - mozversion application_buildid: 20160829204421 22:33:45 INFO - mozversion application_changeset: ea97acdae9a6743452c44b7b8d7f79e7d3865f1b 22:33:45 INFO - mozversion application_display_name: Nightly 22:33:45 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 22:33:45 INFO - mozversion application_name: Firefox 22:33:45 INFO - mozversion application_remotingname: firefox 22:33:45 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland 22:33:45 INFO - mozversion application_vendor: Mozilla 22:33:45 INFO - mozversion application_version: 51.0a1 22:33:45 INFO - mozversion platform_buildid: 20160829204421 22:33:45 INFO - mozversion platform_changeset: ea97acdae9a6743452c44b7b8d7f79e7d3865f1b 22:33:45 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland 22:33:45 INFO - mozversion platform_version: 51.0a1 22:33:45 INFO - using testdate: 1472535225 22:33:45 INFO - actual date: 1472535225 22:33:45 INFO - starting webserver on 'localhost:54593' 22:33:45 INFO - SUITE-START | Running 2 tests 22:33:45 INFO - TEST-START | dromaeo_css 22:33:45 INFO - operating with platform_type : linux_ 22:33:45 INFO - Initialising browser for dromaeo_css test... 22:33:45 INFO - TEST-INFO | started process 18602 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpQQ1zgb/profile http://localhost:54593/getInfo.html) 22:33:50 INFO - PROCESS | 18602 | __metrics Screen width/height:1600/1200 22:33:50 INFO - PROCESS | 18602 | colorDepth:24 22:33:50 INFO - PROCESS | 18602 | Browser inner width/height: 1024/697 22:33:50 INFO - PROCESS | 18602 | __metrics 22:33:50 ERROR - PROCESS | 18602 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2991: TypeError: this.tabs is undefined 22:33:51 INFO - TEST-INFO | 18602: exit 0 22:33:51 INFO - Browser initialized. 22:33:51 INFO - Running cycle 1/1 for dromaeo_css test... 22:33:51 INFO - TEST-INFO | started process 18723 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpQQ1zgb/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 22:34:03 INFO - PROCESS | 18723 | RSS: Main: 193200128 22:34:03 INFO - PROCESS | 18723 | 22:34:53 INFO - PROCESS | 18723 | 1472535293473 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] 22:37:06 INFO - PROCESS | 18723 | Cycle 1(1): loaded http://localhost:54593/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54593/tests/dromaeo/cssquery-ext.html) 22:37:07 INFO - PROCESS | 18723 | RSS: Main: 208187392 22:37:07 INFO - PROCESS | 18723 | 22:40:10 INFO - PROCESS | 18723 | Cycle 1(1): loaded http://localhost:54593/tests/dromaeo/cssquery-ext.html (next: http://localhost:54593/tests/dromaeo/cssquery-jquery.html) 22:40:10 INFO - PROCESS | 18723 | RSS: Main: 204177408 22:40:10 INFO - PROCESS | 18723 | 22:43:13 INFO - PROCESS | 18723 | Cycle 1(1): loaded http://localhost:54593/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54593/tests/dromaeo/cssquery-mootools.html) 22:43:13 INFO - PROCESS | 18723 | RSS: Main: 200355840 22:43:13 INFO - PROCESS | 18723 | 22:46:15 INFO - PROCESS | 18723 | Cycle 1(1): loaded http://localhost:54593/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54593/tests/dromaeo/cssquery-prototype.html) 22:46:16 INFO - PROCESS | 18723 | RSS: Main: 194510848 22:46:16 INFO - PROCESS | 18723 | 22:49:19 INFO - PROCESS | 18723 | Cycle 1(1): loaded http://localhost:54593/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54593/tests/dromaeo/cssquery-yui.html) 22:49:19 INFO - PROCESS | 18723 | RSS: Main: 197828608 22:49:19 INFO - PROCESS | 18723 | 22:52:22 INFO - PROCESS | 18723 | Cycle 1(1): loaded http://localhost:54593/tests/dromaeo/cssquery-yui.html (next: http://localhost:54593/tests/dromaeo/cssquery-dojo.html) 22:52:22 INFO - PROCESS | 18723 | RSS: Main: 198197248 22:52:22 INFO - PROCESS | 18723 | 22:52:22 INFO - PROCESS | 18723 | __start_tp_report 22:52:22 INFO - PROCESS | 18723 | _x_x_mozilla_page_load 22:52:22 INFO - PROCESS | 18723 | _x_x_mozilla_page_load_details 22:52:22 INFO - PROCESS | 18723 | |i|pagename|runs| 22:52:22 INFO - PROCESS | 18723 | |0;dojo.html;2626.69792973808;2638.9604155937654;2642.709301976782;2668.9466210675782;2681.436898251367;4784.019276048411;4857.489963553829;4899.167141585935;4947.158982972895;5004.449510553841;4884.438289596697;4900.558949694527;4932.9753351233285;4944.381952255968;4972.925406118902;4418.5581441855875;4513.300438432048;4546.8863278417975;4567.442232349895;4657.441107067157;4601.3558101865765;4602.884927876797;4623.190941585226;4630.37489938859;4653.046125544255;4411.514733379326;4449.888752781174;4509.391232183646;4557.9789365375345;4569.223232050526;4449.777511124463;4451.198784218872;4458.398116254297;4505.121501307246;4584.701994370389;4478.39541661878;4504.909901801946;4509;4515.864524064284;4549;4840.273958906157;4884.3161957326;4888.535589119028;4920.6801557898625;4931.630127740434;5256.08018596744;5264.18405147199;5267.894642107175;5270.235815806686;5306.204069389584;5267.736613169364;5273.235380869791;5290.232916227125;5292.967871265105;5329.467053294678;4795.712257264575;4847.491013443609;4852.053849499313;4895.975520122377;4934.728589927517;5376.569874410038;5392.73036348181;5425.430329815392;5466.125419932791;5469.726513674301;5162.122439185272;5193.428722840485;5194.220866869924;5199.66202196856;5253.894922101613;5123.205903085028;5182.818601348935;5206.167013277857;5221;5299.2845965794895;5230.424653288135;5242.213667949762;5246.527812496894;5247.7113758743635;5289.920651190235;5240.633155679066;5242.292290540804;5243.790248390022;5263.842084737464;5312.256284120226;4406.294992801137;4443.178012067778;4479.3057076153245;4480.417545719036;4520.706154099973;3875.5736868944396;3891.805409729559;3893.7274390792372;3935.6457918787446;3937.8031098445535;4516;4517.503074661785;4528.298113792367;4538.500764915857;4569.040501494657;5104.974475127675;5248.475152484797;5264.05247055526;5301.946980530145;5308.283381743415;4553.089382123589;4563.0873825235085;4576.405067341224;4595.9080818383445;4632.62938964882;4780.043991201704;4793.281007848851;4801.039792041605;4807.687500312469;4870.09903167915;4781.115493633689;4892.241702536113;4946.03552307311;4949.257611358325;4963.181075122564;5301.1783173608155;5304.893902121858;5324.9733751331;5327.387350454747;5360.597955153301;4886.169351210232;4927.655064145475;4933.038057578881;4933.605311574994;4995.975020124876;5067.189249720027;5138.588912887035;5145.614078944169;5191.428942816363;5249.107651699144;5257.8159764408065;5258.342707161605;5258.631895767259;5259.7370131494035;5264.394594621667;5051.267566202953;5051.722155281494;5053.646244762978;5062.367204099488;5084.771185296597;4980.825671101494;5041.319421878146;5051.318072060371;5107.106256405188;5181.585473162213;5013.498650135103;5022.221555658879;5041.596672266283;5042.344495215599;5120.795168193231;5104.1578139606545;5138.383393992595;5151.407588127413;5163.66436181647;5166.638335316492;4907.950920490749;5018.949810501848;5067.163917953644;5067.265246539305;5108.335916330853 22:52:22 INFO - PROCESS | 18723 | |1;ext.html;530.1544037260568;541.4396100036462;554.1051202308272;561.733176741048;580.2543731305274;34100.658993410056;38178.618213817885;38357.80821095891;38363.424548631796;38490.23019539608;39139.608603913955;39635.20729585407;39647.60352396475;39651.20697586046;39778.20443591126;7613.923860761377;7760.495567788104;7774.611269436506;7780.455368124233;7784.3772498200005;7532.887006694904;7579.4694371394025;7606.201348858345;7619.161892191854;7625.885611715828;7622.237776222389;7642.961785191066;7647.885281720779;7670.923290767105;7675.923240767576;7603.429742769286;7614.238576142341;7623.80940476487;7625.618719064025;7658.8468230635635;7577.128630207541;7621.58081305528;7635.121960974448;7644.617769111522;7647;36547.81726091352;36737;36752.816235918646;36791;36791.26417471662;3075.769317301189;3142.8271445070513;3260.7717459777823;3555.2000799820094;3646.8176591170336;28161.155165345073;28280.575791363146;28299;28539.714602853914;29376;3262;3274.246923207652;3301.108700650811;3371.5111308860323;3384.813835239061;247678;249204;249579;250344;250638.74680626663;51731.741341293804;52291.21563176555;52292.21561676578;52387;52396.73801631044;29022.564661530094;29787.10638680843;48146.27780583294;48241.27638085432;48326.5167348322;13533.593992180053;13853.930730346283;13865.168089914436;13865.445382184802;13868;10216.080552750289;10388.324758890649;10397;10397.48012599367;10438.164946804238;17721.7341739874;17774.08970026618;17871.821281787277;17901.40429637721;17950.91024544869;6590.3080176581725;6670.299618540081;6674.522178506532;6798.966005170041;6813.8977915330315;735.8197241675824;860.5654144657034;870.7823044238941;912.1425859691868;921.5714692667941;26491;27977.720222797918;28213.71786282152;28583.714162858105;28703.569446457903;896.7668406214301;899.3299991506369;906.6237511432813;998.3909815012836;1001.8747656542932;13728.725425491633;14706.264686765619;14706.485273015393;14854.10875347461;14923.552293431214;421836;432501;433149;683124;683340;48834.51165488371;49089.263661045115;49232;49534.50465495371;49723.75138124286;1085.3867564825848;1090.3294473898495;1128.0806142993433;1130.5364800431782;1136.9772604548027;27566.17301480959;28668.566571670915;29083.56374654424;29703.25741856471;29871.402571948875;42923;43082.56917430911;43388;43393;43576.782116090486;355595;357336;357915;358202;358373;25152.874235628704;25299.114530991326;25501.61747573751;25679;25834.483310334064;41249.1750165001;41850.58149418467;42102.578974209864;42505.149897002506;42726.78636606797;35907.10232244215;36133.63866361303;36679.26641467209;36691.63308366882;36920.63079369279;35679.82160089183;35769;37705.62294377021;38340.424893627176;38540.6145938537;36595.81702091473;36763.25773669926;37148.81425592855;37669.05827354229;38269.234615308094;36801;36919.49264819838;37171.25657486781;37703.024940386116;37718.62281377151;25511.23466296014;26095;26498.337541560843;26502;26939.326516837235 22:52:22 INFO - PROCESS | 18723 | |2;jquery.html;344.34402463307407;352.6209324975651;355.36212498565067;358.7417059717006;367.39196629578043;16368.508944731662;16565.585860353513;16905.239264233107;17010.234539445722;17151.056691881942;15810.920945395257;16433.83566164338;16909.99999999997;17026.574335641617;17037.233324500397;4927.384076990385;5137.434882162959;5150.072986862363;5151.201563757605;5153.072446959546;3620.094976255936;5089.567386772129;5698.544116470694;5958.761649534035;5996.700164991755;5912.054071348585;5937.524998000171;5960.195373624549;5980.491658209035;5984.251968503937;5868.325142608612;5924.614900031505;5938.851528711773;5950.434708702666;5971.044632858743;5051.621128415383;5107.442230119812;5202.115640341151;5230.21546767984;5254.133068043769;20109.39671809848;20250.886201258923;20479.795202048088;20546.07542660584;20550.486237844172;1877;2027.4829918370722;2165.339571430713;2373.537160253734;2424.709034915804;12828.615141545768;12999.610011699664;13410.731785364238;13531.255780932142;13663.248521331323;1696.414736915762;1736.4703765351562;1741.703910335246;1746.6070134219826;1771.3148721631214;64596;64754.3524564753;65005.02492462664;65604.3439565603;65613.3438665612;8925.33060020501;8970.147835955573;9168.541572921327;9174.724758257264;9265.72202833916;12325.322107284186;12378.566750163702;12383.442745076492;12403.193792403465;12428.192167509083;6754.628495432798;6911.03245545624;6960.164780226405;7092.787216383516;7115;6627.138471998609;6708.127943367429;6836.623985680835;6918.377346038881;6921.411680007155;5636.85907852307;5685.857853553694;5742.310922689304;5816.185733997244;5922.466977972003;1528.8776897848145;1621.6675581505763;1631.9836801632068;1691.2558474271282;1746.0658547676933;786.1548835002395;826.7271800306005;855.6534603485599;865.8701194820827;880.9471431714118;16278.75581866273;16607.252673629715;16692.72267964989;17100.572485687957;17374.218160182823;793.6944276453492;827.462149602751;861.3755027604936;881.9955900220586;889.7108439757105;10072.546735396778;10093.646722364829;10101.393916365041;10115.797684046278;10172.542235599416;368728.2508699622;371595;373970;378096;379010;66855.66572167107;67239.32760672428;67521.32478675249;67673.3232667667;69867.65066174636;881.8368601808686;883.7172104926361;892.0900681305033;900.8378491871526;902.2240872849344;14908.105513668781;15171.62070948191;16007.519774406786;16093.839061609235;16148.67702645964;33144.00567982964;41560.376594351714;41646;41671.16657666769;43272;46537.534624654676;47426.52573474221;47475;53507.11421743683;53674.19488707751;10866.728331791768;11041.33751974884;11129.499172537093;11288.717782055513;11324.150688698215;11666.125040621817;11924.403779811148;12128.818067729168;12586.685332866386;12970.286634235208;10636.41499717523;10860.185486088732;11099.44502774842;11162.162837787037;11598.768024639628;10271.537780800032;10296.691099267035;10422.583096676048;10808.297460665031;10968;10944.179186560881;11407.771844563229;11422;11470.08239340834;11597.5360985563;11104.167187460811;11132.888671113185;11285.21003529778;11507.539698411969;11780.941095294811;10480.63317783874;10879.782404352027;11177.441127943734;11361.37512436824;11726.237794543327 22:52:22 INFO - PROCESS | 18723 | |3;mootools.html;1340.390122494265;1358.062936573764;1419.90770599911;1585.8255591884897;1639.4589785370829;6732.09116769236;7183.568985860846;7293.854122917539;7694.5767982761;7701.306882380592;7390.334869861711;7665.655045522951;7676.309132178103;7683.462157648967;7685;2142.635751922173;2179.901904414305;2183.4432219783935;2184.2246002669062;2184.5849288635186;2121.7559980602273;2152.4511249631323;2178.444496653351;2183.170395249803;2186.3440967709703;2128.5317230209407;2142.4001279641648;2153.9569208615817;2154.569086182762;2167.3281282802304;2115.4076858479575;2123.055240418015;2124.107874692633;2126.6491028980354;2128.2019242783954;2091.7699053104147;2142.7535833379206;2143.9035243414082;2147.3450597567735;2149.4626343414147;7451.7019319227165;7600.6959721611065;7614.847703045908;7628.61856907158;7633.618319084024;4556.225441674923;4687.367205427257;4697.553732395417;4700.717956922562;4702.412198475191;2861.2703760541135;2937.2363185571903;2939.206414268157;2986.670397090273;3006.9548956765666;919.7056941778634;945.8864936207699;947.1191791633778;976.0483528559597;981.8919918808925;10362.585496580128;10376.896231037668;10387.220958428148;10389.27275090744;10411.271211015232;3928.4500169976227;4127.2570937231585;4159.9376009359885;4289.742615443083;4294.377315289328;8905.332100092519;8930;8930.86603700945;8934.776630584287;8952.194302512806;4585.70192937458;4595.080983803253;4598.172328980816;4604.102200071021;4612.008418190038;3641.10792855752;4032.737872038308;4172.061286210639;4188.790560472025;4197.076643138505;3526.682598566141;3562.6259242779133;3606.6753992140834;3659.1035196376524;3659.505966694462;1166.6966588686832;1178.9233699809486;1184.8874356936078;1188.8989435897872;1190.0360707826687;788.247223901173;819.4141189049858;822.6503735912333;828.5360198288978;845.1886189258381;4952.4304704959395;4958.801647934042;4988.575971042429;5051.3433253676785;5109.948900511022;388.5803332401;861.2980420957025;903.1014140929685;912.5619702542816;914.5244472874068;3400.846961886721;3433.1931995980926;3470.132466883279;3501.28223714138;3549.6450354964295;9029.954850225708;9412;9419.623215071457;9420.670276540288;9423.293253006052;9270.953645231866;9293.488858112869;9317.580708868118;9384;9395.530223488799;6894.276101009422;6911.412529935012;6927.861442771116;6949.861002780017;6984.2317345092;4918.803247870188;4921.188003979303;4975.9004819902675;5031.295618613324;5049.368828896388;8299.419040667095;8321.334293256647;8357.498550087013;8368.832623347376;8476.957615211884;8433.704820331259;8564.05795362522;8576.614052367533;8653.134686531548;8659.177378149066;5747.36778954323;6011.458968692838;6191.566590338633;6222.12890195364;6388.329225431448;7395.778126656209;7438.070241219848;7493;7496.437767167376;7505.399568034435;6560.901586476111;6631.966840165768;6652.833679157866;6734.56225345351;6784.830379240559;6299.937000629935;6595.109660196004;6683.565568238049;6721.899171512529;6803.149606299213;6004;6063.696815159313;6074.3318234994995;6074.483668888194;6076.696165191811;4429.8892527685775;4432.711873728197;4474.015716542355;4495.707778994355;4513.300438432048;4355.4337936068105;4400.053988392511;4418.690691651554;4446.355278484666;4473.46318441789 22:52:22 INFO - PROCESS | 18723 | |4;prototype.html;292.3553564390519;296.32733694513456;298.82369402052785;299.79164480685904;305.0725793587493;5081;5106.719130447828;5115.309433226514;5117.59059275258;5144.922826157611;4987;4992.7547094388665;5039.974800126003;5049.2678561608545;5060.3421555197865;3647.762895411803;3817.5800661927165;3897.123147291865;3914.5498267699154;3939.940900886489;3931.2530619182407;3933.822977965984;3936.5669776324726;3941.1920556286036;3943.8759953413282;3913.3738601823716;3918.1771827916173;3919.9216015679667;3924.921501569967;3934.2328245992044;3822.694184465236;3888.863889763845;3897.3179693553516;3925.2149570085953;3928.1750832325247;3430.9142271443166;3446.7247118566042;3450.1719587298867;3452.8950735764565;3456.7580269381156;4897.706137631718;4897.951020489785;4931.309616653635;4942.108866313211;4942.456329803718;4329.9134017319475;4516.23224051912;4521.208788462039;4525.411696479437;4546.386237857913;5214.191800270964;5261.815836445706;5272.103742363807;5273.419923808378;5314.787408503656;3774.5093137892172;3775.7923314217705;3782.2435512897255;3791;3807.9809600952094;5443.537299329561;5547.55619550439;5562.193481945135;5566.693831839248;5584.664920104807;3777.131259810259;3800.676942459922;3803.733738638324;3806.638369354907;3827.4258861171047;3854.7879866607045;3870.548544295889;3870.903227419337;3871.593482684334;3872.477215575861;4447.977760111244;4448.866534003985;4451.6199978006925;4458.019235768126;4470.463544374696;5023.598112151019;5271.367435907716;5324.41431442541;5337.893242135136;5338.279332290169;1302.550620036086;1324.6622111361735;1325.4764368074557;1325.7746183148888;1327.6083555351195;768.2739810878778;814.1329484099533;816.5264146794844;823.6375994562374;823.7026682974339;4490.416245888014;4573.627911626499;4713.717176969393;4714.858554243309;4720.268358404453;5443.455654434604;5477.260569823103;5491.341039075336;5491.395946445888;5513.173024046425;4670.80894371933;4674.649401294916;4688.655672163918;4692.389989301369;4721.7403042832975;2770;2940.7206315400003;2940.911772646824;2945.4403663303906;2964.170032390934;5179.741012949337;5182.896342073137;5190.844274671766;5199.922001169985;5213.139831927765;5381.219723140122;5637.7181140942785;5656.660600363992;5674.148877668383;5692.203091567184;5190.662606930613;5195.7270468735405;5197.324347834758;5199.232261031268;5211.2443695663915;5559.33288005442;5562.944370556243;5566.192902029264;5572.944270557405;5577.386487486292;5266.1574148136115;5430.51125398716;5454.372747133972;5456.181572763959;5466.453354664502;5175.792968281226;5178.741062946913;5200;5201.76592053366;5202.271681964452;3841.193349396546;3860.517435320585;3861.7103717221885;3871.438641397038;3880.8059597019474;5313.840584782462;5447.12845944647;5468.9179662304305;5488.38092762628;5533.6403133796175;5314.4951229633125;5314.867128321668;5342.569131045288;5343.919841202307;5357;5366.114591092426;5376.6827127354045;5380.219868119023;5391.406945236099;5403.919216156863;5027.245913113063;5287.154055351125;5310.8141215057285;5322.722546588869;5323.311727577703;5143.3284182640045;5205.843824685266;5316.920246196233;5389.784408623611;5444.5916556259235;5205.219217117463;5223.582113430993;5249.501297376743;5251.632385732962;5260.526552610283 22:52:22 INFO - PROCESS | 18723 | |5;yui.html;633.8922383194858;725.2493669052528;736.1975446763031;738.1769327200171;740.6629983357573;11682.941585292072;12755.489780408772;12767.36163191839;12796.168249063805;12816.487340506368;12452.813207801868;13043.739125217513;13155.07914445989;13180;13217.933910330436;730.7040648537351;748.2480107491963;749.4753672429295;749.61394881636;750.047439751518;611.6941529235382;738.5642470942144;760;764.2624867003341;767.5471471831618;805.6737021506299;808.2200676347323;808.4583329169441;809.1827254472995;811.809224832164;797.1510341486356;801.1347744436024;802.6227672993683;802.8033131882697;803.325206826263;577.8959787238296;578.2453897663547;580.8431723434692;585.4789237578558;587.4654064801053;12745.36273186337;12747;12766.17019893704;12782.87217127826;12792.680182995406;13042.86957130426;13091.214527128403;13159.342032898317;13513.932430337785;13763.449462021506;10708.51811668469;10708.839367409495;10720.142388608892;10907.236493445462;10923.563057477691;3258.5763850699495;3275.19757659375;3291.637919828817;3310.453775127101;3315.751318651111;65944.6702766483;66082.3391766081;66247.0062949061;66929.33070669329;67183.66408167928;10508.789824203473;10528;10654.360738355723;10669.19981001428;10758.677239682822;20096;20174.798252017586;20224.797752022292;20271.898640506704;20404.795952040586;6494.740210391531;6678.666066696645;6738.090357801732;6953.235144134142;6991.440684745208;3796.8101594920145;3841.673457756066;3912.1002169500607;3935.7244992850224;3944.7633142011573;2787.6515435570554;2912.504874171396;2913.21343237329;2918.430905973315;2922.327864591156;539.7355295904978;558.5057224356393;562.7973929385417;577.266871073734;578.7771707892492;428.55216298967656;482.4970712626358;491.19934506753765;519.7790938850973;531.8271561742372;7060.117485314336;7219.711211551584;7814.3748500119855;8412.915870841336;8548;473.7844280852204;495.07421122501154;527.5225920541916;528.5296086483033;546.4371697151939;3935;3962.187751510933;4016.5180178378196;4057.9391309130388;4138.193052354822;57448.71275643595;58610.413895860496;58646.70676646675;59926;104493;89677.55161224282;91830.54084729534;92294;92321;92871.5356423227;44492.77753611276;48712.75643621759;55560.72219638876;70627;77708.61145694235;7668.961655191688;7907.525548467111;7969.242921922408;8029.357651387992;8206.507609543447;30173.09480715582;33677.49483757795;38458.23083538258;38664.22671546497;42661.57338426576;59390;59586.40413595809;59690.40309596848;59840.70079649574;62953.37046629475;10693.09108725767;10701.839472408075;10779.622713205;11123.888761112285;11185.888141118485;11467.254628449124;12008.879911201126;12201.51193952232;12522.499100035897;12824.358782060674;11726.589569365031;11908.583199587973;11918.463669134737;12044.939775301067;12211;10716.839247411139;11127.666170014912;11231.101511879193;11755.47100380502;12051.879481205076;9574.569144388659;10298.588056477656;10593.788124237626;11311.038561722346;11313;9393.769002254125;9770.85343719859;9898.257630677585;10011.449370284705;10053.547590358305;9500.382475139093;9703.854442183232;10360.792784144425;10427.165826733692;10685.679429617125 22:52:22 INFO - PROCESS | 18723 | __end_tp_report 22:52:22 INFO - PROCESS | 18723 | __start_cc_report 22:52:22 INFO - PROCESS | 18723 | _x_x_mozilla_cycle_collect,359 22:52:22 INFO - PROCESS | 18723 | __end_cc_report 22:52:22 INFO - PROCESS | 18723 | __startTimestamp1472536342888__endTimestamp 22:52:22 INFO - PROCESS | 18723 | 22:52:22 INFO - PROCESS | 18723 | ------- Summary: start ------- 22:52:22 INFO - PROCESS | 18723 | Number of tests: 6 22:52:22 INFO - PROCESS | 18723 | 22:52:22 INFO - PROCESS | 18723 | [#0] dojo.html Cycles:165 Average:4857.54 Median:4963.18 stddev:518.55 (10.4%) stddev-sans-first:489.72 22:52:22 INFO - PROCESS | 18723 | Values: 2626.7 2639.0 2642.7 2668.9 2681.4 4784.0 4857.5 4899.2 4947.2 5004.4 4884.4 4900.6 4933.0 4944.4 4972.9 4418.6 4513.3 4546.9 4567.4 4657.4 4601.4 4602.9 4623.2 4630.4 4653.0 4411.5 4449.9 4509.4 4558.0 4569.2 4449.8 4451.2 4458.4 4505.1 4584.7 4478.4 4504.9 4509.0 4515.9 4549.0 4840.3 4884.3 4888.5 4920.7 4931.6 5256.1 5264.2 5267.9 5270.2 5306.2 5267.7 5273.2 5290.2 5293.0 5329.5 4795.7 4847.5 4852.1 4896.0 4934.7 5376.6 5392.7 5425.4 5466.1 5469.7 5162.1 5193.4 5194.2 5199.7 5253.9 5123.2 5182.8 5206.2 5221.0 5299.3 5230.4 5242.2 5246.5 5247.7 5289.9 5240.6 5242.3 5243.8 5263.8 5312.3 4406.3 4443.2 4479.3 4480.4 4520.7 3875.6 3891.8 3893.7 3935.6 3937.8 4516.0 4517.5 4528.3 4538.5 4569.0 5105.0 5248.5 5264.1 5301.9 5308.3 4553.1 4563.1 4576.4 4595.9 4632.6 4780.0 4793.3 4801.0 4807.7 4870.1 4781.1 4892.2 4946.0 4949.3 4963.2 5301.2 5304.9 5325.0 5327.4 5360.6 4886.2 4927.7 4933.0 4933.6 4996.0 5067.2 5138.6 5145.6 5191.4 5249.1 5257.8 5258.3 5258.6 5259.7 5264.4 5051.3 5051.7 5053.6 5062.4 5084.8 4980.8 5041.3 5051.3 5107.1 5181.6 5013.5 5022.2 5041.6 5042.3 5120.8 5104.2 5138.4 5151.4 5163.7 5166.6 4908.0 5018.9 5067.2 5067.3 5108.3 22:52:22 INFO - PROCESS | 18723 | 22:52:22 INFO - PROCESS | 18723 | [#1] ext.html Cycles:180 Average:52119.93 Median:37160.04 stddev:107644.80 (289.7%) stddev-sans-first:107877.08 22:52:22 INFO - PROCESS | 18723 | Values: 530.2 541.4 554.1 561.7 580.3 34100.7 38178.6 38357.8 38363.4 38490.2 39139.6 39635.2 39647.6 39651.2 39778.2 7613.9 7760.5 7774.6 7780.5 7784.4 7532.9 7579.5 7606.2 7619.2 7625.9 7622.2 7643.0 7647.9 7670.9 7675.9 7603.4 7614.2 7623.8 7625.6 7658.8 7577.1 7621.6 7635.1 7644.6 7647.0 36547.8 36737.0 36752.8 36791.0 36791.3 3075.8 3142.8 3260.8 3555.2 3646.8 28161.2 28280.6 28299.0 28539.7 29376.0 3262.0 3274.2 3301.1 3371.5 3384.8 247678.0 249204.0 249579.0 250344.0 250638.7 51731.7 52291.2 52292.2 52387.0 52396.7 29022.6 29787.1 48146.3 48241.3 48326.5 13533.6 13853.9 13865.2 13865.4 13868.0 10216.1 10388.3 10397.0 10397.5 10438.2 17721.7 17774.1 17871.8 17901.4 17950.9 6590.3 6670.3 6674.5 6799.0 6813.9 735.8 860.6 870.8 912.1 921.6 26491.0 27977.7 28213.7 28583.7 28703.6 896.8 899.3 906.6 998.4 1001.9 13728.7 14706.3 14706.5 14854.1 14923.6 421836.0 432501.0 433149.0 683124.0 683340.0 48834.5 49089.3 49232.0 49534.5 49723.8 1085.4 1090.3 1128.1 1130.5 1137.0 27566.2 28668.6 29083.6 29703.3 29871.4 42923.0 43082.6 43388.0 43393.0 43576.8 355595.0 357336.0 357915.0 358202.0 358373.0 25152.9 25299.1 25501.6 25679.0 25834.5 41249.2 41850.6 42102.6 42505.1 42726.8 35907.1 36133.6 36679.3 36691.6 36920.6 35679.8 35769.0 37705.6 38340.4 38540.6 36595.8 36763.3 37148.8 37669.1 38269.2 36801.0 36919.5 37171.3 37703.0 37718.6 25511.2 26095.0 26498.3 26502.0 26939.3 22:52:22 INFO - PROCESS | 18723 | 22:52:22 INFO - PROCESS | 18723 | [#2] jquery.html Cycles:180 Average:23964.55 Median:16744.17 stddev:61541.39 (367.5%) stddev-sans-first:61688.47 22:52:22 INFO - PROCESS | 18723 | Values: 344.3 352.6 355.4 358.7 367.4 16368.5 16565.6 16905.2 17010.2 17151.1 15810.9 16433.8 16910.0 17026.6 17037.2 4927.4 5137.4 5150.1 5151.2 5153.1 3620.1 5089.6 5698.5 5958.8 5996.7 5912.1 5937.5 5960.2 5980.5 5984.3 5868.3 5924.6 5938.9 5950.4 5971.0 5051.6 5107.4 5202.1 5230.2 5254.1 20109.4 20250.9 20479.8 20546.1 20550.5 1877.0 2027.5 2165.3 2373.5 2424.7 12828.6 12999.6 13410.7 13531.3 13663.2 1696.4 1736.5 1741.7 1746.6 1771.3 64596.0 64754.4 65005.0 65604.3 65613.3 8925.3 8970.1 9168.5 9174.7 9265.7 12325.3 12378.6 12383.4 12403.2 12428.2 6754.6 6911.0 6960.2 7092.8 7115.0 6627.1 6708.1 6836.6 6918.4 6921.4 5636.9 5685.9 5742.3 5816.2 5922.5 1528.9 1621.7 1632.0 1691.3 1746.1 786.2 826.7 855.7 865.9 880.9 16278.8 16607.3 16692.7 17100.6 17374.2 793.7 827.5 861.4 882.0 889.7 10072.5 10093.6 10101.4 10115.8 10172.5 368728.3 371595.0 373970.0 378096.0 379010.0 66855.7 67239.3 67521.3 67673.3 69867.7 881.8 883.7 892.1 900.8 902.2 14908.1 15171.6 16007.5 16093.8 16148.7 33144.0 41560.4 41646.0 41671.2 43272.0 46537.5 47426.5 47475.0 53507.1 53674.2 10866.7 11041.3 11129.5 11288.7 11324.2 11666.1 11924.4 12128.8 12586.7 12970.3 10636.4 10860.2 11099.4 11162.2 11598.8 10271.5 10296.7 10422.6 10808.3 10968.0 10944.2 11407.8 11422.0 11470.1 11597.5 11104.2 11132.9 11285.2 11507.5 11780.9 10480.6 10879.8 11177.4 11361.4 11726.2 22:52:22 INFO - PROCESS | 18723 | 22:52:22 INFO - PROCESS | 18723 | [#3] mootools.html Cycles:180 Average:4990.70 Median:4982.24 stddev:2763.18 (55.5%) stddev-sans-first:2757.31 22:52:22 INFO - PROCESS | 18723 | Values: 1340.4 1358.1 1419.9 1585.8 1639.5 6732.1 7183.6 7293.9 7694.6 7701.3 7390.3 7665.7 7676.3 7683.5 7685.0 2142.6 2179.9 2183.4 2184.2 2184.6 2121.8 2152.5 2178.4 2183.2 2186.3 2128.5 2142.4 2154.0 2154.6 2167.3 2115.4 2123.1 2124.1 2126.6 2128.2 2091.8 2142.8 2143.9 2147.3 2149.5 7451.7 7600.7 7614.8 7628.6 7633.6 4556.2 4687.4 4697.6 4700.7 4702.4 2861.3 2937.2 2939.2 2986.7 3007.0 919.7 945.9 947.1 976.0 981.9 10362.6 10376.9 10387.2 10389.3 10411.3 3928.5 4127.3 4159.9 4289.7 4294.4 8905.3 8930.0 8930.9 8934.8 8952.2 4585.7 4595.1 4598.2 4604.1 4612.0 3641.1 4032.7 4172.1 4188.8 4197.1 3526.7 3562.6 3606.7 3659.1 3659.5 1166.7 1178.9 1184.9 1188.9 1190.0 788.2 819.4 822.7 828.5 845.2 4952.4 4958.8 4988.6 5051.3 5109.9 388.6 861.3 903.1 912.6 914.5 3400.8 3433.2 3470.1 3501.3 3549.6 9030.0 9412.0 9419.6 9420.7 9423.3 9271.0 9293.5 9317.6 9384.0 9395.5 6894.3 6911.4 6927.9 6949.9 6984.2 4918.8 4921.2 4975.9 5031.3 5049.4 8299.4 8321.3 8357.5 8368.8 8477.0 8433.7 8564.1 8576.6 8653.1 8659.2 5747.4 6011.5 6191.6 6222.1 6388.3 7395.8 7438.1 7493.0 7496.4 7505.4 6560.9 6632.0 6652.8 6734.6 6784.8 6299.9 6595.1 6683.6 6721.9 6803.1 6004.0 6063.7 6074.3 6074.5 6076.7 4429.9 4432.7 4474.0 4495.7 4513.3 4355.4 4400.1 4418.7 4446.4 4473.5 22:52:22 INFO - PROCESS | 18723 | 22:52:22 INFO - PROCESS | 18723 | [#4] prototype.html Cycles:180 Average:4409.10 Median:5054.81 stddev:1304.90 (25.8%) stddev-sans-first:1271.45 22:52:22 INFO - PROCESS | 18723 | Values: 292.4 296.3 298.8 299.8 305.1 5081.0 5106.7 5115.3 5117.6 5144.9 4987.0 4992.8 5040.0 5049.3 5060.3 3647.8 3817.6 3897.1 3914.5 3939.9 3931.3 3933.8 3936.6 3941.2 3943.9 3913.4 3918.2 3919.9 3924.9 3934.2 3822.7 3888.9 3897.3 3925.2 3928.2 3430.9 3446.7 3450.2 3452.9 3456.8 4897.7 4898.0 4931.3 4942.1 4942.5 4329.9 4516.2 4521.2 4525.4 4546.4 5214.2 5261.8 5272.1 5273.4 5314.8 3774.5 3775.8 3782.2 3791.0 3808.0 5443.5 5547.6 5562.2 5566.7 5584.7 3777.1 3800.7 3803.7 3806.6 3827.4 3854.8 3870.5 3870.9 3871.6 3872.5 4448.0 4448.9 4451.6 4458.0 4470.5 5023.6 5271.4 5324.4 5337.9 5338.3 1302.6 1324.7 1325.5 1325.8 1327.6 768.3 814.1 816.5 823.6 823.7 4490.4 4573.6 4713.7 4714.9 4720.3 5443.5 5477.3 5491.3 5491.4 5513.2 4670.8 4674.6 4688.7 4692.4 4721.7 2770.0 2940.7 2940.9 2945.4 2964.2 5179.7 5182.9 5190.8 5199.9 5213.1 5381.2 5637.7 5656.7 5674.1 5692.2 5190.7 5195.7 5197.3 5199.2 5211.2 5559.3 5562.9 5566.2 5572.9 5577.4 5266.2 5430.5 5454.4 5456.2 5466.5 5175.8 5178.7 5200.0 5201.8 5202.3 3841.2 3860.5 3861.7 3871.4 3880.8 5313.8 5447.1 5468.9 5488.4 5533.6 5314.5 5314.9 5342.6 5343.9 5357.0 5366.1 5376.7 5380.2 5391.4 5403.9 5027.2 5287.2 5310.8 5322.7 5323.3 5143.3 5205.8 5316.9 5389.8 5444.6 5205.2 5223.6 5249.5 5251.6 5260.5 22:52:22 INFO - PROCESS | 18723 | 22:52:22 INFO - PROCESS | 18723 | [#5] yui.html Cycles:180 Average:16540.12 Median:22460.66 stddev:23049.04 (102.6%) stddev-sans-first:23082.76 22:52:22 INFO - PROCESS | 18723 | Values: 633.9 725.2 736.2 738.2 740.7 11682.9 12755.5 12767.4 12796.2 12816.5 12452.8 13043.7 13155.1 13180.0 13217.9 730.7 748.2 749.5 749.6 750.0 611.7 738.6 760.0 764.3 767.5 805.7 808.2 808.5 809.2 811.8 797.2 801.1 802.6 802.8 803.3 577.9 578.2 580.8 585.5 587.5 12745.4 12747.0 12766.2 12782.9 12792.7 13042.9 13091.2 13159.3 13513.9 13763.4 10708.5 10708.8 10720.1 10907.2 10923.6 3258.6 3275.2 3291.6 3310.5 3315.8 65944.7 66082.3 66247.0 66929.3 67183.7 10508.8 10528.0 10654.4 10669.2 10758.7 20096.0 20174.8 20224.8 20271.9 20404.8 6494.7 6678.7 6738.1 6953.2 6991.4 3796.8 3841.7 3912.1 3935.7 3944.8 2787.7 2912.5 2913.2 2918.4 2922.3 539.7 558.5 562.8 577.3 578.8 428.6 482.5 491.2 519.8 531.8 7060.1 7219.7 7814.4 8412.9 8548.0 473.8 495.1 527.5 528.5 546.4 3935.0 3962.2 4016.5 4057.9 4138.2 57448.7 58610.4 58646.7 59926.0 104493.0 89677.6 91830.5 92294.0 92321.0 92871.5 44492.8 48712.8 55560.7 70627.0 77708.6 7669.0 7907.5 7969.2 8029.4 8206.5 30173.1 33677.5 38458.2 38664.2 42661.6 59390.0 59586.4 59690.4 59840.7 62953.4 10693.1 10701.8 10779.6 11123.9 11185.9 11467.3 12008.9 12201.5 12522.5 12824.4 11726.6 11908.6 11918.5 12044.9 12211.0 10716.8 11127.7 11231.1 11755.5 12051.9 9574.6 10298.6 10593.8 11311.0 11313.0 9393.8 9770.9 9898.3 10011.4 10053.5 9500.4 9703.9 10360.8 10427.2 10685.7 22:52:22 INFO - PROCESS | 18723 | -------- Summary: end -------- 22:52:22 INFO - PROCESS | 18723 | 22:52:23 INFO - TEST-INFO | 18723: exit 0 22:52:23 INFO - TEST-OK | dromaeo_css | took 1118728ms 22:52:23 INFO - TEST-START | kraken 22:52:23 INFO - operating with platform_type : linux_ 22:52:23 INFO - Initialising browser for kraken test... 22:52:23 INFO - TEST-INFO | started process 19089 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp7hdn6r/profile http://localhost:54593/getInfo.html) 22:52:28 INFO - PROCESS | 19089 | __metrics Screen width/height:1600/1200 22:52:28 INFO - PROCESS | 19089 | colorDepth:24 22:52:28 INFO - PROCESS | 19089 | Browser inner width/height: 1024/697 22:52:28 INFO - PROCESS | 19089 | __metrics 22:52:29 ERROR - PROCESS | 19089 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2991: TypeError: this.tabs is undefined 22:52:30 INFO - TEST-INFO | 19089: exit 0 22:52:30 INFO - Browser initialized. 22:52:30 INFO - Running cycle 1/1 for kraken test... 22:52:30 INFO - TEST-INFO | started process 19210 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp7hdn6r/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 22:52:42 INFO - PROCESS | 19210 | RSS: Main: 193007616 22:52:42 INFO - PROCESS | 19210 | 22:52:45 INFO - PROCESS | 19210 | Cycle 1(1): loaded http://localhost:54593/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54593/tests/kraken/driver.html?testName=audio-beat-detection) 22:52:46 INFO - PROCESS | 19210 | RSS: Main: 205656064 22:52:46 INFO - PROCESS | 19210 | 22:52:49 INFO - PROCESS | 19210 | Cycle 1(1): loaded http://localhost:54593/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54593/tests/kraken/driver.html?testName=audio-dft) 22:52:50 INFO - PROCESS | 19210 | RSS: Main: 204701696 22:52:50 INFO - PROCESS | 19210 | 22:52:53 INFO - PROCESS | 19210 | Cycle 1(1): loaded http://localhost:54593/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54593/tests/kraken/driver.html?testName=audio-fft) 22:52:53 INFO - PROCESS | 19210 | RSS: Main: 196513792 22:52:53 INFO - PROCESS | 19210 | 22:52:55 INFO - PROCESS | 19210 | Cycle 1(1): loaded http://localhost:54593/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54593/tests/kraken/driver.html?testName=audio-oscillator) 22:52:56 INFO - PROCESS | 19210 | RSS: Main: 197410816 22:52:56 INFO - PROCESS | 19210 | 22:52:58 INFO - PROCESS | 19210 | Cycle 1(1): loaded http://localhost:54593/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54593/tests/kraken/driver.html?testName=imaging-gaussian-blur) 22:52:59 INFO - PROCESS | 19210 | RSS: Main: 197939200 22:52:59 INFO - PROCESS | 19210 | 22:53:02 INFO - PROCESS | 19210 | Cycle 1(1): loaded http://localhost:54593/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54593/tests/kraken/driver.html?testName=imaging-darkroom) 22:53:03 INFO - PROCESS | 19210 | RSS: Main: 198025216 22:53:03 INFO - PROCESS | 19210 | 22:53:06 INFO - PROCESS | 19210 | Cycle 1(1): loaded http://localhost:54593/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54593/tests/kraken/driver.html?testName=imaging-desaturate) 22:53:07 INFO - PROCESS | 19210 | RSS: Main: 193863680 22:53:07 INFO - PROCESS | 19210 | 22:53:10 INFO - PROCESS | 19210 | Cycle 1(1): loaded http://localhost:54593/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54593/tests/kraken/driver.html?testName=json-parse-financial) 22:53:10 INFO - PROCESS | 19210 | RSS: Main: 195985408 22:53:10 INFO - PROCESS | 19210 | 22:53:12 INFO - PROCESS | 19210 | Cycle 1(1): loaded http://localhost:54593/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54593/tests/kraken/driver.html?testName=json-stringify-tinderbox) 22:53:13 INFO - PROCESS | 19210 | RSS: Main: 196202496 22:53:13 INFO - PROCESS | 19210 | 22:53:15 INFO - PROCESS | 19210 | Cycle 1(1): loaded http://localhost:54593/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54593/tests/kraken/driver.html?testName=stanford-crypto-aes) 22:53:15 INFO - PROCESS | 19210 | RSS: Main: 196313088 22:53:15 INFO - PROCESS | 19210 | 22:53:18 INFO - PROCESS | 19210 | Cycle 1(1): loaded http://localhost:54593/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54593/tests/kraken/driver.html?testName=stanford-crypto-ccm) 22:53:18 INFO - PROCESS | 19210 | RSS: Main: 196911104 22:53:18 INFO - PROCESS | 19210 | 22:53:21 INFO - PROCESS | 19210 | Cycle 1(1): loaded http://localhost:54593/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54593/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 22:53:22 INFO - PROCESS | 19210 | RSS: Main: 197066752 22:53:22 INFO - PROCESS | 19210 | 22:53:25 INFO - PROCESS | 19210 | Cycle 1(1): loaded http://localhost:54593/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54593/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 22:53:25 INFO - PROCESS | 19210 | RSS: Main: 197304320 22:53:25 INFO - PROCESS | 19210 | 22:53:27 INFO - PROCESS | 19210 | Cycle 1(1): loaded http://localhost:54593/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54593/tests/kraken/driver.html?testName=ai-astar) 22:53:27 INFO - PROCESS | 19210 | RSS: Main: 200151040 22:53:27 INFO - PROCESS | 19210 | 22:53:27 INFO - PROCESS | 19210 | __start_tp_report 22:53:27 INFO - PROCESS | 19210 | _x_x_mozilla_page_load 22:53:27 INFO - PROCESS | 19210 | _x_x_mozilla_page_load_details 22:53:27 INFO - PROCESS | 19210 | |i|pagename|runs| 22:53:27 INFO - PROCESS | 19210 | |0;ai-astar;109;116;114;119;115;116;118;117;118;135 22:53:27 INFO - PROCESS | 19210 | |1;audio-beat-detection;164;126;146;189;124;154;157;130;192;130 22:53:27 INFO - PROCESS | 19210 | |2;audio-dft;169;171;164;163;163;164;163;164;163;163 22:53:27 INFO - PROCESS | 19210 | |3;audio-fft;76;77;78;179;78;79;76;78;162;78 22:53:27 INFO - PROCESS | 19210 | |4;audio-oscillator;84;84;134;85;85;84;130;93;85;135 22:53:27 INFO - PROCESS | 19210 | |5;imaging-gaussian-blur;121;120;118;118;118;118;118;117;118;120 22:53:27 INFO - PROCESS | 19210 | |6;imaging-darkroom;149;149;149;150;150;150;149;150;148;150 22:53:27 INFO - PROCESS | 19210 | |7;imaging-desaturate;97;97;97;96;96;95;98;97;95;96 22:53:27 INFO - PROCESS | 19210 | |8;json-parse-financial;65;68;65;68;69;66;67;70;66;67 22:53:27 INFO - PROCESS | 19210 | |9;json-stringify-tinderbox;66;66;66;67;65;65;66;66;70;65 22:53:27 INFO - PROCESS | 19210 | |10;stanford-crypto-aes;84;83;85;86;85;87;88;82;86;91 22:53:27 INFO - PROCESS | 19210 | |11;stanford-crypto-ccm;139;133;140;137;139;135;139;138;168;142 22:53:27 INFO - PROCESS | 19210 | |12;stanford-crypto-pbkdf2;175;174;175;174;170;172;174;174;176;171 22:53:27 INFO - PROCESS | 19210 | |13;stanford-crypto-sha256-iterative;72;73;71;70;70;69;70;70;68;73 22:53:27 INFO - PROCESS | 19210 | __end_tp_report 22:53:27 INFO - PROCESS | 19210 | __start_cc_report 22:53:27 INFO - PROCESS | 19210 | _x_x_mozilla_cycle_collect,884 22:53:27 INFO - PROCESS | 19210 | __end_cc_report 22:53:27 INFO - PROCESS | 19210 | __startTimestamp1472536407982__endTimestamp 22:53:27 INFO - PROCESS | 19210 | 22:53:27 INFO - PROCESS | 19210 | ------- Summary: start ------- 22:53:27 INFO - PROCESS | 19210 | Number of tests: 14 22:53:27 INFO - PROCESS | 19210 | 22:53:27 INFO - PROCESS | 19210 | [#0] ai-astar Cycles:10 Average:117.70 Median:117.50 stddev:6.70 (5.7%) stddev-sans-first:6.32 22:53:27 INFO - PROCESS | 19210 | Values: 109.0 116.0 114.0 119.0 115.0 116.0 118.0 117.0 118.0 135.0 22:53:27 INFO - PROCESS | 19210 | 22:53:27 INFO - PROCESS | 19210 | [#1] audio-beat-detection Cycles:10 Average:151.20 Median:155.50 stddev:24.94 (16.0%) stddev-sans-first:26.02 22:53:27 INFO - PROCESS | 19210 | Values: 164.0 126.0 146.0 189.0 124.0 154.0 157.0 130.0 192.0 130.0 22:53:27 INFO - PROCESS | 19210 | 22:53:27 INFO - PROCESS | 19210 | [#2] audio-dft Cycles:10 Average:164.70 Median:164.00 stddev:2.87 (1.7%) stddev-sans-first:2.59 22:53:27 INFO - PROCESS | 19210 | Values: 169.0 171.0 164.0 163.0 163.0 164.0 163.0 164.0 163.0 163.0 22:53:27 INFO - PROCESS | 19210 | 22:53:27 INFO - PROCESS | 19210 | [#3] audio-fft Cycles:10 Average:96.10 Median:78.00 stddev:39.43 (50.5%) stddev-sans-first:41.14 22:53:27 INFO - PROCESS | 19210 | Values: 76.0 77.0 78.0 179.0 78.0 79.0 76.0 78.0 162.0 78.0 22:53:27 INFO - PROCESS | 19210 | 22:53:27 INFO - PROCESS | 19210 | [#4] audio-oscillator Cycles:10 Average:99.90 Median:84.50 stddev:23.03 (27.3%) stddev-sans-first:23.70 22:53:27 INFO - PROCESS | 19210 | Values: 84.0 84.0 134.0 85.0 85.0 84.0 130.0 93.0 85.0 135.0 22:53:27 INFO - PROCESS | 19210 | 22:53:27 INFO - PROCESS | 19210 | [#5] imaging-gaussian-blur Cycles:10 Average:118.60 Median:118.00 stddev:1.26 (1.1%) stddev-sans-first:1.00 22:53:27 INFO - PROCESS | 19210 | Values: 121.0 120.0 118.0 118.0 118.0 118.0 118.0 117.0 118.0 120.0 22:53:27 INFO - PROCESS | 19210 | 22:53:28 INFO - PROCESS | 19210 | [#6] imaging-darkroom Cycles:10 Average:149.40 Median:150.00 stddev:0.70 (0.5%) stddev-sans-first:0.73 22:53:28 INFO - PROCESS | 19210 | Values: 149.0 149.0 149.0 150.0 150.0 150.0 149.0 150.0 148.0 150.0 22:53:28 INFO - PROCESS | 19210 | 22:53:28 INFO - PROCESS | 19210 | [#7] imaging-desaturate Cycles:10 Average:96.40 Median:97.00 stddev:0.97 (1.0%) stddev-sans-first:1.00 22:53:28 INFO - PROCESS | 19210 | Values: 97.0 97.0 97.0 96.0 96.0 95.0 98.0 97.0 95.0 96.0 22:53:28 INFO - PROCESS | 19210 | 22:53:28 INFO - PROCESS | 19210 | [#8] json-parse-financial Cycles:10 Average:67.10 Median:67.50 stddev:1.66 (2.5%) stddev-sans-first:1.58 22:53:28 INFO - PROCESS | 19210 | Values: 65.0 68.0 65.0 68.0 69.0 66.0 67.0 70.0 66.0 67.0 22:53:28 INFO - PROCESS | 19210 | 22:53:28 INFO - PROCESS | 19210 | [#9] json-stringify-tinderbox Cycles:10 Average:66.20 Median:66.00 stddev:1.48 (2.2%) stddev-sans-first:1.56 22:53:28 INFO - PROCESS | 19210 | Values: 66.0 66.0 66.0 67.0 65.0 65.0 66.0 66.0 70.0 65.0 22:53:28 INFO - PROCESS | 19210 | 22:53:28 INFO - PROCESS | 19210 | [#10] stanford-crypto-aes Cycles:10 Average:85.70 Median:86.00 stddev:2.58 (3.0%) stddev-sans-first:2.67 22:53:28 INFO - PROCESS | 19210 | Values: 84.0 83.0 85.0 86.0 85.0 87.0 88.0 82.0 86.0 91.0 22:53:28 INFO - PROCESS | 19210 | 22:53:28 INFO - PROCESS | 19210 | [#11] stanford-crypto-ccm Cycles:10 Average:141.00 Median:139.00 stddev:9.82 (7.1%) stddev-sans-first:10.39 22:53:28 INFO - PROCESS | 19210 | Values: 139.0 133.0 140.0 137.0 139.0 135.0 139.0 138.0 168.0 142.0 22:53:28 INFO - PROCESS | 19210 | 22:53:28 INFO - PROCESS | 19210 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:173.50 Median:174.00 stddev:1.90 (1.1%) stddev-sans-first:1.94 22:53:28 INFO - PROCESS | 19210 | Values: 175.0 174.0 175.0 174.0 170.0 172.0 174.0 174.0 176.0 171.0 22:53:28 INFO - PROCESS | 19210 | 22:53:28 INFO - PROCESS | 19210 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.60 Median:70.50 stddev:1.65 (2.3%) stddev-sans-first:1.67 22:53:28 INFO - PROCESS | 19210 | Values: 72.0 73.0 71.0 70.0 70.0 69.0 70.0 70.0 68.0 73.0 22:53:28 INFO - PROCESS | 19210 | -------- Summary: end -------- 22:53:28 INFO - PROCESS | 19210 | 22:53:29 INFO - TEST-INFO | 19210: exit 0 22:53:29 INFO - TEST-OK | kraken | took 65302ms 22:53:29 INFO - SUITE-END | took 1184s 22:53:29 INFO - Completed test suite (00:19:44) 22:53:29 INFO - javascript benchmark 22:53:29 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6474.370954543384, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2626.69792973808, 2638.9604155937654, 2642.709301976782, 2668.9466210675782, 2681.436898251367, 4784.019276048411, 4857.489963553829, 4899.167141585935, 4947.158982972895, 5004.449510553841, 4884.438289596697, 4900.558949694527, 4932.9753351233285, 4944.381952255968, 4972.925406118902, 4418.5581441855875, 4513.300438432048, 4546.8863278417975, 4567.442232349895, 4657.441107067157, 4601.3558101865765, 4602.884927876797, 4623.190941585226, 4630.37489938859, 4653.046125544255, 4411.514733379326, 4449.888752781174, 4509.391232183646, 4557.9789365375345, 4569.223232050526, 4449.777511124463, 4451.198784218872, 4458.398116254297, 4505.121501307246, 4584.701994370389, 4478.39541661878, 4504.909901801946, 4509.0, 4515.864524064284, 4549.0, 4840.273958906157, 4884.3161957326, 4888.535589119028, 4920.6801557898625, 4931.630127740434, 5256.08018596744, 5264.18405147199, 5267.894642107175, 5270.235815806686, 5306.204069389584, 5267.736613169364, 5273.235380869791, 5290.232916227125, 5292.967871265105, 5329.467053294678, 4795.712257264575, 4847.491013443609, 4852.053849499313, 4895.975520122377, 4934.728589927517, 5376.569874410038, 5392.73036348181, 5425.430329815392, 5466.125419932791, 5469.726513674301, 5162.122439185272, 5193.428722840485, 5194.220866869924, 5199.66202196856, 5253.894922101613, 5123.205903085028, 5182.818601348935, 5206.167013277857, 5221.0, 5299.2845965794895, 5230.424653288135, 5242.213667949762, 5246.527812496894, 5247.7113758743635, 5289.920651190235, 5240.633155679066, 5242.292290540804, 5243.790248390022, 5263.842084737464, 5312.256284120226, 4406.294992801137, 4443.178012067778, 4479.3057076153245, 4480.417545719036, 4520.706154099973, 3875.5736868944396, 3891.805409729559, 3893.7274390792372, 3935.6457918787446, 3937.8031098445535, 4516.0, 4517.503074661785, 4528.298113792367, 4538.500764915857, 4569.040501494657, 5104.974475127675, 5248.475152484797, 5264.05247055526, 5301.946980530145, 5308.283381743415, 4553.089382123589, 4563.0873825235085, 4576.405067341224, 4595.9080818383445, 4632.62938964882, 4780.043991201704, 4793.281007848851, 4801.039792041605, 4807.687500312469, 4870.09903167915, 4781.115493633689, 4892.241702536113, 4946.03552307311, 4949.257611358325, 4963.181075122564, 5301.1783173608155, 5304.893902121858, 5324.9733751331, 5327.387350454747, 5360.597955153301, 4886.169351210232, 4927.655064145475, 4933.038057578881, 4933.605311574994, 4995.975020124876, 5067.189249720027, 5138.588912887035, 5145.614078944169, 5191.428942816363, 5249.107651699144, 5257.8159764408065, 5258.342707161605, 5258.631895767259, 5259.7370131494035, 5264.394594621667, 5051.267566202953, 5051.722155281494, 5053.646244762978, 5062.367204099488, 5084.771185296597, 4980.825671101494, 5041.319421878146, 5051.318072060371, 5107.106256405188, 5181.585473162213, 5013.498650135103, 5022.221555658879, 5041.596672266283, 5042.344495215599, 5120.795168193231, 5104.1578139606545, 5138.383393992595, 5151.407588127413, 5163.66436181647, 5166.638335316492, 4907.950920490749, 5018.949810501848, 5067.163917953644, 5067.265246539305, 5108.335916330853], "value": 4823.050584837121, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [530.1544037260568, 541.4396100036462, 554.1051202308272, 561.733176741048, 580.2543731305274, 34100.658993410056, 38178.618213817885, 38357.80821095891, 38363.424548631796, 38490.23019539608, 39139.608603913955, 39635.20729585407, 39647.60352396475, 39651.20697586046, 39778.20443591126, 7613.923860761377, 7760.495567788104, 7774.611269436506, 7780.455368124233, 7784.3772498200005, 7532.887006694904, 7579.4694371394025, 7606.201348858345, 7619.161892191854, 7625.885611715828, 7622.237776222389, 7642.961785191066, 7647.885281720779, 7670.923290767105, 7675.923240767576, 7603.429742769286, 7614.238576142341, 7623.80940476487, 7625.618719064025, 7658.8468230635635, 7577.128630207541, 7621.58081305528, 7635.121960974448, 7644.617769111522, 7647.0, 36547.81726091352, 36737.0, 36752.816235918646, 36791.0, 36791.26417471662, 3075.769317301189, 3142.8271445070513, 3260.7717459777823, 3555.2000799820094, 3646.8176591170336, 28161.155165345073, 28280.575791363146, 28299.0, 28539.714602853914, 29376.0, 3262.0, 3274.246923207652, 3301.108700650811, 3371.5111308860323, 3384.813835239061, 247678.0, 249204.0, 249579.0, 250344.0, 250638.74680626663, 51731.741341293804, 52291.21563176555, 52292.21561676578, 52387.0, 52396.73801631044, 29022.564661530094, 29787.10638680843, 48146.27780583294, 48241.27638085432, 48326.5167348322, 13533.593992180053, 13853.930730346283, 13865.168089914436, 13865.445382184802, 13868.0, 10216.080552750289, 10388.324758890649, 10397.0, 10397.48012599367, 10438.164946804238, 17721.7341739874, 17774.08970026618, 17871.821281787277, 17901.40429637721, 17950.91024544869, 6590.3080176581725, 6670.299618540081, 6674.522178506532, 6798.966005170041, 6813.8977915330315, 735.8197241675824, 860.5654144657034, 870.7823044238941, 912.1425859691868, 921.5714692667941, 26491.0, 27977.720222797918, 28213.71786282152, 28583.714162858105, 28703.569446457903, 896.7668406214301, 899.3299991506369, 906.6237511432813, 998.3909815012836, 1001.8747656542932, 13728.725425491633, 14706.264686765619, 14706.485273015393, 14854.10875347461, 14923.552293431214, 421836.0, 432501.0, 433149.0, 683124.0, 683340.0, 48834.51165488371, 49089.263661045115, 49232.0, 49534.50465495371, 49723.75138124286, 1085.3867564825848, 1090.3294473898495, 1128.0806142993433, 1130.5364800431782, 1136.9772604548027, 27566.17301480959, 28668.566571670915, 29083.56374654424, 29703.25741856471, 29871.402571948875, 42923.0, 43082.56917430911, 43388.0, 43393.0, 43576.782116090486, 355595.0, 357336.0, 357915.0, 358202.0, 358373.0, 25152.874235628704, 25299.114530991326, 25501.61747573751, 25679.0, 25834.483310334064, 41249.1750165001, 41850.58149418467, 42102.578974209864, 42505.149897002506, 42726.78636606797, 35907.10232244215, 36133.63866361303, 36679.26641467209, 36691.63308366882, 36920.63079369279, 35679.82160089183, 35769.0, 37705.62294377021, 38340.424893627176, 38540.6145938537, 36595.81702091473, 36763.25773669926, 37148.81425592855, 37669.05827354229, 38269.234615308094, 36801.0, 36919.49264819838, 37171.25657486781, 37703.024940386116, 37718.62281377151, 25511.23466296014, 26095.0, 26498.337541560843, 26502.0, 26939.326516837235], "value": 17465.04675089022, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [344.34402463307407, 352.6209324975651, 355.36212498565067, 358.7417059717006, 367.39196629578043, 16368.508944731662, 16565.585860353513, 16905.239264233107, 17010.234539445722, 17151.056691881942, 15810.920945395257, 16433.83566164338, 16909.99999999997, 17026.574335641617, 17037.233324500397, 4927.384076990385, 5137.434882162959, 5150.072986862363, 5151.201563757605, 5153.072446959546, 3620.094976255936, 5089.567386772129, 5698.544116470694, 5958.761649534035, 5996.700164991755, 5912.054071348585, 5937.524998000171, 5960.195373624549, 5980.491658209035, 5984.251968503937, 5868.325142608612, 5924.614900031505, 5938.851528711773, 5950.434708702666, 5971.044632858743, 5051.621128415383, 5107.442230119812, 5202.115640341151, 5230.21546767984, 5254.133068043769, 20109.39671809848, 20250.886201258923, 20479.795202048088, 20546.07542660584, 20550.486237844172, 1877.0, 2027.4829918370722, 2165.339571430713, 2373.537160253734, 2424.709034915804, 12828.615141545768, 12999.610011699664, 13410.731785364238, 13531.255780932142, 13663.248521331323, 1696.414736915762, 1736.4703765351562, 1741.703910335246, 1746.6070134219826, 1771.3148721631214, 64596.0, 64754.3524564753, 65005.02492462664, 65604.3439565603, 65613.3438665612, 8925.33060020501, 8970.147835955573, 9168.541572921327, 9174.724758257264, 9265.72202833916, 12325.322107284186, 12378.566750163702, 12383.442745076492, 12403.193792403465, 12428.192167509083, 6754.628495432798, 6911.03245545624, 6960.164780226405, 7092.787216383516, 7115.0, 6627.138471998609, 6708.127943367429, 6836.623985680835, 6918.377346038881, 6921.411680007155, 5636.85907852307, 5685.857853553694, 5742.310922689304, 5816.185733997244, 5922.466977972003, 1528.8776897848145, 1621.6675581505763, 1631.9836801632068, 1691.2558474271282, 1746.0658547676933, 786.1548835002395, 826.7271800306005, 855.6534603485599, 865.8701194820827, 880.9471431714118, 16278.75581866273, 16607.252673629715, 16692.72267964989, 17100.572485687957, 17374.218160182823, 793.6944276453492, 827.462149602751, 861.3755027604936, 881.9955900220586, 889.7108439757105, 10072.546735396778, 10093.646722364829, 10101.393916365041, 10115.797684046278, 10172.542235599416, 368728.2508699622, 371595.0, 373970.0, 378096.0, 379010.0, 66855.66572167107, 67239.32760672428, 67521.32478675249, 67673.3232667667, 69867.65066174636, 881.8368601808686, 883.7172104926361, 892.0900681305033, 900.8378491871526, 902.2240872849344, 14908.105513668781, 15171.62070948191, 16007.519774406786, 16093.839061609235, 16148.67702645964, 33144.00567982964, 41560.376594351714, 41646.0, 41671.16657666769, 43272.0, 46537.534624654676, 47426.52573474221, 47475.0, 53507.11421743683, 53674.19488707751, 10866.728331791768, 11041.33751974884, 11129.499172537093, 11288.717782055513, 11324.150688698215, 11666.125040621817, 11924.403779811148, 12128.818067729168, 12586.685332866386, 12970.286634235208, 10636.41499717523, 10860.185486088732, 11099.44502774842, 11162.162837787037, 11598.768024639628, 10271.537780800032, 10296.691099267035, 10422.583096676048, 10808.297460665031, 10968.0, 10944.179186560881, 11407.771844563229, 11422.0, 11470.08239340834, 11597.5360985563, 11104.167187460811, 11132.888671113185, 11285.21003529778, 11507.539698411969, 11780.941095294811, 10480.63317783874, 10879.782404352027, 11177.441127943734, 11361.37512436824, 11726.237794543327], "value": 8531.544343881782, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1340.390122494265, 1358.062936573764, 1419.90770599911, 1585.8255591884897, 1639.4589785370829, 6732.09116769236, 7183.568985860846, 7293.854122917539, 7694.5767982761, 7701.306882380592, 7390.334869861711, 7665.655045522951, 7676.309132178103, 7683.462157648967, 7685.0, 2142.635751922173, 2179.901904414305, 2183.4432219783935, 2184.2246002669062, 2184.5849288635186, 2121.7559980602273, 2152.4511249631323, 2178.444496653351, 2183.170395249803, 2186.3440967709703, 2128.5317230209407, 2142.4001279641648, 2153.9569208615817, 2154.569086182762, 2167.3281282802304, 2115.4076858479575, 2123.055240418015, 2124.107874692633, 2126.6491028980354, 2128.2019242783954, 2091.7699053104147, 2142.7535833379206, 2143.9035243414082, 2147.3450597567735, 2149.4626343414147, 7451.7019319227165, 7600.6959721611065, 7614.847703045908, 7628.61856907158, 7633.618319084024, 4556.225441674923, 4687.367205427257, 4697.553732395417, 4700.717956922562, 4702.412198475191, 2861.2703760541135, 2937.2363185571903, 2939.206414268157, 2986.670397090273, 3006.9548956765666, 919.7056941778634, 945.8864936207699, 947.1191791633778, 976.0483528559597, 981.8919918808925, 10362.585496580128, 10376.896231037668, 10387.220958428148, 10389.27275090744, 10411.271211015232, 3928.4500169976227, 4127.2570937231585, 4159.9376009359885, 4289.742615443083, 4294.377315289328, 8905.332100092519, 8930.0, 8930.86603700945, 8934.776630584287, 8952.194302512806, 4585.70192937458, 4595.080983803253, 4598.172328980816, 4604.102200071021, 4612.008418190038, 3641.10792855752, 4032.737872038308, 4172.061286210639, 4188.790560472025, 4197.076643138505, 3526.682598566141, 3562.6259242779133, 3606.6753992140834, 3659.1035196376524, 3659.505966694462, 1166.6966588686832, 1178.9233699809486, 1184.8874356936078, 1188.8989435897872, 1190.0360707826687, 788.247223901173, 819.4141189049858, 822.6503735912333, 828.5360198288978, 845.1886189258381, 4952.4304704959395, 4958.801647934042, 4988.575971042429, 5051.3433253676785, 5109.948900511022, 388.5803332401, 861.2980420957025, 903.1014140929685, 912.5619702542816, 914.5244472874068, 3400.846961886721, 3433.1931995980926, 3470.132466883279, 3501.28223714138, 3549.6450354964295, 9029.954850225708, 9412.0, 9419.623215071457, 9420.670276540288, 9423.293253006052, 9270.953645231866, 9293.488858112869, 9317.580708868118, 9384.0, 9395.530223488799, 6894.276101009422, 6911.412529935012, 6927.861442771116, 6949.861002780017, 6984.2317345092, 4918.803247870188, 4921.188003979303, 4975.9004819902675, 5031.295618613324, 5049.368828896388, 8299.419040667095, 8321.334293256647, 8357.498550087013, 8368.832623347376, 8476.957615211884, 8433.704820331259, 8564.05795362522, 8576.614052367533, 8653.134686531548, 8659.177378149066, 5747.36778954323, 6011.458968692838, 6191.566590338633, 6222.12890195364, 6388.329225431448, 7395.778126656209, 7438.070241219848, 7493.0, 7496.437767167376, 7505.399568034435, 6560.901586476111, 6631.966840165768, 6652.833679157866, 6734.56225345351, 6784.830379240559, 6299.937000629935, 6595.109660196004, 6683.565568238049, 6721.899171512529, 6803.149606299213, 6004.0, 6063.696815159313, 6074.3318234994995, 6074.483668888194, 6076.696165191811, 4429.8892527685775, 4432.711873728197, 4474.015716542355, 4495.707778994355, 4513.300438432048, 4355.4337936068105, 4400.053988392511, 4418.690691651554, 4446.355278484666, 4473.46318441789], "value": 4040.640776927181, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [292.3553564390519, 296.32733694513456, 298.82369402052785, 299.79164480685904, 305.0725793587493, 5081.0, 5106.719130447828, 5115.309433226514, 5117.59059275258, 5144.922826157611, 4987.0, 4992.7547094388665, 5039.974800126003, 5049.2678561608545, 5060.3421555197865, 3647.762895411803, 3817.5800661927165, 3897.123147291865, 3914.5498267699154, 3939.940900886489, 3931.2530619182407, 3933.822977965984, 3936.5669776324726, 3941.1920556286036, 3943.8759953413282, 3913.3738601823716, 3918.1771827916173, 3919.9216015679667, 3924.921501569967, 3934.2328245992044, 3822.694184465236, 3888.863889763845, 3897.3179693553516, 3925.2149570085953, 3928.1750832325247, 3430.9142271443166, 3446.7247118566042, 3450.1719587298867, 3452.8950735764565, 3456.7580269381156, 4897.706137631718, 4897.951020489785, 4931.309616653635, 4942.108866313211, 4942.456329803718, 4329.9134017319475, 4516.23224051912, 4521.208788462039, 4525.411696479437, 4546.386237857913, 5214.191800270964, 5261.815836445706, 5272.103742363807, 5273.419923808378, 5314.787408503656, 3774.5093137892172, 3775.7923314217705, 3782.2435512897255, 3791.0, 3807.9809600952094, 5443.537299329561, 5547.55619550439, 5562.193481945135, 5566.693831839248, 5584.664920104807, 3777.131259810259, 3800.676942459922, 3803.733738638324, 3806.638369354907, 3827.4258861171047, 3854.7879866607045, 3870.548544295889, 3870.903227419337, 3871.593482684334, 3872.477215575861, 4447.977760111244, 4448.866534003985, 4451.6199978006925, 4458.019235768126, 4470.463544374696, 5023.598112151019, 5271.367435907716, 5324.41431442541, 5337.893242135136, 5338.279332290169, 1302.550620036086, 1324.6622111361735, 1325.4764368074557, 1325.7746183148888, 1327.6083555351195, 768.2739810878778, 814.1329484099533, 816.5264146794844, 823.6375994562374, 823.7026682974339, 4490.416245888014, 4573.627911626499, 4713.717176969393, 4714.858554243309, 4720.268358404453, 5443.455654434604, 5477.260569823103, 5491.341039075336, 5491.395946445888, 5513.173024046425, 4670.80894371933, 4674.649401294916, 4688.655672163918, 4692.389989301369, 4721.7403042832975, 2770.0, 2940.7206315400003, 2940.911772646824, 2945.4403663303906, 2964.170032390934, 5179.741012949337, 5182.896342073137, 5190.844274671766, 5199.922001169985, 5213.139831927765, 5381.219723140122, 5637.7181140942785, 5656.660600363992, 5674.148877668383, 5692.203091567184, 5190.662606930613, 5195.7270468735405, 5197.324347834758, 5199.232261031268, 5211.2443695663915, 5559.33288005442, 5562.944370556243, 5566.192902029264, 5572.944270557405, 5577.386487486292, 5266.1574148136115, 5430.51125398716, 5454.372747133972, 5456.181572763959, 5466.453354664502, 5175.792968281226, 5178.741062946913, 5200.0, 5201.76592053366, 5202.271681964452, 3841.193349396546, 3860.517435320585, 3861.7103717221885, 3871.438641397038, 3880.8059597019474, 5313.840584782462, 5447.12845944647, 5468.9179662304305, 5488.38092762628, 5533.6403133796175, 5314.4951229633125, 5314.867128321668, 5342.569131045288, 5343.919841202307, 5357.0, 5366.114591092426, 5376.6827127354045, 5380.219868119023, 5391.406945236099, 5403.919216156863, 5027.245913113063, 5287.154055351125, 5310.8141215057285, 5322.722546588869, 5323.311727577703, 5143.3284182640045, 5205.843824685266, 5316.920246196233, 5389.784408623611, 5444.5916556259235, 5205.219217117463, 5223.582113430993, 5249.501297376743, 5251.632385732962, 5260.526552610283], "value": 3981.833627935437, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [633.8922383194858, 725.2493669052528, 736.1975446763031, 738.1769327200171, 740.6629983357573, 11682.941585292072, 12755.489780408772, 12767.36163191839, 12796.168249063805, 12816.487340506368, 12452.813207801868, 13043.739125217513, 13155.07914445989, 13180.0, 13217.933910330436, 730.7040648537351, 748.2480107491963, 749.4753672429295, 749.61394881636, 750.047439751518, 611.6941529235382, 738.5642470942144, 760.0, 764.2624867003341, 767.5471471831618, 805.6737021506299, 808.2200676347323, 808.4583329169441, 809.1827254472995, 811.809224832164, 797.1510341486356, 801.1347744436024, 802.6227672993683, 802.8033131882697, 803.325206826263, 577.8959787238296, 578.2453897663547, 580.8431723434692, 585.4789237578558, 587.4654064801053, 12745.36273186337, 12747.0, 12766.17019893704, 12782.87217127826, 12792.680182995406, 13042.86957130426, 13091.214527128403, 13159.342032898317, 13513.932430337785, 13763.449462021506, 10708.51811668469, 10708.839367409495, 10720.142388608892, 10907.236493445462, 10923.563057477691, 3258.5763850699495, 3275.19757659375, 3291.637919828817, 3310.453775127101, 3315.751318651111, 65944.6702766483, 66082.3391766081, 66247.0062949061, 66929.33070669329, 67183.66408167928, 10508.789824203473, 10528.0, 10654.360738355723, 10669.19981001428, 10758.677239682822, 20096.0, 20174.798252017586, 20224.797752022292, 20271.898640506704, 20404.795952040586, 6494.740210391531, 6678.666066696645, 6738.090357801732, 6953.235144134142, 6991.440684745208, 3796.8101594920145, 3841.673457756066, 3912.1002169500607, 3935.7244992850224, 3944.7633142011573, 2787.6515435570554, 2912.504874171396, 2913.21343237329, 2918.430905973315, 2922.327864591156, 539.7355295904978, 558.5057224356393, 562.7973929385417, 577.266871073734, 578.7771707892492, 428.55216298967656, 482.4970712626358, 491.19934506753765, 519.7790938850973, 531.8271561742372, 7060.117485314336, 7219.711211551584, 7814.3748500119855, 8412.915870841336, 8548.0, 473.7844280852204, 495.07421122501154, 527.5225920541916, 528.5296086483033, 546.4371697151939, 3935.0, 3962.187751510933, 4016.5180178378196, 4057.9391309130388, 4138.193052354822, 57448.71275643595, 58610.413895860496, 58646.70676646675, 59926.0, 104493.0, 89677.55161224282, 91830.54084729534, 92294.0, 92321.0, 92871.5356423227, 44492.77753611276, 48712.75643621759, 55560.72219638876, 70627.0, 77708.61145694235, 7668.961655191688, 7907.525548467111, 7969.242921922408, 8029.357651387992, 8206.507609543447, 30173.09480715582, 33677.49483757795, 38458.23083538258, 38664.22671546497, 42661.57338426576, 59390.0, 59586.40413595809, 59690.40309596848, 59840.70079649574, 62953.37046629475, 10693.09108725767, 10701.839472408075, 10779.622713205, 11123.888761112285, 11185.888141118485, 11467.254628449124, 12008.879911201126, 12201.51193952232, 12522.499100035897, 12824.358782060674, 11726.589569365031, 11908.583199587973, 11918.463669134737, 12044.939775301067, 12211.0, 10716.839247411139, 11127.666170014912, 11231.101511879193, 11755.47100380502, 12051.879481205076, 9574.569144388659, 10298.588056477656, 10593.788124237626, 11311.038561722346, 11313.0, 9393.769002254125, 9770.85343719859, 9898.257630677585, 10011.449370284705, 10053.547590358305, 9500.382475139093, 9703.854442183232, 10360.792784144425, 10427.165826733692, 10685.679429617125], "value": 6369.199241277714, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1598.1, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 116.0, 114.0, 119.0, 115.0, 116.0, 118.0, 117.0, 118.0, 135.0], "value": 117.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 126.0, 146.0, 189.0, 124.0, 154.0, 157.0, 130.0, 192.0, 130.0], "value": 151.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [169.0, 171.0, 164.0, 163.0, 163.0, 164.0, 163.0, 164.0, 163.0, 163.0], "value": 164.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 77.0, 78.0, 179.0, 78.0, 79.0, 76.0, 78.0, 162.0, 78.0], "value": 96.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 134.0, 85.0, 85.0, 84.0, 130.0, 93.0, 85.0, 135.0], "value": 99.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [121.0, 120.0, 118.0, 118.0, 118.0, 118.0, 118.0, 117.0, 118.0, 120.0], "value": 118.6, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 149.0, 149.0, 150.0, 150.0, 150.0, 149.0, 150.0, 148.0, 150.0], "value": 149.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [97.0, 97.0, 97.0, 96.0, 96.0, 95.0, 98.0, 97.0, 95.0, 96.0], "value": 96.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 68.0, 65.0, 68.0, 69.0, 66.0, 67.0, 70.0, 66.0, 67.0], "value": 67.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 66.0, 66.0, 67.0, 65.0, 65.0, 66.0, 66.0, 70.0, 65.0], "value": 66.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 83.0, 85.0, 86.0, 85.0, 87.0, 88.0, 82.0, 86.0, 91.0], "value": 85.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [139.0, 133.0, 140.0, 137.0, 139.0, 135.0, 139.0, 138.0, 168.0, 142.0], "value": 141.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [175.0, 174.0, 175.0, 174.0, 170.0, 172.0, 174.0, 174.0, 176.0, 171.0], "value": 173.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 73.0, 71.0, 70.0, 70.0, 69.0, 70.0, 70.0, 68.0, 73.0], "value": 70.6, "unit": "score"}]}]} 22:53:29 INFO - Return code: 0 22:53:29 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 22:53:29 ERROR - # TBPL SUCCESS # 22:53:29 INFO - Running post-action listener: _resource_record_post_action 22:53:29 INFO - [mozharness: 2016-08-30 05:53:29.798223Z] Finished run-tests step (success) 22:53:29 INFO - Running post-run listener: _resource_record_post_run 22:53:29 INFO - Total resource usage - Wall time: 1201s; CPU: 13.0%; Read bytes: 0; Write bytes: 405692416; Read time: 0; Write time: 267720 22:53:29 INFO - TinderboxPrint: CPU usage
13.4% 22:53:29 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 22:53:29 INFO - TinderboxPrint: I/O write bytes / time
405,692,416 / 267,720 22:53:29 INFO - TinderboxPrint: CPU idle
8,294.1 (86.6%) 22:53:29 INFO - TinderboxPrint: CPU user
1,221.3 (12.8%) 22:53:29 INFO - TinderboxPrint: Swap in / out
0 / 0 22:53:29 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 113598464; Read time: 0; Write time: 73700 22:53:29 INFO - run-tests - Wall time: 1185s; CPU: 13.0%; Read bytes: 0; Write bytes: 292093952; Read time: 0; Write time: 194020 22:53:30 INFO - Running post-run listener: _upload_blobber_files 22:53:30 INFO - Blob upload gear active. 22:53:30 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 22:53:30 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 22:53:30 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Autoland-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 22:53:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Autoland-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 22:53:30 INFO - (blobuploader) - INFO - Open directory for files ... 22:53:30 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 22:53:30 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 22:53:30 INFO - (blobuploader) - INFO - Uploading, attempt #1. 22:53:31 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 22:53:31 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 22:53:31 INFO - (blobuploader) - INFO - Done attempting. 22:53:31 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 22:53:31 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 22:53:31 INFO - (blobuploader) - INFO - Uploading, attempt #1. 22:53:36 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 22:53:36 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 22:53:36 INFO - (blobuploader) - INFO - Done attempting. 22:53:36 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 22:53:36 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 22:53:36 INFO - (blobuploader) - INFO - Uploading, attempt #1. 22:53:37 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 22:53:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 22:53:37 INFO - (blobuploader) - INFO - Done attempting. 22:53:37 INFO - (blobuploader) - INFO - Iteration through files over. 22:53:37 INFO - Return code: 0 22:53:37 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 22:53:37 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 22:53:37 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/67d83605fb155f00b19f8211a482497dd8b738787a14ca8ea11a88c55994ff741c1c1c0c863885565826f35ba00c3f35897a67cc5bfcb10dec8189fdd3236354", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/e67bf65800a3bb32f1f809041a0eb39c87e637cc5d5b1058bb83bace49c418dc3bb585846f6dff9c84811ac2fa6eb0f7be13c06d1de54e8fc5234f34db0c7dc0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/dd08ba7d896232e567963868ee254fc658285b696a54e9e466c485c7d2fb7fe7049018d891b39a55e3b90dada7c3ff35354996bf60f1a6c063b1abe460f97db3"} 22:53:37 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 22:53:37 INFO - Writing to file /builds/slave/test/properties/blobber_files 22:53:37 INFO - Contents: 22:53:37 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/67d83605fb155f00b19f8211a482497dd8b738787a14ca8ea11a88c55994ff741c1c1c0c863885565826f35ba00c3f35897a67cc5bfcb10dec8189fdd3236354", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/e67bf65800a3bb32f1f809041a0eb39c87e637cc5d5b1058bb83bace49c418dc3bb585846f6dff9c84811ac2fa6eb0f7be13c06d1de54e8fc5234f34db0c7dc0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/dd08ba7d896232e567963868ee254fc658285b696a54e9e466c485c7d2fb7fe7049018d891b39a55e3b90dada7c3ff35354996bf60f1a6c063b1abe460f97db3"} 22:53:37 INFO - Running post-run listener: copy_logs_to_upload_dir 22:53:37 INFO - Copying logs to upload dir... 22:53:37 INFO - mkdir: /builds/slave/test/build/upload/logs 22:53:37 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1245.406272 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 45 secs) (at 2016-08-29 22:53:37.200786) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-29 22:53:37.206513) ========= 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=41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033 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/67d83605fb155f00b19f8211a482497dd8b738787a14ca8ea11a88c55994ff741c1c1c0c863885565826f35ba00c3f35897a67cc5bfcb10dec8189fdd3236354", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/e67bf65800a3bb32f1f809041a0eb39c87e637cc5d5b1058bb83bace49c418dc3bb585846f6dff9c84811ac2fa6eb0f7be13c06d1de54e8fc5234f34db0c7dc0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/dd08ba7d896232e567963868ee254fc658285b696a54e9e466c485c7d2fb7fe7049018d891b39a55e3b90dada7c3ff35354996bf60f1a6c063b1abe460f97db3"} build_url:https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011290 build_url: 'https://queue.taskcluster.net/v1/task/FEnUjWZ3SUuxjMvvql5dOg/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/67d83605fb155f00b19f8211a482497dd8b738787a14ca8ea11a88c55994ff741c1c1c0c863885565826f35ba00c3f35897a67cc5bfcb10dec8189fdd3236354", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/e67bf65800a3bb32f1f809041a0eb39c87e637cc5d5b1058bb83bace49c418dc3bb585846f6dff9c84811ac2fa6eb0f7be13c06d1de54e8fc5234f34db0c7dc0", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/dd08ba7d896232e567963868ee254fc658285b696a54e9e466c485c7d2fb7fe7049018d891b39a55e3b90dada7c3ff35354996bf60f1a6c063b1abe460f97db3"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-29 22:53:37.236083) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-29 22:53:37.236848) ========= 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=41a7e32711b8e08598a63237000001d6-1472534838.259770-70587033 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004394 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-29 22:53:37.318978) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-29 22:53:37.319365) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-29 22:53:37.319725) ========= ========= Total master_lag: 0.18 =========