builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-049 starttime: 1486433176.41 results: success (0) buildid: 20170206162459 builduid: 3b5e821eacc543d2b022e37ab14f0cfa revision: feb1845bb0db8d50b9fea389700f70f1de1b628f ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-02-06 18:06:16.409865) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-02-06 18:06:16.410369) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-06 18:06:16.410659) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-06 18:06:16.427246) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-06 18:06:16.427614) ========= 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=db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-02-06 18:06:16-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.3M=0s 2017-02-06 18:06:16 (46.3 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.070235 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-06 18:06:16.510946) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-06 18:06:16.511262) ========= 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=db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019619 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-06 18:06:16.560646) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-02-06 18:06:16.560996) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev feb1845bb0db8d50b9fea389700f70f1de1b628f --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-beta --rev feb1845bb0db8d50b9fea389700f70f1de1b628f --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=db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-02-06 18:06:16,796 truncating revision to first 12 chars 2017-02-06 18:06:16,797 Setting DEBUG logging. 2017-02-06 18:06:16,797 attempt 1/10 2017-02-06 18:06:16,797 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/feb1845bb0db?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-02-06 18:06:18,255 unpacking tar archive at: mozilla-beta-feb1845bb0db/testing/mozharness/ program finished with exit code 0 elapsedTime=1.756787 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-02-06 18:06:18.330682) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-06 18:06:18.331015) ========= script_repo_revision: feb1845bb0db8d50b9fea389700f70f1de1b628f ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-06 18:06:18.331412) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-06 18:06:18.331691) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-06 18:06:18.341194) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2017-02-06 18:06:18.341594) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 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', 'Mozilla-Beta', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] 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=db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 18:06:18 INFO - MultiFileLogger online at 20170206 18:06:18 in /builds/slave/test 18:06:18 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 18:06:18 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 18:06:18 INFO - {'append_to_log': False, 18:06:18 INFO - 'base_work_dir': '/builds/slave/test', 18:06:18 INFO - 'blob_upload_branch': 'Mozilla-Beta', 18:06:18 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 18:06:18 INFO - 'branch': 'Mozilla-Beta', 18:06:18 INFO - 'buildbot_json_path': 'buildprops.json', 18:06:18 INFO - 'config_files': ('talos/linux_config.py',), 18:06:18 INFO - 'default_actions': ('clobber', 18:06:18 INFO - 'read-buildbot-config', 18:06:18 INFO - 'download-and-extract', 18:06:18 INFO - 'populate-webroot', 18:06:18 INFO - 'create-virtualenv', 18:06:18 INFO - 'install', 18:06:18 INFO - 'run-tests'), 18:06:18 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 18:06:18 INFO - 'download_minidump_stackwalk': True, 18:06:18 INFO - 'download_symbols': 'ondemand', 18:06:18 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 18:06:18 INFO - 'tooltool.py': '/tools/tooltool.py', 18:06:18 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 18:06:18 INFO - '/tools/misc-python/virtualenv.py')}, 18:06:18 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 18:06:18 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 18:06:18 INFO - 'installer_path': 'installer.exe', 18:06:18 INFO - 'log_level': 'info', 18:06:18 INFO - 'log_name': 'talos', 18:06:18 INFO - 'log_to_console': True, 18:06:18 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 18:06:18 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 18:06:18 INFO - 'opt_config_files': (), 18:06:18 INFO - 'pip_index': False, 18:06:18 INFO - 'sps_profile': False, 18:06:18 INFO - 'sps_profile_interval': 0, 18:06:18 INFO - 'suite': 'dromaeojs-e10s', 18:06:18 INFO - 'system_bits': '32', 18:06:18 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 18:06:18 INFO - 'title': 'talos-linux64-ix-049', 18:06:18 INFO - 'tooltool_cache': '/builds/tooltool_cache', 18:06:18 INFO - 'use_talos_json': True, 18:06:18 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 18:06:18 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 18:06:18 INFO - 'work_dir': 'build'} 18:06:18 INFO - [mozharness: 2017-02-07 02:06:18.673539Z] Running clobber step. 18:06:18 INFO - Running pre-action listener: _resource_record_pre_action 18:06:18 INFO - Running main action method: clobber 18:06:18 INFO - rmtree: /builds/slave/test/build 18:06:18 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 18:06:19 INFO - Running post-action listener: _resource_record_post_action 18:06:19 INFO - [mozharness: 2017-02-07 02:06:19.697515Z] Finished clobber step (success) 18:06:19 INFO - [mozharness: 2017-02-07 02:06:19.697613Z] Running read-buildbot-config step. 18:06:19 INFO - Running pre-action listener: _resource_record_pre_action 18:06:19 INFO - Running main action method: read_buildbot_config 18:06:19 INFO - Using buildbot properties: 18:06:19 INFO - { 18:06:19 INFO - "project": "", 18:06:19 INFO - "product": "firefox", 18:06:19 INFO - "script_repo_revision": "production", 18:06:19 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s", 18:06:19 INFO - "repository": "", 18:06:19 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta pgo talos dromaeojs-e10s", 18:06:19 INFO - "buildid": "20170206162459", 18:06:19 INFO - "pgo_build": "True", 18:06:19 INFO - "basedir": "/builds/slave/test", 18:06:19 INFO - "buildnumber": 322, 18:06:19 INFO - "slavename": "talos-linux64-ix-049", 18:06:19 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 18:06:19 INFO - "platform": "ubuntu64_hw", 18:06:19 INFO - "scheduler": "tests-mozilla-beta-linux64-pgo-talos", 18:06:19 INFO - "branch": "mozilla-beta", 18:06:19 INFO - "repo_path": "releases/mozilla-beta", 18:06:19 INFO - "revision": "feb1845bb0db8d50b9fea389700f70f1de1b628f", 18:06:19 INFO - "stage_platform": "linux64-pgo", 18:06:19 INFO - "builduid": "3b5e821eacc543d2b022e37ab14f0cfa", 18:06:19 INFO - "slavebuilddir": "test" 18:06:19 INFO - } 18:06:19 INFO - Found installer url https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2. 18:06:19 INFO - Running post-action listener: _resource_record_post_action 18:06:19 INFO - [mozharness: 2017-02-07 02:06:19.700001Z] Finished read-buildbot-config step (success) 18:06:19 INFO - [mozharness: 2017-02-07 02:06:19.700088Z] Running download-and-extract step. 18:06:19 INFO - Running pre-action listener: _resource_record_pre_action 18:06:19 INFO - Running main action method: download_and_extract 18:06:19 INFO - mkdir: /builds/slave/test/build/tests 18:06:19 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')]} 18:06:19 INFO - trying https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.test_packages.json 18:06:19 INFO - Downloading https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.test_packages.json 18:06:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.test_packages.json'}, attempt #1 18:06:20 INFO - Downloaded 1327 bytes. 18:06:20 INFO - Reading from file /builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.test_packages.json 18:06:20 INFO - Using the following test package requirements: 18:06:20 INFO - {u'common': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip'], 18:06:20 INFO - u'cppunittest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 18:06:20 INFO - u'firefox-52.0.en-US.linux-x86_64.cppunittest.tests.zip'], 18:06:20 INFO - u'gtest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 18:06:20 INFO - u'firefox-52.0.en-US.linux-x86_64.gtest.tests.zip'], 18:06:20 INFO - u'jittest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 18:06:20 INFO - u'jsshell-linux-x86_64.zip'], 18:06:20 INFO - u'mochitest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 18:06:20 INFO - u'firefox-52.0.en-US.linux-x86_64.mochitest.tests.zip'], 18:06:20 INFO - u'mozbase': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip'], 18:06:20 INFO - u'reftest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 18:06:20 INFO - u'firefox-52.0.en-US.linux-x86_64.reftest.tests.zip'], 18:06:20 INFO - u'talos': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 18:06:20 INFO - u'firefox-52.0.en-US.linux-x86_64.talos.tests.zip'], 18:06:20 INFO - u'web-platform': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 18:06:20 INFO - u'firefox-52.0.en-US.linux-x86_64.web-platform.tests.zip'], 18:06:20 INFO - u'xpcshell': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 18:06:20 INFO - u'firefox-52.0.en-US.linux-x86_64.xpcshell.tests.zip']} 18:06:20 INFO - Downloading packages: [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 18:06:20 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip 18:06:20 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:06:20 INFO - Fetch https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip into memory 18:06:20 INFO - Http code: 200 18:06:20 INFO - via: 1.1 d2bd759914e30b1d5aee2929535c55f9.cloudfront.net (CloudFront) 18:06:20 INFO - x-amz-cf-id: q541nmHNX4X6_LgNmVhxu5Dx6pZO3hbGxgiSVLDyZdoDqkl5vTG8hA== 18:06:20 INFO - x-amz-version-id: hnu9QqNGGYFRs59vPV8ZbJT9N2QUO_O0 18:06:21 INFO - Expected file size: 21957045 18:06:21 INFO - Obtained file size: 21957045 18:06:25 INFO - Downloading packages: [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', u'firefox-52.0.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 18:06:25 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip 18:06:25 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:06:25 INFO - Fetch https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip into memory 18:06:25 INFO - Http code: 200 18:06:25 INFO - via: 1.1 d2bd759914e30b1d5aee2929535c55f9.cloudfront.net (CloudFront) 18:06:25 INFO - x-amz-cf-id: V7sJN4vrLOINWa91IjK3ZGojzgs8ilgWN8XCi_30F1A7cjuJyNDc6A== 18:06:25 INFO - x-amz-version-id: hnu9QqNGGYFRs59vPV8ZbJT9N2QUO_O0 18:06:26 INFO - Expected file size: 21957045 18:06:26 INFO - Obtained file size: 21957045 18:06:30 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.talos.tests.zip 18:06:30 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 18:06:30 INFO - Fetch https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.talos.tests.zip into memory 18:06:30 INFO - Http code: 200 18:06:30 INFO - via: 1.1 d2bd759914e30b1d5aee2929535c55f9.cloudfront.net (CloudFront) 18:06:30 INFO - x-amz-cf-id: wQ7zVSTh2phY4yVer6l0TLau_UkaUJlZkAnSFMF4LLHqjRcNg0b31Q== 18:06:30 INFO - x-amz-version-id: 0XRaK_9hrMOxpRJrLS1gZiJeDyN9H1Oo 18:06:31 INFO - Expected file size: 14403005 18:06:31 INFO - Obtained file size: 14403005 18:06:31 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')]} 18:06:31 INFO - trying https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 18:06:31 INFO - Downloading https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 18:06:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.tar.bz2'}, attempt #1 18:06:32 INFO - Downloaded 57702403 bytes. 18:06:32 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 18:06:32 INFO - mkdir: /builds/slave/test/properties 18:06:32 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 18:06:32 INFO - Writing to file /builds/slave/test/properties/build_url 18:06:32 INFO - Contents: 18:06:32 INFO - build_url:https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 18:06:33 INFO - Running post-action listener: _resource_record_post_action 18:06:33 INFO - Running post-action listener: set_extra_try_arguments 18:06:33 INFO - [mozharness: 2017-02-07 02:06:33.190977Z] Finished download-and-extract step (success) 18:06:33 INFO - [mozharness: 2017-02-07 02:06:33.191204Z] Running populate-webroot step. 18:06:33 INFO - Running pre-action listener: _resource_record_pre_action 18:06:33 INFO - Running main action method: populate_webroot 18:06:33 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 18:06:33 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 18:06:33 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 18:06:33 INFO - '--tppagecycles', 18:06:33 INFO - '7'], 18:06:33 INFO - 'tests': ['tsvgm']}}, 18:06:33 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 18:06:33 INFO - 'tests': ['tresize', 'tcanvasmark']}, 18:06:33 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 18:06:33 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 18:06:33 INFO - 'tests': ['dromaeo_css', 'kraken']}, 18:06:33 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 18:06:33 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:06:33 INFO - 'talos_options': ['--disable-e10s'], 18:06:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:06:33 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:06:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:06:33 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:06:33 INFO - 'talos_options': ['--disable-e10s'], 18:06:33 INFO - 'tests': ['damp', 'tps']}, 18:06:33 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:06:33 INFO - 'tests': ['damp', 'tps']}, 18:06:33 INFO - 'g3': {'talos_options': ['--disable-e10s'], 18:06:33 INFO - 'tests': ['dromaeo_dom']}, 18:06:33 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 18:06:33 INFO - 'g4': {'talos_options': ['--disable-e10s'], 18:06:33 INFO - 'tests': ['basic_compositor_video']}, 18:06:33 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 18:06:33 INFO - 'other': {'talos_options': ['--disable-e10s'], 18:06:33 INFO - 'tests': ['a11yr', 18:06:33 INFO - 'ts_paint', 18:06:33 INFO - 'tpaint', 18:06:33 INFO - 'sessionrestore', 18:06:33 INFO - 'sessionrestore_no_auto_restore', 18:06:33 INFO - 'tabpaint']}, 18:06:33 INFO - 'other-e10s': {'tests': ['a11yr', 18:06:33 INFO - 'ts_paint', 18:06:33 INFO - 'tpaint', 18:06:33 INFO - 'sessionrestore', 18:06:33 INFO - 'sessionrestore_no_auto_restore', 18:06:33 INFO - 'tabpaint']}, 18:06:33 INFO - 'other-e10s_l64': {'tests': ['a11yr', 18:06:33 INFO - 'ts_paint', 18:06:33 INFO - 'tpaint', 18:06:33 INFO - 'sessionrestore', 18:06:33 INFO - 'sessionrestore_no_auto_restore', 18:06:33 INFO - 'tabpaint']}, 18:06:33 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 18:06:33 INFO - 'ts_paint', 18:06:33 INFO - 'tpaint', 18:06:33 INFO - 'sessionrestore', 18:06:33 INFO - 'sessionrestore_no_auto_restore', 18:06:33 INFO - 'tabpaint']}, 18:06:33 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 18:06:33 INFO - 'tests': ['a11yr', 18:06:33 INFO - 'ts_paint', 18:06:33 INFO - 'tpaint', 18:06:33 INFO - 'sessionrestore', 18:06:33 INFO - 'sessionrestore_no_auto_restore', 18:06:33 INFO - 'tabpaint']}, 18:06:33 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 18:06:33 INFO - 'tests': ['a11yr', 18:06:33 INFO - 'ts_paint', 18:06:33 INFO - 'tpaint', 18:06:33 INFO - 'sessionrestore', 18:06:33 INFO - 'sessionrestore_no_auto_restore', 18:06:33 INFO - 'tabpaint']}, 18:06:33 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 18:06:33 INFO - 'tests': ['tsvgx', 18:06:33 INFO - 'tsvgr_opacity', 18:06:33 INFO - 'tart', 18:06:33 INFO - 'tscrollx', 18:06:33 INFO - 'cart']}, 18:06:33 INFO - 'svgr-e10s': {'tests': ['tsvgx', 18:06:33 INFO - 'tsvgr_opacity', 18:06:33 INFO - 'tart', 18:06:33 INFO - 'tscrollx', 18:06:33 INFO - 'cart']}, 18:06:33 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:06:33 INFO - 'talos_options': ['--disable-e10s'], 18:06:33 INFO - 'tests': ['tp5o']}, 18:06:33 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:06:33 INFO - 'tests': ['tp5o']}, 18:06:33 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:06:33 INFO - 'talos_options': ['--disable-e10s', 18:06:33 INFO - '--xperf_path', 18:06:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:06:33 INFO - 'tests': ['tp5n']}, 18:06:33 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:06:33 INFO - 'talos_options': ['--xperf_path', 18:06:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:06:33 INFO - 'tests': ['tp5n']}}, 18:06:33 INFO - 'talos.zip': {'path': '', 18:06:33 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 18:06:33 INFO - Running post-action listener: _resource_record_post_action 18:06:33 INFO - [mozharness: 2017-02-07 02:06:33.210755Z] Finished populate-webroot step (success) 18:06:33 INFO - [mozharness: 2017-02-07 02:06:33.210843Z] Running create-virtualenv step. 18:06:33 INFO - Running pre-action listener: _resource_record_pre_action 18:06:33 INFO - Running main action method: create_virtualenv 18:06:33 INFO - Creating virtualenv /builds/slave/test/build/venv 18:06:33 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 18:06:33 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 18:06:33 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 18:06:33 INFO - Using real prefix '/usr' 18:06:33 INFO - New python executable in /builds/slave/test/build/venv/bin/python 18:06:33 INFO - Installing distribute.............................................................................................................................................................................................done. 18:06:35 INFO - Installing pip.................done. 18:06:35 INFO - Return code: 0 18:06:35 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 18:06:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 18:06:36 INFO - Reading from file tmpfile_stdout 18:06:36 INFO - Output received: 18:06:36 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 18:06:36 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 18:06:36 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')]} 18:06:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:06:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:36 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')]} 18:06:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:06:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:36 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 0x7ff0c1803f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ea78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f74ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f71f60>, '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 0x1f72d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f731d0>, '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': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', '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 18:06:36 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 18:06:36 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 18:06:36 INFO - Using env: {'DISPLAY': ':0', 18:06:36 INFO - 'HOME': '/home/cltbld', 18:06:36 INFO - 'LANG': 'en_US.UTF-8', 18:06:36 INFO - 'LANGUAGE': 'en_US:en', 18:06:36 INFO - 'LOGNAME': 'cltbld', 18:06:36 INFO - 'MAIL': '/var/mail/cltbld', 18:06:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:06:36 INFO - 'MOZ_NO_REMOTE': '1', 18:06:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:06:36 INFO - 'NO_EM_RESTART': '1', 18:06:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:06:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:06:36 INFO - 'PWD': '/builds/slave/test', 18:06:36 INFO - 'SHELL': '/bin/bash', 18:06:36 INFO - 'SHLVL': '1', 18:06:36 INFO - 'TERM': 'linux', 18:06:36 INFO - 'TMOUT': '86400', 18:06:36 INFO - 'USER': 'cltbld', 18:06:36 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', 18:06:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:06:36 INFO - '_': '/tools/buildbot/bin/python'} 18:06:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:06:36 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 18:06:36 INFO - Cleaning up... 18:06:36 INFO - Return code: 0 18:06:36 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 18:06:36 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')]} 18:06:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:06:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:36 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')]} 18:06:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:06:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:36 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 0x7ff0c1803f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ea78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f74ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f71f60>, '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 0x1f72d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f731d0>, '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': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', '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 18:06:36 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 18:06:36 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 18:06:36 INFO - Using env: {'DISPLAY': ':0', 18:06:36 INFO - 'HOME': '/home/cltbld', 18:06:36 INFO - 'LANG': 'en_US.UTF-8', 18:06:36 INFO - 'LANGUAGE': 'en_US:en', 18:06:36 INFO - 'LOGNAME': 'cltbld', 18:06:36 INFO - 'MAIL': '/var/mail/cltbld', 18:06:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:06:36 INFO - 'MOZ_NO_REMOTE': '1', 18:06:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:06:36 INFO - 'NO_EM_RESTART': '1', 18:06:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:06:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:06:36 INFO - 'PWD': '/builds/slave/test', 18:06:36 INFO - 'SHELL': '/bin/bash', 18:06:36 INFO - 'SHLVL': '1', 18:06:36 INFO - 'TERM': 'linux', 18:06:36 INFO - 'TMOUT': '86400', 18:06:36 INFO - 'USER': 'cltbld', 18:06:36 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', 18:06:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:06:36 INFO - '_': '/tools/buildbot/bin/python'} 18:06:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:06:36 INFO - Downloading/unpacking psutil>=3.1.1 18:06:36 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 18:06:36 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 18:06:36 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 18:06:36 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 18:06:36 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 18:06:36 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 18:06:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 18:06:38 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:06:38 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:06:38 INFO - Installing collected packages: psutil 18:06:38 INFO - Running setup.py install for psutil 18:06:38 INFO - building 'psutil._psutil_linux' extension 18:06:38 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 18:06:38 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 18:06:38 INFO - building 'psutil._psutil_posix' extension 18:06:38 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 18:06:38 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 18:06:39 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:06:39 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:06:39 INFO - Successfully installed psutil 18:06:39 INFO - Cleaning up... 18:06:39 INFO - Return code: 0 18:06:39 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 18:06:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:06:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:06:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:06:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:06:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:39 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 0x7ff0c1803f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ea78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f74ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f71f60>, '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 0x1f72d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f731d0>, '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': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', '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 18:06:39 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 18:06:39 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 18:06:39 INFO - Using env: {'DISPLAY': ':0', 18:06:39 INFO - 'HOME': '/home/cltbld', 18:06:39 INFO - 'LANG': 'en_US.UTF-8', 18:06:39 INFO - 'LANGUAGE': 'en_US:en', 18:06:39 INFO - 'LOGNAME': 'cltbld', 18:06:39 INFO - 'MAIL': '/var/mail/cltbld', 18:06:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:06:39 INFO - 'MOZ_NO_REMOTE': '1', 18:06:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:06:39 INFO - 'NO_EM_RESTART': '1', 18:06:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:06:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:06:39 INFO - 'PWD': '/builds/slave/test', 18:06:39 INFO - 'SHELL': '/bin/bash', 18:06:39 INFO - 'SHLVL': '1', 18:06:39 INFO - 'TERM': 'linux', 18:06:39 INFO - 'TMOUT': '86400', 18:06:39 INFO - 'USER': 'cltbld', 18:06:39 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', 18:06:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:06:39 INFO - '_': '/tools/buildbot/bin/python'} 18:06:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:06:39 INFO - Downloading/unpacking mozsystemmonitor==0.3 18:06:39 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 18:06:39 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 18:06:39 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 18:06:39 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 18:06:39 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 18:06:39 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 18:06:41 INFO - Downloading mozsystemmonitor-0.3.tar.gz 18:06:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 18:06:41 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 18:06:41 INFO - Installing collected packages: mozsystemmonitor 18:06:41 INFO - Running setup.py install for mozsystemmonitor 18:06:41 INFO - Successfully installed mozsystemmonitor 18:06:41 INFO - Cleaning up... 18:06:41 INFO - Return code: 0 18:06:41 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 18:06:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:06:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:06:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:06:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:06:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:41 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 0x7ff0c1803f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ea78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f74ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f71f60>, '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 0x1f72d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f731d0>, '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': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', '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 18:06:41 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 18:06:41 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 18:06:41 INFO - Using env: {'DISPLAY': ':0', 18:06:41 INFO - 'HOME': '/home/cltbld', 18:06:41 INFO - 'LANG': 'en_US.UTF-8', 18:06:41 INFO - 'LANGUAGE': 'en_US:en', 18:06:41 INFO - 'LOGNAME': 'cltbld', 18:06:41 INFO - 'MAIL': '/var/mail/cltbld', 18:06:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:06:41 INFO - 'MOZ_NO_REMOTE': '1', 18:06:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:06:41 INFO - 'NO_EM_RESTART': '1', 18:06:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:06:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:06:41 INFO - 'PWD': '/builds/slave/test', 18:06:41 INFO - 'SHELL': '/bin/bash', 18:06:41 INFO - 'SHLVL': '1', 18:06:41 INFO - 'TERM': 'linux', 18:06:41 INFO - 'TMOUT': '86400', 18:06:41 INFO - 'USER': 'cltbld', 18:06:41 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', 18:06:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:06:41 INFO - '_': '/tools/buildbot/bin/python'} 18:06:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:06:41 INFO - Downloading/unpacking jsonschema==2.5.1 18:06:41 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 18:06:41 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 18:06:41 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 18:06:41 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 18:06:41 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 18:06:41 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 18:06:43 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 18:06:43 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 18:06:43 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 18:06:43 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 18:06:43 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 18:06:43 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 18:06:43 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 18:06:43 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 18:06:43 INFO - Downloading functools32-3.2.3-2.tar.gz 18:06:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 18:06:44 INFO - warning: no files found matching '*.txt' 18:06:44 INFO - no previously-included directories found matching 'build' 18:06:44 INFO - no previously-included directories found matching 'dist' 18:06:44 INFO - no previously-included directories found matching '.git*' 18:06:44 INFO - Installing collected packages: jsonschema, functools32 18:06:44 INFO - Running setup.py install for functools32 18:06:44 INFO - warning: no files found matching '*.txt' 18:06:44 INFO - no previously-included directories found matching 'build' 18:06:44 INFO - no previously-included directories found matching 'dist' 18:06:44 INFO - no previously-included directories found matching '.git*' 18:06:44 INFO - Successfully installed jsonschema functools32 18:06:44 INFO - Cleaning up... 18:06:44 INFO - Return code: 0 18:06:44 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 18:06:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:06:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:06:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:06:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:06:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:44 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 0x7ff0c1803f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ea78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f74ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f71f60>, '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 0x1f72d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f731d0>, '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': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', '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 18:06:44 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 18:06:44 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 18:06:44 INFO - Using env: {'DISPLAY': ':0', 18:06:44 INFO - 'HOME': '/home/cltbld', 18:06:44 INFO - 'LANG': 'en_US.UTF-8', 18:06:44 INFO - 'LANGUAGE': 'en_US:en', 18:06:44 INFO - 'LOGNAME': 'cltbld', 18:06:44 INFO - 'MAIL': '/var/mail/cltbld', 18:06:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:06:44 INFO - 'MOZ_NO_REMOTE': '1', 18:06:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:06:44 INFO - 'NO_EM_RESTART': '1', 18:06:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:06:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:06:44 INFO - 'PWD': '/builds/slave/test', 18:06:44 INFO - 'SHELL': '/bin/bash', 18:06:44 INFO - 'SHLVL': '1', 18:06:44 INFO - 'TERM': 'linux', 18:06:44 INFO - 'TMOUT': '86400', 18:06:44 INFO - 'USER': 'cltbld', 18:06:44 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', 18:06:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:06:44 INFO - '_': '/tools/buildbot/bin/python'} 18:06:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:06:44 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 18:06:44 INFO - Cleaning up... 18:06:44 INFO - Return code: 0 18:06:44 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 18:06:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:06:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:06:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:06:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:06:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:44 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 0x7ff0c1803f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ea78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f74ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f71f60>, '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 0x1f72d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f731d0>, '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': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', '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 18:06:44 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 18:06:44 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 18:06:44 INFO - Using env: {'DISPLAY': ':0', 18:06:44 INFO - 'HOME': '/home/cltbld', 18:06:44 INFO - 'LANG': 'en_US.UTF-8', 18:06:44 INFO - 'LANGUAGE': 'en_US:en', 18:06:44 INFO - 'LOGNAME': 'cltbld', 18:06:44 INFO - 'MAIL': '/var/mail/cltbld', 18:06:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:06:44 INFO - 'MOZ_NO_REMOTE': '1', 18:06:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:06:44 INFO - 'NO_EM_RESTART': '1', 18:06:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:06:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:06:44 INFO - 'PWD': '/builds/slave/test', 18:06:44 INFO - 'SHELL': '/bin/bash', 18:06:44 INFO - 'SHLVL': '1', 18:06:44 INFO - 'TERM': 'linux', 18:06:44 INFO - 'TMOUT': '86400', 18:06:44 INFO - 'USER': 'cltbld', 18:06:44 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', 18:06:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:06:44 INFO - '_': '/tools/buildbot/bin/python'} 18:06:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:06:44 INFO - Downloading/unpacking blobuploader==1.2.4 18:06:44 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 18:06:44 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 18:06:44 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 18:06:44 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 18:06:44 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 18:06:44 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 18:06:46 INFO - Downloading blobuploader-1.2.4.tar.gz 18:06:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 18:06:46 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 18:06:46 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 18:06:46 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 18:06:46 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 18:06:46 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 18:06:46 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 18:06:46 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 18:06:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 18:06:47 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 18:06:47 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 18:06:47 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 18:06:47 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 18:06:47 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 18:06:47 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 18:06:47 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 18:06:47 INFO - Downloading docopt-0.6.1.tar.gz 18:06:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 18:06:47 INFO - Installing collected packages: blobuploader, requests, docopt 18:06:47 INFO - Running setup.py install for blobuploader 18:06:47 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 18:06:47 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 18:06:47 INFO - Running setup.py install for requests 18:06:47 INFO - Running setup.py install for docopt 18:06:48 INFO - Successfully installed blobuploader requests docopt 18:06:48 INFO - Cleaning up... 18:06:48 INFO - Return code: 0 18:06:48 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:06: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')]} 18:06:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:06:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06: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')]} 18:06:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:06:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:48 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 0x7ff0c1803f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ea78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f74ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f71f60>, '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 0x1f72d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f731d0>, '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': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', '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 18:06:48 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 18:06:48 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 18:06:48 INFO - Using env: {'DISPLAY': ':0', 18:06:48 INFO - 'HOME': '/home/cltbld', 18:06:48 INFO - 'LANG': 'en_US.UTF-8', 18:06:48 INFO - 'LANGUAGE': 'en_US:en', 18:06:48 INFO - 'LOGNAME': 'cltbld', 18:06:48 INFO - 'MAIL': '/var/mail/cltbld', 18:06:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:06:48 INFO - 'MOZ_NO_REMOTE': '1', 18:06:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:06:48 INFO - 'NO_EM_RESTART': '1', 18:06:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:06:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:06:48 INFO - 'PWD': '/builds/slave/test', 18:06:48 INFO - 'SHELL': '/bin/bash', 18:06:48 INFO - 'SHLVL': '1', 18:06:48 INFO - 'TERM': 'linux', 18:06:48 INFO - 'TMOUT': '86400', 18:06:48 INFO - 'USER': 'cltbld', 18:06:48 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', 18:06:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:06:48 INFO - '_': '/tools/buildbot/bin/python'} 18:06:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:06:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:06:48 INFO - Running setup.py (path:/tmp/pip-ePL8tF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:06:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:06:48 INFO - Running setup.py (path:/tmp/pip-ipZlzi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:06:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:06:48 INFO - Running setup.py (path:/tmp/pip-cQTDRx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:06:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:06:48 INFO - Running setup.py (path:/tmp/pip-pyTyxb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:06:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:06:48 INFO - Running setup.py (path:/tmp/pip-K1GtYv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:06:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:06:48 INFO - Running setup.py (path:/tmp/pip-O9cy_n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:06:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:06:48 INFO - Running setup.py (path:/tmp/pip-JXrsIY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:06:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:06:48 INFO - Running setup.py (path:/tmp/pip-2pWLk2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:06:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:06:48 INFO - Running setup.py (path:/tmp/pip-C2qCTn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:06:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:06:48 INFO - Running setup.py (path:/tmp/pip-lLnzwr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:06:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:06:49 INFO - Running setup.py (path:/tmp/pip-b2njmp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:06:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:06:49 INFO - Running setup.py (path:/tmp/pip-Bs8uNa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:06:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:06:49 INFO - Running setup.py (path:/tmp/pip-3lEDIK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:06:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:06:49 INFO - Running setup.py (path:/tmp/pip-C5M13F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:06:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:06:49 INFO - Running setup.py (path:/tmp/pip-et2OVM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:06:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:06:49 INFO - Running setup.py (path:/tmp/pip-Er_wVS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:06:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:06:49 INFO - Running setup.py (path:/tmp/pip-mXpXrL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:06:49 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 18:06:49 INFO - Running setup.py install for manifestparser 18:06:49 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 18:06:49 INFO - Running setup.py install for mozcrash 18:06:49 INFO - Running setup.py install for mozdebug 18:06:49 INFO - Running setup.py install for mozdevice 18:06:49 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 18:06:49 INFO - Installing dm script to /builds/slave/test/build/venv/bin 18:06:49 INFO - Running setup.py install for mozfile 18:06:50 INFO - Running setup.py install for mozhttpd 18:06:50 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 18:06:50 INFO - Running setup.py install for mozinfo 18:06:50 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 18:06:50 INFO - Running setup.py install for mozInstall 18:06:50 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 18:06:50 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 18:06:50 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 18:06:50 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 18:06:50 INFO - Running setup.py install for mozleak 18:06:50 INFO - Running setup.py install for mozlog 18:06:50 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 18:06:50 INFO - Running setup.py install for moznetwork 18:06:50 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 18:06:50 INFO - Running setup.py install for mozprocess 18:06:50 INFO - Running setup.py install for mozprofile 18:06:50 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 18:06:50 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 18:06:50 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 18:06:50 INFO - Running setup.py install for mozrunner 18:06:51 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 18:06:51 INFO - Running setup.py install for mozscreenshot 18:06:51 INFO - Running setup.py install for moztest 18:06:51 INFO - Running setup.py install for mozversion 18:06:51 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 18:06:51 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 18:06:51 INFO - Cleaning up... 18:06:51 INFO - Return code: 0 18:06:51 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:06:51 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')]} 18:06:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:06:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:51 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')]} 18:06:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:06:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:51 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 0x7ff0c1803f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ea78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f74ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f71f60>, '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 0x1f72d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f731d0>, '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': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', '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 18:06:51 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 18:06:51 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 18:06:51 INFO - Using env: {'DISPLAY': ':0', 18:06:51 INFO - 'HOME': '/home/cltbld', 18:06:51 INFO - 'LANG': 'en_US.UTF-8', 18:06:51 INFO - 'LANGUAGE': 'en_US:en', 18:06:51 INFO - 'LOGNAME': 'cltbld', 18:06:51 INFO - 'MAIL': '/var/mail/cltbld', 18:06:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:06:51 INFO - 'MOZ_NO_REMOTE': '1', 18:06:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:06:51 INFO - 'NO_EM_RESTART': '1', 18:06:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:06:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:06:51 INFO - 'PWD': '/builds/slave/test', 18:06:51 INFO - 'SHELL': '/bin/bash', 18:06:51 INFO - 'SHLVL': '1', 18:06:51 INFO - 'TERM': 'linux', 18:06:51 INFO - 'TMOUT': '86400', 18:06:51 INFO - 'USER': 'cltbld', 18:06:51 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', 18:06:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:06:51 INFO - '_': '/tools/buildbot/bin/python'} 18:06:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:06:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:06:51 INFO - Running setup.py (path:/tmp/pip-GeTPmb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:06:51 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)) 18:06:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:06:51 INFO - Running setup.py (path:/tmp/pip-oBd5r8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:06:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 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)) 18:06:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:06:51 INFO - Running setup.py (path:/tmp/pip-_8fKMS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:06:51 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)) 18:06:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:06:51 INFO - Running setup.py (path:/tmp/pip-Ms_Alz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:06:51 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)) 18:06:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:06:51 INFO - Running setup.py (path:/tmp/pip-Z03o8E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:06:51 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)) 18:06:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:06:51 INFO - Running setup.py (path:/tmp/pip-OjX1VT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:06:52 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)) 18:06:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:06:52 INFO - Running setup.py (path:/tmp/pip-Ir7VOp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:06:52 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)) 18:06:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:06:52 INFO - Running setup.py (path:/tmp/pip-w40djT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:06:52 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)) 18:06:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:06:52 INFO - Running setup.py (path:/tmp/pip-jFFcGM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:06:52 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)) 18:06:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:06:52 INFO - Running setup.py (path:/tmp/pip-jQox8U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:06:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 18:06:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:06:52 INFO - Running setup.py (path:/tmp/pip-YbMAtV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:06:52 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)) 18:06:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:06:52 INFO - Running setup.py (path:/tmp/pip-J72xMa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:06:52 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)) 18:06:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:06:52 INFO - Running setup.py (path:/tmp/pip-zCm_EL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:06:52 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)) 18:06:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:06:52 INFO - Running setup.py (path:/tmp/pip-vCqYXU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:06:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 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)) 18:06:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:06:52 INFO - Running setup.py (path:/tmp/pip-Xo6dpX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:06:52 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)) 18:06:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:06:52 INFO - Running setup.py (path:/tmp/pip-oSW2jM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:06:52 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 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)) 18:06:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:06:52 INFO - Running setup.py (path:/tmp/pip-_Rqpni-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:06:52 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)) 18:06:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:06:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:06:52 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)) 18:06:52 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)) 18:06:52 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)) 18:06:52 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 18:06:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:06:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:06:52 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:06:52 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:06:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:06:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:06:54 INFO - Downloading blessings-1.6.tar.gz 18:06:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 18:06:54 INFO - Installing collected packages: blessings 18:06:54 INFO - Running setup.py install for blessings 18:06:55 INFO - Successfully installed blessings 18:06:55 INFO - Cleaning up... 18:06:55 INFO - Return code: 0 18:06:55 INFO - Done creating virtualenv /builds/slave/test/build/venv. 18:06:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:06:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:06:55 INFO - Reading from file tmpfile_stdout 18:06:55 INFO - Current package versions: 18:06:55 INFO - argparse == 1.2.1 18:06:55 INFO - blessings == 1.6 18:06:55 INFO - blobuploader == 1.2.4 18:06:55 INFO - docopt == 0.6.1 18:06:55 INFO - functools32 == 3.2.3-2 18:06:55 INFO - jsonschema == 2.5.1 18:06:55 INFO - manifestparser == 1.1 18:06:55 INFO - mozInstall == 1.12 18:06:55 INFO - mozcrash == 1.0 18:06:55 INFO - mozdebug == 0.1 18:06:55 INFO - mozdevice == 0.48 18:06:55 INFO - mozfile == 1.2 18:06:55 INFO - mozhttpd == 0.7 18:06:55 INFO - mozinfo == 0.9 18:06:55 INFO - mozleak == 0.1 18:06:55 INFO - mozlog == 3.4 18:06:55 INFO - moznetwork == 0.27 18:06:55 INFO - mozprocess == 0.23 18:06:55 INFO - mozprofile == 0.28 18:06:55 INFO - mozrunner == 6.13 18:06:55 INFO - mozscreenshot == 0.1 18:06:55 INFO - mozsystemmonitor == 0.3 18:06:55 INFO - moztest == 0.8 18:06:55 INFO - mozversion == 1.4 18:06:55 INFO - psutil == 3.1.1 18:06:55 INFO - requests == 1.2.3 18:06:55 INFO - wsgiref == 0.1.2 18:06:55 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:06:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:06:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:06:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:06:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:06:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:55 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 0x7ff0c1803f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ea78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f74ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f71f60>, '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 0x1f72d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f731d0>, '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': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', '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 18:06:55 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 18:06:55 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 18:06:55 INFO - Using env: {'DISPLAY': ':0', 18:06:55 INFO - 'HOME': '/home/cltbld', 18:06:55 INFO - 'LANG': 'en_US.UTF-8', 18:06:55 INFO - 'LANGUAGE': 'en_US:en', 18:06:55 INFO - 'LOGNAME': 'cltbld', 18:06:55 INFO - 'MAIL': '/var/mail/cltbld', 18:06:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:06:55 INFO - 'MOZ_NO_REMOTE': '1', 18:06:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:06:55 INFO - 'NO_EM_RESTART': '1', 18:06:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:06:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:06:55 INFO - 'PWD': '/builds/slave/test', 18:06:55 INFO - 'SHELL': '/bin/bash', 18:06:55 INFO - 'SHLVL': '1', 18:06:55 INFO - 'TERM': 'linux', 18:06:55 INFO - 'TMOUT': '86400', 18:06:55 INFO - 'USER': 'cltbld', 18:06:55 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', 18:06:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:06:55 INFO - '_': '/tools/buildbot/bin/python'} 18:06:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:06:55 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)) 18:06:55 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)) 18:06:55 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)) 18:06:55 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)) 18:06:55 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)) 18:06:55 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)) 18:06:55 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)) 18:06:55 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)) 18:06:55 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)) 18:06:55 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)) 18:06:55 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)) 18:06:55 INFO - Cleaning up... 18:06:55 INFO - Return code: 0 18:06:55 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 18:06:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:06:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:06:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:06:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:06:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:06:55 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff0c1803f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ea78a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f74ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f71f60>, '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 0x1f72d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f731d0>, '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': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', '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 18:06:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 18:06:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 18:06:55 INFO - Using env: {'DISPLAY': ':0', 18:06:55 INFO - 'HOME': '/home/cltbld', 18:06:55 INFO - 'LANG': 'en_US.UTF-8', 18:06:55 INFO - 'LANGUAGE': 'en_US:en', 18:06:55 INFO - 'LOGNAME': 'cltbld', 18:06:55 INFO - 'MAIL': '/var/mail/cltbld', 18:06:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:06:55 INFO - 'MOZ_NO_REMOTE': '1', 18:06:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:06:55 INFO - 'NO_EM_RESTART': '1', 18:06:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:06:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:06:55 INFO - 'PWD': '/builds/slave/test', 18:06:55 INFO - 'SHELL': '/bin/bash', 18:06:55 INFO - 'SHLVL': '1', 18:06:55 INFO - 'TERM': 'linux', 18:06:55 INFO - 'TMOUT': '86400', 18:06:55 INFO - 'USER': 'cltbld', 18:06:55 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', 18:06:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:06:55 INFO - '_': '/tools/buildbot/bin/python'} 18:06:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:06:55 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 18:06:55 INFO - Cleaning up... 18:06:55 INFO - Return code: 0 18:06:55 INFO - Running post-action listener: _resource_record_post_action 18:06:55 INFO - Running post-action listener: _start_resource_monitoring 18:06:55 INFO - Starting resource monitoring. 18:06:55 INFO - [mozharness: 2017-02-07 02:06:55.837762Z] Finished create-virtualenv step (success) 18:06:55 INFO - [mozharness: 2017-02-07 02:06:55.838224Z] Running install step. 18:06:55 INFO - Running pre-action listener: _resource_record_pre_action 18:06:55 INFO - Running main action method: install 18:06:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:06:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:06:56 INFO - Reading from file tmpfile_stdout 18:06:56 INFO - Detecting whether we're running mozinstall >=1.0... 18:06:56 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 18:06:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 18:06:56 INFO - Reading from file tmpfile_stdout 18:06:56 INFO - Output received: 18:06:56 INFO - Usage: mozinstall [options] installer 18:06:56 INFO - Options: 18:06:56 INFO - -h, --help show this help message and exit 18:06:56 INFO - -d DEST, --destination=DEST 18:06:56 INFO - Directory to install application into. [default: 18:06:56 INFO - "/builds/slave/test"] 18:06:56 INFO - --app=APP Application being installed. [default: firefox] 18:06:56 INFO - mkdir: /builds/slave/test/build/application 18:06:56 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 18:06:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 18:07:09 INFO - Reading from file tmpfile_stdout 18:07:09 INFO - Output received: 18:07:09 INFO - /builds/slave/test/build/application/firefox/firefox 18:07:09 INFO - Running post-action listener: _resource_record_post_action 18:07:09 INFO - [mozharness: 2017-02-07 02:07:09.775620Z] Finished install step (success) 18:07:09 INFO - [mozharness: 2017-02-07 02:07:09.775862Z] Running run-tests step. 18:07:09 INFO - Running pre-action listener: _resource_record_pre_action 18:07:09 INFO - Running main action method: run_tests 18:07:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 18:07:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 18:07:09 INFO - Python 2.7.3 18:07:09 INFO - Return code: 0 18:07:09 INFO - grabbing minidump binary from tooltool 18:07:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 18:07:09 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 0x1f71f60>, '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 0x1f72d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1f731d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 18:07:09 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 18:07:09 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 18:07:09 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 18:07:09 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 18:07:09 INFO - Return code: 0 18:07:09 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 18:07:09 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 18:07:09 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 18:07:09 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 18:07:09 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 18:07:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-049', '--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 18:07:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-049 --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 18:07:09 INFO - Using env: {'DISPLAY': ':0', 18:07:09 INFO - 'HOME': '/home/cltbld', 18:07:09 INFO - 'LANG': 'en_US.UTF-8', 18:07:09 INFO - 'LANGUAGE': 'en_US:en', 18:07:09 INFO - 'LOGNAME': 'cltbld', 18:07:09 INFO - 'MAIL': '/var/mail/cltbld', 18:07:09 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 18:07:09 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 18:07:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:07:09 INFO - 'MOZ_NO_REMOTE': '1', 18:07:09 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 18:07:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:07:09 INFO - 'NO_EM_RESTART': '1', 18:07:09 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:07:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:07:09 INFO - 'PWD': '/builds/slave/test', 18:07:09 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 18:07:09 INFO - 'SHELL': '/bin/bash', 18:07:09 INFO - 'SHLVL': '1', 18:07:09 INFO - 'TERM': 'linux', 18:07:09 INFO - 'TMOUT': '86400', 18:07:09 INFO - 'USER': 'cltbld', 18:07:09 INFO - 'XDG_SESSION_COOKIE': 'db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589', 18:07:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:07:09 INFO - '_': '/tools/buildbot/bin/python'} 18:07:09 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-049', '--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 18:07:10 INFO - mozversion application_buildid: 20170206162459 18:07:10 INFO - mozversion application_changeset: feb1845bb0db8d50b9fea389700f70f1de1b628f 18:07:10 INFO - mozversion application_display_name: Firefox 18:07:10 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 18:07:10 INFO - mozversion application_name: Firefox 18:07:10 INFO - mozversion application_remotingname: firefox 18:07:10 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 18:07:10 INFO - mozversion application_vendor: Mozilla 18:07:10 INFO - mozversion application_version: 52.0 18:07:10 INFO - mozversion platform_buildid: 20170206162459 18:07:10 INFO - mozversion platform_changeset: feb1845bb0db8d50b9fea389700f70f1de1b628f 18:07:10 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 18:07:10 INFO - mozversion platform_version: 52.0 18:07:10 INFO - using testdate: 1486433230 18:07:10 INFO - actual date: 1486433230 18:07:10 INFO - starting webserver on 'localhost:42236' 18:07:10 INFO - SUITE-START | Running 2 tests 18:07:10 INFO - TEST-START | dromaeo_css 18:07:10 INFO - operating with platform_type : linux_ 18:07:10 INFO - Initialising browser for dromaeo_css test... 18:07:10 INFO - TEST-INFO | started process 3282 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWrfMwy/profile http://localhost:42236/getInfo.html) 18:07:14 INFO - PROCESS | 3282 | __metrics Screen width/height:1600/1200 18:07:14 INFO - PROCESS | 3282 | colorDepth:24 18:07:14 INFO - PROCESS | 3282 | Browser inner width/height: 1024/697 18:07:14 INFO - PROCESS | 3282 | __metrics 18:07:15 ERROR - PROCESS | 3282 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3197: TypeError: this.tabs is undefined 18:07:15 INFO - TEST-INFO | 3282: exit 0 18:07:15 INFO - Browser initialized. 18:07:15 INFO - Running cycle 1/1 for dromaeo_css test... 18:07:15 INFO - TEST-INFO | started process 3415 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWrfMwy/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:07:27 INFO - PROCESS | 3415 | RSS: Main: 148496384 18:07:27 INFO - PROCESS | 3415 | 18:10:27 INFO - PROCESS | 3415 | Cycle 1(1): loaded http://localhost:42236/tests/dromaeo/cssquery-dojo.html (next: http://localhost:42236/tests/dromaeo/cssquery-ext.html) 18:10:28 INFO - PROCESS | 3415 | RSS: Main: 153812992 18:10:28 INFO - PROCESS | 3415 | 18:13:30 INFO - PROCESS | 3415 | Cycle 1(1): loaded http://localhost:42236/tests/dromaeo/cssquery-ext.html (next: http://localhost:42236/tests/dromaeo/cssquery-jquery.html) 18:13:30 INFO - PROCESS | 3415 | RSS: Main: 152166400 18:13:30 INFO - PROCESS | 3415 | 18:16:32 INFO - PROCESS | 3415 | Cycle 1(1): loaded http://localhost:42236/tests/dromaeo/cssquery-jquery.html (next: http://localhost:42236/tests/dromaeo/cssquery-mootools.html) 18:16:33 INFO - PROCESS | 3415 | RSS: Main: 151310336 18:16:33 INFO - PROCESS | 3415 | 18:19:34 INFO - PROCESS | 3415 | Cycle 1(1): loaded http://localhost:42236/tests/dromaeo/cssquery-mootools.html (next: http://localhost:42236/tests/dromaeo/cssquery-prototype.html) 18:19:35 INFO - PROCESS | 3415 | RSS: Main: 152920064 18:19:35 INFO - PROCESS | 3415 | 18:22:37 INFO - PROCESS | 3415 | Cycle 1(1): loaded http://localhost:42236/tests/dromaeo/cssquery-prototype.html (next: http://localhost:42236/tests/dromaeo/cssquery-yui.html) 18:22:38 INFO - PROCESS | 3415 | RSS: Main: 154669056 18:22:38 INFO - PROCESS | 3415 | 18:25:40 INFO - PROCESS | 3415 | Cycle 1(1): loaded http://localhost:42236/tests/dromaeo/cssquery-yui.html (next: http://localhost:42236/tests/dromaeo/cssquery-dojo.html) 18:25:41 INFO - PROCESS | 3415 | RSS: Main: 154906624 18:25:41 INFO - PROCESS | 3415 | 18:25:41 INFO - PROCESS | 3415 | __start_tp_report 18:25:41 INFO - PROCESS | 3415 | _x_x_mozilla_page_load 18:25:41 INFO - PROCESS | 3415 | _x_x_mozilla_page_load_details 18:25:41 INFO - PROCESS | 3415 | |i|pagename|runs| 18:25:41 INFO - PROCESS | 3415 | |0;dojo.html;3260.2175477885307;3268.1012721501584;3297.3240485700426;3299.6535363786816;3309.3712194683008;5606.691631960241;5643.097104463287;5645.096784514479;5671.035923892938;5682.659040457575;5654.180143879135;5656.349519805223;5667.4049224831415;5731.283589551306;5742.770289188427;5123.462036486171;5161.993411284801;5186.299849520323;5214.895702085975;5217.686938783666;5206.635535512516;5211.869703257411;5213;5223.164293713006;5225;5032.043911656791;5057.468965758598;5212.1660534314515;5229.163333866582;5249.580033597303;5148.974255128719;5150.021495915764;5204.817831375922;5268.92096618551;5277.894442111175;5134.973005398935;5220.92168617471;5222.608304377187;5223.947760522384;5257.737113144366;5476.205950137248;5655.0103731847175;5669.121286200645;5765.221695071154;5773.220615216934;5924.348321684612;5979.910301345483;6019.458248757633;6058.0610005449225;6096.847578810521;6055.2430946131735;6175;6179.073139029137;6181.9690901545655;6206.720697568575;5736.627119237236;5742.425757424307;5749.13762935563;5752.194692743019;5760.8271751847515;6190.628562286277;6234.688265586702;6265.71804268809;6336.144620476269;6342.143810585512;6030;6063.484603808725;6068.75724971005;6077.453029227391;6086.695665216722;6018.879622407528;6064.090386442069;6139.47814435769;6141.447269745744;6152.323244443108;6060.454559089703;6104.786332478342;6106.511479081662;6116.17431646722;6123.234595675541;6049.758009679652;6064.939350606437;6065.96967015171;6118.265808102967;6119.388061193845;4555.476120246148;4575.359449677047;4599.241125214302;4684.882877928079;4724.102420540155;4106.650934670586;4193.203291374629;4213.052063285736;4226.450561426995;4243.448351714257;5835.124731290341;5835.153902684087;5863.589548731547;5871.706414679249;5877.9118313225335;5913;5955.76176952917;6121.663308518075;6122.877542449215;6129.540284478682;5768.509676677446;5811.27359080115;5851.268591426072;5900.232969713996;5940.435658612425;5299.947000530023;5301.257823904656;5308.362996440374;5309.814156504503;5313.840584782462;6109.938900610937;6394.0408938659575;6454.806355809334;6457.2574153971955;6461.547691661633;5986.551008674454;6089.5737298388685;6089.939100608937;6142.078688196628;6224.782132625336;6430.64631445275;6447.161868957006;6458.7093580789915;6463.224413070461;6486.772962946275;6080.2399700037495;6085.026395776655;6090.330063692902;6091.42131497507;6097.5426842987845;5862.12068189775;5970.283565971938;6022.849428764141;6052.273727152769;6098.237720284965;5905.793297234576;5918.644881307136;5936.614120082181;5998.070299103646;6001.519878409629;5913.231279933581;5936.465718085393;5951.315598706031;5971.373005834324;6006.939930600638;5653.858653533694;5761.395053519488;5794.652320860761;5825.796097136749;5987.700614969322;5893.351731309638;5908.556858235564;5955.285365756137;5973.044312909914;5975.790847320323;5848.94718950593;5849.94150058494;5865.501432378295;5879.235699359056;5883.735231914659 18:25:41 INFO - PROCESS | 3415 | |1;ext.html;589.9705014749261;613.6226220874163;641.7465101284992;652.1001018594342;661.242876905943;44915.326270105936;45852.082958340856;45921.54078459214;48532.757336213355;48667.51332486674;46136;46363.53636463634;46474.767626161825;46589.068218635606;46644;8880.46717196967;9017.32370072244;9026.729198124034;9035.503047332393;9037.096290370942;8877.067907869678;8902.154295341965;8909.331800115016;8965.820683586324;8965.910340896573;8988.325875559327;9023.729288121367;9034;9035.819283614324;9038.2317503012;8935.731928042169;8956.910430895672;8966.237869781076;9010.14403631654;9024;8906.910930890674;8957.417767845069;8966.86549701755;8974.50640214788;8977.236934860479;43414.13171736579;43475.78262108701;43552.78223608893;43718;43943.56056439427;3612.6748592626527;3750.79370634615;3777.452269420946;3861.995881070942;4145.871792447653;33308.6669133308;33600.66399336024;33629;33629.49555756665;33650.326993459996;4495.505494395614;4515.932261016087;4517.119161763458;4520.932186017212;4555.157295900236;323954;324127;324525;324982;325015;59881.70059149677;60451.395486045454;60603.09095363573;60695.69652151711;60714;62681;62732.37267627357;62944.68527657424;62951.37048629455;63025.369746302866;18427.078646067643;18608;18673.439796806117;18728.81271187298;18801.435956921316;14271.215083170526;14292.142471451747;14298.28508574567;14300.070495417765;14307.356168972421;16084.517464476085;16668.49994500167;16670.749938750927;16680.416185433452;16941.661166776594;6303.873922521524;6338.366163383625;6441.194850643669;6445.677716114175;6451.9998200836835;962.1917589225085;963.1716723617683;1023.3143793658118;1091.1816137896578;1099.8955099265556;31034.534481982788;31389.90135345252;31831.84084079611;31843.711600742627;32385.19037024046;1122.803509385854;1127.639155470258;1137.8577677790277;1175.5121624525898;1212.8120141378101;16541;16747;16798.496045118667;16892.324307027826;17061.658766824596;516639;525027;527158;527911;529040;61286.38713612896;61798.69100654468;61809.07286390708;61937.38062619406;61954.380456195766;1376.39438646995;1397.4200706706806;1405.9015868889285;1428.128841406741;1447.1823419767798;31020.53469197919;31457.213569660027;31875.36249275048;32073.839630801696;32928.341433171685;52490.21264680957;53013;53045.73477132744;53087.46912530825;53104.468955311495;442004;444180;444698;447632;447766;41570;41799;41926.371104432845;42236.78881605572;43202.35196471993;48287.75856120697;48670.26994595013;49800.50199497959;49870.75064624654;51526.74236628943;42132;42371.364429532965;43299.567004329554;43649.78175109104;44338.55661443473;41201.79399102985;41662.58337416587;42201.577984219766;42809.35785963275;43281;42335.7883210582;42710.35934461048;43390.13219735651;43631.345529817714;43851;37197.44203836891;37282.440763388026;37754.8112259437;37841.62158378491;38131.237375252895;29233.269168270963;29242.561361579166;29484.410311793214;29537;29843.552346714383 18:25:41 INFO - PROCESS | 3415 | |2;jquery.html;406.71123502313355;411.6624368018224;429.6734481793837;432.2457311990576;438.666613373836;18662.440126796184;19612.411627651192;20338;20520.486987825312;20546.075426605803;19430.22279108834;19521.316753913616;19729.914854682986;19846.900765496153;19969.20123195074;5582.91625625615;5868.354481007086;5868.882622347551;5876.647401155944;5879.147523609074;5608.719564021803;5759.5968282220265;5768.74040668171;5777.624454410471;5826.126081087849;5700.543956483492;5763.5389168866595;5765.221695071154;5777.624454410471;5791.536677065846;5584.581156413245;5695.45893140151;5756.654600723949;5773.509251713609;5791;5169.483051694838;5186.273921650972;5194.428612852621;5196.714180720059;5201.687898726089;23561.29316120519;24157.39606509834;24195.911183996763;24209.757902420926;24489.265322040366;2221.8444708870384;2484.1181380609805;2546.7835234005133;2696.4876673431986;2845.3882415280814;11126.833097503544;11484.023857972083;11528.308301501937;12931.870681293161;14688.926555367261;1927.3928712455531;1990.6018796240664;1991.601679664073;2018.1322031526438;2089.143451185007;89940.10059899448;90053.54973225157;90216.54891725566;90566.99999999935;91056.08943910542;11830.231034982698;11856.347900865363;11948.402579870972;11987.64037078889;12014;16793.580160496087;16947.067911264752;16952.74570881438;16963.915180424017;16972.660546788997;8599.699010534601;9027.819443611092;9120.407173533698;9191.402558833788;9245.352825302165;8775.297976161892;8923.375363724477;8939.284857211407;9051.773705657411;9095.590698418588;5047.419546752097;5106.617003724736;5149.253358263031;5181.715005674649;5236.345456817898;2021.514836439244;2034.7863474335277;2082.3024286863765;2122.1217228277583;2183.552371763785;904.5477261369315;1012.4026824173626;1019.2508506247901;1052.636840290114;1068.1668298727006;19653.41039768809;20198.596028079355;20498.975051247377;20505.79494205069;20523;997.2620261006948;1028.554880393049;1054.5254635414094;1080.5947769586405;1112.6495154026456;10604.575816967235;11282.774344513064;11370.147238957112;11408.486618102206;11459.77080458386;369264;374782.63043423585;377541;487331;489776;59275.40724592699;61309;62098.0685289712;104374.47812761039;104567;1043.5617040842865;1058.8088400549382;1094.414488248783;1104.5857803323754;1104.9116070714324;18377.448676539727;18540.351087711864;18818.623627527646;18827.90586047061;18966.146523406205;37093.81453092717;39198.41202382024;43608.56391436172;43783.124337513706;45034.77482612566;57358.7132064337;58905.11642325283;62451;62560;63421.682891585246;7958.124606293419;8799.348637699619;8838.292936565187;8949.59726812282;9034.412763170372;9125.771855703395;10199.337043092175;13597.728045439233;13648.93175534116;14058.226797526235;11766.176367654525;11792.941035294769;12004.09969252327;12074.758504829679;12333;11757.118216133995;11832.940835295769;11875.821862671894;11949.701257468632;12046.518139274682;11886.227395219283;11987.76024479523;12147.514099435924;12151.331676757864;12371.69070773238;8372.455790373606;8425.157484251526;8443.577821108796;8522.701705440528;8589.269912057294;10008.049235322633;11875.524979000744;11985.820212696643;11998.460069297078;12012.399380031138 18:25:41 INFO - PROCESS | 3415 | |3;mootools.html;1510.992445037775;1532.0577844625554;1712.3150739704117;1783.6967715488365;1821.4626685127887;8462.280706139978;8583.399162058658;8855.512946787923;9080.727578172657;9100.13548712872;8974.820503589925;9046.72859814205;9060.184583387494;9060.864087038699;9111.49886756228;2385.988070059652;2414.14297924237;2424.066734307287;2429.963550546743;2433.9756602434013;2434.2697190842764;2440.1337525178574;2474.5298393305306;2481.727010028895;2494.538510375577;2432.20953190213;2458.409981604411;2472.5796614575474;2476.2199907029317;2487.166799122296;2409.6265078912797;2413.4328432818274;2435.2937648082125;2436.902523899042;2437.7805997460223;2452.1285287723995;2456.8648724320155;2457.7665121813397;2484.3416494628937;2488.2659615413495;8858.911410885938;8958.596863141109;8975.775605609846;9031.23234525066;9033.187013168781;5269.235960785664;5395.973020134914;5428.75570599324;5458.072127738294;5472.781088756445;3438.5873695156492;3480.3039392121677;3518.894433167009;3523.0839981604713;3598.5501812273465;1140.3272069479046;1153.578943685557;1170.2510393348264;1173.6185739634568;1176.2765898972157;11605.593804216896;11642.76714465706;11692.064634829194;11703.18077734559;11721.4139293035;4479.910401791946;4561.384213131251;4653.115907977541;4683.836065737751;4698.859034228979;9208.12522810332;9241.584128714225;9295.07049295065;9295.953520232491;9301.581428835718;5296.549793267615;5304.939012197576;5329.546988505943;5329.9467005330225;5358.276632654542;4955.554000140005;5047.671901326402;5118.513741194581;5141.640085194075;5228.215767634885;3872.380419132925;3965.464662270614;3977.4829272195007;4005.239004589119;4061.817218225187;1193.0634451955173;1201.9819702704467;1212.248405988293;1212.672578403826;1220.700928272579;878.6880657366543;884.394189979853;941.077743811069;970.7670159161892;975.22956864078;5874.471297583153;5981.641101533922;6009.2188015557695;6021.337652858182;6089.695515224221;972.3485264872552;975.7170420578095;978.3298440568234;996.6412091647002;1019.576875596634;3896.7272290939363;4043.130726893732;4128.4632997710705;4161.3549899765585;4167.249895018926;10643.467826608794;10992.450377481095;11049.668509944715;11057.447127643585;11094.833577496343;10834.187435942178;10893.83659245112;10921.508532116073;10947.178961577754;10949.343039417661;8098.109207987117;8184.468009579358;8363.58182090893;8364.37267204962;8385.874211886827;5643.858903527444;5793.420657934342;5839.7372118255635;5866.941330586639;5902.61632993854;9898.851517227104;9925.553350099408;9925.751856203653;9977.10206081456;9981;10192.184625230113;10232;10251.282410231212;10251.692449226535;10267;6444.548881578432;6627.37039981201;7004.789856304319;7446.664900079618;7472.925270747223;8210.63052162642;8543.91456085456;8567.100454452442;8581.91418085836;8584.227419532272;7463.365613922877;7465.738699145504;7518.887216691644;7534.208908064575;7555.282248186413;7488.700451981859;7556;7638.465307428427;7672.769816905502;7727.536347819148;6828.453723702191;6948.895766563607;6966.79099627012;6969.16370035599;6972.79081627552;5026.623003274842;5100.795968161232;5173.1722924331925;5173.3533308336455;5305.787768489217;5193.974030129825;5196.402413722319;5228.843134705965;5240;5399.622026458111 18:25:41 INFO - PROCESS | 3415 | |4;prototype.html;340.92840503494267;341.4042495844751;349.52813701502964;356.35855460171683;358.6843577651666;5529.474699903512;5653.293338332708;5717.142428635701;5737.627054241477;5759.251297331346;5360.544353729938;5485.204645326426;5528.9723551382185;5540.141278101901;5547.1679248112805;4352.630026447748;4376.242966930829;4378.014946636997;4383.605475507204;4399.956000440003;4174.728642638234;4297.914041719164;4353.10761293934;4381.283604165422;4384.758838263894;4287.4779453294095;4290.656747460212;4294.377315289281;4296.763677997709;4303.827846886121;4294.506131794852;4309.741415515064;4317.676174286941;4334.783260836945;4335.3525660249215;3789.2042671039117;3799.0502374406396;3819.675327597158;3830.693544516432;3859.903502412434;5415.83752487426;5436.456354364572;5464.590155738296;5480.80817171401;5497.5601951843755;5044.848654540369;5049.283243697124;5055.342805435306;5071.391433028023;5098.566621837148;5766.971165144189;5801.491612180821;5842.97078514609;5904.940950590525;5938.168656388109;4155.335146376565;4173.7495750254775;4176;4180.874573762792;4198.6641068714425;6092.482139018189;6115.226584290551;6132.540059495555;6177.81466556004;6200.503959683259;4126.690498212646;4265.357837232687;4345.652347812167;4347.4567378084175;4366.166210191727;4383.619159964601;4394.890127746832;4401.361802538614;4425.092855964584;4437.689361744647;5023.321851550067;5075.3148324975655;5078.542931136216;5081.5426611605135;5088;5689.971550142305;5751.079827227623;5960.314563825215;6010.459058684739;6017.939820601826;1456.1772598481823;1474.7566651502382;1477.958039582092;1478.5342617075587;1483.894498598551;973.5035132082547;1014.7564584499667;1017.4861694844057;1029.0995379043336;1034.2191645307744;5453.590980676465;5487.807926722546;5524.281843360337;5556.861078473071;5567.832965011056;5855.238818953594;5858.355580886099;5867.413258674183;5887.735051922674;5969.820905372846;5364.785408583613;5387.1622553753;5423.644088977756;5496.340439147248;5516.172574113915;3066.969330306713;3097.3960077784614;3112.190830384071;3113.3617608390227;3123;5972.641641501524;6087.817365479043;6108.938910610926;6127.693615319216;6132.6933653317155;6128;6211.142874277883;6217.626942383381;6244.875102498016;6254.6872656366995;6393.488520918316;6418.293987661447;6420.229572451336;6443.4523065539015;6453.419192272624;5985.4912332450485;6092.786752463642;6116.847078823065;6130.865789828896;6140.885606643649;6056.394360564084;6076.787312444043;6082.513398927987;6085.604435711664;6086.239220097488;6202.906956395567;6355.173827402408;6355.87288254223;6376;6416.550841441241;4358.714179317172;4394.318880573516;4401.515833258275;4417.580329868657;4427.933580996223;5978.432048955342;6159.846003849761;6218.53360997936;6239.126522286792;6248.843778905563;5969.820905372846;5981.1327357532045;5994.460498555151;5997.880042399041;6014.669193194416;5973.283206015306;6005.819825405245;6010.43728630568;6011.60924539921;6012;5652.886942261214;5927.911081333697;5950.285965684146;5969.70151492415;6000.819975400745;5930.555208359304;6014;6027.2164618601055;6032.728527216374;6032.819015429544;5606.355269144101;5805.996931058778;5840.970795145997;5845.18167456565;5853.239078919713 18:25:41 INFO - PROCESS | 3415 | |5;yui.html;796.3072127249293;808.4300568099491;837.0206857976167;869.7434256894218;907.6324088744061;15530.844691553095;15942.282597283122;15952.76070858935;15956.122413267265;15973.440929567467;14766.335514901828;14807.037542559727;14850;14877.330520126594;14890.404383824634;854.440341576267;871.5642178910545;874.7375787263827;876.2989608313355;877.0221203358274;861.5046348349692;871.1201686296854;872.3936863879607;873.0440168016012;875.829213303406;903.9638414463413;904.2856143646511;905.5743800413795;905.8233644439337;906.71891713569;897.228383590112;901.3825529512305;901.8737376767225;902.1970446302763;902.296208957008;665.950053745971;665.9900101498481;666.473485946102;667.7963221217575;670.6546128743701;13410.26243556604;13474.124181928144;13537.39081741324;13557.186568805902;13584.932075339659;12527.43626536799;12912.612621621367;12913.418896149602;13146;13372.398242079033;10531.578736850517;10569.947150264275;10636.202284828669;11035.337879727242;11062.004419602194;3790.564085130218;3824.208024159183;3840.788756618385;3892.5328960524635;3905.433712111728;54404.45595544033;56708.432915670724;58532.70733646305;60768.696156518934;63175.05237421488;12142.817857732141;12420.130590858553;12466.439010244561;12600.621981340575;12624.87375126237;21690.24084157047;21835;21939.122435102418;21957.67063494049;22272;8783.912160878437;8855.64577416909;8922.910770892338;8971.147740964598;9004.909950900537;4835.274708793709;4965.950340496621;5040.747962601855;5104.566111880532;5150.304708864255;3550.928981420357;3644.4715516249994;3653.488511608377;3743.3636281832155;3906.648401643809;706.1490903461316;707.8831992721143;711.2851584157888;717.7918403662879;718.5365439291733;653.2128784814288;726.5676922231264;759.9810004749814;768.193396933229;776.8601651702747;9202.30982676302;9738.90261097394;9773;9804.264680148875;10031;607.6733656366697;641.2721561028267;676.7834293026184;690.7444245629149;759.3279947246726;4520.954790452053;4521.412216411845;4615.742183057169;4635.165670179333;4707.811687532529;85369.14630853737;88887;89824.85613003513;90873.54563227142;92843.53578232066;51256.48743512592;66819.33180668228;67252.663736681;78785.60607196928;79120;65331.346686532524;67564.66217668979;68309.65845170742;69783.65108174426;69791.65104174548;9844.753881153028;10052.64815731446;10070.093691567794;10123.848142278019;10262.58949642006;35847.46228806518;43832;46215;46771.29843052289;48287.5171248283;57406.42593574011;57838.132428014454;60123;62966.370336297885;63878.68060659667;13383.799243011168;14280.07179533327;14351.210683412513;14507.1295722257;14771.335289912195;14608.634784130481;14642;14927.328270227648;15376.769348460006;16145.59636009109;13359.732805344032;13797.448102075805;13812.1022133561;13892.583222503341;13894.583162505141;14117.364718587483;14316.713665726418;14455.13269203851;14501.4924477647;14671.413143474141;13363.465461381826;13588;14031.579052628438;14389.496367627084;14651.926740366656;11256;11376.601818936297;11737.765244695229;11963.162578619413;12061.698457538632;11656.88343116558;12199;12315.13794034409;12327.137100402886;12418.565350212699 18:25:41 INFO - PROCESS | 3415 | __end_tp_report 18:25:41 INFO - PROCESS | 3415 | __start_cc_report 18:25:41 INFO - PROCESS | 3415 | _x_x_mozilla_cycle_collect,294 18:25:41 INFO - PROCESS | 3415 | __end_cc_report 18:25:41 INFO - PROCESS | 3415 | __startTimestamp1486434341053__endTimestamp 18:25:41 INFO - PROCESS | 3415 | 18:25:41 INFO - PROCESS | 3415 | ------- Summary: start ------- 18:25:41 INFO - PROCESS | 3415 | Number of tests: 6 18:25:41 INFO - PROCESS | 3415 | 18:25:41 INFO - PROCESS | 3415 | [#0] dojo.html Cycles:165 Average:5674.58 Median:5883.74 stddev:649.51 (11.0%) stddev-sans-first:623.28 18:25:41 INFO - PROCESS | 3415 | Values: 3260.2 3268.1 3297.3 3299.7 3309.4 5606.7 5643.1 5645.1 5671.0 5682.7 5654.2 5656.3 5667.4 5731.3 5742.8 5123.5 5162.0 5186.3 5214.9 5217.7 5206.6 5211.9 5213.0 5223.2 5225.0 5032.0 5057.5 5212.2 5229.2 5249.6 5149.0 5150.0 5204.8 5268.9 5277.9 5135.0 5220.9 5222.6 5223.9 5257.7 5476.2 5655.0 5669.1 5765.2 5773.2 5924.3 5979.9 6019.5 6058.1 6096.8 6055.2 6175.0 6179.1 6182.0 6206.7 5736.6 5742.4 5749.1 5752.2 5760.8 6190.6 6234.7 6265.7 6336.1 6342.1 6030.0 6063.5 6068.8 6077.5 6086.7 6018.9 6064.1 6139.5 6141.4 6152.3 6060.5 6104.8 6106.5 6116.2 6123.2 6049.8 6064.9 6066.0 6118.3 6119.4 4555.5 4575.4 4599.2 4684.9 4724.1 4106.7 4193.2 4213.1 4226.5 4243.4 5835.1 5835.2 5863.6 5871.7 5877.9 5913.0 5955.8 6121.7 6122.9 6129.5 5768.5 5811.3 5851.3 5900.2 5940.4 5299.9 5301.3 5308.4 5309.8 5313.8 6109.9 6394.0 6454.8 6457.3 6461.5 5986.6 6089.6 6089.9 6142.1 6224.8 6430.6 6447.2 6458.7 6463.2 6486.8 6080.2 6085.0 6090.3 6091.4 6097.5 5862.1 5970.3 6022.8 6052.3 6098.2 5905.8 5918.6 5936.6 5998.1 6001.5 5913.2 5936.5 5951.3 5971.4 6006.9 5653.9 5761.4 5794.7 5825.8 5987.7 5893.4 5908.6 5955.3 5973.0 5975.8 5848.9 5849.9 5865.5 5879.2 5883.7 18:25:41 INFO - PROCESS | 3415 | 18:25:41 INFO - PROCESS | 3415 | [#1] ext.html Cycles:180 Average:60683.90 Median:43897.28 stddev:116281.49 (264.9%) stddev-sans-first:116520.15 18:25:41 INFO - PROCESS | 3415 | Values: 590.0 613.6 641.7 652.1 661.2 44915.3 45852.1 45921.5 48532.8 48667.5 46136.0 46363.5 46474.8 46589.1 46644.0 8880.5 9017.3 9026.7 9035.5 9037.1 8877.1 8902.2 8909.3 8965.8 8965.9 8988.3 9023.7 9034.0 9035.8 9038.2 8935.7 8956.9 8966.2 9010.1 9024.0 8906.9 8957.4 8966.9 8974.5 8977.2 43414.1 43475.8 43552.8 43718.0 43943.6 3612.7 3750.8 3777.5 3862.0 4145.9 33308.7 33600.7 33629.0 33629.5 33650.3 4495.5 4515.9 4517.1 4520.9 4555.2 323954.0 324127.0 324525.0 324982.0 325015.0 59881.7 60451.4 60603.1 60695.7 60714.0 62681.0 62732.4 62944.7 62951.4 63025.4 18427.1 18608.0 18673.4 18728.8 18801.4 14271.2 14292.1 14298.3 14300.1 14307.4 16084.5 16668.5 16670.7 16680.4 16941.7 6303.9 6338.4 6441.2 6445.7 6452.0 962.2 963.2 1023.3 1091.2 1099.9 31034.5 31389.9 31831.8 31843.7 32385.2 1122.8 1127.6 1137.9 1175.5 1212.8 16541.0 16747.0 16798.5 16892.3 17061.7 516639.0 525027.0 527158.0 527911.0 529040.0 61286.4 61798.7 61809.1 61937.4 61954.4 1376.4 1397.4 1405.9 1428.1 1447.2 31020.5 31457.2 31875.4 32073.8 32928.3 52490.2 53013.0 53045.7 53087.5 53104.5 442004.0 444180.0 444698.0 447632.0 447766.0 41570.0 41799.0 41926.4 42236.8 43202.4 48287.8 48670.3 49800.5 49870.8 51526.7 42132.0 42371.4 43299.6 43649.8 44338.6 41201.8 41662.6 42201.6 42809.4 43281.0 42335.8 42710.4 43390.1 43631.3 43851.0 37197.4 37282.4 37754.8 37841.6 38131.2 29233.3 29242.6 29484.4 29537.0 29843.6 18:25:41 INFO - PROCESS | 3415 | 18:25:41 INFO - PROCESS | 3415 | [#2] jquery.html Cycles:180 Average:27354.49 Median:23859.34 stddev:70256.37 (294.5%) stddev-sans-first:70424.32 18:25:41 INFO - PROCESS | 3415 | Values: 406.7 411.7 429.7 432.2 438.7 18662.4 19612.4 20338.0 20520.5 20546.1 19430.2 19521.3 19729.9 19846.9 19969.2 5582.9 5868.4 5868.9 5876.6 5879.1 5608.7 5759.6 5768.7 5777.6 5826.1 5700.5 5763.5 5765.2 5777.6 5791.5 5584.6 5695.5 5756.7 5773.5 5791.0 5169.5 5186.3 5194.4 5196.7 5201.7 23561.3 24157.4 24195.9 24209.8 24489.3 2221.8 2484.1 2546.8 2696.5 2845.4 11126.8 11484.0 11528.3 12931.9 14688.9 1927.4 1990.6 1991.6 2018.1 2089.1 89940.1 90053.5 90216.5 90567.0 91056.1 11830.2 11856.3 11948.4 11987.6 12014.0 16793.6 16947.1 16952.7 16963.9 16972.7 8599.7 9027.8 9120.4 9191.4 9245.4 8775.3 8923.4 8939.3 9051.8 9095.6 5047.4 5106.6 5149.3 5181.7 5236.3 2021.5 2034.8 2082.3 2122.1 2183.6 904.5 1012.4 1019.3 1052.6 1068.2 19653.4 20198.6 20499.0 20505.8 20523.0 997.3 1028.6 1054.5 1080.6 1112.6 10604.6 11282.8 11370.1 11408.5 11459.8 369264.0 374782.6 377541.0 487331.0 489776.0 59275.4 61309.0 62098.1 104374.5 104567.0 1043.6 1058.8 1094.4 1104.6 1104.9 18377.4 18540.4 18818.6 18827.9 18966.1 37093.8 39198.4 43608.6 43783.1 45034.8 57358.7 58905.1 62451.0 62560.0 63421.7 7958.1 8799.3 8838.3 8949.6 9034.4 9125.8 10199.3 13597.7 13648.9 14058.2 11766.2 11792.9 12004.1 12074.8 12333.0 11757.1 11832.9 11875.8 11949.7 12046.5 11886.2 11987.8 12147.5 12151.3 12371.7 8372.5 8425.2 8443.6 8522.7 8589.3 10008.0 11875.5 11985.8 11998.5 12012.4 18:25:41 INFO - PROCESS | 3415 | 18:25:41 INFO - PROCESS | 3415 | [#3] mootools.html Cycles:180 Average:5780.60 Median:5212.31 stddev:3196.96 (61.3%) stddev-sans-first:3189.82 18:25:41 INFO - PROCESS | 3415 | Values: 1511.0 1532.1 1712.3 1783.7 1821.5 8462.3 8583.4 8855.5 9080.7 9100.1 8974.8 9046.7 9060.2 9060.9 9111.5 2386.0 2414.1 2424.1 2430.0 2434.0 2434.3 2440.1 2474.5 2481.7 2494.5 2432.2 2458.4 2472.6 2476.2 2487.2 2409.6 2413.4 2435.3 2436.9 2437.8 2452.1 2456.9 2457.8 2484.3 2488.3 8858.9 8958.6 8975.8 9031.2 9033.2 5269.2 5396.0 5428.8 5458.1 5472.8 3438.6 3480.3 3518.9 3523.1 3598.6 1140.3 1153.6 1170.3 1173.6 1176.3 11605.6 11642.8 11692.1 11703.2 11721.4 4479.9 4561.4 4653.1 4683.8 4698.9 9208.1 9241.6 9295.1 9296.0 9301.6 5296.5 5304.9 5329.5 5329.9 5358.3 4955.6 5047.7 5118.5 5141.6 5228.2 3872.4 3965.5 3977.5 4005.2 4061.8 1193.1 1202.0 1212.2 1212.7 1220.7 878.7 884.4 941.1 970.8 975.2 5874.5 5981.6 6009.2 6021.3 6089.7 972.3 975.7 978.3 996.6 1019.6 3896.7 4043.1 4128.5 4161.4 4167.2 10643.5 10992.5 11049.7 11057.4 11094.8 10834.2 10893.8 10921.5 10947.2 10949.3 8098.1 8184.5 8363.6 8364.4 8385.9 5643.9 5793.4 5839.7 5866.9 5902.6 9898.9 9925.6 9925.8 9977.1 9981.0 10192.2 10232.0 10251.3 10251.7 10267.0 6444.5 6627.4 7004.8 7446.7 7472.9 8210.6 8543.9 8567.1 8581.9 8584.2 7463.4 7465.7 7518.9 7534.2 7555.3 7488.7 7556.0 7638.5 7672.8 7727.5 6828.5 6948.9 6966.8 6969.2 6972.8 5026.6 5100.8 5173.2 5173.4 5305.8 5194.0 5196.4 5228.8 5240.0 5399.6 18:25:41 INFO - PROCESS | 3415 | 18:25:41 INFO - PROCESS | 3415 | [#4] prototype.html Cycles:180 Average:4970.26 Median:5534.81 stddev:1479.44 (26.7%) stddev-sans-first:1442.21 18:25:41 INFO - PROCESS | 3415 | Values: 340.9 341.4 349.5 356.4 358.7 5529.5 5653.3 5717.1 5737.6 5759.3 5360.5 5485.2 5529.0 5540.1 5547.2 4352.6 4376.2 4378.0 4383.6 4400.0 4174.7 4297.9 4353.1 4381.3 4384.8 4287.5 4290.7 4294.4 4296.8 4303.8 4294.5 4309.7 4317.7 4334.8 4335.4 3789.2 3799.1 3819.7 3830.7 3859.9 5415.8 5436.5 5464.6 5480.8 5497.6 5044.8 5049.3 5055.3 5071.4 5098.6 5767.0 5801.5 5843.0 5904.9 5938.2 4155.3 4173.7 4176.0 4180.9 4198.7 6092.5 6115.2 6132.5 6177.8 6200.5 4126.7 4265.4 4345.7 4347.5 4366.2 4383.6 4394.9 4401.4 4425.1 4437.7 5023.3 5075.3 5078.5 5081.5 5088.0 5690.0 5751.1 5960.3 6010.5 6017.9 1456.2 1474.8 1478.0 1478.5 1483.9 973.5 1014.8 1017.5 1029.1 1034.2 5453.6 5487.8 5524.3 5556.9 5567.8 5855.2 5858.4 5867.4 5887.7 5969.8 5364.8 5387.2 5423.6 5496.3 5516.2 3067.0 3097.4 3112.2 3113.4 3123.0 5972.6 6087.8 6108.9 6127.7 6132.7 6128.0 6211.1 6217.6 6244.9 6254.7 6393.5 6418.3 6420.2 6443.5 6453.4 5985.5 6092.8 6116.8 6130.9 6140.9 6056.4 6076.8 6082.5 6085.6 6086.2 6202.9 6355.2 6355.9 6376.0 6416.6 4358.7 4394.3 4401.5 4417.6 4427.9 5978.4 6159.8 6218.5 6239.1 6248.8 5969.8 5981.1 5994.5 5997.9 6014.7 5973.3 6005.8 6010.4 6011.6 6012.0 5652.9 5927.9 5950.3 5969.7 6000.8 5930.6 6014.0 6027.2 6032.7 6032.8 5606.4 5806.0 5841.0 5845.2 5853.2 18:25:41 INFO - PROCESS | 3415 | 18:25:41 INFO - PROCESS | 3415 | [#5] yui.html Cycles:180 Average:17792.74 Median:25425.08 stddev:22687.34 (89.2%) stddev-sans-first:22715.08 18:25:41 INFO - PROCESS | 3415 | Values: 796.3 808.4 837.0 869.7 907.6 15530.8 15942.3 15952.8 15956.1 15973.4 14766.3 14807.0 14850.0 14877.3 14890.4 854.4 871.6 874.7 876.3 877.0 861.5 871.1 872.4 873.0 875.8 904.0 904.3 905.6 905.8 906.7 897.2 901.4 901.9 902.2 902.3 666.0 666.0 666.5 667.8 670.7 13410.3 13474.1 13537.4 13557.2 13584.9 12527.4 12912.6 12913.4 13146.0 13372.4 10531.6 10569.9 10636.2 11035.3 11062.0 3790.6 3824.2 3840.8 3892.5 3905.4 54404.5 56708.4 58532.7 60768.7 63175.1 12142.8 12420.1 12466.4 12600.6 12624.9 21690.2 21835.0 21939.1 21957.7 22272.0 8783.9 8855.6 8922.9 8971.1 9004.9 4835.3 4966.0 5040.7 5104.6 5150.3 3550.9 3644.5 3653.5 3743.4 3906.6 706.1 707.9 711.3 717.8 718.5 653.2 726.6 760.0 768.2 776.9 9202.3 9738.9 9773.0 9804.3 10031.0 607.7 641.3 676.8 690.7 759.3 4521.0 4521.4 4615.7 4635.2 4707.8 85369.1 88887.0 89824.9 90873.5 92843.5 51256.5 66819.3 67252.7 78785.6 79120.0 65331.3 67564.7 68309.7 69783.7 69791.7 9844.8 10052.6 10070.1 10123.8 10262.6 35847.5 43832.0 46215.0 46771.3 48287.5 57406.4 57838.1 60123.0 62966.4 63878.7 13383.8 14280.1 14351.2 14507.1 14771.3 14608.6 14642.0 14927.3 15376.8 16145.6 13359.7 13797.4 13812.1 13892.6 13894.6 14117.4 14316.7 14455.1 14501.5 14671.4 13363.5 13588.0 14031.6 14389.5 14651.9 11256.0 11376.6 11737.8 11963.2 12061.7 11656.9 12199.0 12315.1 12327.1 12418.6 18:25:41 INFO - PROCESS | 3415 | -------- Summary: end -------- 18:25:41 INFO - PROCESS | 3415 | 18:25:41 INFO - TEST-INFO | 3415: exit 0 18:25:41 INFO - TEST-OK | dromaeo_css | took 1111702ms 18:25:41 INFO - TEST-START | kraken 18:25:41 INFO - operating with platform_type : linux_ 18:25:41 INFO - Initialising browser for kraken test... 18:25:41 INFO - TEST-INFO | started process 3770 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpYT2hJm/profile http://localhost:42236/getInfo.html) 18:25:45 INFO - PROCESS | 3770 | __metrics Screen width/height:1600/1200 18:25:45 INFO - PROCESS | 3770 | colorDepth:24 18:25:45 INFO - PROCESS | 3770 | Browser inner width/height: 1024/697 18:25:45 INFO - PROCESS | 3770 | __metrics 18:25:46 ERROR - PROCESS | 3770 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3197: TypeError: this.tabs is undefined 18:25:47 INFO - TEST-INFO | 3770: exit 0 18:25:47 INFO - Browser initialized. 18:25:47 INFO - Running cycle 1/1 for kraken test... 18:25:47 INFO - TEST-INFO | started process 3902 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpYT2hJm/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:25:59 INFO - PROCESS | 3902 | RSS: Main: 148221952 18:25:59 INFO - PROCESS | 3902 | 18:26:01 INFO - PROCESS | 3902 | Cycle 1(1): loaded http://localhost:42236/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:42236/tests/kraken/driver.html?testName=audio-beat-detection) 18:26:02 INFO - PROCESS | 3902 | RSS: Main: 153743360 18:26:02 INFO - PROCESS | 3902 | 18:26:05 INFO - PROCESS | 3902 | Cycle 1(1): loaded http://localhost:42236/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:42236/tests/kraken/driver.html?testName=audio-dft) 18:26:05 INFO - PROCESS | 3902 | RSS: Main: 152322048 18:26:05 INFO - PROCESS | 3902 | 18:26:08 INFO - PROCESS | 3902 | Cycle 1(1): loaded http://localhost:42236/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:42236/tests/kraken/driver.html?testName=audio-fft) 18:26:09 INFO - PROCESS | 3902 | RSS: Main: 153354240 18:26:09 INFO - PROCESS | 3902 | 18:26:11 INFO - PROCESS | 3902 | Cycle 1(1): loaded http://localhost:42236/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:42236/tests/kraken/driver.html?testName=audio-oscillator) 18:26:11 INFO - PROCESS | 3902 | RSS: Main: 152350720 18:26:11 INFO - PROCESS | 3902 | 18:26:13 INFO - PROCESS | 3902 | Cycle 1(1): loaded http://localhost:42236/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:42236/tests/kraken/driver.html?testName=imaging-gaussian-blur) 18:26:14 INFO - PROCESS | 3902 | RSS: Main: 152723456 18:26:14 INFO - PROCESS | 3902 | 18:26:17 INFO - PROCESS | 3902 | Cycle 1(1): loaded http://localhost:42236/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:42236/tests/kraken/driver.html?testName=imaging-darkroom) 18:26:18 INFO - PROCESS | 3902 | RSS: Main: 155312128 18:26:18 INFO - PROCESS | 3902 | 18:26:21 INFO - PROCESS | 3902 | Cycle 1(1): loaded http://localhost:42236/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:42236/tests/kraken/driver.html?testName=imaging-desaturate) 18:26:22 INFO - PROCESS | 3902 | RSS: Main: 155197440 18:26:22 INFO - PROCESS | 3902 | 18:26:24 INFO - PROCESS | 3902 | Cycle 1(1): loaded http://localhost:42236/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:42236/tests/kraken/driver.html?testName=json-parse-financial) 18:26:25 INFO - PROCESS | 3902 | RSS: Main: 155643904 18:26:25 INFO - PROCESS | 3902 | 18:26:26 INFO - PROCESS | 3902 | Cycle 1(1): loaded http://localhost:42236/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:42236/tests/kraken/driver.html?testName=json-stringify-tinderbox) 18:26:27 INFO - PROCESS | 3902 | RSS: Main: 154873856 18:26:27 INFO - PROCESS | 3902 | 18:26:29 INFO - PROCESS | 3902 | Cycle 1(1): loaded http://localhost:42236/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:42236/tests/kraken/driver.html?testName=stanford-crypto-aes) 18:26:29 INFO - PROCESS | 3902 | RSS: Main: 155385856 18:26:29 INFO - PROCESS | 3902 | 18:26:31 INFO - PROCESS | 3902 | Cycle 1(1): loaded http://localhost:42236/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:42236/tests/kraken/driver.html?testName=stanford-crypto-ccm) 18:26:32 INFO - PROCESS | 3902 | RSS: Main: 155119616 18:26:32 INFO - PROCESS | 3902 | 18:26:35 INFO - PROCESS | 3902 | Cycle 1(1): loaded http://localhost:42236/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:42236/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 18:26:35 INFO - PROCESS | 3902 | RSS: Main: 154988544 18:26:35 INFO - PROCESS | 3902 | 18:26:38 INFO - PROCESS | 3902 | Cycle 1(1): loaded http://localhost:42236/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:42236/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 18:26:39 INFO - PROCESS | 3902 | RSS: Main: 155095040 18:26:39 INFO - PROCESS | 3902 | 18:26:40 INFO - PROCESS | 3902 | Cycle 1(1): loaded http://localhost:42236/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:42236/tests/kraken/driver.html?testName=ai-astar) 18:26:41 INFO - PROCESS | 3902 | RSS: Main: 156389376 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | __start_tp_report 18:26:41 INFO - PROCESS | 3902 | _x_x_mozilla_page_load 18:26:41 INFO - PROCESS | 3902 | _x_x_mozilla_page_load_details 18:26:41 INFO - PROCESS | 3902 | |i|pagename|runs| 18:26:41 INFO - PROCESS | 3902 | |0;ai-astar;103;112;111;111;112;110;111;112;111;110 18:26:41 INFO - PROCESS | 3902 | |1;audio-beat-detection;151;118;116;159;118;119;119;123;148;117 18:26:41 INFO - PROCESS | 3902 | |2;audio-dft;165;162;162;162;165;162;163;165;162;161 18:26:41 INFO - PROCESS | 3902 | |3;audio-fft;76;75;76;108;76;77;76;79;103;76 18:26:41 INFO - PROCESS | 3902 | |4;audio-oscillator;82;83;109;82;83;83;97;82;81;111 18:26:41 INFO - PROCESS | 3902 | |5;imaging-gaussian-blur;118;122;121;118;118;117;118;118;117;117 18:26:41 INFO - PROCESS | 3902 | |6;imaging-darkroom;146;148;148;147;150;147;147;148;146;147 18:26:41 INFO - PROCESS | 3902 | |7;imaging-desaturate;84;85;85;86;86;86;85;85;86;86 18:26:41 INFO - PROCESS | 3902 | |8;json-parse-financial;54;52;59;50;50;51;51;51;53;54 18:26:41 INFO - PROCESS | 3902 | |9;json-stringify-tinderbox;60;59;61;59;60;59;59;58;58;60 18:26:41 INFO - PROCESS | 3902 | |10;stanford-crypto-aes;74;75;75;75;73;74;80;82;83;75 18:26:41 INFO - PROCESS | 3902 | |11;stanford-crypto-ccm;123;122;129;122;134;129;120;129;169;133 18:26:41 INFO - PROCESS | 3902 | |12;stanford-crypto-pbkdf2;154;157;166;156;154;152;154;158;155;154 18:26:41 INFO - PROCESS | 3902 | |13;stanford-crypto-sha256-iterative;63;63;62;63;64;63;66;63;61;60 18:26:41 INFO - PROCESS | 3902 | __end_tp_report 18:26:41 INFO - PROCESS | 3902 | __start_cc_report 18:26:41 INFO - PROCESS | 3902 | _x_x_mozilla_cycle_collect,752 18:26:41 INFO - PROCESS | 3902 | __end_cc_report 18:26:41 INFO - PROCESS | 3902 | __startTimestamp1486434401082__endTimestamp 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | ------- Summary: start ------- 18:26:41 INFO - PROCESS | 3902 | Number of tests: 14 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | [#0] ai-astar Cycles:10 Average:110.30 Median:111.00 stddev:2.67 (2.4%) stddev-sans-first:0.78 18:26:41 INFO - PROCESS | 3902 | Values: 103.0 112.0 111.0 111.0 112.0 110.0 111.0 112.0 111.0 110.0 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | [#1] audio-beat-detection Cycles:10 Average:128.80 Median:121.00 stddev:16.78 (13.9%) stddev-sans-first:15.76 18:26:41 INFO - PROCESS | 3902 | Values: 151.0 118.0 116.0 159.0 118.0 119.0 119.0 123.0 148.0 117.0 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | [#2] audio-dft Cycles:10 Average:162.90 Median:162.50 stddev:1.52 (0.9%) stddev-sans-first:1.41 18:26:41 INFO - PROCESS | 3902 | Values: 165.0 162.0 162.0 162.0 165.0 162.0 163.0 165.0 162.0 161.0 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | [#3] audio-fft Cycles:10 Average:82.20 Median:76.00 stddev:12.38 (16.3%) stddev-sans-first:12.93 18:26:41 INFO - PROCESS | 3902 | Values: 76.0 75.0 76.0 108.0 76.0 77.0 76.0 79.0 103.0 76.0 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | [#4] audio-oscillator Cycles:10 Average:89.30 Median:82.50 stddev:11.86 (14.4%) stddev-sans-first:12.28 18:26:41 INFO - PROCESS | 3902 | Values: 82.0 83.0 109.0 82.0 83.0 83.0 97.0 82.0 81.0 111.0 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | [#5] imaging-gaussian-blur Cycles:10 Average:118.40 Median:118.00 stddev:1.71 (1.5%) stddev-sans-first:1.81 18:26:41 INFO - PROCESS | 3902 | Values: 118.0 122.0 121.0 118.0 118.0 117.0 118.0 118.0 117.0 117.0 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | [#6] imaging-darkroom Cycles:10 Average:147.40 Median:147.50 stddev:1.17 (0.8%) stddev-sans-first:1.13 18:26:41 INFO - PROCESS | 3902 | Values: 146.0 148.0 148.0 147.0 150.0 147.0 147.0 148.0 146.0 147.0 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | [#7] imaging-desaturate Cycles:10 Average:85.40 Median:86.00 stddev:0.70 (0.8%) stddev-sans-first:0.53 18:26:41 INFO - PROCESS | 3902 | Values: 84.0 85.0 85.0 86.0 86.0 86.0 85.0 85.0 86.0 86.0 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | [#8] json-parse-financial Cycles:10 Average:52.50 Median:52.50 stddev:2.72 (5.2%) stddev-sans-first:2.83 18:26:41 INFO - PROCESS | 3902 | Values: 54.0 52.0 59.0 50.0 50.0 51.0 51.0 51.0 53.0 54.0 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | [#9] json-stringify-tinderbox Cycles:10 Average:59.30 Median:59.50 stddev:0.95 (1.6%) stddev-sans-first:0.97 18:26:41 INFO - PROCESS | 3902 | Values: 60.0 59.0 61.0 59.0 60.0 59.0 59.0 58.0 58.0 60.0 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | [#10] stanford-crypto-aes Cycles:10 Average:76.60 Median:75.00 stddev:3.63 (4.8%) stddev-sans-first:3.72 18:26:41 INFO - PROCESS | 3902 | Values: 74.0 75.0 75.0 75.0 73.0 74.0 80.0 82.0 83.0 75.0 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | [#11] stanford-crypto-ccm Cycles:10 Average:131.00 Median:129.00 stddev:14.20 (11.0%) stddev-sans-first:14.77 18:26:41 INFO - PROCESS | 3902 | Values: 123.0 122.0 129.0 122.0 134.0 129.0 120.0 129.0 169.0 133.0 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:156.00 Median:155.50 stddev:3.92 (2.5%) stddev-sans-first:4.09 18:26:41 INFO - PROCESS | 3902 | Values: 154.0 157.0 166.0 156.0 154.0 152.0 154.0 158.0 155.0 154.0 18:26:41 INFO - PROCESS | 3902 | 18:26:41 INFO - PROCESS | 3902 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:62.80 Median:63.00 stddev:1.62 (2.6%) stddev-sans-first:1.72 18:26:41 INFO - PROCESS | 3902 | Values: 63.0 63.0 62.0 63.0 64.0 63.0 66.0 63.0 61.0 60.0 18:26:41 INFO - PROCESS | 3902 | -------- Summary: end -------- 18:26:41 INFO - PROCESS | 3902 | 18:26:42 INFO - TEST-INFO | 3902: exit 0 18:26:42 INFO - TEST-OK | kraken | took 60372ms 18:26:42 INFO - SUITE-END | took 1172s 18:26:42 INFO - Completed test suite (00:19:32) 18:26:42 INFO - javascript benchmark 18:26:42 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7475.147367101406, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3260.2175477885307, 3268.1012721501584, 3297.3240485700426, 3299.6535363786816, 3309.3712194683008, 5606.691631960241, 5643.097104463287, 5645.096784514479, 5671.035923892938, 5682.659040457575, 5654.180143879135, 5656.349519805223, 5667.4049224831415, 5731.283589551306, 5742.770289188427, 5123.462036486171, 5161.993411284801, 5186.299849520323, 5214.895702085975, 5217.686938783666, 5206.635535512516, 5211.869703257411, 5213.0, 5223.164293713006, 5225.0, 5032.043911656791, 5057.468965758598, 5212.1660534314515, 5229.163333866582, 5249.580033597303, 5148.974255128719, 5150.021495915764, 5204.817831375922, 5268.92096618551, 5277.894442111175, 5134.973005398935, 5220.92168617471, 5222.608304377187, 5223.947760522384, 5257.737113144366, 5476.205950137248, 5655.0103731847175, 5669.121286200645, 5765.221695071154, 5773.220615216934, 5924.348321684612, 5979.910301345483, 6019.458248757633, 6058.0610005449225, 6096.847578810521, 6055.2430946131735, 6175.0, 6179.073139029137, 6181.9690901545655, 6206.720697568575, 5736.627119237236, 5742.425757424307, 5749.13762935563, 5752.194692743019, 5760.8271751847515, 6190.628562286277, 6234.688265586702, 6265.71804268809, 6336.144620476269, 6342.143810585512, 6030.0, 6063.484603808725, 6068.75724971005, 6077.453029227391, 6086.695665216722, 6018.879622407528, 6064.090386442069, 6139.47814435769, 6141.447269745744, 6152.323244443108, 6060.454559089703, 6104.786332478342, 6106.511479081662, 6116.17431646722, 6123.234595675541, 6049.758009679652, 6064.939350606437, 6065.96967015171, 6118.265808102967, 6119.388061193845, 4555.476120246148, 4575.359449677047, 4599.241125214302, 4684.882877928079, 4724.102420540155, 4106.650934670586, 4193.203291374629, 4213.052063285736, 4226.450561426995, 4243.448351714257, 5835.124731290341, 5835.153902684087, 5863.589548731547, 5871.706414679249, 5877.9118313225335, 5913.0, 5955.76176952917, 6121.663308518075, 6122.877542449215, 6129.540284478682, 5768.509676677446, 5811.27359080115, 5851.268591426072, 5900.232969713996, 5940.435658612425, 5299.947000530023, 5301.257823904656, 5308.362996440374, 5309.814156504503, 5313.840584782462, 6109.938900610937, 6394.0408938659575, 6454.806355809334, 6457.2574153971955, 6461.547691661633, 5986.551008674454, 6089.5737298388685, 6089.939100608937, 6142.078688196628, 6224.782132625336, 6430.64631445275, 6447.161868957006, 6458.7093580789915, 6463.224413070461, 6486.772962946275, 6080.2399700037495, 6085.026395776655, 6090.330063692902, 6091.42131497507, 6097.5426842987845, 5862.12068189775, 5970.283565971938, 6022.849428764141, 6052.273727152769, 6098.237720284965, 5905.793297234576, 5918.644881307136, 5936.614120082181, 5998.070299103646, 6001.519878409629, 5913.231279933581, 5936.465718085393, 5951.315598706031, 5971.373005834324, 6006.939930600638, 5653.858653533694, 5761.395053519488, 5794.652320860761, 5825.796097136749, 5987.700614969322, 5893.351731309638, 5908.556858235564, 5955.285365756137, 5973.044312909914, 5975.790847320323, 5848.94718950593, 5849.94150058494, 5865.501432378295, 5879.235699359056, 5883.735231914659], "value": 5630.428569213928, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [589.9705014749261, 613.6226220874163, 641.7465101284992, 652.1001018594342, 661.242876905943, 44915.326270105936, 45852.082958340856, 45921.54078459214, 48532.757336213355, 48667.51332486674, 46136.0, 46363.53636463634, 46474.767626161825, 46589.068218635606, 46644.0, 8880.46717196967, 9017.32370072244, 9026.729198124034, 9035.503047332393, 9037.096290370942, 8877.067907869678, 8902.154295341965, 8909.331800115016, 8965.820683586324, 8965.910340896573, 8988.325875559327, 9023.729288121367, 9034.0, 9035.819283614324, 9038.2317503012, 8935.731928042169, 8956.910430895672, 8966.237869781076, 9010.14403631654, 9024.0, 8906.910930890674, 8957.417767845069, 8966.86549701755, 8974.50640214788, 8977.236934860479, 43414.13171736579, 43475.78262108701, 43552.78223608893, 43718.0, 43943.56056439427, 3612.6748592626527, 3750.79370634615, 3777.452269420946, 3861.995881070942, 4145.871792447653, 33308.6669133308, 33600.66399336024, 33629.0, 33629.49555756665, 33650.326993459996, 4495.505494395614, 4515.932261016087, 4517.119161763458, 4520.932186017212, 4555.157295900236, 323954.0, 324127.0, 324525.0, 324982.0, 325015.0, 59881.70059149677, 60451.395486045454, 60603.09095363573, 60695.69652151711, 60714.0, 62681.0, 62732.37267627357, 62944.68527657424, 62951.37048629455, 63025.369746302866, 18427.078646067643, 18608.0, 18673.439796806117, 18728.81271187298, 18801.435956921316, 14271.215083170526, 14292.142471451747, 14298.28508574567, 14300.070495417765, 14307.356168972421, 16084.517464476085, 16668.49994500167, 16670.749938750927, 16680.416185433452, 16941.661166776594, 6303.873922521524, 6338.366163383625, 6441.194850643669, 6445.677716114175, 6451.9998200836835, 962.1917589225085, 963.1716723617683, 1023.3143793658118, 1091.1816137896578, 1099.8955099265556, 31034.534481982788, 31389.90135345252, 31831.84084079611, 31843.711600742627, 32385.19037024046, 1122.803509385854, 1127.639155470258, 1137.8577677790277, 1175.5121624525898, 1212.8120141378101, 16541.0, 16747.0, 16798.496045118667, 16892.324307027826, 17061.658766824596, 516639.0, 525027.0, 527158.0, 527911.0, 529040.0, 61286.38713612896, 61798.69100654468, 61809.07286390708, 61937.38062619406, 61954.380456195766, 1376.39438646995, 1397.4200706706806, 1405.9015868889285, 1428.128841406741, 1447.1823419767798, 31020.53469197919, 31457.213569660027, 31875.36249275048, 32073.839630801696, 32928.341433171685, 52490.21264680957, 53013.0, 53045.73477132744, 53087.46912530825, 53104.468955311495, 442004.0, 444180.0, 444698.0, 447632.0, 447766.0, 41570.0, 41799.0, 41926.371104432845, 42236.78881605572, 43202.35196471993, 48287.75856120697, 48670.26994595013, 49800.50199497959, 49870.75064624654, 51526.74236628943, 42132.0, 42371.364429532965, 43299.567004329554, 43649.78175109104, 44338.55661443473, 41201.79399102985, 41662.58337416587, 42201.577984219766, 42809.35785963275, 43281.0, 42335.7883210582, 42710.35934461048, 43390.13219735651, 43631.345529817714, 43851.0, 37197.44203836891, 37282.440763388026, 37754.8112259437, 37841.62158378491, 38131.237375252895, 29233.269168270963, 29242.561361579166, 29484.410311793214, 29537.0, 29843.552346714383], "value": 20801.215824538016, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [406.71123502313355, 411.6624368018224, 429.6734481793837, 432.2457311990576, 438.666613373836, 18662.440126796184, 19612.411627651192, 20338.0, 20520.486987825312, 20546.075426605803, 19430.22279108834, 19521.316753913616, 19729.914854682986, 19846.900765496153, 19969.20123195074, 5582.91625625615, 5868.354481007086, 5868.882622347551, 5876.647401155944, 5879.147523609074, 5608.719564021803, 5759.5968282220265, 5768.74040668171, 5777.624454410471, 5826.126081087849, 5700.543956483492, 5763.5389168866595, 5765.221695071154, 5777.624454410471, 5791.536677065846, 5584.581156413245, 5695.45893140151, 5756.654600723949, 5773.509251713609, 5791.0, 5169.483051694838, 5186.273921650972, 5194.428612852621, 5196.714180720059, 5201.687898726089, 23561.29316120519, 24157.39606509834, 24195.911183996763, 24209.757902420926, 24489.265322040366, 2221.8444708870384, 2484.1181380609805, 2546.7835234005133, 2696.4876673431986, 2845.3882415280814, 11126.833097503544, 11484.023857972083, 11528.308301501937, 12931.870681293161, 14688.926555367261, 1927.3928712455531, 1990.6018796240664, 1991.601679664073, 2018.1322031526438, 2089.143451185007, 89940.10059899448, 90053.54973225157, 90216.54891725566, 90566.99999999935, 91056.08943910542, 11830.231034982698, 11856.347900865363, 11948.402579870972, 11987.64037078889, 12014.0, 16793.580160496087, 16947.067911264752, 16952.74570881438, 16963.915180424017, 16972.660546788997, 8599.699010534601, 9027.819443611092, 9120.407173533698, 9191.402558833788, 9245.352825302165, 8775.297976161892, 8923.375363724477, 8939.284857211407, 9051.773705657411, 9095.590698418588, 5047.419546752097, 5106.617003724736, 5149.253358263031, 5181.715005674649, 5236.345456817898, 2021.514836439244, 2034.7863474335277, 2082.3024286863765, 2122.1217228277583, 2183.552371763785, 904.5477261369315, 1012.4026824173626, 1019.2508506247901, 1052.636840290114, 1068.1668298727006, 19653.41039768809, 20198.596028079355, 20498.975051247377, 20505.79494205069, 20523.0, 997.2620261006948, 1028.554880393049, 1054.5254635414094, 1080.5947769586405, 1112.6495154026456, 10604.575816967235, 11282.774344513064, 11370.147238957112, 11408.486618102206, 11459.77080458386, 369264.0, 374782.63043423585, 377541.0, 487331.0, 489776.0, 59275.40724592699, 61309.0, 62098.0685289712, 104374.47812761039, 104567.0, 1043.5617040842865, 1058.8088400549382, 1094.414488248783, 1104.5857803323754, 1104.9116070714324, 18377.448676539727, 18540.351087711864, 18818.623627527646, 18827.90586047061, 18966.146523406205, 37093.81453092717, 39198.41202382024, 43608.56391436172, 43783.124337513706, 45034.77482612566, 57358.7132064337, 58905.11642325283, 62451.0, 62560.0, 63421.682891585246, 7958.124606293419, 8799.348637699619, 8838.292936565187, 8949.59726812282, 9034.412763170372, 9125.771855703395, 10199.337043092175, 13597.728045439233, 13648.93175534116, 14058.226797526235, 11766.176367654525, 11792.941035294769, 12004.09969252327, 12074.758504829679, 12333.0, 11757.118216133995, 11832.940835295769, 11875.821862671894, 11949.701257468632, 12046.518139274682, 11886.227395219283, 11987.76024479523, 12147.514099435924, 12151.331676757864, 12371.69070773238, 8372.455790373606, 8425.157484251526, 8443.577821108796, 8522.701705440528, 8589.269912057294, 10008.049235322633, 11875.524979000744, 11985.820212696643, 11998.460069297078, 12012.399380031138], "value": 9520.35114450972, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1510.992445037775, 1532.0577844625554, 1712.3150739704117, 1783.6967715488365, 1821.4626685127887, 8462.280706139978, 8583.399162058658, 8855.512946787923, 9080.727578172657, 9100.13548712872, 8974.820503589925, 9046.72859814205, 9060.184583387494, 9060.864087038699, 9111.49886756228, 2385.988070059652, 2414.14297924237, 2424.066734307287, 2429.963550546743, 2433.9756602434013, 2434.2697190842764, 2440.1337525178574, 2474.5298393305306, 2481.727010028895, 2494.538510375577, 2432.20953190213, 2458.409981604411, 2472.5796614575474, 2476.2199907029317, 2487.166799122296, 2409.6265078912797, 2413.4328432818274, 2435.2937648082125, 2436.902523899042, 2437.7805997460223, 2452.1285287723995, 2456.8648724320155, 2457.7665121813397, 2484.3416494628937, 2488.2659615413495, 8858.911410885938, 8958.596863141109, 8975.775605609846, 9031.23234525066, 9033.187013168781, 5269.235960785664, 5395.973020134914, 5428.75570599324, 5458.072127738294, 5472.781088756445, 3438.5873695156492, 3480.3039392121677, 3518.894433167009, 3523.0839981604713, 3598.5501812273465, 1140.3272069479046, 1153.578943685557, 1170.2510393348264, 1173.6185739634568, 1176.2765898972157, 11605.593804216896, 11642.76714465706, 11692.064634829194, 11703.18077734559, 11721.4139293035, 4479.910401791946, 4561.384213131251, 4653.115907977541, 4683.836065737751, 4698.859034228979, 9208.12522810332, 9241.584128714225, 9295.07049295065, 9295.953520232491, 9301.581428835718, 5296.549793267615, 5304.939012197576, 5329.546988505943, 5329.9467005330225, 5358.276632654542, 4955.554000140005, 5047.671901326402, 5118.513741194581, 5141.640085194075, 5228.215767634885, 3872.380419132925, 3965.464662270614, 3977.4829272195007, 4005.239004589119, 4061.817218225187, 1193.0634451955173, 1201.9819702704467, 1212.248405988293, 1212.672578403826, 1220.700928272579, 878.6880657366543, 884.394189979853, 941.077743811069, 970.7670159161892, 975.22956864078, 5874.471297583153, 5981.641101533922, 6009.2188015557695, 6021.337652858182, 6089.695515224221, 972.3485264872552, 975.7170420578095, 978.3298440568234, 996.6412091647002, 1019.576875596634, 3896.7272290939363, 4043.130726893732, 4128.4632997710705, 4161.3549899765585, 4167.249895018926, 10643.467826608794, 10992.450377481095, 11049.668509944715, 11057.447127643585, 11094.833577496343, 10834.187435942178, 10893.83659245112, 10921.508532116073, 10947.178961577754, 10949.343039417661, 8098.109207987117, 8184.468009579358, 8363.58182090893, 8364.37267204962, 8385.874211886827, 5643.858903527444, 5793.420657934342, 5839.7372118255635, 5866.941330586639, 5902.61632993854, 9898.851517227104, 9925.553350099408, 9925.751856203653, 9977.10206081456, 9981.0, 10192.184625230113, 10232.0, 10251.282410231212, 10251.692449226535, 10267.0, 6444.548881578432, 6627.37039981201, 7004.789856304319, 7446.664900079618, 7472.925270747223, 8210.63052162642, 8543.91456085456, 8567.100454452442, 8581.91418085836, 8584.227419532272, 7463.365613922877, 7465.738699145504, 7518.887216691644, 7534.208908064575, 7555.282248186413, 7488.700451981859, 7556.0, 7638.465307428427, 7672.769816905502, 7727.536347819148, 6828.453723702191, 6948.895766563607, 6966.79099627012, 6969.16370035599, 6972.79081627552, 5026.623003274842, 5100.795968161232, 5173.1722924331925, 5173.3533308336455, 5305.787768489217, 5193.974030129825, 5196.402413722319, 5228.843134705965, 5240.0, 5399.622026458111], "value": 4673.232728741412, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [340.92840503494267, 341.4042495844751, 349.52813701502964, 356.35855460171683, 358.6843577651666, 5529.474699903512, 5653.293338332708, 5717.142428635701, 5737.627054241477, 5759.251297331346, 5360.544353729938, 5485.204645326426, 5528.9723551382185, 5540.141278101901, 5547.1679248112805, 4352.630026447748, 4376.242966930829, 4378.014946636997, 4383.605475507204, 4399.956000440003, 4174.728642638234, 4297.914041719164, 4353.10761293934, 4381.283604165422, 4384.758838263894, 4287.4779453294095, 4290.656747460212, 4294.377315289281, 4296.763677997709, 4303.827846886121, 4294.506131794852, 4309.741415515064, 4317.676174286941, 4334.783260836945, 4335.3525660249215, 3789.2042671039117, 3799.0502374406396, 3819.675327597158, 3830.693544516432, 3859.903502412434, 5415.83752487426, 5436.456354364572, 5464.590155738296, 5480.80817171401, 5497.5601951843755, 5044.848654540369, 5049.283243697124, 5055.342805435306, 5071.391433028023, 5098.566621837148, 5766.971165144189, 5801.491612180821, 5842.97078514609, 5904.940950590525, 5938.168656388109, 4155.335146376565, 4173.7495750254775, 4176.0, 4180.874573762792, 4198.6641068714425, 6092.482139018189, 6115.226584290551, 6132.540059495555, 6177.81466556004, 6200.503959683259, 4126.690498212646, 4265.357837232687, 4345.652347812167, 4347.4567378084175, 4366.166210191727, 4383.619159964601, 4394.890127746832, 4401.361802538614, 4425.092855964584, 4437.689361744647, 5023.321851550067, 5075.3148324975655, 5078.542931136216, 5081.5426611605135, 5088.0, 5689.971550142305, 5751.079827227623, 5960.314563825215, 6010.459058684739, 6017.939820601826, 1456.1772598481823, 1474.7566651502382, 1477.958039582092, 1478.5342617075587, 1483.894498598551, 973.5035132082547, 1014.7564584499667, 1017.4861694844057, 1029.0995379043336, 1034.2191645307744, 5453.590980676465, 5487.807926722546, 5524.281843360337, 5556.861078473071, 5567.832965011056, 5855.238818953594, 5858.355580886099, 5867.413258674183, 5887.735051922674, 5969.820905372846, 5364.785408583613, 5387.1622553753, 5423.644088977756, 5496.340439147248, 5516.172574113915, 3066.969330306713, 3097.3960077784614, 3112.190830384071, 3113.3617608390227, 3123.0, 5972.641641501524, 6087.817365479043, 6108.938910610926, 6127.693615319216, 6132.6933653317155, 6128.0, 6211.142874277883, 6217.626942383381, 6244.875102498016, 6254.6872656366995, 6393.488520918316, 6418.293987661447, 6420.229572451336, 6443.4523065539015, 6453.419192272624, 5985.4912332450485, 6092.786752463642, 6116.847078823065, 6130.865789828896, 6140.885606643649, 6056.394360564084, 6076.787312444043, 6082.513398927987, 6085.604435711664, 6086.239220097488, 6202.906956395567, 6355.173827402408, 6355.87288254223, 6376.0, 6416.550841441241, 4358.714179317172, 4394.318880573516, 4401.515833258275, 4417.580329868657, 4427.933580996223, 5978.432048955342, 6159.846003849761, 6218.53360997936, 6239.126522286792, 6248.843778905563, 5969.820905372846, 5981.1327357532045, 5994.460498555151, 5997.880042399041, 6014.669193194416, 5973.283206015306, 6005.819825405245, 6010.43728630568, 6011.60924539921, 6012.0, 5652.886942261214, 5927.911081333697, 5950.285965684146, 5969.70151492415, 6000.819975400745, 5930.555208359304, 6014.0, 6027.2164618601055, 6032.728527216374, 6032.819015429544, 5606.355269144101, 5805.996931058778, 5840.970795145997, 5845.18167456565, 5853.239078919713], "value": 4497.389405192911, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [796.3072127249293, 808.4300568099491, 837.0206857976167, 869.7434256894218, 907.6324088744061, 15530.844691553095, 15942.282597283122, 15952.76070858935, 15956.122413267265, 15973.440929567467, 14766.335514901828, 14807.037542559727, 14850.0, 14877.330520126594, 14890.404383824634, 854.440341576267, 871.5642178910545, 874.7375787263827, 876.2989608313355, 877.0221203358274, 861.5046348349692, 871.1201686296854, 872.3936863879607, 873.0440168016012, 875.829213303406, 903.9638414463413, 904.2856143646511, 905.5743800413795, 905.8233644439337, 906.71891713569, 897.228383590112, 901.3825529512305, 901.8737376767225, 902.1970446302763, 902.296208957008, 665.950053745971, 665.9900101498481, 666.473485946102, 667.7963221217575, 670.6546128743701, 13410.26243556604, 13474.124181928144, 13537.39081741324, 13557.186568805902, 13584.932075339659, 12527.43626536799, 12912.612621621367, 12913.418896149602, 13146.0, 13372.398242079033, 10531.578736850517, 10569.947150264275, 10636.202284828669, 11035.337879727242, 11062.004419602194, 3790.564085130218, 3824.208024159183, 3840.788756618385, 3892.5328960524635, 3905.433712111728, 54404.45595544033, 56708.432915670724, 58532.70733646305, 60768.696156518934, 63175.05237421488, 12142.817857732141, 12420.130590858553, 12466.439010244561, 12600.621981340575, 12624.87375126237, 21690.24084157047, 21835.0, 21939.122435102418, 21957.67063494049, 22272.0, 8783.912160878437, 8855.64577416909, 8922.910770892338, 8971.147740964598, 9004.909950900537, 4835.274708793709, 4965.950340496621, 5040.747962601855, 5104.566111880532, 5150.304708864255, 3550.928981420357, 3644.4715516249994, 3653.488511608377, 3743.3636281832155, 3906.648401643809, 706.1490903461316, 707.8831992721143, 711.2851584157888, 717.7918403662879, 718.5365439291733, 653.2128784814288, 726.5676922231264, 759.9810004749814, 768.193396933229, 776.8601651702747, 9202.30982676302, 9738.90261097394, 9773.0, 9804.264680148875, 10031.0, 607.6733656366697, 641.2721561028267, 676.7834293026184, 690.7444245629149, 759.3279947246726, 4520.954790452053, 4521.412216411845, 4615.742183057169, 4635.165670179333, 4707.811687532529, 85369.14630853737, 88887.0, 89824.85613003513, 90873.54563227142, 92843.53578232066, 51256.48743512592, 66819.33180668228, 67252.663736681, 78785.60607196928, 79120.0, 65331.346686532524, 67564.66217668979, 68309.65845170742, 69783.65108174426, 69791.65104174548, 9844.753881153028, 10052.64815731446, 10070.093691567794, 10123.848142278019, 10262.58949642006, 35847.46228806518, 43832.0, 46215.0, 46771.29843052289, 48287.5171248283, 57406.42593574011, 57838.132428014454, 60123.0, 62966.370336297885, 63878.68060659667, 13383.799243011168, 14280.07179533327, 14351.210683412513, 14507.1295722257, 14771.335289912195, 14608.634784130481, 14642.0, 14927.328270227648, 15376.769348460006, 16145.59636009109, 13359.732805344032, 13797.448102075805, 13812.1022133561, 13892.583222503341, 13894.583162505141, 14117.364718587483, 14316.713665726418, 14455.13269203851, 14501.4924477647, 14671.413143474141, 13363.465461381826, 13588.0, 14031.579052628438, 14389.496367627084, 14651.926740366656, 11256.0, 11376.601818936297, 11737.765244695229, 11963.162578619413, 12061.698457538632, 11656.88343116558, 12199.0, 12315.13794034409, 12327.137100402886, 12418.565350212699], "value": 7444.14192961127, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1462.8999999999999, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 112.0, 111.0, 111.0, 112.0, 110.0, 111.0, 112.0, 111.0, 110.0], "value": 110.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 118.0, 116.0, 159.0, 118.0, 119.0, 119.0, 123.0, 148.0, 117.0], "value": 128.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 162.0, 162.0, 162.0, 165.0, 162.0, 163.0, 165.0, 162.0, 161.0], "value": 162.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 76.0, 108.0, 76.0, 77.0, 76.0, 79.0, 103.0, 76.0], "value": 82.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 83.0, 109.0, 82.0, 83.0, 83.0, 97.0, 82.0, 81.0, 111.0], "value": 89.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 122.0, 121.0, 118.0, 118.0, 117.0, 118.0, 118.0, 117.0, 117.0], "value": 118.4, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 148.0, 148.0, 147.0, 150.0, 147.0, 147.0, 148.0, 146.0, 147.0], "value": 147.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 85.0, 85.0, 86.0, 86.0, 86.0, 85.0, 85.0, 86.0, 86.0], "value": 85.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 52.0, 59.0, 50.0, 50.0, 51.0, 51.0, 51.0, 53.0, 54.0], "value": 52.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 59.0, 61.0, 59.0, 60.0, 59.0, 59.0, 58.0, 58.0, 60.0], "value": 59.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 75.0, 75.0, 75.0, 73.0, 74.0, 80.0, 82.0, 83.0, 75.0], "value": 76.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [123.0, 122.0, 129.0, 122.0, 134.0, 129.0, 120.0, 129.0, 169.0, 133.0], "value": 131.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [154.0, 157.0, 166.0, 156.0, 154.0, 152.0, 154.0, 158.0, 155.0, 154.0], "value": 156.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 63.0, 62.0, 63.0, 64.0, 63.0, 66.0, 63.0, 61.0, 60.0], "value": 62.8, "unit": "score"}]}]} 18:26:42 INFO - Return code: 0 18:26:42 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 18:26:42 ERROR - # TBPL SUCCESS # 18:26:42 INFO - Running post-action listener: _resource_record_post_action 18:26:42 INFO - [mozharness: 2017-02-07 02:26:42.421563Z] Finished run-tests step (success) 18:26:42 INFO - Running post-run listener: _resource_record_post_run 18:26:42 INFO - Total resource usage - Wall time: 1186s; CPU: 13.0%; Read bytes: 8192; Write bytes: 320995328; Read time: 224; Write time: 184360 18:26:42 INFO - TinderboxPrint: CPU usage
13.2% 18:26:42 INFO - TinderboxPrint: I/O read bytes / time
8,192 / 224 18:26:42 INFO - TinderboxPrint: I/O write bytes / time
320,995,328 / 184,360 18:26:42 INFO - TinderboxPrint: CPU idle
8,214.4 (86.8%) 18:26:42 INFO - TinderboxPrint: CPU user
1,197.0 (12.6%) 18:26:42 INFO - TinderboxPrint: Swap in / out
0 / 0 18:26:42 INFO - install - Wall time: 14s; CPU: 13.0%; Read bytes: 4096; Write bytes: 101011456; Read time: 76; Write time: 69808 18:26:42 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 4096; Write bytes: 219983872; Read time: 148; Write time: 114552 18:26:43 INFO - Running post-run listener: _upload_blobber_files 18:26:43 INFO - Blob upload gear active. 18:26:43 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 18:26:43 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 18:26:43 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', 'Mozilla-Beta', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 18:26:43 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 Mozilla-Beta -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 18:26:43 INFO - (blobuploader) - INFO - Open directory for files ... 18:26:43 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 18:26:43 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:26:43 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:26:44 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 18:26:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:26:44 INFO - (blobuploader) - INFO - Done attempting. 18:26:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 18:26:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:26:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:26:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 18:26:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:26:45 INFO - (blobuploader) - INFO - Done attempting. 18:26:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 18:26:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:26:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:26:48 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 18:26:48 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:26:48 INFO - (blobuploader) - INFO - Done attempting. 18:26:48 INFO - (blobuploader) - INFO - Iteration through files over. 18:26:48 INFO - Return code: 0 18:26:48 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 18:26:48 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 18:26:48 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/a6983309fd19b707e5a6352151bc2bcfdf4f0c7d44ed00b0f45fa51891a08f6bb5c87721172efe3a418a8d4ad43dbdecf3597c3e7bb19111be7f4a5d3baebb2d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f07df108adcd1b64ae43e516d908825e16011b6dec7a914224896d0a16a7cdcb03e1c4533949d6045e522e32229c9d59e6840faa7943f6bdd66b6e12a059d495", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/b67a66fad2f4c8c37ab5ff45c0eb9a389bbd80cc1b699ed929924fa16fadcccc44eee62d74fb4dd0d0fe629b93cb96e2c3ff30b6ca59a528d7bc721dbf580b50"} 18:26:48 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 18:26:48 INFO - Writing to file /builds/slave/test/properties/blobber_files 18:26:48 INFO - Contents: 18:26:48 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/a6983309fd19b707e5a6352151bc2bcfdf4f0c7d44ed00b0f45fa51891a08f6bb5c87721172efe3a418a8d4ad43dbdecf3597c3e7bb19111be7f4a5d3baebb2d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f07df108adcd1b64ae43e516d908825e16011b6dec7a914224896d0a16a7cdcb03e1c4533949d6045e522e32229c9d59e6840faa7943f6bdd66b6e12a059d495", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/b67a66fad2f4c8c37ab5ff45c0eb9a389bbd80cc1b699ed929924fa16fadcccc44eee62d74fb4dd0d0fe629b93cb96e2c3ff30b6ca59a528d7bc721dbf580b50"} 18:26:48 INFO - Running post-run listener: copy_logs_to_upload_dir 18:26:48 INFO - Copying logs to upload dir... 18:26:48 INFO - mkdir: /builds/slave/test/build/upload/logs 18:26:48 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1230.159340 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2017-02-06 18:26:48.513884) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-06 18:26:48.517019) ========= 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=db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589 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/Mozilla-Beta/sha512/a6983309fd19b707e5a6352151bc2bcfdf4f0c7d44ed00b0f45fa51891a08f6bb5c87721172efe3a418a8d4ad43dbdecf3597c3e7bb19111be7f4a5d3baebb2d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f07df108adcd1b64ae43e516d908825e16011b6dec7a914224896d0a16a7cdcb03e1c4533949d6045e522e32229c9d59e6840faa7943f6bdd66b6e12a059d495", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/b67a66fad2f4c8c37ab5ff45c0eb9a389bbd80cc1b699ed929924fa16fadcccc44eee62d74fb4dd0d0fe629b93cb96e2c3ff30b6ca59a528d7bc721dbf580b50"} build_url:https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011376 build_url: 'https://queue.taskcluster.net/v1/task/d2xZERahQ-mlv9qbDVBZKg/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/a6983309fd19b707e5a6352151bc2bcfdf4f0c7d44ed00b0f45fa51891a08f6bb5c87721172efe3a418a8d4ad43dbdecf3597c3e7bb19111be7f4a5d3baebb2d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/f07df108adcd1b64ae43e516d908825e16011b6dec7a914224896d0a16a7cdcb03e1c4533949d6045e522e32229c9d59e6840faa7943f6bdd66b6e12a059d495", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/b67a66fad2f4c8c37ab5ff45c0eb9a389bbd80cc1b699ed929924fa16fadcccc44eee62d74fb4dd0d0fe629b93cb96e2c3ff30b6ca59a528d7bc721dbf580b50"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-06 18:26:48.542171) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-06 18:26:48.542496) ========= 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=db7e7c15f3ca076d53731445000001ba-1486433176.52431-819177589 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004437 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-06 18:26:48.626397) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-06 18:26:48.626748) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-06 18:26:48.627046) ========= ========= Total master_lag: 0.16 =========