builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-036 starttime: 1472609855.38 results: success (0) buildid: 20160830175220 builduid: eb06c4610377437ca3d674f629fca409 revision: 506facea63169a29e04eb140663da1730052db64 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-30 19:17:35.378425) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-30 19:17:35.378971) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-30 19:17:35.379315) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-30 19:17:35.394289) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-30 19:17:35.394634) ========= 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=14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-08-30 19:17:35-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.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% 219M=0s 2016-08-30 19:17:35 (219 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.140427 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-30 19:17:35.550314) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-30 19:17:35.550751) ========= 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=14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015264 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-30 19:17:35.601330) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-30 19:17:35.601769) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 506facea63169a29e04eb140663da1730052db64 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 506facea63169a29e04eb140663da1730052db64 --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=14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-08-30 19:17:35,887 truncating revision to first 12 chars 2016-08-30 19:17:35,887 Setting DEBUG logging. 2016-08-30 19:17:35,887 attempt 1/10 2016-08-30 19:17:35,888 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/506facea6316?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-30 19:17:36,654 unpacking tar archive at: mozilla-central-506facea6316/testing/mozharness/ program finished with exit code 0 elapsedTime=1.138432 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-30 19:17:36.754149) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-30 19:17:36.754477) ========= script_repo_revision: 506facea63169a29e04eb140663da1730052db64 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-30 19:17:36.754866) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-30 19:17:36.755157) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-30 19:17:36.763437) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 45 secs) (at 2016-08-30 19:17:36.763724) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-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', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-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=14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 19:17:37 INFO - MultiFileLogger online at 20160830 19:17:37 in /builds/slave/test 19:17:37 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 19:17:37 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 19:17:37 INFO - {'append_to_log': False, 19:17:37 INFO - 'base_work_dir': '/builds/slave/test', 19:17:37 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 19:17:37 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 19:17:37 INFO - 'branch': 'Firefox-Non-PGO', 19:17:37 INFO - 'buildbot_json_path': 'buildprops.json', 19:17:37 INFO - 'config_files': ('talos/linux_config.py',), 19:17:37 INFO - 'default_actions': ('clobber', 19:17:37 INFO - 'read-buildbot-config', 19:17:37 INFO - 'download-and-extract', 19:17:37 INFO - 'populate-webroot', 19:17:37 INFO - 'create-virtualenv', 19:17:37 INFO - 'install', 19:17:37 INFO - 'run-tests'), 19:17:37 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 19:17:37 INFO - 'download_minidump_stackwalk': True, 19:17:37 INFO - 'download_symbols': 'ondemand', 19:17:37 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 19:17:37 INFO - 'tooltool.py': '/tools/tooltool.py', 19:17:37 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 19:17:37 INFO - '/tools/misc-python/virtualenv.py')}, 19:17:37 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 19:17:37 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 19:17:37 INFO - 'installer_path': 'installer.exe', 19:17:37 INFO - 'log_level': 'info', 19:17:37 INFO - 'log_name': 'talos', 19:17:37 INFO - 'log_to_console': True, 19:17:37 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 19:17:37 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 19:17:37 INFO - 'opt_config_files': (), 19:17:37 INFO - 'pip_index': False, 19:17:37 INFO - 'sps_profile': False, 19:17:37 INFO - 'sps_profile_interval': 0, 19:17:37 INFO - 'suite': 'dromaeojs-e10s', 19:17:37 INFO - 'system_bits': '32', 19:17:37 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 19:17:37 INFO - 'title': 'talos-linux64-ix-036', 19:17:37 INFO - 'tooltool_cache': '/builds/tooltool_cache', 19:17:37 INFO - 'use_talos_json': True, 19:17:37 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 19:17:37 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 19:17:37 INFO - 'work_dir': 'build'} 19:17:37 INFO - [mozharness: 2016-08-31 02:17:37.138869Z] Running clobber step. 19:17:37 INFO - Running pre-action listener: _resource_record_pre_action 19:17:37 INFO - Running main action method: clobber 19:17:37 INFO - rmtree: /builds/slave/test/build 19:17:37 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 19:17:37 INFO - Running post-action listener: _resource_record_post_action 19:17:37 INFO - [mozharness: 2016-08-31 02:17:37.598534Z] Finished clobber step (success) 19:17:37 INFO - [mozharness: 2016-08-31 02:17:37.598637Z] Running read-buildbot-config step. 19:17:37 INFO - Running pre-action listener: _resource_record_pre_action 19:17:37 INFO - Running main action method: read_buildbot_config 19:17:37 INFO - Using buildbot properties: 19:17:37 INFO - { 19:17:37 INFO - "project": "", 19:17:37 INFO - "product": "firefox", 19:17:37 INFO - "script_repo_revision": "production", 19:17:37 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 19:17:37 INFO - "repository": "", 19:17:37 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-e10s", 19:17:37 INFO - "buildid": "20160830175220", 19:17:37 INFO - "pgo_build": "False", 19:17:37 INFO - "basedir": "/builds/slave/test", 19:17:37 INFO - "buildnumber": 429, 19:17:37 INFO - "slavename": "talos-linux64-ix-036", 19:17:37 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 19:17:37 INFO - "platform": "ubuntu64_hw", 19:17:37 INFO - "scheduler": "tests-mozilla-central-linux64-talos", 19:17:37 INFO - "branch": "mozilla-central", 19:17:37 INFO - "repo_path": "mozilla-central", 19:17:37 INFO - "revision": "506facea63169a29e04eb140663da1730052db64", 19:17:37 INFO - "stage_platform": "linux64", 19:17:37 INFO - "builduid": "eb06c4610377437ca3d674f629fca409", 19:17:37 INFO - "slavebuilddir": "test" 19:17:37 INFO - } 19:17:37 INFO - Found installer url https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 19:17:37 INFO - Running post-action listener: _resource_record_post_action 19:17:37 INFO - [mozharness: 2016-08-31 02:17:37.601086Z] Finished read-buildbot-config step (success) 19:17:37 INFO - [mozharness: 2016-08-31 02:17:37.601177Z] Running download-and-extract step. 19:17:37 INFO - Running pre-action listener: _resource_record_pre_action 19:17:37 INFO - Running main action method: download_and_extract 19:17:37 INFO - mkdir: /builds/slave/test/build/tests 19:17:37 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')]} 19:17:37 INFO - trying https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 19:17:37 INFO - Downloading https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/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 19:17:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/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 19:17:38 INFO - Downloaded 1361 bytes. 19:17:38 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 19:17:38 INFO - Using the following test package requirements: 19:17:38 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 19:17:38 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 19:17:38 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 19:17:38 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 19:17:38 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 19:17:38 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 19:17:38 INFO - u'jsshell-linux-x86_64.zip'], 19:17:38 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 19:17:38 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 19:17:38 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 19:17:38 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 19:17:38 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 19:17:38 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 19:17:38 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 19:17:38 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 19:17:38 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 19:17:38 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 19:17:38 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 19:17:38 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 19:17:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:17:38 INFO - trying https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 19:17:38 INFO - Downloading https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/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 19:17:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/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 19:17:39 INFO - Downloaded 20325883 bytes. 19:17:39 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 19:17:43 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 19:17:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:17:43 INFO - trying https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 19:17:43 INFO - Downloading https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/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 19:17:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/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 19:17:44 INFO - Downloaded 20325883 bytes. 19:17:44 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 19:17:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:17:48 INFO - trying https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 19:17:48 INFO - Downloading https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/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 19:17:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/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 19:17:49 INFO - Downloaded 14413998 bytes. 19:17:49 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 19:17:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:17:49 INFO - trying https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 19:17:49 INFO - Downloading https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/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 19:17:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/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 19:17:50 INFO - Downloaded 55860290 bytes. 19:17:50 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 19:17:50 INFO - mkdir: /builds/slave/test/properties 19:17:50 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 19:17:50 INFO - Writing to file /builds/slave/test/properties/build_url 19:17:50 INFO - Contents: 19:17:50 INFO - build_url:https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 19:17:51 INFO - Running post-action listener: _resource_record_post_action 19:17:51 INFO - Running post-action listener: set_extra_try_arguments 19:17:51 INFO - [mozharness: 2016-08-31 02:17:51.453153Z] Finished download-and-extract step (success) 19:17:51 INFO - [mozharness: 2016-08-31 02:17:51.453382Z] Running populate-webroot step. 19:17:51 INFO - Running pre-action listener: _resource_record_pre_action 19:17:51 INFO - Running main action method: populate_webroot 19:17:51 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 19:17:51 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 19:17:51 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 19:17:51 INFO - '--tppagecycles', 19:17:51 INFO - '7'], 19:17:51 INFO - 'tests': ['tsvgm']}}, 19:17:51 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 19:17:51 INFO - 'tests': ['tresize', 'tcanvasmark']}, 19:17:51 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 19:17:51 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 19:17:51 INFO - 'tests': ['dromaeo_css', 'kraken']}, 19:17:51 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 19:17:51 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:17:51 INFO - 'talos_options': ['--disable-e10s'], 19:17:51 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:17:51 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:17:51 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:17:51 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:17:51 INFO - 'talos_options': ['--disable-e10s'], 19:17:51 INFO - 'tests': ['damp', 'tps']}, 19:17:51 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:17:51 INFO - 'tests': ['damp', 'tps']}, 19:17:51 INFO - 'g3': {'talos_options': ['--disable-e10s'], 19:17:51 INFO - 'tests': ['dromaeo_dom']}, 19:17:51 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 19:17:51 INFO - 'g4': {'talos_options': ['--disable-e10s'], 19:17:51 INFO - 'tests': ['basic_compositor_video']}, 19:17:51 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 19:17:51 INFO - 'other': {'talos_options': ['--disable-e10s'], 19:17:51 INFO - 'tests': ['a11yr', 19:17:51 INFO - 'ts_paint', 19:17:51 INFO - 'tpaint', 19:17:51 INFO - 'sessionrestore', 19:17:51 INFO - 'sessionrestore_no_auto_restore', 19:17:51 INFO - 'tabpaint']}, 19:17:51 INFO - 'other-e10s': {'tests': ['a11yr', 19:17:51 INFO - 'ts_paint', 19:17:51 INFO - 'tpaint', 19:17:51 INFO - 'sessionrestore', 19:17:51 INFO - 'sessionrestore_no_auto_restore', 19:17:51 INFO - 'tabpaint']}, 19:17:51 INFO - 'other-e10s_l64': {'tests': ['a11yr', 19:17:51 INFO - 'ts_paint', 19:17:51 INFO - 'tpaint', 19:17:51 INFO - 'sessionrestore', 19:17:51 INFO - 'sessionrestore_no_auto_restore', 19:17:51 INFO - 'tabpaint']}, 19:17:51 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 19:17:51 INFO - 'ts_paint', 19:17:51 INFO - 'tpaint', 19:17:51 INFO - 'sessionrestore', 19:17:51 INFO - 'sessionrestore_no_auto_restore', 19:17:51 INFO - 'tabpaint']}, 19:17:51 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 19:17:51 INFO - 'tests': ['a11yr', 19:17:51 INFO - 'ts_paint', 19:17:51 INFO - 'tpaint', 19:17:51 INFO - 'sessionrestore', 19:17:51 INFO - 'sessionrestore_no_auto_restore', 19:17:51 INFO - 'tabpaint']}, 19:17:51 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 19:17:51 INFO - 'tests': ['a11yr', 19:17:51 INFO - 'ts_paint', 19:17:51 INFO - 'tpaint', 19:17:51 INFO - 'sessionrestore', 19:17:51 INFO - 'sessionrestore_no_auto_restore', 19:17:51 INFO - 'tabpaint']}, 19:17:51 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 19:17:51 INFO - 'tests': ['tsvgx', 19:17:51 INFO - 'tsvgr_opacity', 19:17:51 INFO - 'tart', 19:17:51 INFO - 'tscrollx', 19:17:51 INFO - 'cart']}, 19:17:51 INFO - 'svgr-e10s': {'tests': ['tsvgx', 19:17:51 INFO - 'tsvgr_opacity', 19:17:51 INFO - 'tart', 19:17:51 INFO - 'tscrollx', 19:17:51 INFO - 'cart']}, 19:17:51 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:17:51 INFO - 'talos_options': ['--disable-e10s'], 19:17:51 INFO - 'tests': ['tp5o']}, 19:17:51 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:17:51 INFO - 'tests': ['tp5o']}, 19:17:51 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:17:51 INFO - 'talos_options': ['--disable-e10s', 19:17:51 INFO - '--xperf_path', 19:17:51 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:17:51 INFO - 'tests': ['tp5n']}, 19:17:51 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:17:51 INFO - 'talos_options': ['--xperf_path', 19:17:51 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:17:51 INFO - 'tests': ['tp5n']}}, 19:17:51 INFO - 'talos.zip': {'path': '', 19:17:51 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 19:17:51 INFO - Running post-action listener: _resource_record_post_action 19:17:51 INFO - [mozharness: 2016-08-31 02:17:51.474024Z] Finished populate-webroot step (success) 19:17:51 INFO - [mozharness: 2016-08-31 02:17:51.474113Z] Running create-virtualenv step. 19:17:51 INFO - Running pre-action listener: _resource_record_pre_action 19:17:51 INFO - Running main action method: create_virtualenv 19:17:51 INFO - Creating virtualenv /builds/slave/test/build/venv 19:17:51 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 19:17:51 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 19:17:51 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 19:17:51 INFO - Using real prefix '/usr' 19:17:51 INFO - New python executable in /builds/slave/test/build/venv/bin/python 19:17:52 INFO - Installing distribute.............................................................................................................................................................................................done. 19:17:54 INFO - Installing pip.................done. 19:17:54 INFO - Return code: 0 19:17:54 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 19:17:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:17:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:17:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:17:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:17:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:17:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:17:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff497a4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1afd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcc230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bc6090>, '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 0x1bc99b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bc9e40>, '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': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', '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 19:17:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 19:17:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 19:17:54 INFO - Using env: {'DISPLAY': ':0', 19:17:54 INFO - 'HOME': '/home/cltbld', 19:17:54 INFO - 'LANG': 'en_US.UTF-8', 19:17:54 INFO - 'LANGUAGE': 'en_US:en', 19:17:54 INFO - 'LOGNAME': 'cltbld', 19:17:54 INFO - 'MAIL': '/var/mail/cltbld', 19:17:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:17:54 INFO - 'MOZ_NO_REMOTE': '1', 19:17:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:17:54 INFO - 'NO_EM_RESTART': '1', 19:17:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:17:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:17:54 INFO - 'PWD': '/builds/slave/test', 19:17:54 INFO - 'SHELL': '/bin/bash', 19:17:54 INFO - 'SHLVL': '1', 19:17:54 INFO - 'TERM': 'linux', 19:17:54 INFO - 'TMOUT': '86400', 19:17:54 INFO - 'USER': 'cltbld', 19:17:54 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', 19:17:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:17:54 INFO - '_': '/tools/buildbot/bin/python'} 19:17:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:17:54 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 19:17:54 INFO - Cleaning up... 19:17:54 INFO - Return code: 0 19:17:54 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 19:17:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:17:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:17:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:17:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:17:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:17:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:17:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7ff497a4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1afd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcc230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bc6090>, '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 0x1bc99b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bc9e40>, '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': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', '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 19:17:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 19:17:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 19:17:54 INFO - Using env: {'DISPLAY': ':0', 19:17:54 INFO - 'HOME': '/home/cltbld', 19:17:54 INFO - 'LANG': 'en_US.UTF-8', 19:17:54 INFO - 'LANGUAGE': 'en_US:en', 19:17:54 INFO - 'LOGNAME': 'cltbld', 19:17:54 INFO - 'MAIL': '/var/mail/cltbld', 19:17:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:17:54 INFO - 'MOZ_NO_REMOTE': '1', 19:17:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:17:54 INFO - 'NO_EM_RESTART': '1', 19:17:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:17:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:17:54 INFO - 'PWD': '/builds/slave/test', 19:17:54 INFO - 'SHELL': '/bin/bash', 19:17:54 INFO - 'SHLVL': '1', 19:17:54 INFO - 'TERM': 'linux', 19:17:54 INFO - 'TMOUT': '86400', 19:17:54 INFO - 'USER': 'cltbld', 19:17:54 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', 19:17:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:17:54 INFO - '_': '/tools/buildbot/bin/python'} 19:17:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:17:54 INFO - Downloading/unpacking psutil>=3.1.1 19:17:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:17:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:17:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:17:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:17:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:17:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:17:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 19:17:56 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:17:56 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:17:56 INFO - Installing collected packages: psutil 19:17:56 INFO - Running setup.py install for psutil 19:17:56 INFO - building 'psutil._psutil_linux' extension 19:17:56 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 19:17:56 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 19:17:56 INFO - building 'psutil._psutil_posix' extension 19:17:56 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 19:17:56 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 19:17:56 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:17:56 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:17:57 INFO - Successfully installed psutil 19:17:57 INFO - Cleaning up... 19:17:57 INFO - Return code: 0 19:17:57 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 19:17:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:17:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:17:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:17:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:17:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:17:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:17:57 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff497a4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1afd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcc230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bc6090>, '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 0x1bc99b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bc9e40>, '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': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', '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 19:17:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 19:17:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 19:17:57 INFO - Using env: {'DISPLAY': ':0', 19:17:57 INFO - 'HOME': '/home/cltbld', 19:17:57 INFO - 'LANG': 'en_US.UTF-8', 19:17:57 INFO - 'LANGUAGE': 'en_US:en', 19:17:57 INFO - 'LOGNAME': 'cltbld', 19:17:57 INFO - 'MAIL': '/var/mail/cltbld', 19:17:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:17:57 INFO - 'MOZ_NO_REMOTE': '1', 19:17:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:17:57 INFO - 'NO_EM_RESTART': '1', 19:17:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:17:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:17:57 INFO - 'PWD': '/builds/slave/test', 19:17:57 INFO - 'SHELL': '/bin/bash', 19:17:57 INFO - 'SHLVL': '1', 19:17:57 INFO - 'TERM': 'linux', 19:17:57 INFO - 'TMOUT': '86400', 19:17:57 INFO - 'USER': 'cltbld', 19:17:57 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', 19:17:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:17:57 INFO - '_': '/tools/buildbot/bin/python'} 19:17:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:17:57 INFO - Downloading/unpacking mozsystemmonitor==0.3 19:17:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:17:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:17:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:17:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:17:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:17:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:17:59 INFO - Downloading mozsystemmonitor-0.3.tar.gz 19:17:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 19:17:59 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 19:17:59 INFO - Installing collected packages: mozsystemmonitor 19:17:59 INFO - Running setup.py install for mozsystemmonitor 19:17:59 INFO - Successfully installed mozsystemmonitor 19:17:59 INFO - Cleaning up... 19:17:59 INFO - Return code: 0 19:17:59 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 19:17:59 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')]} 19:17:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:17:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:17:59 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')]} 19:17:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:17:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:17:59 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 0x7ff497a4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1afd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcc230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bc6090>, '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 0x1bc99b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bc9e40>, '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': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', '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 19:17:59 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 19:17:59 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 19:17:59 INFO - Using env: {'DISPLAY': ':0', 19:17:59 INFO - 'HOME': '/home/cltbld', 19:17:59 INFO - 'LANG': 'en_US.UTF-8', 19:17:59 INFO - 'LANGUAGE': 'en_US:en', 19:17:59 INFO - 'LOGNAME': 'cltbld', 19:17:59 INFO - 'MAIL': '/var/mail/cltbld', 19:17:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:17:59 INFO - 'MOZ_NO_REMOTE': '1', 19:17:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:17:59 INFO - 'NO_EM_RESTART': '1', 19:17:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:17:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:17:59 INFO - 'PWD': '/builds/slave/test', 19:17:59 INFO - 'SHELL': '/bin/bash', 19:17:59 INFO - 'SHLVL': '1', 19:17:59 INFO - 'TERM': 'linux', 19:17:59 INFO - 'TMOUT': '86400', 19:17:59 INFO - 'USER': 'cltbld', 19:17:59 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', 19:17:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:17:59 INFO - '_': '/tools/buildbot/bin/python'} 19:17:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:17:59 INFO - Downloading/unpacking jsonschema==2.5.1 19:17:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:17:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:17:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:17:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:17:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:17:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:01 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 19:18:01 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 19:18:01 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 19:18:01 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 19:18:01 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 19:18:01 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 19:18:01 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 19:18:01 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 19:18:01 INFO - Downloading functools32-3.2.3-2.tar.gz 19:18:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 19:18:01 INFO - warning: no files found matching '*.txt' 19:18:01 INFO - no previously-included directories found matching 'build' 19:18:01 INFO - no previously-included directories found matching 'dist' 19:18:01 INFO - no previously-included directories found matching '.git*' 19:18:01 INFO - Installing collected packages: jsonschema, functools32 19:18:01 INFO - Running setup.py install for functools32 19:18:01 INFO - warning: no files found matching '*.txt' 19:18:01 INFO - no previously-included directories found matching 'build' 19:18:01 INFO - no previously-included directories found matching 'dist' 19:18:01 INFO - no previously-included directories found matching '.git*' 19:18:01 INFO - Successfully installed jsonschema functools32 19:18:01 INFO - Cleaning up... 19:18:01 INFO - Return code: 0 19:18:01 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 19:18:01 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')]} 19:18:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:18:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:01 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')]} 19:18:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:18:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:01 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 0x7ff497a4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1afd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcc230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bc6090>, '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 0x1bc99b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bc9e40>, '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': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', '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 19:18:01 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 19:18:01 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 19:18:01 INFO - Using env: {'DISPLAY': ':0', 19:18:01 INFO - 'HOME': '/home/cltbld', 19:18:01 INFO - 'LANG': 'en_US.UTF-8', 19:18:01 INFO - 'LANGUAGE': 'en_US:en', 19:18:01 INFO - 'LOGNAME': 'cltbld', 19:18:01 INFO - 'MAIL': '/var/mail/cltbld', 19:18:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:18:01 INFO - 'MOZ_NO_REMOTE': '1', 19:18:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:18:01 INFO - 'NO_EM_RESTART': '1', 19:18:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:18:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:18:01 INFO - 'PWD': '/builds/slave/test', 19:18:01 INFO - 'SHELL': '/bin/bash', 19:18:01 INFO - 'SHLVL': '1', 19:18:01 INFO - 'TERM': 'linux', 19:18:01 INFO - 'TMOUT': '86400', 19:18:01 INFO - 'USER': 'cltbld', 19:18:01 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', 19:18:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:18:01 INFO - '_': '/tools/buildbot/bin/python'} 19:18:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:18:02 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 19:18:02 INFO - Cleaning up... 19:18:02 INFO - Return code: 0 19:18:02 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 19:18:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:18:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:18:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:18:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:18:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:02 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 0x7ff497a4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1afd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcc230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bc6090>, '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 0x1bc99b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bc9e40>, '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': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', '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 19:18:02 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 19:18:02 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 19:18:02 INFO - Using env: {'DISPLAY': ':0', 19:18:02 INFO - 'HOME': '/home/cltbld', 19:18:02 INFO - 'LANG': 'en_US.UTF-8', 19:18:02 INFO - 'LANGUAGE': 'en_US:en', 19:18:02 INFO - 'LOGNAME': 'cltbld', 19:18:02 INFO - 'MAIL': '/var/mail/cltbld', 19:18:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:18:02 INFO - 'MOZ_NO_REMOTE': '1', 19:18:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:18:02 INFO - 'NO_EM_RESTART': '1', 19:18:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:18:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:18:02 INFO - 'PWD': '/builds/slave/test', 19:18:02 INFO - 'SHELL': '/bin/bash', 19:18:02 INFO - 'SHLVL': '1', 19:18:02 INFO - 'TERM': 'linux', 19:18:02 INFO - 'TMOUT': '86400', 19:18:02 INFO - 'USER': 'cltbld', 19:18:02 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', 19:18:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:18:02 INFO - '_': '/tools/buildbot/bin/python'} 19:18:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:18:02 INFO - Downloading/unpacking blobuploader==1.2.4 19:18:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:18:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:18:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:18:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:18:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:04 INFO - Downloading blobuploader-1.2.4.tar.gz 19:18:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 19:18:04 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 19:18:04 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 19:18:04 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 19:18:04 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 19:18:04 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 19:18:04 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 19:18:04 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 19:18:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 19:18:04 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 19:18:04 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 19:18:04 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 19:18:04 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 19:18:04 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 19:18:04 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 19:18:04 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 19:18:04 INFO - Downloading docopt-0.6.1.tar.gz 19:18:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 19:18:05 INFO - Installing collected packages: blobuploader, requests, docopt 19:18:05 INFO - Running setup.py install for blobuploader 19:18:05 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 19:18:05 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 19:18:05 INFO - Running setup.py install for requests 19:18:05 INFO - Running setup.py install for docopt 19:18:05 INFO - Successfully installed blobuploader requests docopt 19:18:05 INFO - Cleaning up... 19:18:05 INFO - Return code: 0 19:18:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:18:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:18:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:18:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:18:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:18:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:05 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 0x7ff497a4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1afd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcc230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bc6090>, '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 0x1bc99b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bc9e40>, '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': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', '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 19:18:05 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 19:18:05 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 19:18:05 INFO - Using env: {'DISPLAY': ':0', 19:18:05 INFO - 'HOME': '/home/cltbld', 19:18:05 INFO - 'LANG': 'en_US.UTF-8', 19:18:05 INFO - 'LANGUAGE': 'en_US:en', 19:18:05 INFO - 'LOGNAME': 'cltbld', 19:18:05 INFO - 'MAIL': '/var/mail/cltbld', 19:18:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:18:05 INFO - 'MOZ_NO_REMOTE': '1', 19:18:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:18:05 INFO - 'NO_EM_RESTART': '1', 19:18:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:18:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:18:05 INFO - 'PWD': '/builds/slave/test', 19:18:05 INFO - 'SHELL': '/bin/bash', 19:18:05 INFO - 'SHLVL': '1', 19:18:05 INFO - 'TERM': 'linux', 19:18:05 INFO - 'TMOUT': '86400', 19:18:05 INFO - 'USER': 'cltbld', 19:18:05 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', 19:18:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:18:05 INFO - '_': '/tools/buildbot/bin/python'} 19:18:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:18:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 19:18:05 INFO - Running setup.py (path:/tmp/pip-DoZj1f-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 19:18:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 19:18:05 INFO - Running setup.py (path:/tmp/pip-L9YJM0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 19:18:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 19:18:05 INFO - Running setup.py (path:/tmp/pip-RO91pp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 19:18:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 19:18:06 INFO - Running setup.py (path:/tmp/pip-mpWqy3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 19:18:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 19:18:06 INFO - Running setup.py (path:/tmp/pip-SLydWi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 19:18:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 19:18:06 INFO - Running setup.py (path:/tmp/pip-fjHRS1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 19:18:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 19:18:06 INFO - Running setup.py (path:/tmp/pip-IyXV3U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 19:18:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 19:18:06 INFO - Running setup.py (path:/tmp/pip-3UmXaa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 19:18:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 19:18:06 INFO - Running setup.py (path:/tmp/pip-pxPgdY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 19:18:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 19:18:06 INFO - Running setup.py (path:/tmp/pip-gzjIfF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 19:18:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 19:18:06 INFO - Running setup.py (path:/tmp/pip-IL0TYX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 19:18:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 19:18:06 INFO - Running setup.py (path:/tmp/pip-VKz0IP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 19:18:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 19:18:06 INFO - Running setup.py (path:/tmp/pip-2YJBho-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 19:18:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 19:18:06 INFO - Running setup.py (path:/tmp/pip-jXJuLX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 19:18:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 19:18:06 INFO - Running setup.py (path:/tmp/pip-VkH1wL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 19:18:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 19:18:06 INFO - Running setup.py (path:/tmp/pip-jE8i1M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 19:18:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 19:18:06 INFO - Running setup.py (path:/tmp/pip-SqG4iQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 19:18:07 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 19:18:07 INFO - Running setup.py install for manifestparser 19:18:07 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 19:18:07 INFO - Running setup.py install for mozcrash 19:18:07 INFO - Running setup.py install for mozdebug 19:18:07 INFO - Running setup.py install for mozdevice 19:18:07 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 19:18:07 INFO - Installing dm script to /builds/slave/test/build/venv/bin 19:18:07 INFO - Running setup.py install for mozfile 19:18:07 INFO - Running setup.py install for mozhttpd 19:18:07 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 19:18:07 INFO - Running setup.py install for mozinfo 19:18:07 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 19:18:07 INFO - Running setup.py install for mozInstall 19:18:07 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 19:18:07 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 19:18:07 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 19:18:07 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 19:18:07 INFO - Running setup.py install for mozleak 19:18:07 INFO - Running setup.py install for mozlog 19:18:08 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 19:18:08 INFO - Running setup.py install for moznetwork 19:18:08 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 19:18:08 INFO - Running setup.py install for mozprocess 19:18:08 INFO - Running setup.py install for mozprofile 19:18:08 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 19:18:08 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 19:18:08 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 19:18:08 INFO - Running setup.py install for mozrunner 19:18:08 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 19:18:08 INFO - Running setup.py install for mozscreenshot 19:18:08 INFO - Running setup.py install for moztest 19:18:08 INFO - Running setup.py install for mozversion 19:18:08 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 19:18:08 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 19:18:08 INFO - Cleaning up... 19:18:08 INFO - Return code: 0 19:18:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:18:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:18:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:18:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 19:18:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:18:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:08 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 0x7ff497a4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1afd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcc230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bc6090>, '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 0x1bc99b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bc9e40>, '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': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', '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 19:18:08 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 19:18:08 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 19:18:08 INFO - Using env: {'DISPLAY': ':0', 19:18:08 INFO - 'HOME': '/home/cltbld', 19:18:08 INFO - 'LANG': 'en_US.UTF-8', 19:18:08 INFO - 'LANGUAGE': 'en_US:en', 19:18:08 INFO - 'LOGNAME': 'cltbld', 19:18:08 INFO - 'MAIL': '/var/mail/cltbld', 19:18:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:18:08 INFO - 'MOZ_NO_REMOTE': '1', 19:18:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:18:08 INFO - 'NO_EM_RESTART': '1', 19:18:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:18:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:18:08 INFO - 'PWD': '/builds/slave/test', 19:18:08 INFO - 'SHELL': '/bin/bash', 19:18:08 INFO - 'SHLVL': '1', 19:18:08 INFO - 'TERM': 'linux', 19:18:08 INFO - 'TMOUT': '86400', 19:18:08 INFO - 'USER': 'cltbld', 19:18:08 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', 19:18:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:18:08 INFO - '_': '/tools/buildbot/bin/python'} 19:18:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:18:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 19:18:09 INFO - Running setup.py (path:/tmp/pip-jlk9fg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 19:18:09 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)) 19:18:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 19:18:09 INFO - Running setup.py (path:/tmp/pip-SgFzHm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 19:18:09 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)) 19:18:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 19:18:09 INFO - Running setup.py (path:/tmp/pip-CGyrWN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 19:18:09 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)) 19:18:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 19:18:09 INFO - Running setup.py (path:/tmp/pip-aUh40r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 19:18:09 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)) 19:18:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 19:18:09 INFO - Running setup.py (path:/tmp/pip-Z2hm5L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 19:18:09 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)) 19:18:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 19:18:09 INFO - Running setup.py (path:/tmp/pip-iZApkM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 19:18:09 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)) 19:18:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 19:18:09 INFO - Running setup.py (path:/tmp/pip-hnVnsC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 19:18:09 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)) 19:18:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 19:18:09 INFO - Running setup.py (path:/tmp/pip-i8AIxL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 19:18:09 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)) 19:18:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 19:18:09 INFO - Running setup.py (path:/tmp/pip-mwT5mN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 19:18:09 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)) 19:18:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 19:18:09 INFO - Running setup.py (path:/tmp/pip-JfZSCK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 19:18:09 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)) 19:18:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 19:18:09 INFO - Running setup.py (path:/tmp/pip-y08LQk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 19:18:09 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)) 19:18:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 19:18:09 INFO - Running setup.py (path:/tmp/pip-k5NMlh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 19:18:09 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)) 19:18:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 19:18:09 INFO - Running setup.py (path:/tmp/pip-PBVV48-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 19:18:10 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)) 19:18:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 19:18:10 INFO - Running setup.py (path:/tmp/pip-Gag5DB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 19:18:10 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)) 19:18:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 19:18:10 INFO - Running setup.py (path:/tmp/pip-_Stt8d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 19:18:10 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)) 19:18:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 19:18:10 INFO - Running setup.py (path:/tmp/pip-u9nxNE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 19:18:10 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)) 19:18:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 19:18:10 INFO - Running setup.py (path:/tmp/pip-k4o5ld-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 19:18:10 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)) 19:18:10 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)) 19:18:10 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)) 19:18:10 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)) 19:18:10 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)) 19:18:10 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)) 19:18:10 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 19:18:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:18:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:18:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:18:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:18:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:18:12 INFO - Downloading blessings-1.6.tar.gz 19:18:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 19:18:12 INFO - Installing collected packages: blessings 19:18:12 INFO - Running setup.py install for blessings 19:18:12 INFO - Successfully installed blessings 19:18:12 INFO - Cleaning up... 19:18:12 INFO - Return code: 0 19:18:12 INFO - Done creating virtualenv /builds/slave/test/build/venv. 19:18:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 19:18:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 19:18:12 INFO - Reading from file tmpfile_stdout 19:18:12 INFO - Current package versions: 19:18:12 INFO - argparse == 1.2.1 19:18:12 INFO - blessings == 1.6 19:18:12 INFO - blobuploader == 1.2.4 19:18:12 INFO - docopt == 0.6.1 19:18:12 INFO - functools32 == 3.2.3-2 19:18:12 INFO - jsonschema == 2.5.1 19:18:12 INFO - manifestparser == 1.1 19:18:12 INFO - mozInstall == 1.12 19:18:12 INFO - mozcrash == 0.17 19:18:12 INFO - mozdebug == 0.1 19:18:12 INFO - mozdevice == 0.48 19:18:12 INFO - mozfile == 1.2 19:18:12 INFO - mozhttpd == 0.7 19:18:12 INFO - mozinfo == 0.9 19:18:12 INFO - mozleak == 0.1 19:18:12 INFO - mozlog == 3.3 19:18:12 INFO - moznetwork == 0.27 19:18:12 INFO - mozprocess == 0.23 19:18:12 INFO - mozprofile == 0.28 19:18:12 INFO - mozrunner == 6.12 19:18:12 INFO - mozscreenshot == 0.1 19:18:12 INFO - mozsystemmonitor == 0.3 19:18:12 INFO - moztest == 0.7 19:18:12 INFO - mozversion == 1.4 19:18:12 INFO - psutil == 3.1.1 19:18:12 INFO - requests == 1.2.3 19:18:12 INFO - wsgiref == 0.1.2 19:18:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 19:18: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')]} 19:18:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:18:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18: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')]} 19:18:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:18:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18:12 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 0x7ff497a4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1afd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcc230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bc6090>, '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 0x1bc99b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bc9e40>, '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': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', '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 19:18:12 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 19:18:12 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 19:18:12 INFO - Using env: {'DISPLAY': ':0', 19:18:12 INFO - 'HOME': '/home/cltbld', 19:18:12 INFO - 'LANG': 'en_US.UTF-8', 19:18:12 INFO - 'LANGUAGE': 'en_US:en', 19:18:12 INFO - 'LOGNAME': 'cltbld', 19:18:12 INFO - 'MAIL': '/var/mail/cltbld', 19:18:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:18:12 INFO - 'MOZ_NO_REMOTE': '1', 19:18:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:18:12 INFO - 'NO_EM_RESTART': '1', 19:18:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:18:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:18:12 INFO - 'PWD': '/builds/slave/test', 19:18:12 INFO - 'SHELL': '/bin/bash', 19:18:12 INFO - 'SHLVL': '1', 19:18:12 INFO - 'TERM': 'linux', 19:18:12 INFO - 'TMOUT': '86400', 19:18:12 INFO - 'USER': 'cltbld', 19:18:12 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', 19:18:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:18:12 INFO - '_': '/tools/buildbot/bin/python'} 19:18:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:18:12 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)) 19:18:12 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)) 19:18:12 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)) 19:18:12 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)) 19:18:12 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)) 19:18:12 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)) 19:18:12 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)) 19:18:12 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)) 19:18:12 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)) 19:18:12 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)) 19:18:12 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)) 19:18:12 INFO - Cleaning up... 19:18:12 INFO - Return code: 0 19:18:12 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 19:18: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')]} 19:18:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:18:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18: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')]} 19:18:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:18:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:18: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff497a4af10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1afd8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bcc230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bc6090>, '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 0x1bc99b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bc9e40>, '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': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', '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 19:18: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', 'jsonschema'] in /builds/slave/test/build 19:18: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 jsonschema 19:18:12 INFO - Using env: {'DISPLAY': ':0', 19:18:12 INFO - 'HOME': '/home/cltbld', 19:18:12 INFO - 'LANG': 'en_US.UTF-8', 19:18:12 INFO - 'LANGUAGE': 'en_US:en', 19:18:12 INFO - 'LOGNAME': 'cltbld', 19:18:12 INFO - 'MAIL': '/var/mail/cltbld', 19:18:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:18:12 INFO - 'MOZ_NO_REMOTE': '1', 19:18:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:18:12 INFO - 'NO_EM_RESTART': '1', 19:18:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:18:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:18:12 INFO - 'PWD': '/builds/slave/test', 19:18:12 INFO - 'SHELL': '/bin/bash', 19:18:12 INFO - 'SHLVL': '1', 19:18:12 INFO - 'TERM': 'linux', 19:18:12 INFO - 'TMOUT': '86400', 19:18:12 INFO - 'USER': 'cltbld', 19:18:12 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', 19:18:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:18:12 INFO - '_': '/tools/buildbot/bin/python'} 19:18:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:18:13 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 19:18:13 INFO - Cleaning up... 19:18:13 INFO - Return code: 0 19:18:13 INFO - Running post-action listener: _resource_record_post_action 19:18:13 INFO - Running post-action listener: _start_resource_monitoring 19:18:13 INFO - Starting resource monitoring. 19:18:13 INFO - [mozharness: 2016-08-31 02:18:13.150555Z] Finished create-virtualenv step (success) 19:18:13 INFO - [mozharness: 2016-08-31 02:18:13.151066Z] Running install step. 19:18:13 INFO - Running pre-action listener: _resource_record_pre_action 19:18:13 INFO - Running main action method: install 19:18:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 19:18:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 19:18:13 INFO - Reading from file tmpfile_stdout 19:18:13 INFO - Detecting whether we're running mozinstall >=1.0... 19:18:13 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 19:18:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 19:18:13 INFO - Reading from file tmpfile_stdout 19:18:13 INFO - Output received: 19:18:13 INFO - Usage: mozinstall [options] installer 19:18:13 INFO - Options: 19:18:13 INFO - -h, --help show this help message and exit 19:18:13 INFO - -d DEST, --destination=DEST 19:18:13 INFO - Directory to install application into. [default: 19:18:13 INFO - "/builds/slave/test"] 19:18:13 INFO - --app=APP Application being installed. [default: firefox] 19:18:13 INFO - mkdir: /builds/slave/test/build/application 19:18:13 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'] 19:18:13 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 19:18:29 INFO - Reading from file tmpfile_stdout 19:18:29 INFO - Output received: 19:18:29 INFO - /builds/slave/test/build/application/firefox/firefox 19:18:29 INFO - Running post-action listener: _resource_record_post_action 19:18:29 INFO - [mozharness: 2016-08-31 02:18:29.711210Z] Finished install step (success) 19:18:29 INFO - [mozharness: 2016-08-31 02:18:29.711491Z] Running run-tests step. 19:18:29 INFO - Running pre-action listener: _resource_record_pre_action 19:18:29 INFO - Running main action method: run_tests 19:18:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 19:18:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 19:18:29 INFO - Python 2.7.3 19:18:29 INFO - Return code: 0 19:18:29 INFO - grabbing minidump binary from tooltool 19:18:29 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')]} 19:18:29 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 0x1bc6090>, '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 0x1bc99b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bc9e40>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 19:18:29 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 19:18:29 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 19:18:29 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 19:18:29 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 19:18:29 INFO - Return code: 0 19:18:29 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 19:18:29 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 19:18:29 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 19:18:29 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 19:18:29 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 19:18:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-036', '--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 19:18:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-036 --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 19:18:29 INFO - Using env: {'DISPLAY': ':0', 19:18:29 INFO - 'HOME': '/home/cltbld', 19:18:29 INFO - 'LANG': 'en_US.UTF-8', 19:18:29 INFO - 'LANGUAGE': 'en_US:en', 19:18:29 INFO - 'LOGNAME': 'cltbld', 19:18:29 INFO - 'MAIL': '/var/mail/cltbld', 19:18:29 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 19:18:29 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 19:18:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:18:29 INFO - 'MOZ_NO_REMOTE': '1', 19:18:29 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 19:18:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:18:29 INFO - 'NO_EM_RESTART': '1', 19:18:29 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:18:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 19:18:29 INFO - 'PWD': '/builds/slave/test', 19:18:29 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 19:18:29 INFO - 'SHELL': '/bin/bash', 19:18:29 INFO - 'SHLVL': '1', 19:18:29 INFO - 'TERM': 'linux', 19:18:29 INFO - 'TMOUT': '86400', 19:18:29 INFO - 'USER': 'cltbld', 19:18:29 INFO - 'XDG_SESSION_COOKIE': '14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978', 19:18:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:18:29 INFO - '_': '/tools/buildbot/bin/python'} 19:18:29 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-036', '--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 19:18:29 INFO - mozversion application_buildid: 20160830175220 19:18:29 INFO - mozversion application_changeset: 506facea63169a29e04eb140663da1730052db64 19:18:29 INFO - mozversion application_display_name: Nightly 19:18:29 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 19:18:29 INFO - mozversion application_name: Firefox 19:18:29 INFO - mozversion application_remotingname: firefox 19:18:29 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 19:18:29 INFO - mozversion application_vendor: Mozilla 19:18:29 INFO - mozversion application_version: 51.0a1 19:18:29 INFO - mozversion platform_buildid: 20160830175220 19:18:29 INFO - mozversion platform_changeset: 506facea63169a29e04eb140663da1730052db64 19:18:29 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 19:18:29 INFO - mozversion platform_version: 51.0a1 19:18:29 INFO - using testdate: 1472609909 19:18:29 INFO - actual date: 1472609909 19:18:29 INFO - starting webserver on 'localhost:37945' 19:18:29 INFO - SUITE-START | Running 2 tests 19:18:29 INFO - TEST-START | dromaeo_css 19:18:29 INFO - operating with platform_type : linux_ 19:18:29 INFO - Initialising browser for dromaeo_css test... 19:18:29 INFO - TEST-INFO | started process 3993 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpEym4YO/profile http://localhost:37945/getInfo.html) 19:18:35 INFO - PROCESS | 3993 | __metrics Screen width/height:1600/1200 19:18:35 INFO - PROCESS | 3993 | colorDepth:24 19:18:35 INFO - PROCESS | 3993 | Browser inner width/height: 1024/697 19:18:35 INFO - PROCESS | 3993 | __metrics 19:18:35 ERROR - PROCESS | 3993 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2991: TypeError: this.tabs is undefined 19:18:36 INFO - TEST-INFO | 3993: exit 0 19:18:36 INFO - Browser initialized. 19:18:36 INFO - Running cycle 1/1 for dromaeo_css test... 19:18:36 INFO - TEST-INFO | started process 4112 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpEym4YO/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 19:18:49 INFO - PROCESS | 4112 | RSS: Main: 192864256 19:18:49 INFO - PROCESS | 4112 | 19:19:38 INFO - PROCESS | 4112 | 1472609978825 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] 19:21:51 INFO - PROCESS | 4112 | Cycle 1(1): loaded http://localhost:37945/tests/dromaeo/cssquery-dojo.html (next: http://localhost:37945/tests/dromaeo/cssquery-ext.html) 19:21:52 INFO - PROCESS | 4112 | RSS: Main: 212557824 19:21:52 INFO - PROCESS | 4112 | 19:24:55 INFO - PROCESS | 4112 | Cycle 1(1): loaded http://localhost:37945/tests/dromaeo/cssquery-ext.html (next: http://localhost:37945/tests/dromaeo/cssquery-jquery.html) 19:24:55 INFO - PROCESS | 4112 | RSS: Main: 206897152 19:24:55 INFO - PROCESS | 4112 | 19:27:57 INFO - PROCESS | 4112 | Cycle 1(1): loaded http://localhost:37945/tests/dromaeo/cssquery-jquery.html (next: http://localhost:37945/tests/dromaeo/cssquery-mootools.html) 19:27:58 INFO - PROCESS | 4112 | RSS: Main: 203079680 19:27:58 INFO - PROCESS | 4112 | 19:31:00 INFO - PROCESS | 4112 | Cycle 1(1): loaded http://localhost:37945/tests/dromaeo/cssquery-mootools.html (next: http://localhost:37945/tests/dromaeo/cssquery-prototype.html) 19:31:01 INFO - PROCESS | 4112 | RSS: Main: 196739072 19:31:01 INFO - PROCESS | 4112 | 19:34:03 INFO - PROCESS | 4112 | Cycle 1(1): loaded http://localhost:37945/tests/dromaeo/cssquery-prototype.html (next: http://localhost:37945/tests/dromaeo/cssquery-yui.html) 19:34:04 INFO - PROCESS | 4112 | RSS: Main: 198668288 19:34:04 INFO - PROCESS | 4112 | 19:37:07 INFO - PROCESS | 4112 | Cycle 1(1): loaded http://localhost:37945/tests/dromaeo/cssquery-yui.html (next: http://localhost:37945/tests/dromaeo/cssquery-dojo.html) 19:37:07 INFO - PROCESS | 4112 | RSS: Main: 198148096 19:37:07 INFO - PROCESS | 4112 | 19:37:07 INFO - PROCESS | 4112 | __start_tp_report 19:37:07 INFO - PROCESS | 4112 | _x_x_mozilla_page_load 19:37:07 INFO - PROCESS | 4112 | _x_x_mozilla_page_load_details 19:37:07 INFO - PROCESS | 4112 | |i|pagename|runs| 19:37:07 INFO - PROCESS | 4112 | |0;dojo.html;2604.7525485078913;2610.9869450652745;2630.842149471032;2633.5917932720436;2657.295816608599;4619.6304295656355;4716.726483849363;4726.149293127236;4727.858164255078;4807.254875494304;4710.293455981605;4738.431388233417;4770.212914869043;4781.617470602352;4783.928241076378;4303.569643035703;4362.389265502832;4389.582989615981;4423.336499525065;4480.6639502037315;4382.145481631083;4418.447694038246;4435.9556404436025;4446.288593824988;4490.528494508062;4250.319948808206;4307.6769242306955;4342.804573794187;4360.258756011485;4396.978015109904;4347.739135651871;4368.956310436887;4389.956100438987;4400.845970391053;4422.358757980107;4302.612764851147;4308.504521979981;4331.133773245364;4334.761588112652;4372.584604462571;4616.3537104805355;4749.09767144245;4772.809087636525;4791.7124972501415;4804.25534042224;5102.923456148161;5104.05574968632;5116.846494605168;5137.12668846297;5147.588192944556;5136.922946155811;5154.252633368178;5156;5161.225816127573;5221.373435187764;4600.148972440109;4621.95378046222;4711.670183087151;4767.070421267854;4768.117898188846;5151.407588127413;5166.9224961625605;5182.170852663556;5243.030039442715;5269.394019687708;4927.285543596158;4970.751462426864;4976.4525902150735;4984.470046540192;5042.899142017139;4866.099771542276;5056.317397151338;5067.265246539231;5083.771230294646;5104.872378190575;5072.239164125411;5092.719900405439;5106.310648062464;5139.7687104080405;5153.0466863630345;4988.401391833003;5038.042771873333;5049.040682270357;5078.5937125029905;5146.794128234828;4185.372194170838;4201.495820501498;4288.4210631564965;4321.956780432219;4365.236083685342;3767.5102236709054;3768.605615922126;3797;3813.103920578662;3827.6937844972335;4334.978325108417;4381.605655491021;4404.119176164716;4407.977960110179;4408.691391602557;4962.702237865739;4974.228994505857;5038.294638750578;5093.9490605094215;5131.5638170755155;4355.629771469397;4392.363107349481;4413.624841888475;4435.556444355603;4451.243288640874;4619.630429565626;4624.838130665411;4629.051044535862;4635.188841952645;4684.2271025281125;4817.373741413594;4818.253170758538;4823.734694591831;4826.444958829779;4877.292792545061;4959.132151873336;4961.900761984813;5018.673786203885;5028.446870844277;5063.063333283354;4670.252759558454;4693.319468677091;4731.976340118277;4735.195016847213;4801.063792560417;5064.772085256099;5082.491750824888;5082.796688132581;5088.440271570198;5133.076046311699;4900.215965445512;5033.597312215087;5067.163917953497;5075.87310317245;5120.052790233819;4942.950570494393;4953.653244272867;4956.231784073474;4956.430010548833;4991.401031876198;4762.380890484214;4891.168501354707;4901.411830580353;4939.061578300255;4942.752862356796;4819.783109759999;4855.732934688484;4892.535209155125;4922.335484709519;4941.085899108676;4974.9751251243515;4985.675931064469;4995;5000.524950129732;5054.848354549369;4753.429588449409;4814.7833347498745;4816.710997340171;4880.658353915192;4954.702717836942 19:37:07 INFO - PROCESS | 4112 | |1;ext.html;536.4287034308461;545.3183520599251;558.7122631844601;559.4517372974485;589.7257775134567;35421.46867796982;39118.99999999993;39134.08659134085;39182.21635567291;39195.02012449686;39172.412413813814;39422.40866387007;39788.40846366149;39883.80058099713;39886.20227595446;7599.430042746789;7701.922980770205;7757.224277572254;7773.611319434006;7776.961115194416;7595.430342724318;7657.578833164173;7665.271799179069;7673.731419400322;7678.808029799272;7691.307782299592;7699.615019249043;7706.190849960757;7716.922830771705;7725.536467811921;7612.04849393823;7663.578503182351;7675.347595454393;7675.961620191919;7677.078750549914;7321.487495875291;7436.107667079931;7453;7458.4033277337685;7465.664045117983;36369;36616.084597885;36629.267414651826;36682;36683.08292292687;2731.685856126551;2732.453509298148;2742.8628568571494;2749.5325794614764;2771.5426954552477;27931.58102628462;28251.57622635662;28264.858675706695;28637.57043644347;28677;3339;3371.393149233137;3382.8646854125805;3485.873617093571;3494.0566047167376;255248;256477;256531;258227;258519;51609;51654.48345516572;51818.74090629523;51852.481475184766;51928.74035629873;28680.426391472054;29290.267743306587;56057.43942560604;56180.71909640425;56294.71852640711;13611.863881361258;14066;14068.788968165485;14071.71856562863;14104.506342278177;10481.161507079416;10614.89385106139;10618.469076546142;10625.203109766644;10656.413897235727;17685.381011664787;17740.379086731904;17791.73312400315;17801.910990444965;17841.821581784276;6487.902681459782;6525.151730275129;6560.803175904635;6683.164604424447;6908.965455172793;742.4988133010196;824.6289169873581;943.9716808495756;976.3507267666922;998.7902540466583;25846.741532584434;27570;28015.579766303523;28186;28215.15354539326;832.6003518311123;836.4145098431122;893.8346405914926;913.5660561233361;917.2570218123208;13653.317334133253;14680.55958321252;14757.926210369094;14985.100893946397;15036.699266014619;119909.40045299717;121148;121207;121217;122011;48515.75742121267;48609.812558434955;48680;49036;49156.50843491591;1130.1185075641013;1149.316156886651;1154.1747650429816;1163.069544364505;1167.9124065694937;25506.74493255044;26380;27380.589291161046;27503.724962750915;27538.586921195798;41367;41543;41759.582404176785;41783.1643367137;41793.79103104465;316501;318124;318739;319131;319494;24585.508289834463;24926.37684057913;24968.500629987662;24980.500389992463;24991;39922.600773991886;40363.36729694224;40465.39301910532;40503.392449113875;41543.169136616496;34616.30767384689;35043.64956350404;35422.291554169286;35522.11194720153;35914;34621.826890865384;34770.304593908484;34828.65171348254;35040;35612.46581301335;34001.40209917184;34305.656943430244;34925.47611785876;35073.47389789104;35252;29667.703322966496;32328.83835580807;32584;32601.67398326081;32669;25020.249392518253;25070.37324066913;25380.11169609055;25691.614625780254;25877.48245035051 19:37:07 INFO - PROCESS | 4112 | |2;jquery.html;342.2590092449846;349.62066158218335;351.60620105481865;356.7057177828289;369.50855362368054;15353.15557644329;15705.214739263049;16785.748213776773;16841.41055063073;17017.234224459884;13922.373493192805;14117.223552704623;14610;14649.707005859877;14664;5542.334919809628;5667.319921609413;5680.573956953224;5802.361740208595;5806.622569532988;5569.66582005079;5573.804916827912;5595.664260144405;5596.188552659862;5597.692126933017;5559.972200139014;5672.149177623369;5721.113227449731;5726.3987281335485;5730.05454100073;5593.077142271521;5684.403137670547;5723.2559767230205;5726.828195154152;5735.541156707453;5360.705161216131;5518.33779946405;5531.834044978657;5535.169724541311;5544.972275138599;22849.200277990356;23113.0754769809;23240.767592324028;23800.04799808023;23868.64197037046;1857.322077441724;1936.7772706138692;1954.4332143678316;2016.0222292188278;2505.8872350744077;14165.362558684781;14373.568792936228;14795;15158.621034474116;15447.845521544754;1878.1078987480973;1906.8283854453166;1917.9520511987173;1943.5626983928644;1997.8401727861735;67313.66343168302;75688.62155689186;79852;79862.60068699677;81966.18033819646;16065.759013614805;16456.341746330014;16478.42325518601;16832.69770022439;17145;28655.426891462055;28667.713322866504;28725.56911646327;28763.712362876104;28966.42067158687;8217.917820821835;8369.623366948503;8484.575771211415;8689.56552172389;8740.956295218482;6920.411764999931;6933.237343892168;7000.824979375557;7212.71149154028;7284.635768211569;8175.550344731097;8193.918060819435;8261.256486916207;8450.915490845136;8452.661893524313;3081.1372815611217;3098.9724984904146;3171.337105642986;3199.920001999922;3281.868725251011;341.1845688803761;341.27994905675615;342.5495473452402;353.94513850353235;716.2050124361954;9792.461414622121;9884.159846412991;9933.900660993297;10093.39816401904;10118.443485608363;370.1745108408265;375.249500998004;380.1124374585374;384.92301539692176;390.51966081719075;5274.340707411574;5285.365756109291;5403;5468.179773033997;5513.61404701675;315967;316194;319270;342042;346326;47943.28085078727;79984.20015799884;80006.19993799987;81073.18926810774;81754.18245817584;372.12736133766276;384.1625256939898;384.6826368246152;385.6798856948726;387.73633928928035;8834.233153369223;8966.955165224132;9016.639334426549;9044.683436079706;9451.763705907408;33538;34724.82637586796;37622.62377376191;38163.80918095392;38480;47175.76412117918;49823;49961.25058124059;50008;52453;6998.650067496503;7002.124734408199;7232.132144142736;7448.664810083667;7638.197989211053;8102.068262149693;10636.41499717523;11150.163737719866;11498.425078745862;11523.308601483937;10123.443210623487;10264.794704106025;10329.690109296733;10372.273940824372;10629.521671524646;10076.84884726715;10159.644412445528;10249.282550221711;10378.584856605652;10442.112420444348;9923.40459572428;9933.503324833584;10290.536925838205;10469.790604187721;10712.19658525598;6405.19935008124;6550.213974323112;6586.637734924625;7177.892331615134;7694.653740581575;9427.292953028413;10221.9488902555;10265.729265967506;10317;10574.312669676754 19:37:07 INFO - PROCESS | 4112 | |3;mootools.html;1313.0808434096132;1375.2985977151652;1430.678097428079;1612.137506434058;1650;6481.870362592746;7018.859622807548;7149.285071492861;7584.203658615842;7599.354054905333;7347.742829000986;7565.167831538526;7585.7344992925255;7587.734429294962;7589.165191828894;2123.9681404778903;2144.2173606633546;2156.439325775294;2158.104386679534;2161.1787520742096;2083.6666133418657;2122.7664956854733;2135.1032566322106;2156.493224092337;2156.5255643758346;2079.656856618656;2121.140937920145;2124.1715730864976;2130.0734180631475;2135.957280854382;2072.0882811562865;2075.7716651168357;2076.49125964139;2079.5736873940805;2082.2607974169255;2045.7136000959877;2086.9373918782308;2093.3510611710417;2096.1615353858424;2097.318371529244;7420.369268612175;7573.469857110004;7576.545407275581;7579.1662917079075;7582;4269.573042695705;4378.759168245745;4385.890352741175;4389.582989615981;4392.1874453226255;2618.947621047568;2734.3847634282324;2778.472090302836;2784.3456787655086;2788.8187267827525;854.133054949227;894.7181637784078;911.8221946720392;928.6331898899964;937.704623043739;9882.65410710629;9904.603815847357;9906.108450239513;9932.751681207956;9939.304248702521;3695.316366472211;3798.8290526926353;3892.591277915835;3963.960360396417;3966.900827479336;8449.23956843887;8491.660333586711;8511.148885111439;8513.95743021281;8549.658013679507;4371.672124590668;4412.757298348557;4415;4430;4439.622632076245;3499.492573576817;3821.636944490269;3934.252492026506;4039.3335099708806;4041.636252737209;3429.451287793941;3475.565554305712;3486.4944583035826;3538.7345949053924;3584.444411116281;1069.5133714160038;1085.978280434387;1088.1294964028746;1089.2865173311493;1096.6052221200362;691.6852831961445;707.8124297061283;731.5574077682925;738.6860584251672;748.9737859174903;4696.694714843524;4790.640701947368;4933.062718083553;4948.777305021283;4967.602591792648;385.5700893503723;392.0355924425887;392.42117876132477;398.07646260674954;398.2493000693713;3339.766216364831;3340.799552026886;3362.8486718097743;3388.8136152511356;3455.568053993251;8335.49987000782;8500.10748871372;8597.871031934526;8630.180132887366;8637.0499245083;8539.146085391536;8583;8587.527685977206;8592.3555733319;8607.741767746978;6703.564268322543;6747.59514429126;6760.594364338155;6769.120014398097;6782.966085169543;4582.19811532987;4758.381410416624;4837.298591704112;4896.314515967696;4985.252212168204;8024.157463466252;8358.373122015752;8392.874106888523;8399.41204115706;8410.243078122998;8373.246407823324;8376.32989360862;8449.662013519635;8465.322774178174;8479.745607631781;5664.830055098354;6120.846978825565;6334.936650633619;6365.586236894587;6478.5141114415665;6948.965255173894;6999.160100787734;7004;7060.7881763547175;7083.220845707071;6081.969590152021;6098.542609304409;6202.131701561695;6217.658028808459;6331.96834015827;6153.753849845956;6160.691965401622;6166.229221347332;6171.783987560414;6193.194884664965;5790.9286781945475;5802;5806.332271788799;5813.360530341574;5844.211031510692;4221.556736542619;4227.704060715843;4236.08924081324;4340.197063543254;4353.259945809284;4332.6317263033;4411.4926783420315;4421.734695918255;4461.665375096816;4580.519045500175 19:37:07 INFO - PROCESS | 4112 | |4;prototype.html;272.3490856852124;274.9175247425772;279.34354267471446;284.5532513953095;285.3138202622693;4830.541098595637;4887;4976.552110310071;4981.501849815012;5003.924941125882;4938.691246819596;4967.130752118383;5008.49915008499;5017.824376146836;5028.522290382417;3882.8835134945925;3926.8429262829454;3931.0368959604793;3939.172773717523;3955.624215699504;3798.8480460781534;3847.5190601174854;3930.9386465654256;3940.6059394060653;3951.5455722591983;3793.867214647488;3815.7328986970924;3819.8663046793367;3834.3098242316373;3836.769793812366;3833.639058134364;3878.351700527279;3908.472356231901;3912.5304963404287;3930.862419815321;3379.239671074013;3400.710939570115;3443.070370999841;3445.4831775233665;3449.862005519776;4636.211843986531;4916.606671466274;4935.6545041847085;4948.331975183376;4985.5513003829465;4350.869473915787;4366.868993930188;4367.323064924942;4369.4756629204385;4370.8033138508845;5246.8688282792855;5271.341082364705;5272.31459910213;5289.100852855024;5295.947040529584;3410.1645096951156;3574.8391322390294;3623.6376362363553;3627.8730244441317;3642.3990041643096;5481.972590137064;5485.945140548583;5504.532114770249;5507.669539827583;5515.4760297771645;3707.8146092695256;3718.535183102112;3719.367707489733;3720.8325625346924;3724.42271447926;3735.3377746902365;3757.680597149218;3765.4163604641326;3773.2642134783455;3773.547174339042;4155.168966206771;4298.882290604465;4325.589069038437;4337.566243375637;4348.543402942709;5256;5264.6051546134195;5266.578673706094;5300.224424817729;5316.83648229303;1218.2873019283818;1262.267884626914;1281.2760790153534;1284.640300715801;1285.9099863009499;830.7839961609905;844.5439462690201;868.3096937934357;871.5685735560938;871.8997315308694;4590.495045544987;4618.35343051973;4620.330052142421;4630.259158534618;4633.235516139866;5382.439092663084;5391.353037635509;5398.406175320712;5399.919001214985;5415.404305526389;4477.686561940698;4604.194266003503;4620.468646105741;4628.375169352094;4641.141388843075;2452.6321051842365;2470.666460027909;2489.6224105978745;2519.9748002520105;2521.2562294123277;4440.57901471526;4456.997175635456;4477.462704475483;4491.8427855025575;4492.820287188541;4725.5510726480925;4821.63837712173;4827.758612069452;4828.299896514985;4845.63657725672;4690.9765451172525;5072.239164125411;5097.8725531861255;5097.974510127426;5107.131787596192;5409.675419474844;5414.511009472427;5433.103537916358;5447.754851031634;5464.672119672832;5200.2719619252575;5299.9470005301;5355.678659280456;5368.409474957673;5392.622516423813;5095.87260318495;5112.9744351278005;5124.5131712487255;5127.897442051213;5129.8717532062;3703.7037037036434;3743.513343265358;3743.943840842444;3747.512823332949;3759.2481503698823;5369.597280203922;5497.340319161726;5533.6126471148245;5537.363203231519;5545.500904918576;5288.920666189933;5299.549538289289;5304.893902122013;5325.547328477122;5367.597430192829;5247.638562646901;5260.763265653131;5269.604779641466;5276.419593844751;5307.150855863043;5019.372578427697;5191.896162076813;5213.165893457029;5256.89486210266;5268.4731526848545;5327.467253274642;5344.866378340573;5364.356277246756;5373.811916582901;5390.086519285597;5243.134882744457;5255.343082114736;5258.710770907637;5269.78920843162;5273.868153296198 19:37:07 INFO - PROCESS | 4112 | |5;yui.html;565.6436445039625;574.5776854012298;586.560079940045;631.6134446270651;649.4285029174329;12834.80747788784;12874.613761587167;13436.932815335935;13493.19040857548;14013.999999999975;12981.74036519269;12984;13023.15349502284;13082.345882705851;13085.34573271335;734.9926500734991;746.0376114811913;746.4550877859166;746.675196289613;747.7495039161887;610.9419605137505;725.785893161516;747.1930315259534;761.2919984414492;761.3870833978644;783.6042798386807;785.8742601183811;786.7128498098182;787.3622365883652;787.6927998080724;775.4455564271517;775.5540564175593;775.8176828445311;778.2451022508158;779.2091027606983;566.8582854286428;571.9113537401668;572.1732097119664;572.6936089192304;572.9799457019026;12739.490420383174;12764.936175319064;12801.167924084904;12807.295598742065;12807.487700491969;12949.287789171593;13289.933550332187;13535.864641353657;13555.796663050061;13835.79246311306;9779.168770654504;9923.851142232872;10061.69814905554;10121.443320617363;10151.543180556819;3254.707076363115;3327.96672033279;3331.4336562784383;3357.8321083945707;3375.476801095834;67276;67729.66135169342;68036.6598167011;69092.90874097063;69532;9994;10016.248781341283;10098.596056157818;10263.281570290008;10350.689479315633;19933;20013.899930500254;20032.098555565033;20036.799632003786;20214.494637634176;7071.646417679095;7219.038522763484;7286.198518162998;7381.667824947783;7455.291747283999;3784.829682664287;3863.8840834775;3880.165764360676;3895.182011777502;3914.3541315683165;2769.695333513312;2824.3645179834784;2846.8434236117214;2859.7140285971655;2870.2393865625627;477.58450148370446;483.32817383836493;491.7148054128597;496.63001064207396;502.90193412284253;462.7570525474153;472.54399504478346;474.76024607573646;533.3786139147927;545.9181122831527;7735.071551659594;7749.535027898344;7934.682612695543;7949.165337639581;8229.835403291901;478.72735832693076;490.72028943502573;490.76443307212736;507.7423281915783;514.6448950224333;3756.6565756476757;4019;4027.2750904836826;4051.108756073659;4100.323446631332;87450.56274718586;91317;91340;93896.53051734834;94366.5281673601;80623;81345.18654813376;81455;82374.17625823784;83130;72751.2724872755;73555.26444735484;73670.63164684143;74523.62738186383;77287.22712772913;7102.218755936946;7404.703811847466;7443.925560744323;7508.399328053633;7626.96186519086;42607.786961064994;43286.35070473883;43487;44516.55483445254;44590.77704611456;57729.422705774086;58109.70945145247;63059;63603;64540;9788.412695238309;9794.118529332394;9847.162991145833;9935.652252171429;10068.44623545712;9998.450085245382;10074.244431667508;10117.595296188365;10892.61875834342;10897.073748731129;10126.544305506122;10487;10632.84050739255;10717.839232411365;10728.731781705208;10059.29584929048;10197.13324367437;10268.486575671037;10557.99699028591;10640.361578305326;10047.849282260919;10070.546825393021;10494.055535001886;10500.369977801356;10599.89400105989;7891.289783919475;7994.5602991836;8091.312238459797;8179.345652347917;8318.292945099492;8576.528290943808;8604.182602652738;8775.736727898173;8964.641414343354;9003 19:37:07 INFO - PROCESS | 4112 | __end_tp_report 19:37:07 INFO - PROCESS | 4112 | __start_cc_report 19:37:07 INFO - PROCESS | 4112 | _x_x_mozilla_cycle_collect,368 19:37:07 INFO - PROCESS | 4112 | __end_cc_report 19:37:07 INFO - PROCESS | 4112 | __startTimestamp1472611027611__endTimestamp 19:37:07 INFO - PROCESS | 4112 | 19:37:07 INFO - PROCESS | 4112 | ------- Summary: start ------- 19:37:07 INFO - PROCESS | 4112 | Number of tests: 6 19:37:07 INFO - PROCESS | 4112 | 19:37:07 INFO - PROCESS | 4112 | [#0] dojo.html Cycles:165 Average:4694.43 Median:4814.78 stddev:493.29 (10.2%) stddev-sans-first:466.77 19:37:07 INFO - PROCESS | 4112 | Values: 2604.8 2611.0 2630.8 2633.6 2657.3 4619.6 4716.7 4726.1 4727.9 4807.3 4710.3 4738.4 4770.2 4781.6 4783.9 4303.6 4362.4 4389.6 4423.3 4480.7 4382.1 4418.4 4436.0 4446.3 4490.5 4250.3 4307.7 4342.8 4360.3 4397.0 4347.7 4369.0 4390.0 4400.8 4422.4 4302.6 4308.5 4331.1 4334.8 4372.6 4616.4 4749.1 4772.8 4791.7 4804.3 5102.9 5104.1 5116.8 5137.1 5147.6 5136.9 5154.3 5156.0 5161.2 5221.4 4600.1 4622.0 4711.7 4767.1 4768.1 5151.4 5166.9 5182.2 5243.0 5269.4 4927.3 4970.8 4976.5 4984.5 5042.9 4866.1 5056.3 5067.3 5083.8 5104.9 5072.2 5092.7 5106.3 5139.8 5153.0 4988.4 5038.0 5049.0 5078.6 5146.8 4185.4 4201.5 4288.4 4322.0 4365.2 3767.5 3768.6 3797.0 3813.1 3827.7 4335.0 4381.6 4404.1 4408.0 4408.7 4962.7 4974.2 5038.3 5093.9 5131.6 4355.6 4392.4 4413.6 4435.6 4451.2 4619.6 4624.8 4629.1 4635.2 4684.2 4817.4 4818.3 4823.7 4826.4 4877.3 4959.1 4961.9 5018.7 5028.4 5063.1 4670.3 4693.3 4732.0 4735.2 4801.1 5064.8 5082.5 5082.8 5088.4 5133.1 4900.2 5033.6 5067.2 5075.9 5120.1 4943.0 4953.7 4956.2 4956.4 4991.4 4762.4 4891.2 4901.4 4939.1 4942.8 4819.8 4855.7 4892.5 4922.3 4941.1 4975.0 4985.7 4995.0 5000.5 5054.8 4753.4 4814.8 4816.7 4880.7 4954.7 19:37:07 INFO - PROCESS | 4112 | 19:37:07 INFO - PROCESS | 4112 | [#1] ext.html Cycles:180 Average:39463.50 Median:35058.56 stddev:64845.01 (185.0%) stddev-sans-first:64961.04 19:37:07 INFO - PROCESS | 4112 | Values: 536.4 545.3 558.7 559.5 589.7 35421.5 39119.0 39134.1 39182.2 39195.0 39172.4 39422.4 39788.4 39883.8 39886.2 7599.4 7701.9 7757.2 7773.6 7777.0 7595.4 7657.6 7665.3 7673.7 7678.8 7691.3 7699.6 7706.2 7716.9 7725.5 7612.0 7663.6 7675.3 7676.0 7677.1 7321.5 7436.1 7453.0 7458.4 7465.7 36369.0 36616.1 36629.3 36682.0 36683.1 2731.7 2732.5 2742.9 2749.5 2771.5 27931.6 28251.6 28264.9 28637.6 28677.0 3339.0 3371.4 3382.9 3485.9 3494.1 255248.0 256477.0 256531.0 258227.0 258519.0 51609.0 51654.5 51818.7 51852.5 51928.7 28680.4 29290.3 56057.4 56180.7 56294.7 13611.9 14066.0 14068.8 14071.7 14104.5 10481.2 10614.9 10618.5 10625.2 10656.4 17685.4 17740.4 17791.7 17801.9 17841.8 6487.9 6525.2 6560.8 6683.2 6909.0 742.5 824.6 944.0 976.4 998.8 25846.7 27570.0 28015.6 28186.0 28215.2 832.6 836.4 893.8 913.6 917.3 13653.3 14680.6 14757.9 14985.1 15036.7 119909.4 121148.0 121207.0 121217.0 122011.0 48515.8 48609.8 48680.0 49036.0 49156.5 1130.1 1149.3 1154.2 1163.1 1167.9 25506.7 26380.0 27380.6 27503.7 27538.6 41367.0 41543.0 41759.6 41783.2 41793.8 316501.0 318124.0 318739.0 319131.0 319494.0 24585.5 24926.4 24968.5 24980.5 24991.0 39922.6 40363.4 40465.4 40503.4 41543.2 34616.3 35043.6 35422.3 35522.1 35914.0 34621.8 34770.3 34828.7 35040.0 35612.5 34001.4 34305.7 34925.5 35073.5 35252.0 29667.7 32328.8 32584.0 32601.7 32669.0 25020.2 25070.4 25380.1 25691.6 25877.5 19:37:07 INFO - PROCESS | 4112 | 19:37:07 INFO - PROCESS | 4112 | [#2] jquery.html Cycles:180 Average:23071.83 Median:384.42 stddev:54816.95 (14259.6%) stddev-sans-first:54944.16 19:37:07 INFO - PROCESS | 4112 | Values: 342.3 349.6 351.6 356.7 369.5 15353.2 15705.2 16785.7 16841.4 17017.2 13922.4 14117.2 14610.0 14649.7 14664.0 5542.3 5667.3 5680.6 5802.4 5806.6 5569.7 5573.8 5595.7 5596.2 5597.7 5560.0 5672.1 5721.1 5726.4 5730.1 5593.1 5684.4 5723.3 5726.8 5735.5 5360.7 5518.3 5531.8 5535.2 5545.0 22849.2 23113.1 23240.8 23800.0 23868.6 1857.3 1936.8 1954.4 2016.0 2505.9 14165.4 14373.6 14795.0 15158.6 15447.8 1878.1 1906.8 1918.0 1943.6 1997.8 67313.7 75688.6 79852.0 79862.6 81966.2 16065.8 16456.3 16478.4 16832.7 17145.0 28655.4 28667.7 28725.6 28763.7 28966.4 8217.9 8369.6 8484.6 8689.6 8741.0 6920.4 6933.2 7000.8 7212.7 7284.6 8175.6 8193.9 8261.3 8450.9 8452.7 3081.1 3099.0 3171.3 3199.9 3281.9 341.2 341.3 342.5 353.9 716.2 9792.5 9884.2 9933.9 10093.4 10118.4 370.2 375.2 380.1 384.9 390.5 5274.3 5285.4 5403.0 5468.2 5513.6 315967.0 316194.0 319270.0 342042.0 346326.0 47943.3 79984.2 80006.2 81073.2 81754.2 372.1 384.2 384.7 385.7 387.7 8834.2 8967.0 9016.6 9044.7 9451.8 33538.0 34724.8 37622.6 38163.8 38480.0 47175.8 49823.0 49961.3 50008.0 52453.0 6998.7 7002.1 7232.1 7448.7 7638.2 8102.1 10636.4 11150.2 11498.4 11523.3 10123.4 10264.8 10329.7 10372.3 10629.5 10076.8 10159.6 10249.3 10378.6 10442.1 9923.4 9933.5 10290.5 10469.8 10712.2 6405.2 6550.2 6586.6 7177.9 7694.7 9427.3 10221.9 10265.7 10317.0 10574.3 19:37:07 INFO - PROCESS | 4112 | 19:37:07 INFO - PROCESS | 4112 | [#3] mootools.html Cycles:180 Average:4787.05 Median:4914.69 stddev:2657.68 (54.1%) stddev-sans-first:2652.31 19:37:07 INFO - PROCESS | 4112 | Values: 1313.1 1375.3 1430.7 1612.1 1650.0 6481.9 7018.9 7149.3 7584.2 7599.4 7347.7 7565.2 7585.7 7587.7 7589.2 2124.0 2144.2 2156.4 2158.1 2161.2 2083.7 2122.8 2135.1 2156.5 2156.5 2079.7 2121.1 2124.2 2130.1 2136.0 2072.1 2075.8 2076.5 2079.6 2082.3 2045.7 2086.9 2093.4 2096.2 2097.3 7420.4 7573.5 7576.5 7579.2 7582.0 4269.6 4378.8 4385.9 4389.6 4392.2 2618.9 2734.4 2778.5 2784.3 2788.8 854.1 894.7 911.8 928.6 937.7 9882.7 9904.6 9906.1 9932.8 9939.3 3695.3 3798.8 3892.6 3964.0 3966.9 8449.2 8491.7 8511.1 8514.0 8549.7 4371.7 4412.8 4415.0 4430.0 4439.6 3499.5 3821.6 3934.3 4039.3 4041.6 3429.5 3475.6 3486.5 3538.7 3584.4 1069.5 1086.0 1088.1 1089.3 1096.6 691.7 707.8 731.6 738.7 749.0 4696.7 4790.6 4933.1 4948.8 4967.6 385.6 392.0 392.4 398.1 398.2 3339.8 3340.8 3362.8 3388.8 3455.6 8335.5 8500.1 8597.9 8630.2 8637.0 8539.1 8583.0 8587.5 8592.4 8607.7 6703.6 6747.6 6760.6 6769.1 6783.0 4582.2 4758.4 4837.3 4896.3 4985.3 8024.2 8358.4 8392.9 8399.4 8410.2 8373.2 8376.3 8449.7 8465.3 8479.7 5664.8 6120.8 6334.9 6365.6 6478.5 6949.0 6999.2 7004.0 7060.8 7083.2 6082.0 6098.5 6202.1 6217.7 6332.0 6153.8 6160.7 6166.2 6171.8 6193.2 5790.9 5802.0 5806.3 5813.4 5844.2 4221.6 4227.7 4236.1 4340.2 4353.3 4332.6 4411.5 4421.7 4461.7 4580.5 19:37:07 INFO - PROCESS | 4112 | 19:37:07 INFO - PROCESS | 4112 | [#4] prototype.html Cycles:180 Average:4301.37 Median:4829.42 stddev:1289.70 (26.7%) stddev-sans-first:1257.37 19:37:07 INFO - PROCESS | 4112 | Values: 272.3 274.9 279.3 284.6 285.3 4830.5 4887.0 4976.6 4981.5 5003.9 4938.7 4967.1 5008.5 5017.8 5028.5 3882.9 3926.8 3931.0 3939.2 3955.6 3798.8 3847.5 3930.9 3940.6 3951.5 3793.9 3815.7 3819.9 3834.3 3836.8 3833.6 3878.4 3908.5 3912.5 3930.9 3379.2 3400.7 3443.1 3445.5 3449.9 4636.2 4916.6 4935.7 4948.3 4985.6 4350.9 4366.9 4367.3 4369.5 4370.8 5246.9 5271.3 5272.3 5289.1 5295.9 3410.2 3574.8 3623.6 3627.9 3642.4 5482.0 5485.9 5504.5 5507.7 5515.5 3707.8 3718.5 3719.4 3720.8 3724.4 3735.3 3757.7 3765.4 3773.3 3773.5 4155.2 4298.9 4325.6 4337.6 4348.5 5256.0 5264.6 5266.6 5300.2 5316.8 1218.3 1262.3 1281.3 1284.6 1285.9 830.8 844.5 868.3 871.6 871.9 4590.5 4618.4 4620.3 4630.3 4633.2 5382.4 5391.4 5398.4 5399.9 5415.4 4477.7 4604.2 4620.5 4628.4 4641.1 2452.6 2470.7 2489.6 2520.0 2521.3 4440.6 4457.0 4477.5 4491.8 4492.8 4725.6 4821.6 4827.8 4828.3 4845.6 4691.0 5072.2 5097.9 5098.0 5107.1 5409.7 5414.5 5433.1 5447.8 5464.7 5200.3 5299.9 5355.7 5368.4 5392.6 5095.9 5113.0 5124.5 5127.9 5129.9 3703.7 3743.5 3743.9 3747.5 3759.2 5369.6 5497.3 5533.6 5537.4 5545.5 5288.9 5299.5 5304.9 5325.5 5367.6 5247.6 5260.8 5269.6 5276.4 5307.2 5019.4 5191.9 5213.2 5256.9 5268.5 5327.5 5344.9 5364.4 5373.8 5390.1 5243.1 5255.3 5258.7 5269.8 5273.9 19:37:07 INFO - PROCESS | 4112 | 19:37:07 INFO - PROCESS | 4112 | [#5] yui.html Cycles:180 Average:17354.19 Median:539.65 stddev:24982.71 (4629.4%) stddev-sans-first:25020.99 19:37:07 INFO - PROCESS | 4112 | Values: 565.6 574.6 586.6 631.6 649.4 12834.8 12874.6 13436.9 13493.2 14014.0 12981.7 12984.0 13023.2 13082.3 13085.3 735.0 746.0 746.5 746.7 747.7 610.9 725.8 747.2 761.3 761.4 783.6 785.9 786.7 787.4 787.7 775.4 775.6 775.8 778.2 779.2 566.9 571.9 572.2 572.7 573.0 12739.5 12764.9 12801.2 12807.3 12807.5 12949.3 13289.9 13535.9 13555.8 13835.8 9779.2 9923.9 10061.7 10121.4 10151.5 3254.7 3328.0 3331.4 3357.8 3375.5 67276.0 67729.7 68036.7 69092.9 69532.0 9994.0 10016.2 10098.6 10263.3 10350.7 19933.0 20013.9 20032.1 20036.8 20214.5 7071.6 7219.0 7286.2 7381.7 7455.3 3784.8 3863.9 3880.2 3895.2 3914.4 2769.7 2824.4 2846.8 2859.7 2870.2 477.6 483.3 491.7 496.6 502.9 462.8 472.5 474.8 533.4 545.9 7735.1 7749.5 7934.7 7949.2 8229.8 478.7 490.7 490.8 507.7 514.6 3756.7 4019.0 4027.3 4051.1 4100.3 87450.6 91317.0 91340.0 93896.5 94366.5 80623.0 81345.2 81455.0 82374.2 83130.0 72751.3 73555.3 73670.6 74523.6 77287.2 7102.2 7404.7 7443.9 7508.4 7627.0 42607.8 43286.4 43487.0 44516.6 44590.8 57729.4 58109.7 63059.0 63603.0 64540.0 9788.4 9794.1 9847.2 9935.7 10068.4 9998.5 10074.2 10117.6 10892.6 10897.1 10126.5 10487.0 10632.8 10717.8 10728.7 10059.3 10197.1 10268.5 10558.0 10640.4 10047.8 10070.5 10494.1 10500.4 10599.9 7891.3 7994.6 8091.3 8179.3 8318.3 8576.5 8604.2 8775.7 8964.6 9003.0 19:37:07 INFO - PROCESS | 4112 | -------- Summary: end -------- 19:37:07 INFO - PROCESS | 4112 | 19:37:08 INFO - TEST-INFO | 4112: exit 0 19:37:08 INFO - TEST-OK | dromaeo_css | took 1118754ms 19:37:08 INFO - TEST-START | kraken 19:37:08 INFO - operating with platform_type : linux_ 19:37:08 INFO - Initialising browser for kraken test... 19:37:08 INFO - TEST-INFO | started process 4467 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpCyMqqc/profile http://localhost:37945/getInfo.html) 19:37:14 INFO - PROCESS | 4467 | __metrics Screen width/height:1600/1200 19:37:14 INFO - PROCESS | 4467 | colorDepth:24 19:37:14 INFO - PROCESS | 4467 | Browser inner width/height: 1024/697 19:37:14 INFO - PROCESS | 4467 | __metrics 19:37:14 ERROR - PROCESS | 4467 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2991: TypeError: this.tabs is undefined 19:37:15 INFO - TEST-INFO | 4467: exit 0 19:37:15 INFO - Browser initialized. 19:37:15 INFO - Running cycle 1/1 for kraken test... 19:37:15 INFO - TEST-INFO | started process 4586 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpCyMqqc/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 19:37:27 INFO - PROCESS | 4586 | RSS: Main: 192614400 19:37:27 INFO - PROCESS | 4586 | 19:37:30 INFO - PROCESS | 4586 | Cycle 1(1): loaded http://localhost:37945/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:37945/tests/kraken/driver.html?testName=audio-beat-detection) 19:37:31 INFO - PROCESS | 4586 | RSS: Main: 205459456 19:37:31 INFO - PROCESS | 4586 | 19:37:34 INFO - PROCESS | 4586 | Cycle 1(1): loaded http://localhost:37945/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:37945/tests/kraken/driver.html?testName=audio-dft) 19:37:35 INFO - PROCESS | 4586 | RSS: Main: 204632064 19:37:35 INFO - PROCESS | 4586 | 19:37:38 INFO - PROCESS | 4586 | Cycle 1(1): loaded http://localhost:37945/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:37945/tests/kraken/driver.html?testName=audio-fft) 19:37:38 INFO - PROCESS | 4586 | RSS: Main: 197246976 19:37:38 INFO - PROCESS | 4586 | 19:37:41 INFO - PROCESS | 4586 | Cycle 1(1): loaded http://localhost:37945/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:37945/tests/kraken/driver.html?testName=audio-oscillator) 19:37:41 INFO - PROCESS | 4586 | RSS: Main: 197419008 19:37:41 INFO - PROCESS | 4586 | 19:37:43 INFO - PROCESS | 4586 | Cycle 1(1): loaded http://localhost:37945/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:37945/tests/kraken/driver.html?testName=imaging-gaussian-blur) 19:37:44 INFO - PROCESS | 4586 | RSS: Main: 197672960 19:37:44 INFO - PROCESS | 4586 | 19:37:47 INFO - PROCESS | 4586 | Cycle 1(1): loaded http://localhost:37945/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:37945/tests/kraken/driver.html?testName=imaging-darkroom) 19:37:48 INFO - PROCESS | 4586 | RSS: Main: 198049792 19:37:48 INFO - PROCESS | 4586 | 19:37:52 INFO - PROCESS | 4586 | Cycle 1(1): loaded http://localhost:37945/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:37945/tests/kraken/driver.html?testName=imaging-desaturate) 19:37:52 INFO - PROCESS | 4586 | RSS: Main: 193736704 19:37:52 INFO - PROCESS | 4586 | 19:37:55 INFO - PROCESS | 4586 | Cycle 1(1): loaded http://localhost:37945/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:37945/tests/kraken/driver.html?testName=json-parse-financial) 19:37:56 INFO - PROCESS | 4586 | RSS: Main: 195301376 19:37:56 INFO - PROCESS | 4586 | 19:37:58 INFO - PROCESS | 4586 | Cycle 1(1): loaded http://localhost:37945/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:37945/tests/kraken/driver.html?testName=json-stringify-tinderbox) 19:37:58 INFO - PROCESS | 4586 | RSS: Main: 195903488 19:37:58 INFO - PROCESS | 4586 | 19:38:00 INFO - PROCESS | 4586 | Cycle 1(1): loaded http://localhost:37945/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:37945/tests/kraken/driver.html?testName=stanford-crypto-aes) 19:38:01 INFO - PROCESS | 4586 | RSS: Main: 195977216 19:38:01 INFO - PROCESS | 4586 | 19:38:03 INFO - PROCESS | 4586 | Cycle 1(1): loaded http://localhost:37945/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:37945/tests/kraken/driver.html?testName=stanford-crypto-ccm) 19:38:04 INFO - PROCESS | 4586 | RSS: Main: 196657152 19:38:04 INFO - PROCESS | 4586 | 19:38:07 INFO - PROCESS | 4586 | Cycle 1(1): loaded http://localhost:37945/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:37945/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 19:38:07 INFO - PROCESS | 4586 | RSS: Main: 196481024 19:38:07 INFO - PROCESS | 4586 | 19:38:10 INFO - PROCESS | 4586 | Cycle 1(1): loaded http://localhost:37945/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:37945/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 19:38:11 INFO - PROCESS | 4586 | RSS: Main: 196579328 19:38:11 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | Cycle 1(1): loaded http://localhost:37945/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:37945/tests/kraken/driver.html?testName=ai-astar) 19:38:13 INFO - PROCESS | 4586 | RSS: Main: 199221248 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | __start_tp_report 19:38:13 INFO - PROCESS | 4586 | _x_x_mozilla_page_load 19:38:13 INFO - PROCESS | 4586 | _x_x_mozilla_page_load_details 19:38:13 INFO - PROCESS | 4586 | |i|pagename|runs| 19:38:13 INFO - PROCESS | 4586 | |0;ai-astar;112;115;117;116;121;118;119;118;115;135 19:38:13 INFO - PROCESS | 4586 | |1;audio-beat-detection;158;127;148;191;135;156;152;130;180;126 19:38:13 INFO - PROCESS | 4586 | |2;audio-dft;170;165;164;163;163;167;164;164;164;166 19:38:13 INFO - PROCESS | 4586 | |3;audio-fft;78;77;77;177;78;77;78;78;166;77 19:38:13 INFO - PROCESS | 4586 | |4;audio-oscillator;85;84;143;84;85;84;135;85;84;142 19:38:13 INFO - PROCESS | 4586 | |5;imaging-gaussian-blur;118;117;117;118;117;117;119;118;118;118 19:38:13 INFO - PROCESS | 4586 | |6;imaging-darkroom;148;148;151;148;147;148;149;150;150;148 19:38:13 INFO - PROCESS | 4586 | |7;imaging-desaturate;97;97;97;97;96;96;95;95;95;98 19:38:13 INFO - PROCESS | 4586 | |8;json-parse-financial;64;65;67;66;74;66;68;68;67;66 19:38:13 INFO - PROCESS | 4586 | |9;json-stringify-tinderbox;66;67;65;66;67;66;65;67;67;67 19:38:13 INFO - PROCESS | 4586 | |10;stanford-crypto-aes;84;88;84;87;83;82;84;82;90;86 19:38:13 INFO - PROCESS | 4586 | |11;stanford-crypto-ccm;142;136;139;142;135;140;150;141;186;136 19:38:13 INFO - PROCESS | 4586 | |12;stanford-crypto-pbkdf2;180;176;176;181;173;181;177;176;173;175 19:38:13 INFO - PROCESS | 4586 | |13;stanford-crypto-sha256-iterative;70;71;69;70;68;69;71;69;71;71 19:38:13 INFO - PROCESS | 4586 | __end_tp_report 19:38:13 INFO - PROCESS | 4586 | __start_cc_report 19:38:13 INFO - PROCESS | 4586 | _x_x_mozilla_cycle_collect,909 19:38:13 INFO - PROCESS | 4586 | __end_cc_report 19:38:13 INFO - PROCESS | 4586 | __startTimestamp1472611093341__endTimestamp 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | ------- Summary: start ------- 19:38:13 INFO - PROCESS | 4586 | Number of tests: 14 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | [#0] ai-astar Cycles:10 Average:118.60 Median:118.00 stddev:6.28 (5.3%) stddev-sans-first:6.18 19:38:13 INFO - PROCESS | 4586 | Values: 112.0 115.0 117.0 116.0 121.0 118.0 119.0 118.0 115.0 135.0 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | [#1] audio-beat-detection Cycles:10 Average:150.30 Median:154.00 stddev:22.16 (14.4%) stddev-sans-first:23.32 19:38:13 INFO - PROCESS | 4586 | Values: 158.0 127.0 148.0 191.0 135.0 156.0 152.0 130.0 180.0 126.0 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | [#2] audio-dft Cycles:10 Average:165.00 Median:164.50 stddev:2.16 (1.3%) stddev-sans-first:1.33 19:38:13 INFO - PROCESS | 4586 | Values: 170.0 165.0 164.0 163.0 163.0 167.0 164.0 164.0 164.0 166.0 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | [#3] audio-fft Cycles:10 Average:96.30 Median:77.50 stddev:39.72 (51.3%) stddev-sans-first:41.58 19:38:13 INFO - PROCESS | 4586 | Values: 78.0 77.0 77.0 177.0 78.0 77.0 78.0 78.0 166.0 77.0 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | [#4] audio-oscillator Cycles:10 Average:101.10 Median:84.00 stddev:26.93 (32.1%) stddev-sans-first:27.92 19:38:13 INFO - PROCESS | 4586 | Values: 85.0 84.0 143.0 84.0 85.0 84.0 135.0 85.0 84.0 142.0 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | [#5] imaging-gaussian-blur Cycles:10 Average:117.70 Median:118.00 stddev:0.67 (0.6%) stddev-sans-first:0.71 19:38:13 INFO - PROCESS | 4586 | Values: 118.0 117.0 117.0 118.0 117.0 117.0 119.0 118.0 118.0 118.0 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | [#6] imaging-darkroom Cycles:10 Average:148.70 Median:148.50 stddev:1.25 (0.8%) stddev-sans-first:1.30 19:38:13 INFO - PROCESS | 4586 | Values: 148.0 148.0 151.0 148.0 147.0 148.0 149.0 150.0 150.0 148.0 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | [#7] imaging-desaturate Cycles:10 Average:96.30 Median:97.00 stddev:1.06 (1.1%) stddev-sans-first:1.09 19:38:13 INFO - PROCESS | 4586 | Values: 97.0 97.0 97.0 97.0 96.0 96.0 95.0 95.0 95.0 98.0 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | [#8] json-parse-financial Cycles:10 Average:67.10 Median:67.00 stddev:2.73 (4.1%) stddev-sans-first:2.65 19:38:13 INFO - PROCESS | 4586 | Values: 64.0 65.0 67.0 66.0 74.0 66.0 68.0 68.0 67.0 66.0 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | [#9] json-stringify-tinderbox Cycles:10 Average:66.30 Median:67.00 stddev:0.82 (1.2%) stddev-sans-first:0.87 19:38:13 INFO - PROCESS | 4586 | Values: 66.0 67.0 65.0 66.0 67.0 66.0 65.0 67.0 67.0 67.0 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | [#10] stanford-crypto-aes Cycles:10 Average:85.00 Median:85.00 stddev:2.67 (3.1%) stddev-sans-first:2.80 19:38:13 INFO - PROCESS | 4586 | Values: 84.0 88.0 84.0 87.0 83.0 82.0 84.0 82.0 90.0 86.0 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | [#11] stanford-crypto-ccm Cycles:10 Average:144.70 Median:141.50 stddev:15.14 (10.7%) stddev-sans-first:16.02 19:38:13 INFO - PROCESS | 4586 | Values: 142.0 136.0 139.0 142.0 135.0 140.0 150.0 141.0 186.0 136.0 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:176.80 Median:176.50 stddev:2.97 (1.7%) stddev-sans-first:2.92 19:38:13 INFO - PROCESS | 4586 | Values: 180.0 176.0 176.0 181.0 173.0 181.0 177.0 176.0 173.0 175.0 19:38:13 INFO - PROCESS | 4586 | 19:38:13 INFO - PROCESS | 4586 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.90 Median:70.50 stddev:1.10 (1.6%) stddev-sans-first:1.17 19:38:13 INFO - PROCESS | 4586 | Values: 70.0 71.0 69.0 70.0 68.0 69.0 71.0 69.0 71.0 71.0 19:38:13 INFO - PROCESS | 4586 | -------- Summary: end -------- 19:38:13 INFO - PROCESS | 4586 | 19:38:14 INFO - TEST-INFO | 4586: exit 0 19:38:14 INFO - TEST-OK | kraken | took 65853ms 19:38:14 INFO - SUITE-END | took 1184s 19:38:14 INFO - Completed test suite (00:19:45) 19:38:15 INFO - javascript benchmark 19:38:15 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6195.340708456308, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2604.7525485078913, 2610.9869450652745, 2630.842149471032, 2633.5917932720436, 2657.295816608599, 4619.6304295656355, 4716.726483849363, 4726.149293127236, 4727.858164255078, 4807.254875494304, 4710.293455981605, 4738.431388233417, 4770.212914869043, 4781.617470602352, 4783.928241076378, 4303.569643035703, 4362.389265502832, 4389.582989615981, 4423.336499525065, 4480.6639502037315, 4382.145481631083, 4418.447694038246, 4435.9556404436025, 4446.288593824988, 4490.528494508062, 4250.319948808206, 4307.6769242306955, 4342.804573794187, 4360.258756011485, 4396.978015109904, 4347.739135651871, 4368.956310436887, 4389.956100438987, 4400.845970391053, 4422.358757980107, 4302.612764851147, 4308.504521979981, 4331.133773245364, 4334.761588112652, 4372.584604462571, 4616.3537104805355, 4749.09767144245, 4772.809087636525, 4791.7124972501415, 4804.25534042224, 5102.923456148161, 5104.05574968632, 5116.846494605168, 5137.12668846297, 5147.588192944556, 5136.922946155811, 5154.252633368178, 5156.0, 5161.225816127573, 5221.373435187764, 4600.148972440109, 4621.95378046222, 4711.670183087151, 4767.070421267854, 4768.117898188846, 5151.407588127413, 5166.9224961625605, 5182.170852663556, 5243.030039442715, 5269.394019687708, 4927.285543596158, 4970.751462426864, 4976.4525902150735, 4984.470046540192, 5042.899142017139, 4866.099771542276, 5056.317397151338, 5067.265246539231, 5083.771230294646, 5104.872378190575, 5072.239164125411, 5092.719900405439, 5106.310648062464, 5139.7687104080405, 5153.0466863630345, 4988.401391833003, 5038.042771873333, 5049.040682270357, 5078.5937125029905, 5146.794128234828, 4185.372194170838, 4201.495820501498, 4288.4210631564965, 4321.956780432219, 4365.236083685342, 3767.5102236709054, 3768.605615922126, 3797.0, 3813.103920578662, 3827.6937844972335, 4334.978325108417, 4381.605655491021, 4404.119176164716, 4407.977960110179, 4408.691391602557, 4962.702237865739, 4974.228994505857, 5038.294638750578, 5093.9490605094215, 5131.5638170755155, 4355.629771469397, 4392.363107349481, 4413.624841888475, 4435.556444355603, 4451.243288640874, 4619.630429565626, 4624.838130665411, 4629.051044535862, 4635.188841952645, 4684.2271025281125, 4817.373741413594, 4818.253170758538, 4823.734694591831, 4826.444958829779, 4877.292792545061, 4959.132151873336, 4961.900761984813, 5018.673786203885, 5028.446870844277, 5063.063333283354, 4670.252759558454, 4693.319468677091, 4731.976340118277, 4735.195016847213, 4801.063792560417, 5064.772085256099, 5082.491750824888, 5082.796688132581, 5088.440271570198, 5133.076046311699, 4900.215965445512, 5033.597312215087, 5067.163917953497, 5075.87310317245, 5120.052790233819, 4942.950570494393, 4953.653244272867, 4956.231784073474, 4956.430010548833, 4991.401031876198, 4762.380890484214, 4891.168501354707, 4901.411830580353, 4939.061578300255, 4942.752862356796, 4819.783109759999, 4855.732934688484, 4892.535209155125, 4922.335484709519, 4941.085899108676, 4974.9751251243515, 4985.675931064469, 4995.0, 5000.524950129732, 5054.848354549369, 4753.429588449409, 4814.7833347498745, 4816.710997340171, 4880.658353915192, 4954.702717836942], "value": 4662.668163874339, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [536.4287034308461, 545.3183520599251, 558.7122631844601, 559.4517372974485, 589.7257775134567, 35421.46867796982, 39118.99999999993, 39134.08659134085, 39182.21635567291, 39195.02012449686, 39172.412413813814, 39422.40866387007, 39788.40846366149, 39883.80058099713, 39886.20227595446, 7599.430042746789, 7701.922980770205, 7757.224277572254, 7773.611319434006, 7776.961115194416, 7595.430342724318, 7657.578833164173, 7665.271799179069, 7673.731419400322, 7678.808029799272, 7691.307782299592, 7699.615019249043, 7706.190849960757, 7716.922830771705, 7725.536467811921, 7612.04849393823, 7663.578503182351, 7675.347595454393, 7675.961620191919, 7677.078750549914, 7321.487495875291, 7436.107667079931, 7453.0, 7458.4033277337685, 7465.664045117983, 36369.0, 36616.084597885, 36629.267414651826, 36682.0, 36683.08292292687, 2731.685856126551, 2732.453509298148, 2742.8628568571494, 2749.5325794614764, 2771.5426954552477, 27931.58102628462, 28251.57622635662, 28264.858675706695, 28637.57043644347, 28677.0, 3339.0, 3371.393149233137, 3382.8646854125805, 3485.873617093571, 3494.0566047167376, 255248.0, 256477.0, 256531.0, 258227.0, 258519.0, 51609.0, 51654.48345516572, 51818.74090629523, 51852.481475184766, 51928.74035629873, 28680.426391472054, 29290.267743306587, 56057.43942560604, 56180.71909640425, 56294.71852640711, 13611.863881361258, 14066.0, 14068.788968165485, 14071.71856562863, 14104.506342278177, 10481.161507079416, 10614.89385106139, 10618.469076546142, 10625.203109766644, 10656.413897235727, 17685.381011664787, 17740.379086731904, 17791.73312400315, 17801.910990444965, 17841.821581784276, 6487.902681459782, 6525.151730275129, 6560.803175904635, 6683.164604424447, 6908.965455172793, 742.4988133010196, 824.6289169873581, 943.9716808495756, 976.3507267666922, 998.7902540466583, 25846.741532584434, 27570.0, 28015.579766303523, 28186.0, 28215.15354539326, 832.6003518311123, 836.4145098431122, 893.8346405914926, 913.5660561233361, 917.2570218123208, 13653.317334133253, 14680.55958321252, 14757.926210369094, 14985.100893946397, 15036.699266014619, 119909.40045299717, 121148.0, 121207.0, 121217.0, 122011.0, 48515.75742121267, 48609.812558434955, 48680.0, 49036.0, 49156.50843491591, 1130.1185075641013, 1149.316156886651, 1154.1747650429816, 1163.069544364505, 1167.9124065694937, 25506.74493255044, 26380.0, 27380.589291161046, 27503.724962750915, 27538.586921195798, 41367.0, 41543.0, 41759.582404176785, 41783.1643367137, 41793.79103104465, 316501.0, 318124.0, 318739.0, 319131.0, 319494.0, 24585.508289834463, 24926.37684057913, 24968.500629987662, 24980.500389992463, 24991.0, 39922.600773991886, 40363.36729694224, 40465.39301910532, 40503.392449113875, 41543.169136616496, 34616.30767384689, 35043.64956350404, 35422.291554169286, 35522.11194720153, 35914.0, 34621.826890865384, 34770.304593908484, 34828.65171348254, 35040.0, 35612.46581301335, 34001.40209917184, 34305.656943430244, 34925.47611785876, 35073.47389789104, 35252.0, 29667.703322966496, 32328.83835580807, 32584.0, 32601.67398326081, 32669.0, 25020.249392518253, 25070.37324066913, 25380.11169609055, 25691.614625780254, 25877.48245035051], "value": 16456.909018630256, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [342.2590092449846, 349.62066158218335, 351.60620105481865, 356.7057177828289, 369.50855362368054, 15353.15557644329, 15705.214739263049, 16785.748213776773, 16841.41055063073, 17017.234224459884, 13922.373493192805, 14117.223552704623, 14610.0, 14649.707005859877, 14664.0, 5542.334919809628, 5667.319921609413, 5680.573956953224, 5802.361740208595, 5806.622569532988, 5569.66582005079, 5573.804916827912, 5595.664260144405, 5596.188552659862, 5597.692126933017, 5559.972200139014, 5672.149177623369, 5721.113227449731, 5726.3987281335485, 5730.05454100073, 5593.077142271521, 5684.403137670547, 5723.2559767230205, 5726.828195154152, 5735.541156707453, 5360.705161216131, 5518.33779946405, 5531.834044978657, 5535.169724541311, 5544.972275138599, 22849.200277990356, 23113.0754769809, 23240.767592324028, 23800.04799808023, 23868.64197037046, 1857.322077441724, 1936.7772706138692, 1954.4332143678316, 2016.0222292188278, 2505.8872350744077, 14165.362558684781, 14373.568792936228, 14795.0, 15158.621034474116, 15447.845521544754, 1878.1078987480973, 1906.8283854453166, 1917.9520511987173, 1943.5626983928644, 1997.8401727861735, 67313.66343168302, 75688.62155689186, 79852.0, 79862.60068699677, 81966.18033819646, 16065.759013614805, 16456.341746330014, 16478.42325518601, 16832.69770022439, 17145.0, 28655.426891462055, 28667.713322866504, 28725.56911646327, 28763.712362876104, 28966.42067158687, 8217.917820821835, 8369.623366948503, 8484.575771211415, 8689.56552172389, 8740.956295218482, 6920.411764999931, 6933.237343892168, 7000.824979375557, 7212.71149154028, 7284.635768211569, 8175.550344731097, 8193.918060819435, 8261.256486916207, 8450.915490845136, 8452.661893524313, 3081.1372815611217, 3098.9724984904146, 3171.337105642986, 3199.920001999922, 3281.868725251011, 341.1845688803761, 341.27994905675615, 342.5495473452402, 353.94513850353235, 716.2050124361954, 9792.461414622121, 9884.159846412991, 9933.900660993297, 10093.39816401904, 10118.443485608363, 370.1745108408265, 375.249500998004, 380.1124374585374, 384.92301539692176, 390.51966081719075, 5274.340707411574, 5285.365756109291, 5403.0, 5468.179773033997, 5513.61404701675, 315967.0, 316194.0, 319270.0, 342042.0, 346326.0, 47943.28085078727, 79984.20015799884, 80006.19993799987, 81073.18926810774, 81754.18245817584, 372.12736133766276, 384.1625256939898, 384.6826368246152, 385.6798856948726, 387.73633928928035, 8834.233153369223, 8966.955165224132, 9016.639334426549, 9044.683436079706, 9451.763705907408, 33538.0, 34724.82637586796, 37622.62377376191, 38163.80918095392, 38480.0, 47175.76412117918, 49823.0, 49961.25058124059, 50008.0, 52453.0, 6998.650067496503, 7002.124734408199, 7232.132144142736, 7448.664810083667, 7638.197989211053, 8102.068262149693, 10636.41499717523, 11150.163737719866, 11498.425078745862, 11523.308601483937, 10123.443210623487, 10264.794704106025, 10329.690109296733, 10372.273940824372, 10629.521671524646, 10076.84884726715, 10159.644412445528, 10249.282550221711, 10378.584856605652, 10442.112420444348, 9923.40459572428, 9933.503324833584, 10290.536925838205, 10469.790604187721, 10712.19658525598, 6405.19935008124, 6550.213974323112, 6586.637734924625, 7177.892331615134, 7694.653740581575, 9427.292953028413, 10221.9488902555, 10265.729265967506, 10317.0, 10574.312669676754], "value": 7976.2023254614505, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1313.0808434096132, 1375.2985977151652, 1430.678097428079, 1612.137506434058, 1650.0, 6481.870362592746, 7018.859622807548, 7149.285071492861, 7584.203658615842, 7599.354054905333, 7347.742829000986, 7565.167831538526, 7585.7344992925255, 7587.734429294962, 7589.165191828894, 2123.9681404778903, 2144.2173606633546, 2156.439325775294, 2158.104386679534, 2161.1787520742096, 2083.6666133418657, 2122.7664956854733, 2135.1032566322106, 2156.493224092337, 2156.5255643758346, 2079.656856618656, 2121.140937920145, 2124.1715730864976, 2130.0734180631475, 2135.957280854382, 2072.0882811562865, 2075.7716651168357, 2076.49125964139, 2079.5736873940805, 2082.2607974169255, 2045.7136000959877, 2086.9373918782308, 2093.3510611710417, 2096.1615353858424, 2097.318371529244, 7420.369268612175, 7573.469857110004, 7576.545407275581, 7579.1662917079075, 7582.0, 4269.573042695705, 4378.759168245745, 4385.890352741175, 4389.582989615981, 4392.1874453226255, 2618.947621047568, 2734.3847634282324, 2778.472090302836, 2784.3456787655086, 2788.8187267827525, 854.133054949227, 894.7181637784078, 911.8221946720392, 928.6331898899964, 937.704623043739, 9882.65410710629, 9904.603815847357, 9906.108450239513, 9932.751681207956, 9939.304248702521, 3695.316366472211, 3798.8290526926353, 3892.591277915835, 3963.960360396417, 3966.900827479336, 8449.23956843887, 8491.660333586711, 8511.148885111439, 8513.95743021281, 8549.658013679507, 4371.672124590668, 4412.757298348557, 4415.0, 4430.0, 4439.622632076245, 3499.492573576817, 3821.636944490269, 3934.252492026506, 4039.3335099708806, 4041.636252737209, 3429.451287793941, 3475.565554305712, 3486.4944583035826, 3538.7345949053924, 3584.444411116281, 1069.5133714160038, 1085.978280434387, 1088.1294964028746, 1089.2865173311493, 1096.6052221200362, 691.6852831961445, 707.8124297061283, 731.5574077682925, 738.6860584251672, 748.9737859174903, 4696.694714843524, 4790.640701947368, 4933.062718083553, 4948.777305021283, 4967.602591792648, 385.5700893503723, 392.0355924425887, 392.42117876132477, 398.07646260674954, 398.2493000693713, 3339.766216364831, 3340.799552026886, 3362.8486718097743, 3388.8136152511356, 3455.568053993251, 8335.49987000782, 8500.10748871372, 8597.871031934526, 8630.180132887366, 8637.0499245083, 8539.146085391536, 8583.0, 8587.527685977206, 8592.3555733319, 8607.741767746978, 6703.564268322543, 6747.59514429126, 6760.594364338155, 6769.120014398097, 6782.966085169543, 4582.19811532987, 4758.381410416624, 4837.298591704112, 4896.314515967696, 4985.252212168204, 8024.157463466252, 8358.373122015752, 8392.874106888523, 8399.41204115706, 8410.243078122998, 8373.246407823324, 8376.32989360862, 8449.662013519635, 8465.322774178174, 8479.745607631781, 5664.830055098354, 6120.846978825565, 6334.936650633619, 6365.586236894587, 6478.5141114415665, 6948.965255173894, 6999.160100787734, 7004.0, 7060.7881763547175, 7083.220845707071, 6081.969590152021, 6098.542609304409, 6202.131701561695, 6217.658028808459, 6331.96834015827, 6153.753849845956, 6160.691965401622, 6166.229221347332, 6171.783987560414, 6193.194884664965, 5790.9286781945475, 5802.0, 5806.332271788799, 5813.360530341574, 5844.211031510692, 4221.556736542619, 4227.704060715843, 4236.08924081324, 4340.197063543254, 4353.259945809284, 4332.6317263033, 4411.4926783420315, 4421.734695918255, 4461.665375096816, 4580.519045500175], "value": 3811.510906940047, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [272.3490856852124, 274.9175247425772, 279.34354267471446, 284.5532513953095, 285.3138202622693, 4830.541098595637, 4887.0, 4976.552110310071, 4981.501849815012, 5003.924941125882, 4938.691246819596, 4967.130752118383, 5008.49915008499, 5017.824376146836, 5028.522290382417, 3882.8835134945925, 3926.8429262829454, 3931.0368959604793, 3939.172773717523, 3955.624215699504, 3798.8480460781534, 3847.5190601174854, 3930.9386465654256, 3940.6059394060653, 3951.5455722591983, 3793.867214647488, 3815.7328986970924, 3819.8663046793367, 3834.3098242316373, 3836.769793812366, 3833.639058134364, 3878.351700527279, 3908.472356231901, 3912.5304963404287, 3930.862419815321, 3379.239671074013, 3400.710939570115, 3443.070370999841, 3445.4831775233665, 3449.862005519776, 4636.211843986531, 4916.606671466274, 4935.6545041847085, 4948.331975183376, 4985.5513003829465, 4350.869473915787, 4366.868993930188, 4367.323064924942, 4369.4756629204385, 4370.8033138508845, 5246.8688282792855, 5271.341082364705, 5272.31459910213, 5289.100852855024, 5295.947040529584, 3410.1645096951156, 3574.8391322390294, 3623.6376362363553, 3627.8730244441317, 3642.3990041643096, 5481.972590137064, 5485.945140548583, 5504.532114770249, 5507.669539827583, 5515.4760297771645, 3707.8146092695256, 3718.535183102112, 3719.367707489733, 3720.8325625346924, 3724.42271447926, 3735.3377746902365, 3757.680597149218, 3765.4163604641326, 3773.2642134783455, 3773.547174339042, 4155.168966206771, 4298.882290604465, 4325.589069038437, 4337.566243375637, 4348.543402942709, 5256.0, 5264.6051546134195, 5266.578673706094, 5300.224424817729, 5316.83648229303, 1218.2873019283818, 1262.267884626914, 1281.2760790153534, 1284.640300715801, 1285.9099863009499, 830.7839961609905, 844.5439462690201, 868.3096937934357, 871.5685735560938, 871.8997315308694, 4590.495045544987, 4618.35343051973, 4620.330052142421, 4630.259158534618, 4633.235516139866, 5382.439092663084, 5391.353037635509, 5398.406175320712, 5399.919001214985, 5415.404305526389, 4477.686561940698, 4604.194266003503, 4620.468646105741, 4628.375169352094, 4641.141388843075, 2452.6321051842365, 2470.666460027909, 2489.6224105978745, 2519.9748002520105, 2521.2562294123277, 4440.57901471526, 4456.997175635456, 4477.462704475483, 4491.8427855025575, 4492.820287188541, 4725.5510726480925, 4821.63837712173, 4827.758612069452, 4828.299896514985, 4845.63657725672, 4690.9765451172525, 5072.239164125411, 5097.8725531861255, 5097.974510127426, 5107.131787596192, 5409.675419474844, 5414.511009472427, 5433.103537916358, 5447.754851031634, 5464.672119672832, 5200.2719619252575, 5299.9470005301, 5355.678659280456, 5368.409474957673, 5392.622516423813, 5095.87260318495, 5112.9744351278005, 5124.5131712487255, 5127.897442051213, 5129.8717532062, 3703.7037037036434, 3743.513343265358, 3743.943840842444, 3747.512823332949, 3759.2481503698823, 5369.597280203922, 5497.340319161726, 5533.6126471148245, 5537.363203231519, 5545.500904918576, 5288.920666189933, 5299.549538289289, 5304.893902122013, 5325.547328477122, 5367.597430192829, 5247.638562646901, 5260.763265653131, 5269.604779641466, 5276.419593844751, 5307.150855863043, 5019.372578427697, 5191.896162076813, 5213.165893457029, 5256.89486210266, 5268.4731526848545, 5327.467253274642, 5344.866378340573, 5364.356277246756, 5373.811916582901, 5390.086519285597, 5243.134882744457, 5255.343082114736, 5258.710770907637, 5269.78920843162, 5273.868153296198], "value": 3879.6619284525646, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [565.6436445039625, 574.5776854012298, 586.560079940045, 631.6134446270651, 649.4285029174329, 12834.80747788784, 12874.613761587167, 13436.932815335935, 13493.19040857548, 14013.999999999975, 12981.74036519269, 12984.0, 13023.15349502284, 13082.345882705851, 13085.34573271335, 734.9926500734991, 746.0376114811913, 746.4550877859166, 746.675196289613, 747.7495039161887, 610.9419605137505, 725.785893161516, 747.1930315259534, 761.2919984414492, 761.3870833978644, 783.6042798386807, 785.8742601183811, 786.7128498098182, 787.3622365883652, 787.6927998080724, 775.4455564271517, 775.5540564175593, 775.8176828445311, 778.2451022508158, 779.2091027606983, 566.8582854286428, 571.9113537401668, 572.1732097119664, 572.6936089192304, 572.9799457019026, 12739.490420383174, 12764.936175319064, 12801.167924084904, 12807.295598742065, 12807.487700491969, 12949.287789171593, 13289.933550332187, 13535.864641353657, 13555.796663050061, 13835.79246311306, 9779.168770654504, 9923.851142232872, 10061.69814905554, 10121.443320617363, 10151.543180556819, 3254.707076363115, 3327.96672033279, 3331.4336562784383, 3357.8321083945707, 3375.476801095834, 67276.0, 67729.66135169342, 68036.6598167011, 69092.90874097063, 69532.0, 9994.0, 10016.248781341283, 10098.596056157818, 10263.281570290008, 10350.689479315633, 19933.0, 20013.899930500254, 20032.098555565033, 20036.799632003786, 20214.494637634176, 7071.646417679095, 7219.038522763484, 7286.198518162998, 7381.667824947783, 7455.291747283999, 3784.829682664287, 3863.8840834775, 3880.165764360676, 3895.182011777502, 3914.3541315683165, 2769.695333513312, 2824.3645179834784, 2846.8434236117214, 2859.7140285971655, 2870.2393865625627, 477.58450148370446, 483.32817383836493, 491.7148054128597, 496.63001064207396, 502.90193412284253, 462.7570525474153, 472.54399504478346, 474.76024607573646, 533.3786139147927, 545.9181122831527, 7735.071551659594, 7749.535027898344, 7934.682612695543, 7949.165337639581, 8229.835403291901, 478.72735832693076, 490.72028943502573, 490.76443307212736, 507.7423281915783, 514.6448950224333, 3756.6565756476757, 4019.0, 4027.2750904836826, 4051.108756073659, 4100.323446631332, 87450.56274718586, 91317.0, 91340.0, 93896.53051734834, 94366.5281673601, 80623.0, 81345.18654813376, 81455.0, 82374.17625823784, 83130.0, 72751.2724872755, 73555.26444735484, 73670.63164684143, 74523.62738186383, 77287.22712772913, 7102.218755936946, 7404.703811847466, 7443.925560744323, 7508.399328053633, 7626.96186519086, 42607.786961064994, 43286.35070473883, 43487.0, 44516.55483445254, 44590.77704611456, 57729.422705774086, 58109.70945145247, 63059.0, 63603.0, 64540.0, 9788.412695238309, 9794.118529332394, 9847.162991145833, 9935.652252171429, 10068.44623545712, 9998.450085245382, 10074.244431667508, 10117.595296188365, 10892.61875834342, 10897.073748731129, 10126.544305506122, 10487.0, 10632.84050739255, 10717.839232411365, 10728.731781705208, 10059.29584929048, 10197.13324367437, 10268.486575671037, 10557.99699028591, 10640.361578305326, 10047.849282260919, 10070.546825393021, 10494.055535001886, 10500.369977801356, 10599.89400105989, 7891.289783919475, 7994.5602991836, 8091.312238459797, 8179.345652347917, 8318.292945099492, 8576.528290943808, 8604.182602652738, 8775.736727898173, 8964.641414343354, 9003.0], "value": 6247.013040009603, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1603.8, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [112.0, 115.0, 117.0, 116.0, 121.0, 118.0, 119.0, 118.0, 115.0, 135.0], "value": 118.6, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [158.0, 127.0, 148.0, 191.0, 135.0, 156.0, 152.0, 130.0, 180.0, 126.0], "value": 150.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [170.0, 165.0, 164.0, 163.0, 163.0, 167.0, 164.0, 164.0, 164.0, 166.0], "value": 165.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 77.0, 77.0, 177.0, 78.0, 77.0, 78.0, 78.0, 166.0, 77.0], "value": 96.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 84.0, 143.0, 84.0, 85.0, 84.0, 135.0, 85.0, 84.0, 142.0], "value": 101.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 117.0, 118.0, 117.0, 117.0, 119.0, 118.0, 118.0, 118.0], "value": 117.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 148.0, 151.0, 148.0, 147.0, 148.0, 149.0, 150.0, 150.0, 148.0], "value": 148.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [97.0, 97.0, 97.0, 97.0, 96.0, 96.0, 95.0, 95.0, 95.0, 98.0], "value": 96.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 65.0, 67.0, 66.0, 74.0, 66.0, 68.0, 68.0, 67.0, 66.0], "value": 67.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 67.0, 65.0, 66.0, 67.0, 66.0, 65.0, 67.0, 67.0, 67.0], "value": 66.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 88.0, 84.0, 87.0, 83.0, 82.0, 84.0, 82.0, 90.0, 86.0], "value": 85.0, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [142.0, 136.0, 139.0, 142.0, 135.0, 140.0, 150.0, 141.0, 186.0, 136.0], "value": 144.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [180.0, 176.0, 176.0, 181.0, 173.0, 181.0, 177.0, 176.0, 173.0, 175.0], "value": 176.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 71.0, 69.0, 70.0, 68.0, 69.0, 71.0, 69.0, 71.0, 71.0], "value": 69.9, "unit": "score"}]}]} 19:38:15 INFO - Return code: 0 19:38:15 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 19:38:15 ERROR - # TBPL SUCCESS # 19:38:15 INFO - Running post-action listener: _resource_record_post_action 19:38:15 INFO - [mozharness: 2016-08-31 02:38:15.150335Z] Finished run-tests step (success) 19:38:15 INFO - Running post-run listener: _resource_record_post_run 19:38:15 INFO - Total resource usage - Wall time: 1201s; CPU: 13.0%; Read bytes: 0; Write bytes: 410210304; Read time: 0; Write time: 371180 19:38:15 INFO - TinderboxPrint: CPU usage
13.4% 19:38:15 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 19:38:15 INFO - TinderboxPrint: I/O write bytes / time
410,210,304 / 371,180 19:38:15 INFO - TinderboxPrint: CPU idle
8,292.0 (86.6%) 19:38:15 INFO - TinderboxPrint: CPU user
1,223.1 (12.8%) 19:38:15 INFO - TinderboxPrint: Swap in / out
0 / 0 19:38:15 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 120725504; Read time: 0; Write time: 106560 19:38:15 INFO - run-tests - Wall time: 1185s; CPU: 13.0%; Read bytes: 0; Write bytes: 289484800; Read time: 0; Write time: 264620 19:38:15 INFO - Running post-run listener: _upload_blobber_files 19:38:15 INFO - Blob upload gear active. 19:38:15 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 19:38:15 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 19:38:15 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', 'Firefox-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 19:38:15 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 Firefox-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 19:38:16 INFO - (blobuploader) - INFO - Open directory for files ... 19:38:16 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 19:38:16 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:38:16 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:38:16 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 19:38:16 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:38:16 INFO - (blobuploader) - INFO - Done attempting. 19:38:16 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 19:38:16 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:38:16 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:38:17 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 19:38:17 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:38:17 INFO - (blobuploader) - INFO - Done attempting. 19:38:17 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 19:38:17 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:38:17 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:38:22 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 19:38:22 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:38:22 INFO - (blobuploader) - INFO - Done attempting. 19:38:22 INFO - (blobuploader) - INFO - Iteration through files over. 19:38:22 INFO - Return code: 0 19:38:22 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 19:38:22 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 19:38:22 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c6dd534365184f00575d970c312ea1d9cc138bf48294f8bb73bc66822bc9d1e6658804f3b23182bdddf6923e96d1ee41f61037ba5b3cfcaa80d7828865a7062a", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e4304ca37a9fdcce29f8e3534b903b317f2138d0385a5efc173f4d2feea2275b26f26b37476517e03508a57e541d66d4ce6b69e92eed22c6ce1e0735f603f2f7", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ddcff27b5a1489abcc4bc7906af7f1fb06f4dd97d39de378881750466bb6680abd3a6374d7354ebefe767ce01baf6354d0ee2b854ce4a5d2ef507661551926ee"} 19:38:22 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 19:38:22 INFO - Writing to file /builds/slave/test/properties/blobber_files 19:38:22 INFO - Contents: 19:38:22 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c6dd534365184f00575d970c312ea1d9cc138bf48294f8bb73bc66822bc9d1e6658804f3b23182bdddf6923e96d1ee41f61037ba5b3cfcaa80d7828865a7062a", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e4304ca37a9fdcce29f8e3534b903b317f2138d0385a5efc173f4d2feea2275b26f26b37476517e03508a57e541d66d4ce6b69e92eed22c6ce1e0735f603f2f7", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ddcff27b5a1489abcc4bc7906af7f1fb06f4dd97d39de378881750466bb6680abd3a6374d7354ebefe767ce01baf6354d0ee2b854ce4a5d2ef507661551926ee"} 19:38:22 INFO - Running post-run listener: copy_logs_to_upload_dir 19:38:22 INFO - Copying logs to upload dir... 19:38:22 INFO - mkdir: /builds/slave/test/build/upload/logs 19:38:22 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1245.493297 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 45 secs) (at 2016-08-30 19:38:22.275762) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-30 19:38:22.279500) ========= 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=14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978 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/Firefox-Non-PGO/sha512/c6dd534365184f00575d970c312ea1d9cc138bf48294f8bb73bc66822bc9d1e6658804f3b23182bdddf6923e96d1ee41f61037ba5b3cfcaa80d7828865a7062a", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e4304ca37a9fdcce29f8e3534b903b317f2138d0385a5efc173f4d2feea2275b26f26b37476517e03508a57e541d66d4ce6b69e92eed22c6ce1e0735f603f2f7", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ddcff27b5a1489abcc4bc7906af7f1fb06f4dd97d39de378881750466bb6680abd3a6374d7354ebefe767ce01baf6354d0ee2b854ce4a5d2ef507661551926ee"} build_url:https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011384 build_url: 'https://queue.taskcluster.net/v1/task/Idf2-bx0SNml9VUbbqkPZA/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/Firefox-Non-PGO/sha512/c6dd534365184f00575d970c312ea1d9cc138bf48294f8bb73bc66822bc9d1e6658804f3b23182bdddf6923e96d1ee41f61037ba5b3cfcaa80d7828865a7062a", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e4304ca37a9fdcce29f8e3534b903b317f2138d0385a5efc173f4d2feea2275b26f26b37476517e03508a57e541d66d4ce6b69e92eed22c6ce1e0735f603f2f7", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ddcff27b5a1489abcc4bc7906af7f1fb06f4dd97d39de378881750466bb6680abd3a6374d7354ebefe767ce01baf6354d0ee2b854ce4a5d2ef507661551926ee"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-30 19:38:22.307187) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-30 19:38:22.307743) ========= 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=14ef55db36f7623abb31b9cf000001d5-1472609854.844032-987470978 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004570 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-30 19:38:22.389522) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-30 19:38:22.390013) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-30 19:38:22.390561) ========= ========= Total master_lag: 0.18 =========