builder: mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s slave: talos-linux64-ix-003 starttime: 1491216815.92 results: success (0) revision: aaa0cd3bd620daf6be29c72625f6e63fd0bc1d46 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-04-03 03:53:35.917412) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-04-03 03:53:35.918439) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-04-03 03:53:35.918731) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-04-03 03:53:35.935144) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-03 03:53:35.935648) ========= 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=7de08804244eb36560b44971000001c3-1491216816.154123-685521 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-04-03 03:53:36-- 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% 45.9M=0s 2017-04-03 03:53:36 (45.9 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.144444 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-03 03:53:36.094328) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-04-03 03:53:36.094641) ========= 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=7de08804244eb36560b44971000001c3-1491216816.154123-685521 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017126 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-04-03 03:53:36.145106) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-04-03 03:53:36.145435) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev aaa0cd3bd620daf6be29c72625f6e63fd0bc1d46 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev aaa0cd3bd620daf6be29c72625f6e63fd0bc1d46 --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=7de08804244eb36560b44971000001c3-1491216816.154123-685521 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-04-03 03:53:37,059 truncating revision to first 12 chars 2017-04-03 03:53:37,059 Setting DEBUG logging. 2017-04-03 03:53:37,059 attempt 1/10 2017-04-03 03:53:37,059 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/aaa0cd3bd620?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-04-03 03:53:38,626 unpacking tar archive at: mozilla-central-aaa0cd3bd620/testing/mozharness/ program finished with exit code 0 elapsedTime=1.883605 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-04-03 03:53:38.045233) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-04-03 03:53:38.046033) ========= script_repo_revision: aaa0cd3bd620daf6be29c72625f6e63fd0bc1d46 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-04-03 03:53:38.046962) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-04-03 03:53:38.047651) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-04-03 03:53:38.059064) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 3 secs) (at 2017-04-03 03:53:38.059330) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] 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=7de08804244eb36560b44971000001c3-1491216816.154123-685521 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 03:53:39 INFO - MultiFileLogger online at 20170403 03:53:39 in /builds/slave/test 03:53:39 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 03:53:39 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:53:39 INFO - {'append_to_log': False, 03:53:39 INFO - 'base_work_dir': '/builds/slave/test', 03:53:39 INFO - 'blob_upload_branch': 'Firefox', 03:53:39 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:53:39 INFO - 'branch': 'Firefox', 03:53:39 INFO - 'buildbot_json_path': 'buildprops.json', 03:53:39 INFO - 'config_files': ('talos/linux_config.py',), 03:53:39 INFO - 'default_actions': ('clobber', 03:53:39 INFO - 'read-buildbot-config', 03:53:39 INFO - 'download-and-extract', 03:53:39 INFO - 'populate-webroot', 03:53:39 INFO - 'create-virtualenv', 03:53:39 INFO - 'install', 03:53:39 INFO - 'run-tests'), 03:53:39 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:53:39 INFO - 'download_minidump_stackwalk': True, 03:53:39 INFO - 'download_symbols': 'ondemand', 03:53:39 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:53:39 INFO - 'tooltool.py': '/tools/tooltool.py', 03:53:39 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:53:39 INFO - '/tools/misc-python/virtualenv.py')}, 03:53:39 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:53:39 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:53:39 INFO - 'gecko_profile': False, 03:53:39 INFO - 'gecko_profile_interval': 0, 03:53:39 INFO - 'installer_path': 'installer.exe', 03:53:39 INFO - 'log_level': 'info', 03:53:39 INFO - 'log_name': 'talos', 03:53:39 INFO - 'log_to_console': True, 03:53:39 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 03:53:39 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 03:53:39 INFO - 'opt_config_files': (), 03:53:39 INFO - 'pip_index': False, 03:53:39 INFO - 'suite': 'dromaeojs-e10s', 03:53:39 INFO - 'system_bits': '32', 03:53:39 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:53:39 INFO - 'title': 'talos-linux64-ix-003', 03:53:39 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:53:39 INFO - 'use_talos_json': True, 03:53:39 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:53:39 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:53:39 INFO - 'work_dir': 'build'} 03:53:39 INFO - [mozharness: 2017-04-03 10:53:39.077811Z] Running clobber step. 03:53:39 INFO - Running pre-action listener: _resource_record_pre_action 03:53:39 INFO - Running main action method: clobber 03:53:39 INFO - rmtree: /builds/slave/test/build 03:53:39 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:53:40 INFO - Running post-action listener: _resource_record_post_action 03:53:40 INFO - [mozharness: 2017-04-03 10:53:40.026281Z] Finished clobber step (success) 03:53:40 INFO - [mozharness: 2017-04-03 10:53:40.026379Z] Running read-buildbot-config step. 03:53:40 INFO - Running pre-action listener: _resource_record_pre_action 03:53:40 INFO - Running main action method: read_buildbot_config 03:53:40 INFO - Using buildbot properties: 03:53:40 INFO - { 03:53:40 INFO - "project": "", 03:53:40 INFO - "product": "firefox", 03:53:40 INFO - "who": "cbook@mozilla.com", 03:53:40 INFO - "installer_path": "public/build/target.tar.bz2", 03:53:40 INFO - "builddir": "mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s", 03:53:40 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 03:53:40 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo mozilla-central talos dromaeojs-e10s", 03:53:40 INFO - "stage_platform": "linux64-stylo", 03:53:40 INFO - "basedir": "/builds/slave/test", 03:53:40 INFO - "buildnumber": 7, 03:53:40 INFO - "platform": "ubuntu64_hw_stylo", 03:53:40 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 03:53:40 INFO - "slavebuilddir": "test", 03:53:40 INFO - "taskId": "I-AXrjZHR2a3RXH49tcDtw", 03:53:40 INFO - "branch": "mozilla-central", 03:53:40 INFO - "script_repo_revision": "production", 03:53:40 INFO - "revision": "aaa0cd3bd620daf6be29c72625f6e63fd0bc1d46", 03:53:40 INFO - "slavename": "talos-linux64-ix-003", 03:53:40 INFO - "repo_path": "mozilla-central" 03:53:40 INFO - } 03:53:40 INFO - Finding installer, test and symbols from parent task. 03:53:40 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/I-AXrjZHR2a3RXH49tcDtw'}, attempt #1 03:53:40 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/I-AXrjZHR2a3RXH49tcDtw'}, attempt #1 03:53:40 INFO - Task dependencies: RxRNfBRjTxOWjg7ZTcr2NQ 03:53:40 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ'}, attempt #1 03:53:41 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.tar.bz2 03:53:41 INFO - Set test_url: https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/test_packages.json 03:53:41 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.crashreporter-symbols.zip 03:53:41 INFO - Running post-action listener: _resource_record_post_action 03:53:41 INFO - [mozharness: 2017-04-03 10:53:41.393615Z] Finished read-buildbot-config step (success) 03:53:41 INFO - [mozharness: 2017-04-03 10:53:41.393832Z] Running download-and-extract step. 03:53:41 INFO - Running pre-action listener: _resource_record_pre_action 03:53:41 INFO - Running main action method: download_and_extract 03:53:41 INFO - mkdir: /builds/slave/test/build/tests 03:53: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')]} 03:53:41 INFO - trying https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.test_packages.json 03:53:41 INFO - Downloading https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 03:53:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 03:53:41 INFO - Downloaded 986 bytes. 03:53:41 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 03:53:41 INFO - Using the following test package requirements: 03:53:41 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 03:53:41 INFO - u'common': [u'target.common.tests.zip'], 03:53:41 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 03:53:41 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 03:53:41 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 03:53:41 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 03:53:41 INFO - u'mozbase': [u'target.common.tests.zip'], 03:53:41 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 03:53:41 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 03:53:41 INFO - u'web-platform': [u'target.common.tests.zip', 03:53:41 INFO - u'target.web-platform.tests.zip'], 03:53:41 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 03:53:41 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 03:53:41 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.common.tests.zip 03:53:41 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 03:53:41 INFO - Fetch https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.common.tests.zip into memory 03:53:43 INFO - Expected file size: 58240304 03:53:43 INFO - Obtained file size: 58240304 03:53:52 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 03:53:52 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.common.tests.zip 03:53:52 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 03:53:52 INFO - Fetch https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.common.tests.zip into memory 03:53:54 INFO - Expected file size: 58240304 03:53:54 INFO - Obtained file size: 58240304 03:54:06 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.talos.tests.zip 03:54:06 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.talos.tests.zip'}, attempt #1 03:54:06 INFO - Fetch https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.talos.tests.zip into memory 03:54:07 INFO - Expected file size: 14404152 03:54:07 INFO - Obtained file size: 14404152 03:54:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:07 INFO - trying https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.tar.bz2 03:54:07 INFO - Downloading https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 03:54:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 03:54:08 INFO - Downloaded 63881445 bytes. 03:54:08 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.tar.bz2 03:54:08 INFO - mkdir: /builds/slave/test/properties 03:54:08 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:54:08 INFO - Writing to file /builds/slave/test/properties/build_url 03:54:08 INFO - Contents: 03:54:08 INFO - build_url:https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.tar.bz2 03:54:08 INFO - Running post-action listener: _resource_record_post_action 03:54:08 INFO - Running post-action listener: set_extra_try_arguments 03:54:08 INFO - [mozharness: 2017-04-03 10:54:08.630374Z] Finished download-and-extract step (success) 03:54:08 INFO - [mozharness: 2017-04-03 10:54:08.630472Z] Running populate-webroot step. 03:54:08 INFO - Running pre-action listener: _resource_record_pre_action 03:54:08 INFO - Running main action method: populate_webroot 03:54:08 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:54:08 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:54:08 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:54:08 INFO - '--tppagecycles', 03:54:08 INFO - '7'], 03:54:08 INFO - 'tests': ['tsvgm']}}, 03:54:08 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 03:54:08 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:54:08 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 03:54:08 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 03:54:08 INFO - 'tests': ['dromaeo_css', 'kraken']}, 03:54:08 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 03:54:08 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 03:54:08 INFO - 'talos_options': ['--disable-e10s'], 03:54:08 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:54:08 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 03:54:08 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:54:08 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 03:54:08 INFO - 'talos_options': ['--disable-e10s'], 03:54:08 INFO - 'tests': ['damp', 'tps']}, 03:54:08 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 03:54:08 INFO - 'tests': ['damp', 'tps']}, 03:54:08 INFO - 'g3': {'talos_options': ['--disable-e10s'], 03:54:08 INFO - 'tests': ['dromaeo_dom']}, 03:54:08 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:54:08 INFO - 'g4': {'talos_options': ['--disable-e10s'], 03:54:08 INFO - 'tests': ['basic_compositor_video']}, 03:54:08 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 03:54:08 INFO - 'other': {'talos_options': ['--disable-e10s'], 03:54:08 INFO - 'tests': ['a11yr', 03:54:08 INFO - 'ts_paint', 03:54:08 INFO - 'tpaint', 03:54:08 INFO - 'sessionrestore', 03:54:08 INFO - 'sessionrestore_no_auto_restore', 03:54:08 INFO - 'tabpaint']}, 03:54:08 INFO - 'other-e10s': {'tests': ['a11yr', 03:54:08 INFO - 'ts_paint', 03:54:08 INFO - 'tpaint', 03:54:08 INFO - 'sessionrestore', 03:54:08 INFO - 'sessionrestore_no_auto_restore', 03:54:08 INFO - 'tabpaint']}, 03:54:08 INFO - 'other-e10s_l64': {'tests': ['a11yr', 03:54:08 INFO - 'ts_paint', 03:54:08 INFO - 'tpaint', 03:54:08 INFO - 'sessionrestore', 03:54:08 INFO - 'sessionrestore_no_auto_restore', 03:54:08 INFO - 'tabpaint']}, 03:54:08 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 03:54:08 INFO - 'ts_paint', 03:54:08 INFO - 'tpaint', 03:54:08 INFO - 'sessionrestore', 03:54:08 INFO - 'sessionrestore_no_auto_restore', 03:54:08 INFO - 'tabpaint']}, 03:54:08 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 03:54:08 INFO - 'tests': ['a11yr', 03:54:08 INFO - 'ts_paint', 03:54:08 INFO - 'tpaint', 03:54:08 INFO - 'sessionrestore', 03:54:08 INFO - 'sessionrestore_no_auto_restore', 03:54:08 INFO - 'tabpaint']}, 03:54:08 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 03:54:08 INFO - 'tests': ['a11yr', 03:54:08 INFO - 'ts_paint', 03:54:08 INFO - 'tpaint', 03:54:08 INFO - 'sessionrestore', 03:54:08 INFO - 'sessionrestore_no_auto_restore', 03:54:08 INFO - 'tabpaint']}, 03:54:08 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 03:54:08 INFO - 'tests': ['tsvgx', 03:54:08 INFO - 'tsvgr_opacity', 03:54:08 INFO - 'tart', 03:54:08 INFO - 'tscrollx', 03:54:08 INFO - 'cart', 03:54:08 INFO - 'tsvg_static']}, 03:54:08 INFO - 'svgr-e10s': {'tests': ['tsvgx', 03:54:08 INFO - 'tsvgr_opacity', 03:54:08 INFO - 'tart', 03:54:08 INFO - 'tscrollx', 03:54:08 INFO - 'cart', 03:54:08 INFO - 'tsvg_static']}, 03:54:08 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 03:54:08 INFO - 'talos_options': ['--disable-e10s'], 03:54:08 INFO - 'tests': ['tp5o']}, 03:54:08 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 03:54:08 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 03:54:08 INFO - 'talos_options': ['--disable-e10s', 03:54:08 INFO - '--xperf_path', 03:54:08 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:54:08 INFO - 'tests': ['tp5n']}, 03:54:08 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 03:54:08 INFO - 'talos_options': ['--xperf_path', 03:54:08 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:54:08 INFO - 'tests': ['tp5n']}}, 03:54:08 INFO - 'talos.zip': {'path': '', 03:54:08 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:54:08 INFO - Running post-action listener: _resource_record_post_action 03:54:08 INFO - [mozharness: 2017-04-03 10:54:08.643660Z] Finished populate-webroot step (success) 03:54:08 INFO - [mozharness: 2017-04-03 10:54:08.643750Z] Running create-virtualenv step. 03:54:08 INFO - Running pre-action listener: _resource_record_pre_action 03:54:08 INFO - Running main action method: create_virtualenv 03:54:08 INFO - Creating virtualenv /builds/slave/test/build/venv 03:54:08 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 03:54:08 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 03:54:08 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:54:08 INFO - Using real prefix '/usr' 03:54:08 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:54:09 INFO - Installing distribute.............................................................................................................................................................................................done. 03:54:11 INFO - Installing pip.................done. 03:54:11 INFO - Return code: 0 03:54:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 03:54:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 03:54:11 INFO - Reading from file tmpfile_stdout 03:54:11 INFO - Output received: 03:54:11 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) 03:54:11 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:54:11 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')]} 03:54:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:11 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')]} 03:54:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:11 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 0x25341f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x262ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27d1b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27cf290>, '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 0x27cfb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27d0040>, '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': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', '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 03:54:11 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 03:54:11 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 03:54:11 INFO - Using env: {'DISPLAY': ':0', 03:54:11 INFO - 'HOME': '/home/cltbld', 03:54:11 INFO - 'LANG': 'en_US.UTF-8', 03:54:11 INFO - 'LANGUAGE': 'en_US:en', 03:54:11 INFO - 'LOGNAME': 'cltbld', 03:54:11 INFO - 'MAIL': '/var/mail/cltbld', 03:54:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:11 INFO - 'MOZ_NO_REMOTE': '1', 03:54:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:11 INFO - 'NO_EM_RESTART': '1', 03:54:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:11 INFO - 'PWD': '/builds/slave/test', 03:54:11 INFO - 'SHELL': '/bin/bash', 03:54:11 INFO - 'SHLVL': '1', 03:54:11 INFO - 'TERM': 'linux', 03:54:11 INFO - 'TMOUT': '86400', 03:54:11 INFO - 'USER': 'cltbld', 03:54:11 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', 03:54:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:11 INFO - '_': '/tools/buildbot/bin/python'} 03:54:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:11 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 03:54:11 INFO - Cleaning up... 03:54:11 INFO - Return code: 0 03:54:11 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 03:54:11 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')]} 03:54:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:11 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')]} 03:54:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:11 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 0x25341f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x262ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27d1b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27cf290>, '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 0x27cfb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27d0040>, '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': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', '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 03:54:11 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 03:54:11 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 03:54:11 INFO - Using env: {'DISPLAY': ':0', 03:54:11 INFO - 'HOME': '/home/cltbld', 03:54:11 INFO - 'LANG': 'en_US.UTF-8', 03:54:11 INFO - 'LANGUAGE': 'en_US:en', 03:54:11 INFO - 'LOGNAME': 'cltbld', 03:54:11 INFO - 'MAIL': '/var/mail/cltbld', 03:54:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:11 INFO - 'MOZ_NO_REMOTE': '1', 03:54:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:11 INFO - 'NO_EM_RESTART': '1', 03:54:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:11 INFO - 'PWD': '/builds/slave/test', 03:54:11 INFO - 'SHELL': '/bin/bash', 03:54:11 INFO - 'SHLVL': '1', 03:54:11 INFO - 'TERM': 'linux', 03:54:11 INFO - 'TMOUT': '86400', 03:54:11 INFO - 'USER': 'cltbld', 03:54:11 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', 03:54:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:11 INFO - '_': '/tools/buildbot/bin/python'} 03:54:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:11 INFO - Downloading/unpacking psutil>=3.1.1 03:54:11 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 03:54:11 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 03:54:11 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 03:54:11 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 03:54:11 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 03:54:11 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 03:54:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:54:13 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:54:13 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:54:14 INFO - Installing collected packages: psutil 03:54:14 INFO - Running setup.py install for psutil 03:54:14 INFO - building 'psutil._psutil_linux' extension 03:54:14 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 03:54:14 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 03:54:14 INFO - building 'psutil._psutil_posix' extension 03:54:14 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 03:54:14 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 03:54:14 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:54:14 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:54:14 INFO - Successfully installed psutil 03:54:14 INFO - Cleaning up... 03:54:14 INFO - Return code: 0 03:54:14 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 03:54:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25341f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x262ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27d1b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27cf290>, '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 0x27cfb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27d0040>, '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': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', '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 03:54:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 03:54:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 03:54:14 INFO - Using env: {'DISPLAY': ':0', 03:54:14 INFO - 'HOME': '/home/cltbld', 03:54:14 INFO - 'LANG': 'en_US.UTF-8', 03:54:14 INFO - 'LANGUAGE': 'en_US:en', 03:54:14 INFO - 'LOGNAME': 'cltbld', 03:54:14 INFO - 'MAIL': '/var/mail/cltbld', 03:54:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:14 INFO - 'MOZ_NO_REMOTE': '1', 03:54:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:14 INFO - 'NO_EM_RESTART': '1', 03:54:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:14 INFO - 'PWD': '/builds/slave/test', 03:54:14 INFO - 'SHELL': '/bin/bash', 03:54:14 INFO - 'SHLVL': '1', 03:54:14 INFO - 'TERM': 'linux', 03:54:14 INFO - 'TMOUT': '86400', 03:54:14 INFO - 'USER': 'cltbld', 03:54:14 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', 03:54:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:14 INFO - '_': '/tools/buildbot/bin/python'} 03:54:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:14 INFO - Downloading/unpacking mozsystemmonitor==0.3 03:54:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:54:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:54:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:16 INFO - Downloading mozsystemmonitor-0.3.tar.gz 03:54:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:54:16 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 03:54:16 INFO - Installing collected packages: mozsystemmonitor 03:54:16 INFO - Running setup.py install for mozsystemmonitor 03:54:16 INFO - Successfully installed mozsystemmonitor 03:54:16 INFO - Cleaning up... 03:54:16 INFO - Return code: 0 03:54:16 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 03:54:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:54:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x25341f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x262ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27d1b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27cf290>, '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 0x27cfb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27d0040>, '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': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', '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 03:54:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 03:54:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 03:54:16 INFO - Using env: {'DISPLAY': ':0', 03:54:16 INFO - 'HOME': '/home/cltbld', 03:54:16 INFO - 'LANG': 'en_US.UTF-8', 03:54:16 INFO - 'LANGUAGE': 'en_US:en', 03:54:16 INFO - 'LOGNAME': 'cltbld', 03:54:16 INFO - 'MAIL': '/var/mail/cltbld', 03:54:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:16 INFO - 'MOZ_NO_REMOTE': '1', 03:54:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:16 INFO - 'NO_EM_RESTART': '1', 03:54:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:16 INFO - 'PWD': '/builds/slave/test', 03:54:16 INFO - 'SHELL': '/bin/bash', 03:54:16 INFO - 'SHLVL': '1', 03:54:16 INFO - 'TERM': 'linux', 03:54:16 INFO - 'TMOUT': '86400', 03:54:16 INFO - 'USER': 'cltbld', 03:54:16 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', 03:54:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:16 INFO - '_': '/tools/buildbot/bin/python'} 03:54:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:17 INFO - Downloading/unpacking jsonschema==2.5.1 03:54:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:54:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:54:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:19 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:54:19 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 03:54:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:54:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:54:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:19 INFO - Downloading functools32-3.2.3-2.tar.gz 03:54:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 03:54:19 INFO - warning: no files found matching '*.txt' 03:54:19 INFO - no previously-included directories found matching 'build' 03:54:19 INFO - no previously-included directories found matching 'dist' 03:54:19 INFO - no previously-included directories found matching '.git*' 03:54:19 INFO - Installing collected packages: jsonschema, functools32 03:54:19 INFO - Running setup.py install for functools32 03:54:19 INFO - warning: no files found matching '*.txt' 03:54:19 INFO - no previously-included directories found matching 'build' 03:54:19 INFO - no previously-included directories found matching 'dist' 03:54:19 INFO - no previously-included directories found matching '.git*' 03:54:19 INFO - Successfully installed jsonschema functools32 03:54:19 INFO - Cleaning up... 03:54:19 INFO - Return code: 0 03:54:19 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 03:54: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')]} 03:54:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54: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')]} 03:54:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:19 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 0x25341f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x262ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27d1b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27cf290>, '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 0x27cfb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27d0040>, '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': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', '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 03:54:19 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 03:54:19 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 03:54:19 INFO - Using env: {'DISPLAY': ':0', 03:54:19 INFO - 'HOME': '/home/cltbld', 03:54:19 INFO - 'LANG': 'en_US.UTF-8', 03:54:19 INFO - 'LANGUAGE': 'en_US:en', 03:54:19 INFO - 'LOGNAME': 'cltbld', 03:54:19 INFO - 'MAIL': '/var/mail/cltbld', 03:54:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:19 INFO - 'MOZ_NO_REMOTE': '1', 03:54:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:19 INFO - 'NO_EM_RESTART': '1', 03:54:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:19 INFO - 'PWD': '/builds/slave/test', 03:54:19 INFO - 'SHELL': '/bin/bash', 03:54:19 INFO - 'SHLVL': '1', 03:54:19 INFO - 'TERM': 'linux', 03:54:19 INFO - 'TMOUT': '86400', 03:54:19 INFO - 'USER': 'cltbld', 03:54:19 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', 03:54:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:19 INFO - '_': '/tools/buildbot/bin/python'} 03:54:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:19 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 03:54:19 INFO - Cleaning up... 03:54:19 INFO - Return code: 0 03:54:19 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:54: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')]} 03:54:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54: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')]} 03:54:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:19 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 0x25341f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x262ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27d1b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27cf290>, '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 0x27cfb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27d0040>, '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': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', '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 03:54:19 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 03:54:19 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 03:54:19 INFO - Using env: {'DISPLAY': ':0', 03:54:19 INFO - 'HOME': '/home/cltbld', 03:54:19 INFO - 'LANG': 'en_US.UTF-8', 03:54:19 INFO - 'LANGUAGE': 'en_US:en', 03:54:19 INFO - 'LOGNAME': 'cltbld', 03:54:19 INFO - 'MAIL': '/var/mail/cltbld', 03:54:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:19 INFO - 'MOZ_NO_REMOTE': '1', 03:54:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:19 INFO - 'NO_EM_RESTART': '1', 03:54:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:19 INFO - 'PWD': '/builds/slave/test', 03:54:19 INFO - 'SHELL': '/bin/bash', 03:54:19 INFO - 'SHLVL': '1', 03:54:19 INFO - 'TERM': 'linux', 03:54:19 INFO - 'TMOUT': '86400', 03:54:19 INFO - 'USER': 'cltbld', 03:54:19 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', 03:54:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:19 INFO - '_': '/tools/buildbot/bin/python'} 03:54:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:20 INFO - Downloading/unpacking blobuploader==1.2.4 03:54:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:54:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:54:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:54:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:54:22 INFO - Downloading blobuploader-1.2.4.tar.gz 03:54:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:54:22 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:54:22 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 03:54:22 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 03:54:22 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 03:54:22 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 03:54:22 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 03:54:22 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 03:54:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:54:22 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:54:22 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 03:54:22 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 03:54:22 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 03:54:22 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 03:54:22 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 03:54:22 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 03:54:22 INFO - Downloading docopt-0.6.1.tar.gz 03:54:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:54:22 INFO - Installing collected packages: blobuploader, requests, docopt 03:54:22 INFO - Running setup.py install for blobuploader 03:54:22 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:54:23 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:54:23 INFO - Running setup.py install for requests 03:54:23 INFO - Running setup.py install for docopt 03:54:23 INFO - Successfully installed blobuploader requests docopt 03:54:23 INFO - Cleaning up... 03:54:23 INFO - Return code: 0 03:54:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:54:23 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')]} 03:54:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:23 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')]} 03:54:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:23 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 0x25341f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x262ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27d1b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27cf290>, '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 0x27cfb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27d0040>, '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': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', '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 03:54:23 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 03:54:23 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 03:54:23 INFO - Using env: {'DISPLAY': ':0', 03:54:23 INFO - 'HOME': '/home/cltbld', 03:54:23 INFO - 'LANG': 'en_US.UTF-8', 03:54:23 INFO - 'LANGUAGE': 'en_US:en', 03:54:23 INFO - 'LOGNAME': 'cltbld', 03:54:23 INFO - 'MAIL': '/var/mail/cltbld', 03:54:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:23 INFO - 'MOZ_NO_REMOTE': '1', 03:54:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:23 INFO - 'NO_EM_RESTART': '1', 03:54:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:23 INFO - 'PWD': '/builds/slave/test', 03:54:23 INFO - 'SHELL': '/bin/bash', 03:54:23 INFO - 'SHLVL': '1', 03:54:23 INFO - 'TERM': 'linux', 03:54:23 INFO - 'TMOUT': '86400', 03:54:23 INFO - 'USER': 'cltbld', 03:54:23 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', 03:54:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:23 INFO - '_': '/tools/buildbot/bin/python'} 03:54:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:54:23 INFO - Running setup.py (path:/tmp/pip-ts5lo8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:54:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:54:23 INFO - Running setup.py (path:/tmp/pip-Zu89O5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:54:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:54:23 INFO - Running setup.py (path:/tmp/pip-ZVBlyv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:54:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:54:23 INFO - Running setup.py (path:/tmp/pip-dQuKX9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:54:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:54:24 INFO - Running setup.py (path:/tmp/pip-AqJOL3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:54:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:54:24 INFO - Running setup.py (path:/tmp/pip-je8yiQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:54:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:54:24 INFO - Running setup.py (path:/tmp/pip-yw_6ht-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:54:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:54:24 INFO - Running setup.py (path:/tmp/pip-lm8E19-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:54:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:54:24 INFO - Running setup.py (path:/tmp/pip-iZyJNH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:54:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:54:24 INFO - Running setup.py (path:/tmp/pip-tCiZux-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:54:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:54:24 INFO - Running setup.py (path:/tmp/pip-Z0FGnz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:54:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:54:24 INFO - Running setup.py (path:/tmp/pip-KANW4H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:54:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:54:24 INFO - Running setup.py (path:/tmp/pip-XBWUl2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:54:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:54:24 INFO - Running setup.py (path:/tmp/pip-iy3PAm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:54:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:54:24 INFO - Running setup.py (path:/tmp/pip-it1niG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:54:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:54:24 INFO - Running setup.py (path:/tmp/pip-_A0t2c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:54:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:54:24 INFO - Running setup.py (path:/tmp/pip-duurNF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:54:24 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:54:24 INFO - Running setup.py install for manifestparser 03:54:25 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:54:25 INFO - Running setup.py install for mozcrash 03:54:25 INFO - Running setup.py install for mozdebug 03:54:25 INFO - Running setup.py install for mozdevice 03:54:25 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:54:25 INFO - Running setup.py install for mozfile 03:54:25 INFO - Running setup.py install for mozhttpd 03:54:25 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:54:25 INFO - Running setup.py install for mozinfo 03:54:25 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:54:25 INFO - Running setup.py install for mozInstall 03:54:25 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:54:25 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:54:25 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:54:25 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:54:25 INFO - Running setup.py install for mozleak 03:54:25 INFO - Running setup.py install for mozlog 03:54:25 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:54:26 INFO - Running setup.py install for moznetwork 03:54:26 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:54:26 INFO - Running setup.py install for mozprocess 03:54:26 INFO - Running setup.py install for mozprofile 03:54:26 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:54:26 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:54:26 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:54:26 INFO - Running setup.py install for mozrunner 03:54:26 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:54:26 INFO - Running setup.py install for mozscreenshot 03:54:26 INFO - Running setup.py install for moztest 03:54:26 INFO - Running setup.py install for mozversion 03:54:26 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:54:26 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:54:26 INFO - Cleaning up... 03:54:26 INFO - Return code: 0 03:54:26 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:54:26 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')]} 03:54:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:26 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')]} 03:54:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:26 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 0x25341f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x262ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27d1b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27cf290>, '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 0x27cfb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27d0040>, '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': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', '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 03:54:26 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 03:54:26 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 03:54:26 INFO - Using env: {'DISPLAY': ':0', 03:54:26 INFO - 'HOME': '/home/cltbld', 03:54:26 INFO - 'LANG': 'en_US.UTF-8', 03:54:26 INFO - 'LANGUAGE': 'en_US:en', 03:54:26 INFO - 'LOGNAME': 'cltbld', 03:54:26 INFO - 'MAIL': '/var/mail/cltbld', 03:54:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:26 INFO - 'MOZ_NO_REMOTE': '1', 03:54:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:26 INFO - 'NO_EM_RESTART': '1', 03:54:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:26 INFO - 'PWD': '/builds/slave/test', 03:54:26 INFO - 'SHELL': '/bin/bash', 03:54:26 INFO - 'SHLVL': '1', 03:54:26 INFO - 'TERM': 'linux', 03:54:26 INFO - 'TMOUT': '86400', 03:54:26 INFO - 'USER': 'cltbld', 03:54:26 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', 03:54:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:26 INFO - '_': '/tools/buildbot/bin/python'} 03:54:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:54:26 INFO - Running setup.py (path:/tmp/pip-wO5tOZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:54:27 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)) 03:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:54:27 INFO - Running setup.py (path:/tmp/pip-CWgnO4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:54:27 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)) 03:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:54:27 INFO - Running setup.py (path:/tmp/pip-9XXQe0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:54:27 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)) 03:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:54:27 INFO - Running setup.py (path:/tmp/pip-5dFwIB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:54:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 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)) 03:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:54:27 INFO - Running setup.py (path:/tmp/pip-x1bkSn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:54:27 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)) 03:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:54:27 INFO - Running setup.py (path:/tmp/pip-Iz5Vb6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:54:27 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)) 03:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:54:27 INFO - Running setup.py (path:/tmp/pip-X945Pw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:54:27 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)) 03:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:54:27 INFO - Running setup.py (path:/tmp/pip-C8eEY2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:54:27 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)) 03:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:54:27 INFO - Running setup.py (path:/tmp/pip-aCq9p1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:54:27 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)) 03:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:54:27 INFO - Running setup.py (path:/tmp/pip-T3PwI7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:54:27 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)) 03:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:54:27 INFO - Running setup.py (path:/tmp/pip-N4yLg5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:54:27 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)) 03:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:54:27 INFO - Running setup.py (path:/tmp/pip-GBKPM8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:54:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 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)) 03:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:54:27 INFO - Running setup.py (path:/tmp/pip-ZRyXV_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:54:27 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)) 03:54:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:54:27 INFO - Running setup.py (path:/tmp/pip-CAx33P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:54:28 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)) 03:54:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:54:28 INFO - Running setup.py (path:/tmp/pip-w6Vfii-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:54:28 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)) 03:54:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:54:28 INFO - Running setup.py (path:/tmp/pip-C3ao4b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:54:28 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)) 03:54:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:54:28 INFO - Running setup.py (path:/tmp/pip-tiKjIF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:54:28 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)) 03:54:28 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)) 03:54:28 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)) 03:54:28 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)) 03:54:28 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:54:28 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:54:28 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:54:28 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 03:54:28 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 03:54:28 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 03:54:28 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 03:54:28 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 03:54:28 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 03:54:30 INFO - Downloading blessings-1.6.tar.gz 03:54:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:54:30 INFO - Installing collected packages: blessings 03:54:30 INFO - Running setup.py install for blessings 03:54:30 INFO - Successfully installed blessings 03:54:30 INFO - Cleaning up... 03:54:30 INFO - Return code: 0 03:54:30 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:54:30 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:54:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:54:30 INFO - Reading from file tmpfile_stdout 03:54:30 INFO - Current package versions: 03:54:30 INFO - argparse == 1.2.1 03:54:30 INFO - blessings == 1.6 03:54:30 INFO - blobuploader == 1.2.4 03:54:30 INFO - docopt == 0.6.1 03:54:30 INFO - functools32 == 3.2.3-2 03:54:30 INFO - jsonschema == 2.5.1 03:54:30 INFO - manifestparser == 1.1 03:54:30 INFO - mozInstall == 1.12 03:54:30 INFO - mozcrash == 1.0 03:54:30 INFO - mozdebug == 0.1 03:54:30 INFO - mozdevice == 0.49 03:54:30 INFO - mozfile == 1.2 03:54:30 INFO - mozhttpd == 0.7 03:54:30 INFO - mozinfo == 0.9 03:54:30 INFO - mozleak == 0.1 03:54:30 INFO - mozlog == 3.4 03:54:30 INFO - moznetwork == 0.27 03:54:30 INFO - mozprocess == 0.25 03:54:30 INFO - mozprofile == 0.28 03:54:30 INFO - mozrunner == 6.13 03:54:30 INFO - mozscreenshot == 0.1 03:54:30 INFO - mozsystemmonitor == 0.3 03:54:30 INFO - moztest == 0.8 03:54:30 INFO - mozversion == 1.4 03:54:30 INFO - psutil == 3.1.1 03:54:30 INFO - requests == 1.2.3 03:54:30 INFO - wsgiref == 0.1.2 03:54:30 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:54:30 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')]} 03:54:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:30 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')]} 03:54:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:30 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 0x25341f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x262ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27d1b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27cf290>, '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 0x27cfb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27d0040>, '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': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', '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 03:54:30 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 03:54:30 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 03:54:30 INFO - Using env: {'DISPLAY': ':0', 03:54:30 INFO - 'HOME': '/home/cltbld', 03:54:30 INFO - 'LANG': 'en_US.UTF-8', 03:54:30 INFO - 'LANGUAGE': 'en_US:en', 03:54:30 INFO - 'LOGNAME': 'cltbld', 03:54:30 INFO - 'MAIL': '/var/mail/cltbld', 03:54:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:30 INFO - 'MOZ_NO_REMOTE': '1', 03:54:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:30 INFO - 'NO_EM_RESTART': '1', 03:54:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:30 INFO - 'PWD': '/builds/slave/test', 03:54:30 INFO - 'SHELL': '/bin/bash', 03:54:30 INFO - 'SHLVL': '1', 03:54:30 INFO - 'TERM': 'linux', 03:54:30 INFO - 'TMOUT': '86400', 03:54:30 INFO - 'USER': 'cltbld', 03:54:30 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', 03:54:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:30 INFO - '_': '/tools/buildbot/bin/python'} 03:54:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:30 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)) 03:54:30 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)) 03:54:30 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)) 03:54:30 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)) 03:54:30 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)) 03:54:30 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)) 03:54:30 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)) 03:54:30 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)) 03:54:30 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)) 03:54:30 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)) 03:54:30 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)) 03:54:30 INFO - Cleaning up... 03:54:30 INFO - Return code: 0 03:54:30 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 03:54:30 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')]} 03:54:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:54:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:30 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')]} 03:54:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:54:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:54:30 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 0x25341f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x262ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27d1b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27cf290>, '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 0x27cfb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27d0040>, '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': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', '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 03:54:30 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 03:54:30 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 03:54:30 INFO - Using env: {'DISPLAY': ':0', 03:54:30 INFO - 'HOME': '/home/cltbld', 03:54:30 INFO - 'LANG': 'en_US.UTF-8', 03:54:30 INFO - 'LANGUAGE': 'en_US:en', 03:54:30 INFO - 'LOGNAME': 'cltbld', 03:54:30 INFO - 'MAIL': '/var/mail/cltbld', 03:54:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:30 INFO - 'MOZ_NO_REMOTE': '1', 03:54:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:30 INFO - 'NO_EM_RESTART': '1', 03:54:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:30 INFO - 'PWD': '/builds/slave/test', 03:54:30 INFO - 'SHELL': '/bin/bash', 03:54:30 INFO - 'SHLVL': '1', 03:54:30 INFO - 'TERM': 'linux', 03:54:30 INFO - 'TMOUT': '86400', 03:54:30 INFO - 'USER': 'cltbld', 03:54:30 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', 03:54:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:30 INFO - '_': '/tools/buildbot/bin/python'} 03:54:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:54:31 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 03:54:31 INFO - Cleaning up... 03:54:31 INFO - Return code: 0 03:54:31 INFO - Running post-action listener: _resource_record_post_action 03:54:31 INFO - Running post-action listener: _start_resource_monitoring 03:54:31 INFO - Starting resource monitoring. 03:54:31 INFO - [mozharness: 2017-04-03 10:54:31.212420Z] Finished create-virtualenv step (success) 03:54:31 INFO - [mozharness: 2017-04-03 10:54:31.212886Z] Running install step. 03:54:31 INFO - Running pre-action listener: _resource_record_pre_action 03:54:31 INFO - Running main action method: install 03:54:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:54:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:54:31 INFO - Reading from file tmpfile_stdout 03:54:31 INFO - Detecting whether we're running mozinstall >=1.0... 03:54:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:54:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:54:31 INFO - Reading from file tmpfile_stdout 03:54:31 INFO - Output received: 03:54:31 INFO - Usage: mozinstall [options] installer 03:54:31 INFO - Options: 03:54:31 INFO - -h, --help show this help message and exit 03:54:31 INFO - -d DEST, --destination=DEST 03:54:31 INFO - Directory to install application into. [default: 03:54:31 INFO - "/builds/slave/test"] 03:54:31 INFO - --app=APP Application being installed. [default: firefox] 03:54:31 INFO - mkdir: /builds/slave/test/build/application 03:54:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 03:54:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 03:54:47 INFO - Reading from file tmpfile_stdout 03:54:47 INFO - Output received: 03:54:47 INFO - /builds/slave/test/build/application/firefox/firefox 03:54:47 INFO - Running post-action listener: _resource_record_post_action 03:54:47 INFO - [mozharness: 2017-04-03 10:54:47.554334Z] Finished install step (success) 03:54:47 INFO - [mozharness: 2017-04-03 10:54:47.554670Z] Running run-tests step. 03:54:47 INFO - Running pre-action listener: _resource_record_pre_action 03:54:47 INFO - Running main action method: run_tests 03:54:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:54:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:54:47 INFO - Python 2.7.3 03:54:47 INFO - Return code: 0 03:54:47 INFO - grabbing minidump binary from tooltool 03:54:47 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')]} 03:54:47 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 0x27cf290>, '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 0x27cfb90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27d0040>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:54:47 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 03:54:47 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 03:54:47 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 03:54:47 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:54:47 INFO - Return code: 0 03:54:47 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 03:54:47 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:54:47 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:54:47 INFO - ENV: RUST_BACKTRACE is now 1 03:54:47 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 03:54:47 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:54:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-003', '--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 03:54:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-003 --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 03:54:47 INFO - Using env: {'DISPLAY': ':0', 03:54:47 INFO - 'HOME': '/home/cltbld', 03:54:47 INFO - 'LANG': 'en_US.UTF-8', 03:54:47 INFO - 'LANGUAGE': 'en_US:en', 03:54:47 INFO - 'LOGNAME': 'cltbld', 03:54:47 INFO - 'MAIL': '/var/mail/cltbld', 03:54:47 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:54:47 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 03:54:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:54:47 INFO - 'MOZ_NO_REMOTE': '1', 03:54:47 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:54:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:54:47 INFO - 'NO_EM_RESTART': '1', 03:54:47 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:54:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:54:47 INFO - 'PWD': '/builds/slave/test', 03:54:47 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:54:47 INFO - 'RUST_BACKTRACE': '1', 03:54:47 INFO - 'SHELL': '/bin/bash', 03:54:47 INFO - 'SHLVL': '1', 03:54:47 INFO - 'TERM': 'linux', 03:54:47 INFO - 'TMOUT': '86400', 03:54:47 INFO - 'USER': 'cltbld', 03:54:47 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1491216816.154123-685521', 03:54:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:54:47 INFO - '_': '/tools/buildbot/bin/python'} 03:54:47 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-003', '--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 03:54:47 INFO - mozversion application_buildid: 20170403101416 03:54:47 INFO - mozversion application_changeset: aaa0cd3bd620daf6be29c72625f6e63fd0bc1d46 03:54:47 INFO - mozversion application_display_name: Nightly 03:54:47 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:54:47 INFO - mozversion application_name: Firefox 03:54:47 INFO - mozversion application_remotingname: firefox 03:54:47 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 03:54:47 INFO - mozversion application_vendor: Mozilla 03:54:47 INFO - mozversion application_version: 55.0a1 03:54:47 INFO - mozversion platform_buildid: 20170403101416 03:54:47 INFO - mozversion platform_changeset: aaa0cd3bd620daf6be29c72625f6e63fd0bc1d46 03:54:47 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 03:54:47 INFO - mozversion platform_version: 55.0a1 03:54:47 INFO - using testdate: 1491216887 03:54:47 INFO - actual date: 1491216887 03:54:47 INFO - starting webserver on 'localhost:34065' 03:54:47 INFO - SUITE-START | Running 2 tests 03:54:47 INFO - TEST-START | dromaeo_css 03:54:47 INFO - operating with platform_type : linux_ 03:54:47 INFO - Initialising browser for dromaeo_css test... 03:54:47 INFO - TEST-INFO | started process 23673 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpSVcGGe/profile http://localhost:34065/getInfo.html) 03:54:52 INFO - PID 23673 | __metrics Screen width/height:1600/1200 03:54:52 INFO - PID 23673 | colorDepth:24 03:54:52 INFO - PID 23673 | Browser inner width/height: 1024/697 03:54:52 INFO - PID 23673 | __metrics 03:54:53 ERROR - PID 23673 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3396: TypeError: this.tabs is undefined 03:54:54 INFO - TEST-INFO | 23673: exit 0 03:54:54 INFO - Browser initialized. 03:54:54 INFO - Running cycle 1/1 for dromaeo_css test... 03:54:54 INFO - TEST-INFO | started process 23816 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpSVcGGe/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:55:06 INFO - PID 23816 | RSS: Main: 173604864 03:55:06 INFO - PID 23816 | 03:58:12 INFO - PID 23816 | Cycle 1(1): loaded http://localhost:34065/tests/dromaeo/cssquery-dojo.html (next: http://localhost:34065/tests/dromaeo/cssquery-ext.html) 03:58:13 INFO - PID 23816 | RSS: Main: 188997632 03:58:13 INFO - PID 23816 | 03:59:55 INFO - PID 23816 | ************************* 03:59:55 INFO - PID 23816 | A coding exception was thrown and uncaught in a Task. 03:59:55 INFO - PID 23816 | 03:59:55 ERROR - PID 23816 | Full message: TypeError: NetworkError when attempting to fetch resource. 03:59:55 INFO - PID 23816 | Full stack: 03:59:55 INFO - PID 23816 | ************************* 03:59:55 INFO - PID 23816 | ************************* 03:59:55 INFO - PID 23816 | A coding exception was thrown and uncaught in a Task. 03:59:55 INFO - PID 23816 | 03:59:55 ERROR - PID 23816 | Full message: TypeError: NetworkError when attempting to fetch resource. 03:59:55 INFO - PID 23816 | Full stack: 03:59:55 INFO - PID 23816 | ************************* 03:59:55 INFO - PID 23816 | ************************* 03:59:55 INFO - PID 23816 | A coding exception was thrown and uncaught in a Task. 03:59:55 INFO - PID 23816 | 03:59:55 ERROR - PID 23816 | Full message: TypeError: NetworkError when attempting to fetch resource. 03:59:55 INFO - PID 23816 | Full stack: 03:59:55 INFO - PID 23816 | ************************* 03:59:55 INFO - PID 23816 | ************************* 03:59:55 INFO - PID 23816 | A coding exception was thrown and uncaught in a Task. 03:59:55 INFO - PID 23816 | 03:59:55 ERROR - PID 23816 | Full message: TypeError: NetworkError when attempting to fetch resource. 03:59:55 INFO - PID 23816 | Full stack: 03:59:55 INFO - PID 23816 | ************************* 04:01:15 INFO - PID 23816 | Cycle 1(1): loaded http://localhost:34065/tests/dromaeo/cssquery-ext.html (next: http://localhost:34065/tests/dromaeo/cssquery-jquery.html) 04:01:16 INFO - PID 23816 | RSS: Main: 186216448 04:01:16 INFO - PID 23816 | 04:04:18 INFO - PID 23816 | Cycle 1(1): loaded http://localhost:34065/tests/dromaeo/cssquery-jquery.html (next: http://localhost:34065/tests/dromaeo/cssquery-mootools.html) 04:04:19 INFO - PID 23816 | RSS: Main: 194584576 04:04:19 INFO - PID 23816 | 04:07:21 INFO - PID 23816 | Cycle 1(1): loaded http://localhost:34065/tests/dromaeo/cssquery-mootools.html (next: http://localhost:34065/tests/dromaeo/cssquery-prototype.html) 04:07:21 INFO - PID 23816 | RSS: Main: 187367424 04:07:21 INFO - PID 23816 | 04:10:24 INFO - PID 23816 | Cycle 1(1): loaded http://localhost:34065/tests/dromaeo/cssquery-prototype.html (next: http://localhost:34065/tests/dromaeo/cssquery-yui.html) 04:10:25 INFO - PID 23816 | RSS: Main: 194764800 04:10:25 INFO - PID 23816 | 04:13:28 INFO - PID 23816 | Cycle 1(1): loaded http://localhost:34065/tests/dromaeo/cssquery-yui.html (next: http://localhost:34065/tests/dromaeo/cssquery-dojo.html) 04:13:28 INFO - PID 23816 | RSS: Main: 190590976 04:13:28 INFO - PID 23816 | 04:13:28 INFO - PID 23816 | __start_tp_report 04:13:28 INFO - PID 23816 | _x_x_mozilla_page_load 04:13:28 INFO - PID 23816 | _x_x_mozilla_page_load_details 04:13:28 INFO - PID 23816 | |i|pagename|runs| 04:13:28 INFO - PID 23816 | |0;dojo.html;2752.7522522972936;2774.292555398373;2792.3717163638185;2808.7191280871916;2813.1701148161305;5215.1395019821775;5228.189630607258;5253.264542963988;5282.630215884889;5293;5224.843254702356;5241.8951620967655;5273.472652734725;5315.202719592063;5362.490563396471;4644.558766917155;4697.859064228079;4714.387129673138;4731.858044258661;4732.05358928214;4358.193734159175;4695.295705644146;4738.147133515983;4744.1934871072;4784.210605250129;4634.165850146972;4673.369095172142;4686;4694.201985662446;4747.643926705511;4667.696599721007;4675.13510000651;4683.367745354368;4695.929561056587;4698.342232087511;4621.537846215385;4648.302754586805;4672.976635116803;4697.224957881946;4712.0811441768865;5027.949720502821;5040.949590504085;5052.191649336089;5054.444011158769;5070.2394640803805;5568.053430916754;5586.720663966786;5607.943920560783;5613.2422123013275;5616.410276920946;5602.13166959122;5686.0617998030275;5689.630174038674;5773.855653608652;5780.277465316835;5202.297689811827;5259.579233661298;5261.657992230493;5270.762815673227;5316.4683531646915;5753;5806.593538452352;5811.767529298865;5812.854678633068;5819.6508209507565;5492.725363731797;5527.723613819293;5551.805686800943;5563.36021357541;5609.0184217761725;5618.522425593788;5661.547076233974;5671.489565939085;5688.40271771458;5711.8000869969355;5614.85962850932;5615.522680572116;5627;5627.155926611041;5630.915536266959;5572.4148964358155;5605.859853503695;5625.971870140705;5655;5671.461211184931;4690.624750019991;4691.483936766953;4705.741184234831;4726.125666751662;4751.4535828379485;4011.29802284599;4043.474348334698;4044.5753195914003;4068.105016896278;4089.284375234322;4761.309610106515;4798.376211092535;4819.49395313494;4843.200871856175;4885.145099607555;5646.971765141148;5655.5475561954945;5662.207290979266;5710.057840456361;5722.198892155102;4796.37647105874;4800.879978000508;4819.903601927942;4820.39745031871;4849.2968519564465;4904.362432883774;4929.137400954819;4943;4946.554810067111;4988.9251661225835;5218.869528261672;5275.89448211026;5309.283246761792;5322.920156197582;5333.893322133458;5666.660000399989;5669.461401166883;5672.659640421588;5675.687837168995;5689.829305120853;5180.119379705384;5266.289050978069;5285.603579731613;5304.893902121858;5328.307320048369;5498.725063746877;5523.088690366045;5584.748686309044;5616.719164041863;5650.915236271377;5658.151277308437;5680.460356266148;5696.11710184922;5704.543636509153;5713.457221563945;5370.650907690988;5450.754716037867;5487.20435536837;5494.697791621339;5539.584531160099;5440.8639784004135;5482.479164479368;5486.259354987025;5522.5858060646415;5543.417941116286;5388.515033646991;5424.186372044225;5424.7558859850615;5433.293671822796;5481.3422389311945;5416.945830541802;5488.313960754906;5533.253010843646;5539.19681646151;5545.417731138334;5292.603054770984;5318.627696061239;5346.518813306821;5346.599005074713;5352.732363381738 04:13:28 INFO - PID 23816 | |1;ext.html;668.4618881800149;724.3336130759701;748.7267147491166;1094.3215206571927;1114.286856411896;34246.65753342466;35674.643253567454;35758.463623045645;35778.8211058945;35811.64188358116;36516;36918.815405923;36935;37018.814905925436;37063.62936370636;7268.927310726878;7376.373008294301;7521.05986751656;7526;7544.0569928758905;7474.514156579832;7537.397008239328;7579.848403031936;7590.544567325978;7607.771766847003;7530.134034586011;7606.657700403495;7625.885611715828;7629.122650895162;7633.236676332378;7589;7595.43034272429;7642.350400215988;7646.197149299327;7657.157712651604;7402.555846649218;7405.296496832792;7411.147718012444;7447.9627601862185;7473.1405888323;34495.31009379798;34576;34642.65357346445;34719.132021699406;34738;2735;2740.5615101583653;2775.458785536801;2778.6248856404327;2789.149309460634;23984.760152398427;24108.638370424458;24275.87862060696;25005.999760009578;25042.49915001708;2875.2093174377005;2925.648922129337;2962.7926045176846;2965.5551667250083;2974.881004759807;153573;154040.22979885028;166084;168801.3119868798;169437;41358;41663;41675;41722;41872.79063604662;44053.33919991203;44124.77937610292;44146.77926610346;44166.558334416884;44235.77882110633;11713.18007739467;11762.647120586396;11799.52801887915;11801;11828.585999489977;9283.860742088875;9284.442933424016;9317.767055823659;9325.953370233241;9333.253339732804;13267.336633168303;13371.398287077105;13455.596332110052;13478.19130852152;13596.456141754417;5408.864778380494;5607.7476513556985;5619.943800562024;5727.083666613322;5789.507891829242;898.2768871058861;931.2456909903;939.0656296984544;939.6945992552311;942.2744486745167;20922.581548368948;21440.89279553592;21763.455913602287;21942;21991.560168796856;997.8952210017989;999.9150072243941;1009.1573536097294;1022.6318525330875;1038.2161468091695;11277.154213434025;11390.715232119263;11430.314181148991;11579.305241685526;11594.130440217017;241552;241951;242336;243320;244434;42974;43218;43448;43492.13015739668;43508.782456087516;1229.7417542316214;1264.6016504801141;1265.601335579308;1268.7145392286661;1293.9842223854416;19990.800091998895;20443.591128177057;21475.892620536797;21514.78485215128;21707.240246591293;30850;31350.52974205343;31356.843215783774;31425.52861707122;31484.370312594077;213266;213275;213354;213869;214041;29578.112656620335;30208.244793880327;30452.84773576118;30746.538801918436;30756.692433075383;36327.38302421497;36780.26439471142;37028.62971370252;37671.434928475544;37790;28215.57676634893;28555;28563.42873142567;28687.282817929718;29392;28458.43083138284;28638.284042899093;28659.28351791222;29630.259243519085;29659.40681186321;30846.69153308438;31084.22289442782;31088.067357979297;31612.051638450885;31655.84172079125;27596;27648.308792280353;27822;28091.578626320214;28683.56974645424;22334.66498002564;22855.885720571292;23044.4238894029;23238.1866634667;23282.534349313257 04:13:28 INFO - PID 23816 | |2;jquery.html;418.37453007753373;429.5082130960051;437.98686039418817;441.8232706917233;444.9243628583143;17521.299148034064;18808.435746927596;19541.804581954177;19555.21779128835;19615;19023.714644280346;19118.852868827846;19900.70148947767;20148.19407223713;20150.596988060268;5641.943580564193;5851.034579294412;5879.265091863517;5884.293884733838;5885.087811389241;5804.2744656917885;5807.070868660994;5807.070868661015;5849.707514624273;5859.033259512175;5698.487136157745;5759.049756790146;5782.9421705782825;5810.709464526778;5822.505087067583;5616.803411880585;5693.715314234313;5722.341930677983;5818.5345172386105;5850.64896106235;5164.328637277167;5169.508896654812;5169.741512924339;5170.095233334151;5178.326817513736;22875.77124228753;22880.65679014816;23720.288391348287;23886;24141.39646508834;1585.1281795012696;1588.5155027716542;1593.8804589655706;1597.297189236732;1615.5314958661975;14378.424863005468;14400.927995360062;14426.278686065654;14550.345234464474;15052.096874187584;1851.8981456019912;1898.019801980198;1923.4614307993784;1951.2000079967145;1958.8628795984287;89158;90154;90534.5473272636;91839;94879.99999999932;11020;11270.605528806453;11355.886441135648;11398.145139114433;11518.94240528792;15878.761818572731;15967.361305547647;15979.600509987344;15994.120323382092;16018.279177437043;7348.816279593053;7538.3215510604305;7671.731489397956;7800.219978002267;7800.414968877243;6834.726610935507;6873.140857392826;7071.752488662975;7103.573785572882;7128.821779455451;7120.931860220905;7128.394086502705;7194.784156475314;7241.384482319062;7270.4910656254615;2103.2743703422293;2114.6827975803444;2127.744670639502;2144.3888491779767;2220.178533942452;861.961211745473;882.9028806831243;891.2736120062128;894.065701342099;918.1736437206567;16868.831311686972;16945.06802125895;17373.044482553327;17498.737518937225;17849.10754462272;897.1656359585518;905.6649039855164;905.7237542549585;908.7818923458323;917.605429665237;9361.859572106423;9368.250539956787;9689.27330450219;9741.172000380047;9926.751831204278;463726;464876;477136;483517;485044;90969.54515227381;93477.53261233651;94584.48739613467;96726;98007.50996244974;1102.5093833244289;1131.0838221040983;1158.5481662151767;1169.6257197696655;1170.3621526268205;17680;17784.199711012778;18317.175727092046;18552.794068385512;18569.44291671252;44968.32547511855;45793;45858;46336.55274148149;46718.76640616775;58637.70681146567;59061.409385905594;59638.40361596502;60009;60843;8322.334213263046;8508.446950948168;8534.146585341416;8585.613647385757;8852.690155844515;12283.324417157142;12624.747505049663;12843.29361885068;12903.612891613267;13084.672883177996;11421.600243991421;11592.594259200887;11603.5358585659;12054.397280135783;12157.635270941886;10590.682279531626;10786.406747628642;10929.890701092887;11014.284071535645;11394.658160255205;11341.319520828776;11506.424678765861;11515.769684606094;11571.942140289244;11733;8200.753977380688;8206.83586328282;8248.670053197804;8471.872921906053;8614.483131012159;10769.284596814086;11602.187846850977;11661.6501504955;11821.940890295493;11840.881591183977 04:13:28 INFO - PID 23816 | |3;mootools.html;1307.48354400012;1364.986350136499;1391.5338361648846;1394.5676840179551;1398.1680899864577;9789.902100978989;9829.65596204133;10194.286399952007;10255.794884102314;10293.433861137635;10120.645777397793;10209.693709188736;10280.126189273902;10331.63839265626;10340.482975851197;2270.3642979965634;2289.2331069091792;2310.584094862924;2312.8727919964394;2313.8727369994645;2133.221374198422;2250.7636698146703;2283.794458498735;2284.9543009139807;2293.6788849561076;2202.0421116814236;2206.91433700821;2213.4023813570325;2229.9665505017356;2276.590213761522;2153.849230553862;2202.702635144259;2208.293346129239;2211.8119959803435;2213.3249358945595;1845.8984755838424;1910.646530391882;2164.39396968849;2203.327984964585;2241.5180736141806;9917.256205784595;9949.30354875159;9991.10080092788;10028.648997285132;10068.69793906184;5511.669299842022;5697.202391665171;5701.429857014306;5712.685802280873;5713.371529131792;3274.2960263543214;3374.1901943533376;3396.8641254349795;3401.3537427888623;3467.271872906693;990.7473594233496;1032.8037672842136;1039.7608550033535;1043.8590790243295;1064.1008347945974;14419.78370324446;14428.855711442857;14436.350364233635;14477.638059048502;14536.563903082924;4719.528047195253;4920.40955085392;5003.074431230234;5053.671511351824;5070.898582028339;10840.13278937683;10945.945270273756;10975.615853445091;10981.725456863482;10985.39580323074;5647.717614119278;5657.43425657431;5661.377248502661;5666.235058267163;5673.858153546194;5040.773165207501;5117.360329958755;5185.844424667266;5284.656497327662;5386.434424385461;4209.473815773028;4221.409002739619;4272.380504826782;4286.099919016979;4304.170727440825;1306.790913453843;1352.48605529898;1375.9449622015006;1377.7106807570322;1388.6597783543098;702.118840854724;702.2415790945767;727.7380143148463;734.3684431389001;744.423072119112;5521.475459831309;5659.179418984224;5668.178114173422;5773.595848290579;5968.731407086691;813.0487329824002;818.275825894088;827.1686954610578;829.8838162657232;838.9580520973927;3401.234722187488;3451.913702157466;3601.729870259741;3618.7466877318334;3689.631036896289;12429.689257768629;13004.349782510837;13213.33933303331;13341.466341346431;13341.799873001914;12943.935280323538;13220.603381898558;13266.137701049594;13298.268595227162;13311.068225224142;9262.490563019099;9467.857982130274;9498.667546635834;9566.756321678138;9591.136797688241;5510.531604813636;5516.310461192351;5536.2249285100925;5601.719914004365;5692.51613612831;11709.121815863675;11717.179797414441;11738.823917641414;11883.643490695293;11900.107491937966;11724.355160466257;11904.583339583072;12090.939545302217;12160.695982600506;12242;7991.920080799117;8088.150744171778;8107.108218096123;8159.224873636995;8223.09545949957;9183.770405739642;9427.434353938786;9460.763480913032;9486.383385079947;9506.524673766422;7989.880151797844;8166.469179503313;8179.877301840358;8359;8380.497170169809;7882.881756773768;7887.40844436681;7895.171007044178;8098.7165449209;8144.959275203586;6947.7220911162985;7000.929990700231;7002.2297547268745;7057.611831349325;7075.398591119812;5035.823746168867;5087.313212716236;5207.973960130175;5224.425313215467;5274.393444753902;4879.926801097916;4984.32711583946;5055.823046193365;5167.870803229949;5216.791328346823 04:13:28 INFO - PID 23816 | |4;prototype.html;371.63579691901936;381.2907991136484;382.2832189644415;383.5282602399049;392.9901752456189;5367.1680889462195;5472.850701352716;5525.2817133772605;5530.5022547970675;5557.472040156189;5274.2879711238975;5368.731563421833;5384.219288203218;5387.905192054038;5389.487998640133;4090.8363665453494;4103.528094269167;4106.938395924063;4123.8969025774295;4134.4831896013;4006.6193711597352;4090.3455447128467;4117.6705863531;4121.423000779893;4123;4013.5183777946686;4024.7182697211206;4032.4354590357375;4042.070323825522;4060.7157498975084;4021;4031.9596804032026;4076.2458945095254;4078.2862998975356;4081.8163182656854;3529.505869178317;3550.2721942001826;3586.5337506124297;3593.5328407306883;3593.8921832345072;4947.975260123712;5109.6678715883345;5127.333446651912;5132.820351287687;5153.201253805666;4805.519448055166;4806.134895718769;4818.34952281441;4819.951800481986;4825.469198388175;5684.971575142139;5717.028105222081;5728.914066289009;5737.569682273846;5744.770209191627;3895.668868146211;3959.8020098994934;3996.6003399660094;3999.7800120993334;4002.7198096133284;5891.528677705816;5989.281286245635;6060.151578778975;6094.786682466092;6098.32296118571;4403.32673584036;4433.623142032963;4448.733076015449;4451.399061126706;4455.242608756519;4536.841210557614;4536.886577835515;4539.841105561355;4549.612368227657;4557.589816916494;4817.373741413594;4995;5031.823886163967;5045.974770126126;5051.520105589963;5780.797672081457;5785;5790.913136302959;5804.187413762077;5806.419358064244;1544.189300617185;1565.6164239761104;1571.758310934349;1572.968540629181;1581.1619841484032;1127.616610352484;1130.7003644034337;1133.6825688807148;1135.0805847263744;1148.62095508482;4981.726005069756;4998.9500104999215;5018.548330650186;5024.171011783015;5028.17035189197;5922.970385148046;5923.378045305267;5932.3474417814;5942.762289508371;6007.969960150172;4781.2350023996;4943.3573635427165;4954.281629163751;4955.529224723646;4982.451930287665;3105.58074659918;3146.229173852375;3148.4332820092145;3162.810231386124;3165.5409965554863;5300.257963885059;5505.504504594605;5509.724513774296;5510.3938566758425;5572.411862619215;6019.879602407927;6027.57806953509;6059.424354686298;6063.151158837766;6077.17958075663;5556;5558.972205138948;5559.722013899289;5560.971220324253;5581.190727344512;5688.40271771458;5898.3216930053595;5928.347881733092;5939.406059394026;5987.503124218945;5600.831975040755;5874.206982057539;5884.117382392676;5895.764169433346;5914.2311499504785;5445.945540544544;5482.588805839658;5573.665580065209;5601.719914004202;5608.579356548356;4079.428879956749;4091.831329395425;4099.836006559704;4104.8768536943935;4115.218108559484;5687.1753595729215;5928.79249226275;5950.19672344228;5959.851003724942;5972.611780234271;5712.343080545625;5716.342620598684;5780.335261444988;5782.2194003808945;5789;5781.739821708117;5793.94206057934;5794.072948328248;5794.681292528951;5822.70886455684;5581.49766521015;5676.77292908279;5697.145428185805;5722.885542289047;5729.312482502127;5786.768529258782;5808.76764929415;5809.5352371811;5822.272215973004;5843.094320380348;5474.835754927359;5603.915941260966;5638.85902852432;5640.379558248672;5649.237352957298 04:13:28 INFO - PID 23816 | |5;yui.html;671.5500614588226;676.3777324861127;696.7352406085683;706.0186340986029;740.5075624709568;13274.601761947133;13909.652258693524;13937.163770173796;13959.651008724799;14028.929855350709;12902.612921612343;12996.28520431376;13335.466581336736;13379.26414047227;13511.932440337785;873.8820259264998;880.9559522023906;884.9203571678547;886.167003017165;915.496476937685;921.3734660430904;924.7040946896961;929.8744669469636;931.3154831199063;931.7950050988771;949.4113649537296;949.8052899155656;950.0831697411996;950.4154944709023;952.8523078922778;943.0381011368365;944.9055094490565;946.5693109635134;946.962121515142;947.5688561704477;686.3239708886742;695.3741632530712;695.9443244540424;697.9441644668415;699.4858778797579;13022.609321720363;13078.215307081606;13127.671808204776;13910.374033168431;14884.330205140795;14016.92991535046;14906.180160091191;14935.477258295907;14960.551183464513;14962.850371496255;10593.629222977159;10696.51865666047;10856.837147442795;10891.455427228608;10933.781324373467;2759.8206116602355;2762.1052631578946;2765.2395591212576;2826.3640680846647;2826.8303901765753;67383.32616673819;67790.3220967789;67968.3203167967;68826.65586672084;70163.64918175427;10658.62694805678;10669.306495077795;10727.141828653845;10740.516676749565;10816.945915270373;22125.557488850132;22185.667214991787;22427;22675.886620567122;22740;6747.359000894907;6804.944728396545;6848.897266541006;6889.0355350251;6982.47631427645;3337.766356355032;3381.458966565338;3411.181316484026;3435.6736110069505;3458.273762509901;3773.396256598931;3824.158685089276;3858.2090671412293;3861.4593956846065;3873.5932727063814;635.4535099814157;638.1894993358409;641.1344684675744;642.8392901774556;659.1595715462728;559.8432438917109;563.788579282769;564.8107883858953;575.847400438884;581.1863391252281;8042.758717238492;8521.318294536422;8634.956825215833;8645.005824330157;8814.834721848852;535.2860994756625;546.8414159893587;573.4953241147763;581.2734082397004;588.8292395205428;3603.6036036036016;3694.2057457646197;3777.773333599993;3783.4703141560203;3982.5021872265966;67305.6634716833;67365;67759;69608;70006.64996675086;53132;53582.196267056024;56280.43719562752;56401;58033;46439;46961.76519117451;47601.52398475971;47817;48192.27711584329;8819.206271435602;9683.66107186245;9692.757681057748;9710.465924373944;9726.659566915407;25892.870535647202;25911.352216194748;26068.087616933317;26933.730662693124;27183.184504464898;42302.25035372691;44466;45287.77356113198;45821.54178458173;46009.539904601865;11805.940970295094;11904.226225295675;12105.69735756613;12127;12367.196132251374;12636.55772047974;13848.515301964382;13952.372143253375;14012.299385030912;14079.225642589756;11760.411979400824;12515.249085054926;12623.747525049632;13007.869921300666;13011.934940325238;10673.35959842412;11486.483108259981;11534.94232528832;11547.942260288644;11596.072314214674;10785.137189025016;11102.666919992413;11520.481578328827;11524.82712759326;11529.481173347387;9347.766305842137;9660.95169524148;9709.27180461454;9833.459159745997;9904.306698531322;9229.538523073954;9479.715608531755;9755.56099975517;9760;9853.359531630422 04:13:28 INFO - PID 23816 | __end_tp_report 04:13:28 INFO - PID 23816 | __start_cc_report 04:13:28 INFO - PID 23816 | _x_x_mozilla_cycle_collect,377 04:13:28 INFO - PID 23816 | __end_cc_report 04:13:28 INFO - PID 23816 | __startTimestamp1491218008754__endTimestamp 04:13:28 INFO - PID 23816 | 04:13:28 INFO - PID 23816 | ------- Summary: start ------- 04:13:28 INFO - PID 23816 | Number of tests: 6 04:13:28 INFO - PID 23816 | 04:13:28 INFO - PID 23816 | [#0] dojo.html Cycles:165 Average:5163.10 Median:5318.63 stddev:599.27 (11.3%) stddev-sans-first:570.50 04:13:28 INFO - PID 23816 | Values: 2752.8 2774.3 2792.4 2808.7 2813.2 5215.1 5228.2 5253.3 5282.6 5293.0 5224.8 5241.9 5273.5 5315.2 5362.5 4644.6 4697.9 4714.4 4731.9 4732.1 4358.2 4695.3 4738.1 4744.2 4784.2 4634.2 4673.4 4686.0 4694.2 4747.6 4667.7 4675.1 4683.4 4695.9 4698.3 4621.5 4648.3 4673.0 4697.2 4712.1 5027.9 5040.9 5052.2 5054.4 5070.2 5568.1 5586.7 5607.9 5613.2 5616.4 5602.1 5686.1 5689.6 5773.9 5780.3 5202.3 5259.6 5261.7 5270.8 5316.5 5753.0 5806.6 5811.8 5812.9 5819.7 5492.7 5527.7 5551.8 5563.4 5609.0 5618.5 5661.5 5671.5 5688.4 5711.8 5614.9 5615.5 5627.0 5627.2 5630.9 5572.4 5605.9 5626.0 5655.0 5671.5 4690.6 4691.5 4705.7 4726.1 4751.5 4011.3 4043.5 4044.6 4068.1 4089.3 4761.3 4798.4 4819.5 4843.2 4885.1 5647.0 5655.5 5662.2 5710.1 5722.2 4796.4 4800.9 4819.9 4820.4 4849.3 4904.4 4929.1 4943.0 4946.6 4988.9 5218.9 5275.9 5309.3 5322.9 5333.9 5666.7 5669.5 5672.7 5675.7 5689.8 5180.1 5266.3 5285.6 5304.9 5328.3 5498.7 5523.1 5584.7 5616.7 5650.9 5658.2 5680.5 5696.1 5704.5 5713.5 5370.7 5450.8 5487.2 5494.7 5539.6 5440.9 5482.5 5486.3 5522.6 5543.4 5388.5 5424.2 5424.8 5433.3 5481.3 5416.9 5488.3 5533.3 5539.2 5545.4 5292.6 5318.6 5346.5 5346.6 5352.7 04:13:28 INFO - PID 23816 | 04:13:28 INFO - PID 23816 | [#1] ext.html Cycles:180 Average:34988.48 Median:30848.35 stddev:54378.83 (176.3%) stddev-sans-first:54470.32 04:13:28 INFO - PID 23816 | Values: 668.5 724.3 748.7 1094.3 1114.3 34246.7 35674.6 35758.5 35778.8 35811.6 36516.0 36918.8 36935.0 37018.8 37063.6 7268.9 7376.4 7521.1 7526.0 7544.1 7474.5 7537.4 7579.8 7590.5 7607.8 7530.1 7606.7 7625.9 7629.1 7633.2 7589.0 7595.4 7642.4 7646.2 7657.2 7402.6 7405.3 7411.1 7448.0 7473.1 34495.3 34576.0 34642.7 34719.1 34738.0 2735.0 2740.6 2775.5 2778.6 2789.1 23984.8 24108.6 24275.9 25006.0 25042.5 2875.2 2925.6 2962.8 2965.6 2974.9 153573.0 154040.2 166084.0 168801.3 169437.0 41358.0 41663.0 41675.0 41722.0 41872.8 44053.3 44124.8 44146.8 44166.6 44235.8 11713.2 11762.6 11799.5 11801.0 11828.6 9283.9 9284.4 9317.8 9326.0 9333.3 13267.3 13371.4 13455.6 13478.2 13596.5 5408.9 5607.7 5619.9 5727.1 5789.5 898.3 931.2 939.1 939.7 942.3 20922.6 21440.9 21763.5 21942.0 21991.6 997.9 999.9 1009.2 1022.6 1038.2 11277.2 11390.7 11430.3 11579.3 11594.1 241552.0 241951.0 242336.0 243320.0 244434.0 42974.0 43218.0 43448.0 43492.1 43508.8 1229.7 1264.6 1265.6 1268.7 1294.0 19990.8 20443.6 21475.9 21514.8 21707.2 30850.0 31350.5 31356.8 31425.5 31484.4 213266.0 213275.0 213354.0 213869.0 214041.0 29578.1 30208.2 30452.8 30746.5 30756.7 36327.4 36780.3 37028.6 37671.4 37790.0 28215.6 28555.0 28563.4 28687.3 29392.0 28458.4 28638.3 28659.3 29630.3 29659.4 30846.7 31084.2 31088.1 31612.1 31655.8 27596.0 27648.3 27822.0 28091.6 28683.6 22334.7 22855.9 23044.4 23238.2 23282.5 04:13:28 INFO - PID 23816 | 04:13:28 INFO - PID 23816 | [#2] jquery.html Cycles:180 Average:29173.88 Median:45380.66 stddev:78695.87 (173.4%) stddev-sans-first:78887.02 04:13:28 INFO - PID 23816 | Values: 418.4 429.5 438.0 441.8 444.9 17521.3 18808.4 19541.8 19555.2 19615.0 19023.7 19118.9 19900.7 20148.2 20150.6 5641.9 5851.0 5879.3 5884.3 5885.1 5804.3 5807.1 5807.1 5849.7 5859.0 5698.5 5759.0 5782.9 5810.7 5822.5 5616.8 5693.7 5722.3 5818.5 5850.6 5164.3 5169.5 5169.7 5170.1 5178.3 22875.8 22880.7 23720.3 23886.0 24141.4 1585.1 1588.5 1593.9 1597.3 1615.5 14378.4 14400.9 14426.3 14550.3 15052.1 1851.9 1898.0 1923.5 1951.2 1958.9 89158.0 90154.0 90534.5 91839.0 94880.0 11020.0 11270.6 11355.9 11398.1 11518.9 15878.8 15967.4 15979.6 15994.1 16018.3 7348.8 7538.3 7671.7 7800.2 7800.4 6834.7 6873.1 7071.8 7103.6 7128.8 7120.9 7128.4 7194.8 7241.4 7270.5 2103.3 2114.7 2127.7 2144.4 2220.2 862.0 882.9 891.3 894.1 918.2 16868.8 16945.1 17373.0 17498.7 17849.1 897.2 905.7 905.7 908.8 917.6 9361.9 9368.3 9689.3 9741.2 9926.8 463726.0 464876.0 477136.0 483517.0 485044.0 90969.5 93477.5 94584.5 96726.0 98007.5 1102.5 1131.1 1158.5 1169.6 1170.4 17680.0 17784.2 18317.2 18552.8 18569.4 44968.3 45793.0 45858.0 46336.6 46718.8 58637.7 59061.4 59638.4 60009.0 60843.0 8322.3 8508.4 8534.1 8585.6 8852.7 12283.3 12624.7 12843.3 12903.6 13084.7 11421.6 11592.6 11603.5 12054.4 12157.6 10590.7 10786.4 10929.9 11014.3 11394.7 11341.3 11506.4 11515.8 11571.9 11733.0 8200.8 8206.8 8248.7 8471.9 8614.5 10769.3 11602.2 11661.7 11821.9 11840.9 04:13:28 INFO - PID 23816 | 04:13:28 INFO - PID 23816 | [#3] mootools.html Cycles:180 Average:6294.09 Median:4246.89 stddev:3981.68 (93.8%) stddev-sans-first:3975.22 04:13:28 INFO - PID 23816 | Values: 1307.5 1365.0 1391.5 1394.6 1398.2 9789.9 9829.7 10194.3 10255.8 10293.4 10120.6 10209.7 10280.1 10331.6 10340.5 2270.4 2289.2 2310.6 2312.9 2313.9 2133.2 2250.8 2283.8 2285.0 2293.7 2202.0 2206.9 2213.4 2230.0 2276.6 2153.8 2202.7 2208.3 2211.8 2213.3 1845.9 1910.6 2164.4 2203.3 2241.5 9917.3 9949.3 9991.1 10028.6 10068.7 5511.7 5697.2 5701.4 5712.7 5713.4 3274.3 3374.2 3396.9 3401.4 3467.3 990.7 1032.8 1039.8 1043.9 1064.1 14419.8 14428.9 14436.4 14477.6 14536.6 4719.5 4920.4 5003.1 5053.7 5070.9 10840.1 10945.9 10975.6 10981.7 10985.4 5647.7 5657.4 5661.4 5666.2 5673.9 5040.8 5117.4 5185.8 5284.7 5386.4 4209.5 4221.4 4272.4 4286.1 4304.2 1306.8 1352.5 1375.9 1377.7 1388.7 702.1 702.2 727.7 734.4 744.4 5521.5 5659.2 5668.2 5773.6 5968.7 813.0 818.3 827.2 829.9 839.0 3401.2 3451.9 3601.7 3618.7 3689.6 12429.7 13004.3 13213.3 13341.5 13341.8 12943.9 13220.6 13266.1 13298.3 13311.1 9262.5 9467.9 9498.7 9566.8 9591.1 5510.5 5516.3 5536.2 5601.7 5692.5 11709.1 11717.2 11738.8 11883.6 11900.1 11724.4 11904.6 12090.9 12160.7 12242.0 7991.9 8088.2 8107.1 8159.2 8223.1 9183.8 9427.4 9460.8 9486.4 9506.5 7989.9 8166.5 8179.9 8359.0 8380.5 7882.9 7887.4 7895.2 8098.7 8145.0 6947.7 7000.9 7002.2 7057.6 7075.4 5035.8 5087.3 5208.0 5224.4 5274.4 4879.9 4984.3 5055.8 5167.9 5216.8 04:13:28 INFO - PID 23816 | 04:13:28 INFO - PID 23816 | [#4] prototype.html Cycles:180 Average:4756.34 Median:5287.27 stddev:1375.86 (26.0%) stddev-sans-first:1339.78 04:13:28 INFO - PID 23816 | Values: 371.6 381.3 382.3 383.5 393.0 5367.2 5472.9 5525.3 5530.5 5557.5 5274.3 5368.7 5384.2 5387.9 5389.5 4090.8 4103.5 4106.9 4123.9 4134.5 4006.6 4090.3 4117.7 4121.4 4123.0 4013.5 4024.7 4032.4 4042.1 4060.7 4021.0 4032.0 4076.2 4078.3 4081.8 3529.5 3550.3 3586.5 3593.5 3593.9 4948.0 5109.7 5127.3 5132.8 5153.2 4805.5 4806.1 4818.3 4820.0 4825.5 5685.0 5717.0 5728.9 5737.6 5744.8 3895.7 3959.8 3996.6 3999.8 4002.7 5891.5 5989.3 6060.2 6094.8 6098.3 4403.3 4433.6 4448.7 4451.4 4455.2 4536.8 4536.9 4539.8 4549.6 4557.6 4817.4 4995.0 5031.8 5046.0 5051.5 5780.8 5785.0 5790.9 5804.2 5806.4 1544.2 1565.6 1571.8 1573.0 1581.2 1127.6 1130.7 1133.7 1135.1 1148.6 4981.7 4999.0 5018.5 5024.2 5028.2 5923.0 5923.4 5932.3 5942.8 6008.0 4781.2 4943.4 4954.3 4955.5 4982.5 3105.6 3146.2 3148.4 3162.8 3165.5 5300.3 5505.5 5509.7 5510.4 5572.4 6019.9 6027.6 6059.4 6063.2 6077.2 5556.0 5559.0 5559.7 5561.0 5581.2 5688.4 5898.3 5928.3 5939.4 5987.5 5600.8 5874.2 5884.1 5895.8 5914.2 5445.9 5482.6 5573.7 5601.7 5608.6 4079.4 4091.8 4099.8 4104.9 4115.2 5687.2 5928.8 5950.2 5959.9 5972.6 5712.3 5716.3 5780.3 5782.2 5789.0 5781.7 5793.9 5794.1 5794.7 5822.7 5581.5 5676.8 5697.1 5722.9 5729.3 5786.8 5808.8 5809.5 5822.3 5843.1 5474.8 5603.9 5638.9 5640.4 5649.2 04:13:28 INFO - PID 23816 | 04:13:28 INFO - PID 23816 | [#5] yui.html Cycles:180 Average:14893.58 Median:46700.38 stddev:18397.17 (39.4%) stddev-sans-first:18417.78 04:13:28 INFO - PID 23816 | Values: 671.6 676.4 696.7 706.0 740.5 13274.6 13909.7 13937.2 13959.7 14028.9 12902.6 12996.3 13335.5 13379.3 13511.9 873.9 881.0 884.9 886.2 915.5 921.4 924.7 929.9 931.3 931.8 949.4 949.8 950.1 950.4 952.9 943.0 944.9 946.6 947.0 947.6 686.3 695.4 695.9 697.9 699.5 13022.6 13078.2 13127.7 13910.4 14884.3 14016.9 14906.2 14935.5 14960.6 14962.9 10593.6 10696.5 10856.8 10891.5 10933.8 2759.8 2762.1 2765.2 2826.4 2826.8 67383.3 67790.3 67968.3 68826.7 70163.6 10658.6 10669.3 10727.1 10740.5 10816.9 22125.6 22185.7 22427.0 22675.9 22740.0 6747.4 6804.9 6848.9 6889.0 6982.5 3337.8 3381.5 3411.2 3435.7 3458.3 3773.4 3824.2 3858.2 3861.5 3873.6 635.5 638.2 641.1 642.8 659.2 559.8 563.8 564.8 575.8 581.2 8042.8 8521.3 8635.0 8645.0 8814.8 535.3 546.8 573.5 581.3 588.8 3603.6 3694.2 3777.8 3783.5 3982.5 67305.7 67365.0 67759.0 69608.0 70006.6 53132.0 53582.2 56280.4 56401.0 58033.0 46439.0 46961.8 47601.5 47817.0 48192.3 8819.2 9683.7 9692.8 9710.5 9726.7 25892.9 25911.4 26068.1 26933.7 27183.2 42302.3 44466.0 45287.8 45821.5 46009.5 11805.9 11904.2 12105.7 12127.0 12367.2 12636.6 13848.5 13952.4 14012.3 14079.2 11760.4 12515.2 12623.7 13007.9 13011.9 10673.4 11486.5 11534.9 11547.9 11596.1 10785.1 11102.7 11520.5 11524.8 11529.5 9347.8 9661.0 9709.3 9833.5 9904.3 9229.5 9479.7 9755.6 9760.0 9853.4 04:13:28 INFO - PID 23816 | -------- Summary: end -------- 04:13:28 INFO - PID 23816 | 04:13:29 INFO - TEST-INFO | 23816: exit 0 04:13:29 INFO - TEST-OK | dromaeo_css | took 1121699ms 04:13:29 INFO - TEST-START | kraken 04:13:29 INFO - operating with platform_type : linux_ 04:13:29 INFO - Initialising browser for kraken test... 04:13:29 INFO - TEST-INFO | started process 24202 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpOz8VpF/profile http://localhost:34065/getInfo.html) 04:13:34 INFO - PID 24202 | __metrics Screen width/height:1600/1200 04:13:34 INFO - PID 24202 | colorDepth:24 04:13:34 INFO - PID 24202 | Browser inner width/height: 1024/697 04:13:34 INFO - PID 24202 | __metrics 04:13:35 ERROR - PID 24202 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3396: TypeError: this.tabs is undefined 04:13:36 INFO - TEST-INFO | 24202: exit 0 04:13:36 INFO - Browser initialized. 04:13:36 INFO - Running cycle 1/1 for kraken test... 04:13:36 INFO - TEST-INFO | started process 24342 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpOz8VpF/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:13:48 INFO - PID 24342 | RSS: Main: 172453888 04:13:48 INFO - PID 24342 | 04:13:50 INFO - PID 24342 | Cycle 1(1): loaded http://localhost:34065/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:34065/tests/kraken/driver.html?testName=audio-beat-detection) 04:13:51 INFO - PID 24342 | RSS: Main: 180498432 04:13:51 INFO - PID 24342 | 04:13:54 INFO - PID 24342 | Cycle 1(1): loaded http://localhost:34065/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:34065/tests/kraken/driver.html?testName=audio-dft) 04:13:55 INFO - PID 24342 | RSS: Main: 179884032 04:13:55 INFO - PID 24342 | 04:13:58 INFO - PID 24342 | Cycle 1(1): loaded http://localhost:34065/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:34065/tests/kraken/driver.html?testName=audio-fft) 04:13:58 INFO - PID 24342 | RSS: Main: 177881088 04:13:58 INFO - PID 24342 | 04:14:01 INFO - PID 24342 | Cycle 1(1): loaded http://localhost:34065/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:34065/tests/kraken/driver.html?testName=audio-oscillator) 04:14:01 INFO - PID 24342 | RSS: Main: 179040256 04:14:01 INFO - PID 24342 | 04:14:03 INFO - PID 24342 | Cycle 1(1): loaded http://localhost:34065/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:34065/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:14:04 INFO - PID 24342 | RSS: Main: 179339264 04:14:04 INFO - PID 24342 | 04:14:07 INFO - PID 24342 | Cycle 1(1): loaded http://localhost:34065/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:34065/tests/kraken/driver.html?testName=imaging-darkroom) 04:14:08 INFO - PID 24342 | RSS: Main: 182247424 04:14:08 INFO - PID 24342 | 04:14:11 INFO - PID 24342 | Cycle 1(1): loaded http://localhost:34065/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:34065/tests/kraken/driver.html?testName=imaging-desaturate) 04:14:12 INFO - PID 24342 | RSS: Main: 179671040 04:14:12 INFO - PID 24342 | 04:14:15 INFO - PID 24342 | Cycle 1(1): loaded http://localhost:34065/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:34065/tests/kraken/driver.html?testName=json-parse-financial) 04:14:16 INFO - PID 24342 | RSS: Main: 180862976 04:14:16 INFO - PID 24342 | 04:14:17 INFO - PID 24342 | Cycle 1(1): loaded http://localhost:34065/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:34065/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:14:18 INFO - PID 24342 | RSS: Main: 181424128 04:14:18 INFO - PID 24342 | 04:14:20 INFO - PID 24342 | Cycle 1(1): loaded http://localhost:34065/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:34065/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:14:20 INFO - PID 24342 | RSS: Main: 182177792 04:14:20 INFO - PID 24342 | 04:14:23 INFO - PID 24342 | Cycle 1(1): loaded http://localhost:34065/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:34065/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:14:23 INFO - PID 24342 | RSS: Main: 183140352 04:14:23 INFO - PID 24342 | 04:14:26 INFO - PID 24342 | Cycle 1(1): loaded http://localhost:34065/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:34065/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:14:27 INFO - PID 24342 | RSS: Main: 183250944 04:14:27 INFO - PID 24342 | 04:14:30 INFO - PID 24342 | Cycle 1(1): loaded http://localhost:34065/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:34065/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:14:31 INFO - PID 24342 | RSS: Main: 183054336 04:14:31 INFO - PID 24342 | 04:14:32 INFO - PID 24342 | Cycle 1(1): loaded http://localhost:34065/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:34065/tests/kraken/driver.html?testName=ai-astar) 04:14:33 INFO - PID 24342 | RSS: Main: 185401344 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | __start_tp_report 04:14:33 INFO - PID 24342 | _x_x_mozilla_page_load 04:14:33 INFO - PID 24342 | _x_x_mozilla_page_load_details 04:14:33 INFO - PID 24342 | |i|pagename|runs| 04:14:33 INFO - PID 24342 | |0;ai-astar;103;112;116;122;114;114;116;115;123;122 04:14:33 INFO - PID 24342 | |1;audio-beat-detection;153;126;123;172;124;123;123;122;143;125 04:14:33 INFO - PID 24342 | |2;audio-dft;167;167;170;168;173;169;177;166;165;177 04:14:33 INFO - PID 24342 | |3;audio-fft;75;76;75;104;78;78;77;76;96;75 04:14:33 INFO - PID 24342 | |4;audio-oscillator;85;85;102;84;84;84;111;84;84;112 04:14:33 INFO - PID 24342 | |5;imaging-gaussian-blur;114;114;114;115;123;121;122;114;115;114 04:14:33 INFO - PID 24342 | |6;imaging-darkroom;159;152;155;152;151;151;152;154;152;151 04:14:33 INFO - PID 24342 | |7;imaging-desaturate;95;95;95;95;94;96;95;95;95;95 04:14:33 INFO - PID 24342 | |8;json-parse-financial;54;53;54;53;55;54;53;54;54;54 04:14:33 INFO - PID 24342 | |9;json-stringify-tinderbox;56;57;57;58;56;57;55;55;56;56 04:14:33 INFO - PID 24342 | |10;stanford-crypto-aes;86;81;81;89;90;90;85;85;83;83 04:14:33 INFO - PID 24342 | |11;stanford-crypto-ccm;143;144;135;137;133;135;131;131;171;138 04:14:33 INFO - PID 24342 | |12;stanford-crypto-pbkdf2;185;205;189;192;191;200;193;200;182;191 04:14:33 INFO - PID 24342 | |13;stanford-crypto-sha256-iterative;70;69;69;69;69;69;71;70;70;70 04:14:33 INFO - PID 24342 | __end_tp_report 04:14:33 INFO - PID 24342 | __start_cc_report 04:14:33 INFO - PID 24342 | _x_x_mozilla_cycle_collect,867 04:14:33 INFO - PID 24342 | __end_cc_report 04:14:33 INFO - PID 24342 | __startTimestamp1491218073095__endTimestamp 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | ------- Summary: start ------- 04:14:33 INFO - PID 24342 | Number of tests: 14 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | [#0] ai-astar Cycles:10 Average:115.70 Median:116.00 stddev:5.91 (5.1%) stddev-sans-first:4.11 04:14:33 INFO - PID 24342 | Values: 103.0 112.0 116.0 122.0 114.0 114.0 116.0 115.0 123.0 122.0 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | [#1] audio-beat-detection Cycles:10 Average:133.40 Median:125.50 stddev:17.11 (13.6%) stddev-sans-first:16.61 04:14:33 INFO - PID 24342 | Values: 153.0 126.0 123.0 172.0 124.0 123.0 123.0 122.0 143.0 125.0 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | [#2] audio-dft Cycles:10 Average:169.90 Median:169.50 stddev:4.36 (2.6%) stddev-sans-first:4.49 04:14:33 INFO - PID 24342 | Values: 167.0 167.0 170.0 168.0 173.0 169.0 177.0 166.0 165.0 177.0 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | [#3] audio-fft Cycles:10 Average:81.00 Median:76.50 stddev:10.25 (13.4%) stddev-sans-first:10.64 04:14:33 INFO - PID 24342 | Values: 75.0 76.0 75.0 104.0 78.0 78.0 77.0 76.0 96.0 75.0 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | [#4] audio-oscillator Cycles:10 Average:91.50 Median:84.00 stddev:11.91 (14.2%) stddev-sans-first:12.40 04:14:33 INFO - PID 24342 | Values: 85.0 85.0 102.0 84.0 84.0 84.0 111.0 84.0 84.0 112.0 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | [#5] imaging-gaussian-blur Cycles:10 Average:116.60 Median:115.00 stddev:3.78 (3.3%) stddev-sans-first:3.89 04:14:33 INFO - PID 24342 | Values: 114.0 114.0 114.0 115.0 123.0 121.0 122.0 114.0 115.0 114.0 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | [#6] imaging-darkroom Cycles:10 Average:152.90 Median:152.00 stddev:2.51 (1.7%) stddev-sans-first:1.39 04:14:33 INFO - PID 24342 | Values: 159.0 152.0 155.0 152.0 151.0 151.0 152.0 154.0 152.0 151.0 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | [#7] imaging-desaturate Cycles:10 Average:95.00 Median:95.00 stddev:0.47 (0.5%) stddev-sans-first:0.50 04:14:33 INFO - PID 24342 | Values: 95.0 95.0 95.0 95.0 94.0 96.0 95.0 95.0 95.0 95.0 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | [#8] json-parse-financial Cycles:10 Average:53.80 Median:54.00 stddev:0.63 (1.2%) stddev-sans-first:0.67 04:14:33 INFO - PID 24342 | Values: 54.0 53.0 54.0 53.0 55.0 54.0 53.0 54.0 54.0 54.0 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | [#9] json-stringify-tinderbox Cycles:10 Average:56.30 Median:56.50 stddev:0.95 (1.7%) stddev-sans-first:1.00 04:14:33 INFO - PID 24342 | Values: 56.0 57.0 57.0 58.0 56.0 57.0 55.0 55.0 56.0 56.0 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | [#10] stanford-crypto-aes Cycles:10 Average:85.30 Median:85.50 stddev:3.43 (4.0%) stddev-sans-first:3.63 04:14:33 INFO - PID 24342 | Values: 86.0 81.0 81.0 89.0 90.0 90.0 85.0 85.0 83.0 83.0 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | [#11] stanford-crypto-ccm Cycles:10 Average:139.80 Median:137.50 stddev:11.83 (8.6%) stddev-sans-first:12.49 04:14:33 INFO - PID 24342 | Values: 143.0 144.0 135.0 137.0 133.0 135.0 131.0 131.0 171.0 138.0 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:192.80 Median:192.50 stddev:7.08 (3.7%) stddev-sans-first:6.93 04:14:33 INFO - PID 24342 | Values: 185.0 205.0 189.0 192.0 191.0 200.0 193.0 200.0 182.0 191.0 04:14:33 INFO - PID 24342 | 04:14:33 INFO - PID 24342 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.60 Median:70.00 stddev:0.70 (1.0%) stddev-sans-first:0.73 04:14:33 INFO - PID 24342 | Values: 70.0 69.0 69.0 69.0 69.0 69.0 71.0 70.0 70.0 70.0 04:14:33 INFO - PID 24342 | -------- Summary: end -------- 04:14:33 INFO - PID 24342 | 04:14:34 INFO - TEST-INFO | 24342: exit 0 04:14:34 INFO - TEST-OK | kraken | took 64738ms 04:14:34 INFO - SUITE-END | took 1186s 04:14:34 INFO - Completed test suite (00:19:46) 04:14:34 INFO - javascript benchmark 04:14:34 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6791.84880342919, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2752.7522522972936, 2774.292555398373, 2792.3717163638185, 2808.7191280871916, 2813.1701148161305, 5215.1395019821775, 5228.189630607258, 5253.264542963988, 5282.630215884889, 5293.0, 5224.843254702356, 5241.8951620967655, 5273.472652734725, 5315.202719592063, 5362.490563396471, 4644.558766917155, 4697.859064228079, 4714.387129673138, 4731.858044258661, 4732.05358928214, 4358.193734159175, 4695.295705644146, 4738.147133515983, 4744.1934871072, 4784.210605250129, 4634.165850146972, 4673.369095172142, 4686.0, 4694.201985662446, 4747.643926705511, 4667.696599721007, 4675.13510000651, 4683.367745354368, 4695.929561056587, 4698.342232087511, 4621.537846215385, 4648.302754586805, 4672.976635116803, 4697.224957881946, 4712.0811441768865, 5027.949720502821, 5040.949590504085, 5052.191649336089, 5054.444011158769, 5070.2394640803805, 5568.053430916754, 5586.720663966786, 5607.943920560783, 5613.2422123013275, 5616.410276920946, 5602.13166959122, 5686.0617998030275, 5689.630174038674, 5773.855653608652, 5780.277465316835, 5202.297689811827, 5259.579233661298, 5261.657992230493, 5270.762815673227, 5316.4683531646915, 5753.0, 5806.593538452352, 5811.767529298865, 5812.854678633068, 5819.6508209507565, 5492.725363731797, 5527.723613819293, 5551.805686800943, 5563.36021357541, 5609.0184217761725, 5618.522425593788, 5661.547076233974, 5671.489565939085, 5688.40271771458, 5711.8000869969355, 5614.85962850932, 5615.522680572116, 5627.0, 5627.155926611041, 5630.915536266959, 5572.4148964358155, 5605.859853503695, 5625.971870140705, 5655.0, 5671.461211184931, 4690.624750019991, 4691.483936766953, 4705.741184234831, 4726.125666751662, 4751.4535828379485, 4011.29802284599, 4043.474348334698, 4044.5753195914003, 4068.105016896278, 4089.284375234322, 4761.309610106515, 4798.376211092535, 4819.49395313494, 4843.200871856175, 4885.145099607555, 5646.971765141148, 5655.5475561954945, 5662.207290979266, 5710.057840456361, 5722.198892155102, 4796.37647105874, 4800.879978000508, 4819.903601927942, 4820.39745031871, 4849.2968519564465, 4904.362432883774, 4929.137400954819, 4943.0, 4946.554810067111, 4988.9251661225835, 5218.869528261672, 5275.89448211026, 5309.283246761792, 5322.920156197582, 5333.893322133458, 5666.660000399989, 5669.461401166883, 5672.659640421588, 5675.687837168995, 5689.829305120853, 5180.119379705384, 5266.289050978069, 5285.603579731613, 5304.893902121858, 5328.307320048369, 5498.725063746877, 5523.088690366045, 5584.748686309044, 5616.719164041863, 5650.915236271377, 5658.151277308437, 5680.460356266148, 5696.11710184922, 5704.543636509153, 5713.457221563945, 5370.650907690988, 5450.754716037867, 5487.20435536837, 5494.697791621339, 5539.584531160099, 5440.8639784004135, 5482.479164479368, 5486.259354987025, 5522.5858060646415, 5543.417941116286, 5388.515033646991, 5424.186372044225, 5424.7558859850615, 5433.293671822796, 5481.3422389311945, 5416.945830541802, 5488.313960754906, 5533.253010843646, 5539.19681646151, 5545.417731138334, 5292.603054770984, 5318.627696061239, 5346.518813306821, 5346.599005074713, 5352.732363381738], "value": 5120.631310825389, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [668.4618881800149, 724.3336130759701, 748.7267147491166, 1094.3215206571927, 1114.286856411896, 34246.65753342466, 35674.643253567454, 35758.463623045645, 35778.8211058945, 35811.64188358116, 36516.0, 36918.815405923, 36935.0, 37018.814905925436, 37063.62936370636, 7268.927310726878, 7376.373008294301, 7521.05986751656, 7526.0, 7544.0569928758905, 7474.514156579832, 7537.397008239328, 7579.848403031936, 7590.544567325978, 7607.771766847003, 7530.134034586011, 7606.657700403495, 7625.885611715828, 7629.122650895162, 7633.236676332378, 7589.0, 7595.43034272429, 7642.350400215988, 7646.197149299327, 7657.157712651604, 7402.555846649218, 7405.296496832792, 7411.147718012444, 7447.9627601862185, 7473.1405888323, 34495.31009379798, 34576.0, 34642.65357346445, 34719.132021699406, 34738.0, 2735.0, 2740.5615101583653, 2775.458785536801, 2778.6248856404327, 2789.149309460634, 23984.760152398427, 24108.638370424458, 24275.87862060696, 25005.999760009578, 25042.49915001708, 2875.2093174377005, 2925.648922129337, 2962.7926045176846, 2965.5551667250083, 2974.881004759807, 153573.0, 154040.22979885028, 166084.0, 168801.3119868798, 169437.0, 41358.0, 41663.0, 41675.0, 41722.0, 41872.79063604662, 44053.33919991203, 44124.77937610292, 44146.77926610346, 44166.558334416884, 44235.77882110633, 11713.18007739467, 11762.647120586396, 11799.52801887915, 11801.0, 11828.585999489977, 9283.860742088875, 9284.442933424016, 9317.767055823659, 9325.953370233241, 9333.253339732804, 13267.336633168303, 13371.398287077105, 13455.596332110052, 13478.19130852152, 13596.456141754417, 5408.864778380494, 5607.7476513556985, 5619.943800562024, 5727.083666613322, 5789.507891829242, 898.2768871058861, 931.2456909903, 939.0656296984544, 939.6945992552311, 942.2744486745167, 20922.581548368948, 21440.89279553592, 21763.455913602287, 21942.0, 21991.560168796856, 997.8952210017989, 999.9150072243941, 1009.1573536097294, 1022.6318525330875, 1038.2161468091695, 11277.154213434025, 11390.715232119263, 11430.314181148991, 11579.305241685526, 11594.130440217017, 241552.0, 241951.0, 242336.0, 243320.0, 244434.0, 42974.0, 43218.0, 43448.0, 43492.13015739668, 43508.782456087516, 1229.7417542316214, 1264.6016504801141, 1265.601335579308, 1268.7145392286661, 1293.9842223854416, 19990.800091998895, 20443.591128177057, 21475.892620536797, 21514.78485215128, 21707.240246591293, 30850.0, 31350.52974205343, 31356.843215783774, 31425.52861707122, 31484.370312594077, 213266.0, 213275.0, 213354.0, 213869.0, 214041.0, 29578.112656620335, 30208.244793880327, 30452.84773576118, 30746.538801918436, 30756.692433075383, 36327.38302421497, 36780.26439471142, 37028.62971370252, 37671.434928475544, 37790.0, 28215.57676634893, 28555.0, 28563.42873142567, 28687.282817929718, 29392.0, 28458.43083138284, 28638.284042899093, 28659.28351791222, 29630.259243519085, 29659.40681186321, 30846.69153308438, 31084.22289442782, 31088.067357979297, 31612.051638450885, 31655.84172079125, 27596.0, 27648.308792280353, 27822.0, 28091.578626320214, 28683.56974645424, 22334.66498002564, 22855.885720571292, 23044.4238894029, 23238.1866634667, 23282.534349313257], "value": 15241.32246656537, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [418.37453007753373, 429.5082130960051, 437.98686039418817, 441.8232706917233, 444.9243628583143, 17521.299148034064, 18808.435746927596, 19541.804581954177, 19555.21779128835, 19615.0, 19023.714644280346, 19118.852868827846, 19900.70148947767, 20148.19407223713, 20150.596988060268, 5641.943580564193, 5851.034579294412, 5879.265091863517, 5884.293884733838, 5885.087811389241, 5804.2744656917885, 5807.070868660994, 5807.070868661015, 5849.707514624273, 5859.033259512175, 5698.487136157745, 5759.049756790146, 5782.9421705782825, 5810.709464526778, 5822.505087067583, 5616.803411880585, 5693.715314234313, 5722.341930677983, 5818.5345172386105, 5850.64896106235, 5164.328637277167, 5169.508896654812, 5169.741512924339, 5170.095233334151, 5178.326817513736, 22875.77124228753, 22880.65679014816, 23720.288391348287, 23886.0, 24141.39646508834, 1585.1281795012696, 1588.5155027716542, 1593.8804589655706, 1597.297189236732, 1615.5314958661975, 14378.424863005468, 14400.927995360062, 14426.278686065654, 14550.345234464474, 15052.096874187584, 1851.8981456019912, 1898.019801980198, 1923.4614307993784, 1951.2000079967145, 1958.8628795984287, 89158.0, 90154.0, 90534.5473272636, 91839.0, 94879.99999999932, 11020.0, 11270.605528806453, 11355.886441135648, 11398.145139114433, 11518.94240528792, 15878.761818572731, 15967.361305547647, 15979.600509987344, 15994.120323382092, 16018.279177437043, 7348.816279593053, 7538.3215510604305, 7671.731489397956, 7800.219978002267, 7800.414968877243, 6834.726610935507, 6873.140857392826, 7071.752488662975, 7103.573785572882, 7128.821779455451, 7120.931860220905, 7128.394086502705, 7194.784156475314, 7241.384482319062, 7270.4910656254615, 2103.2743703422293, 2114.6827975803444, 2127.744670639502, 2144.3888491779767, 2220.178533942452, 861.961211745473, 882.9028806831243, 891.2736120062128, 894.065701342099, 918.1736437206567, 16868.831311686972, 16945.06802125895, 17373.044482553327, 17498.737518937225, 17849.10754462272, 897.1656359585518, 905.6649039855164, 905.7237542549585, 908.7818923458323, 917.605429665237, 9361.859572106423, 9368.250539956787, 9689.27330450219, 9741.172000380047, 9926.751831204278, 463726.0, 464876.0, 477136.0, 483517.0, 485044.0, 90969.54515227381, 93477.53261233651, 94584.48739613467, 96726.0, 98007.50996244974, 1102.5093833244289, 1131.0838221040983, 1158.5481662151767, 1169.6257197696655, 1170.3621526268205, 17680.0, 17784.199711012778, 18317.175727092046, 18552.794068385512, 18569.44291671252, 44968.32547511855, 45793.0, 45858.0, 46336.55274148149, 46718.76640616775, 58637.70681146567, 59061.409385905594, 59638.40361596502, 60009.0, 60843.0, 8322.334213263046, 8508.446950948168, 8534.146585341416, 8585.613647385757, 8852.690155844515, 12283.324417157142, 12624.747505049663, 12843.29361885068, 12903.612891613267, 13084.672883177996, 11421.600243991421, 11592.594259200887, 11603.5358585659, 12054.397280135783, 12157.635270941886, 10590.682279531626, 10786.406747628642, 10929.890701092887, 11014.284071535645, 11394.658160255205, 11341.319520828776, 11506.424678765861, 11515.769684606094, 11571.942140289244, 11733.0, 8200.753977380688, 8206.83586328282, 8248.670053197804, 8471.872921906053, 8614.483131012159, 10769.284596814086, 11602.187846850977, 11661.6501504955, 11821.940890295493, 11840.881591183977], "value": 9298.109097237193, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1307.48354400012, 1364.986350136499, 1391.5338361648846, 1394.5676840179551, 1398.1680899864577, 9789.902100978989, 9829.65596204133, 10194.286399952007, 10255.794884102314, 10293.433861137635, 10120.645777397793, 10209.693709188736, 10280.126189273902, 10331.63839265626, 10340.482975851197, 2270.3642979965634, 2289.2331069091792, 2310.584094862924, 2312.8727919964394, 2313.8727369994645, 2133.221374198422, 2250.7636698146703, 2283.794458498735, 2284.9543009139807, 2293.6788849561076, 2202.0421116814236, 2206.91433700821, 2213.4023813570325, 2229.9665505017356, 2276.590213761522, 2153.849230553862, 2202.702635144259, 2208.293346129239, 2211.8119959803435, 2213.3249358945595, 1845.8984755838424, 1910.646530391882, 2164.39396968849, 2203.327984964585, 2241.5180736141806, 9917.256205784595, 9949.30354875159, 9991.10080092788, 10028.648997285132, 10068.69793906184, 5511.669299842022, 5697.202391665171, 5701.429857014306, 5712.685802280873, 5713.371529131792, 3274.2960263543214, 3374.1901943533376, 3396.8641254349795, 3401.3537427888623, 3467.271872906693, 990.7473594233496, 1032.8037672842136, 1039.7608550033535, 1043.8590790243295, 1064.1008347945974, 14419.78370324446, 14428.855711442857, 14436.350364233635, 14477.638059048502, 14536.563903082924, 4719.528047195253, 4920.40955085392, 5003.074431230234, 5053.671511351824, 5070.898582028339, 10840.13278937683, 10945.945270273756, 10975.615853445091, 10981.725456863482, 10985.39580323074, 5647.717614119278, 5657.43425657431, 5661.377248502661, 5666.235058267163, 5673.858153546194, 5040.773165207501, 5117.360329958755, 5185.844424667266, 5284.656497327662, 5386.434424385461, 4209.473815773028, 4221.409002739619, 4272.380504826782, 4286.099919016979, 4304.170727440825, 1306.790913453843, 1352.48605529898, 1375.9449622015006, 1377.7106807570322, 1388.6597783543098, 702.118840854724, 702.2415790945767, 727.7380143148463, 734.3684431389001, 744.423072119112, 5521.475459831309, 5659.179418984224, 5668.178114173422, 5773.595848290579, 5968.731407086691, 813.0487329824002, 818.275825894088, 827.1686954610578, 829.8838162657232, 838.9580520973927, 3401.234722187488, 3451.913702157466, 3601.729870259741, 3618.7466877318334, 3689.631036896289, 12429.689257768629, 13004.349782510837, 13213.33933303331, 13341.466341346431, 13341.799873001914, 12943.935280323538, 13220.603381898558, 13266.137701049594, 13298.268595227162, 13311.068225224142, 9262.490563019099, 9467.857982130274, 9498.667546635834, 9566.756321678138, 9591.136797688241, 5510.531604813636, 5516.310461192351, 5536.2249285100925, 5601.719914004365, 5692.51613612831, 11709.121815863675, 11717.179797414441, 11738.823917641414, 11883.643490695293, 11900.107491937966, 11724.355160466257, 11904.583339583072, 12090.939545302217, 12160.695982600506, 12242.0, 7991.920080799117, 8088.150744171778, 8107.108218096123, 8159.224873636995, 8223.09545949957, 9183.770405739642, 9427.434353938786, 9460.763480913032, 9486.383385079947, 9506.524673766422, 7989.880151797844, 8166.469179503313, 8179.877301840358, 8359.0, 8380.497170169809, 7882.881756773768, 7887.40844436681, 7895.171007044178, 8098.7165449209, 8144.959275203586, 6947.7220911162985, 7000.929990700231, 7002.2297547268745, 7057.611831349325, 7075.398591119812, 5035.823746168867, 5087.313212716236, 5207.973960130175, 5224.425313215467, 5274.393444753902, 4879.926801097916, 4984.32711583946, 5055.823046193365, 5167.870803229949, 5216.791328346823], "value": 4778.196908498253, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [371.63579691901936, 381.2907991136484, 382.2832189644415, 383.5282602399049, 392.9901752456189, 5367.1680889462195, 5472.850701352716, 5525.2817133772605, 5530.5022547970675, 5557.472040156189, 5274.2879711238975, 5368.731563421833, 5384.219288203218, 5387.905192054038, 5389.487998640133, 4090.8363665453494, 4103.528094269167, 4106.938395924063, 4123.8969025774295, 4134.4831896013, 4006.6193711597352, 4090.3455447128467, 4117.6705863531, 4121.423000779893, 4123.0, 4013.5183777946686, 4024.7182697211206, 4032.4354590357375, 4042.070323825522, 4060.7157498975084, 4021.0, 4031.9596804032026, 4076.2458945095254, 4078.2862998975356, 4081.8163182656854, 3529.505869178317, 3550.2721942001826, 3586.5337506124297, 3593.5328407306883, 3593.8921832345072, 4947.975260123712, 5109.6678715883345, 5127.333446651912, 5132.820351287687, 5153.201253805666, 4805.519448055166, 4806.134895718769, 4818.34952281441, 4819.951800481986, 4825.469198388175, 5684.971575142139, 5717.028105222081, 5728.914066289009, 5737.569682273846, 5744.770209191627, 3895.668868146211, 3959.8020098994934, 3996.6003399660094, 3999.7800120993334, 4002.7198096133284, 5891.528677705816, 5989.281286245635, 6060.151578778975, 6094.786682466092, 6098.32296118571, 4403.32673584036, 4433.623142032963, 4448.733076015449, 4451.399061126706, 4455.242608756519, 4536.841210557614, 4536.886577835515, 4539.841105561355, 4549.612368227657, 4557.589816916494, 4817.373741413594, 4995.0, 5031.823886163967, 5045.974770126126, 5051.520105589963, 5780.797672081457, 5785.0, 5790.913136302959, 5804.187413762077, 5806.419358064244, 1544.189300617185, 1565.6164239761104, 1571.758310934349, 1572.968540629181, 1581.1619841484032, 1127.616610352484, 1130.7003644034337, 1133.6825688807148, 1135.0805847263744, 1148.62095508482, 4981.726005069756, 4998.9500104999215, 5018.548330650186, 5024.171011783015, 5028.17035189197, 5922.970385148046, 5923.378045305267, 5932.3474417814, 5942.762289508371, 6007.969960150172, 4781.2350023996, 4943.3573635427165, 4954.281629163751, 4955.529224723646, 4982.451930287665, 3105.58074659918, 3146.229173852375, 3148.4332820092145, 3162.810231386124, 3165.5409965554863, 5300.257963885059, 5505.504504594605, 5509.724513774296, 5510.3938566758425, 5572.411862619215, 6019.879602407927, 6027.57806953509, 6059.424354686298, 6063.151158837766, 6077.17958075663, 5556.0, 5558.972205138948, 5559.722013899289, 5560.971220324253, 5581.190727344512, 5688.40271771458, 5898.3216930053595, 5928.347881733092, 5939.406059394026, 5987.503124218945, 5600.831975040755, 5874.206982057539, 5884.117382392676, 5895.764169433346, 5914.2311499504785, 5445.945540544544, 5482.588805839658, 5573.665580065209, 5601.719914004202, 5608.579356548356, 4079.428879956749, 4091.831329395425, 4099.836006559704, 4104.8768536943935, 4115.218108559484, 5687.1753595729215, 5928.79249226275, 5950.19672344228, 5959.851003724942, 5972.611780234271, 5712.343080545625, 5716.342620598684, 5780.335261444988, 5782.2194003808945, 5789.0, 5781.739821708117, 5793.94206057934, 5794.072948328248, 5794.681292528951, 5822.70886455684, 5581.49766521015, 5676.77292908279, 5697.145428185805, 5722.885542289047, 5729.312482502127, 5786.768529258782, 5808.76764929415, 5809.5352371811, 5822.272215973004, 5843.094320380348, 5474.835754927359, 5603.915941260966, 5638.85902852432, 5640.379558248672, 5649.237352957298], "value": 4345.879656195713, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [671.5500614588226, 676.3777324861127, 696.7352406085683, 706.0186340986029, 740.5075624709568, 13274.601761947133, 13909.652258693524, 13937.163770173796, 13959.651008724799, 14028.929855350709, 12902.612921612343, 12996.28520431376, 13335.466581336736, 13379.26414047227, 13511.932440337785, 873.8820259264998, 880.9559522023906, 884.9203571678547, 886.167003017165, 915.496476937685, 921.3734660430904, 924.7040946896961, 929.8744669469636, 931.3154831199063, 931.7950050988771, 949.4113649537296, 949.8052899155656, 950.0831697411996, 950.4154944709023, 952.8523078922778, 943.0381011368365, 944.9055094490565, 946.5693109635134, 946.962121515142, 947.5688561704477, 686.3239708886742, 695.3741632530712, 695.9443244540424, 697.9441644668415, 699.4858778797579, 13022.609321720363, 13078.215307081606, 13127.671808204776, 13910.374033168431, 14884.330205140795, 14016.92991535046, 14906.180160091191, 14935.477258295907, 14960.551183464513, 14962.850371496255, 10593.629222977159, 10696.51865666047, 10856.837147442795, 10891.455427228608, 10933.781324373467, 2759.8206116602355, 2762.1052631578946, 2765.2395591212576, 2826.3640680846647, 2826.8303901765753, 67383.32616673819, 67790.3220967789, 67968.3203167967, 68826.65586672084, 70163.64918175427, 10658.62694805678, 10669.306495077795, 10727.141828653845, 10740.516676749565, 10816.945915270373, 22125.557488850132, 22185.667214991787, 22427.0, 22675.886620567122, 22740.0, 6747.359000894907, 6804.944728396545, 6848.897266541006, 6889.0355350251, 6982.47631427645, 3337.766356355032, 3381.458966565338, 3411.181316484026, 3435.6736110069505, 3458.273762509901, 3773.396256598931, 3824.158685089276, 3858.2090671412293, 3861.4593956846065, 3873.5932727063814, 635.4535099814157, 638.1894993358409, 641.1344684675744, 642.8392901774556, 659.1595715462728, 559.8432438917109, 563.788579282769, 564.8107883858953, 575.847400438884, 581.1863391252281, 8042.758717238492, 8521.318294536422, 8634.956825215833, 8645.005824330157, 8814.834721848852, 535.2860994756625, 546.8414159893587, 573.4953241147763, 581.2734082397004, 588.8292395205428, 3603.6036036036016, 3694.2057457646197, 3777.773333599993, 3783.4703141560203, 3982.5021872265966, 67305.6634716833, 67365.0, 67759.0, 69608.0, 70006.64996675086, 53132.0, 53582.196267056024, 56280.43719562752, 56401.0, 58033.0, 46439.0, 46961.76519117451, 47601.52398475971, 47817.0, 48192.27711584329, 8819.206271435602, 9683.66107186245, 9692.757681057748, 9710.465924373944, 9726.659566915407, 25892.870535647202, 25911.352216194748, 26068.087616933317, 26933.730662693124, 27183.184504464898, 42302.25035372691, 44466.0, 45287.77356113198, 45821.54178458173, 46009.539904601865, 11805.940970295094, 11904.226225295675, 12105.69735756613, 12127.0, 12367.196132251374, 12636.55772047974, 13848.515301964382, 13952.372143253375, 14012.299385030912, 14079.225642589756, 11760.411979400824, 12515.249085054926, 12623.747525049632, 13007.869921300666, 13011.934940325238, 10673.35959842412, 11486.483108259981, 11534.94232528832, 11547.942260288644, 11596.072314214674, 10785.137189025016, 11102.666919992413, 11520.481578328827, 11524.82712759326, 11529.481173347387, 9347.766305842137, 9660.95169524148, 9709.27180461454, 9833.459159745997, 9904.306698531322, 9229.538523073954, 9479.715608531755, 9755.56099975517, 9760.0, 9853.359531630422], "value": 6513.458882243616, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1553.5999999999997, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 112.0, 116.0, 122.0, 114.0, 114.0, 116.0, 115.0, 123.0, 122.0], "value": 115.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [153.0, 126.0, 123.0, 172.0, 124.0, 123.0, 123.0, 122.0, 143.0, 125.0], "value": 133.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 167.0, 170.0, 168.0, 173.0, 169.0, 177.0, 166.0, 165.0, 177.0], "value": 169.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 76.0, 75.0, 104.0, 78.0, 78.0, 77.0, 76.0, 96.0, 75.0], "value": 81.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 102.0, 84.0, 84.0, 84.0, 111.0, 84.0, 84.0, 112.0], "value": 91.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 114.0, 114.0, 115.0, 123.0, 121.0, 122.0, 114.0, 115.0, 114.0], "value": 116.6, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [159.0, 152.0, 155.0, 152.0, 151.0, 151.0, 152.0, 154.0, 152.0, 151.0], "value": 152.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 95.0, 95.0, 94.0, 96.0, 95.0, 95.0, 95.0, 95.0], "value": 95.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 53.0, 54.0, 53.0, 55.0, 54.0, 53.0, 54.0, 54.0, 54.0], "value": 53.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 57.0, 57.0, 58.0, 56.0, 57.0, 55.0, 55.0, 56.0, 56.0], "value": 56.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 81.0, 81.0, 89.0, 90.0, 90.0, 85.0, 85.0, 83.0, 83.0], "value": 85.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [143.0, 144.0, 135.0, 137.0, 133.0, 135.0, 131.0, 131.0, 171.0, 138.0], "value": 139.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [185.0, 205.0, 189.0, 192.0, 191.0, 200.0, 193.0, 200.0, 182.0, 191.0], "value": 192.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 69.0, 69.0, 69.0, 69.0, 69.0, 71.0, 70.0, 70.0, 70.0], "value": 69.6, "unit": "score"}]}]} 04:14:34 INFO - Return code: 0 04:14:34 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 04:14:34 ERROR - # TBPL SUCCESS # 04:14:34 INFO - Running post-action listener: _resource_record_post_action 04:14:34 INFO - [mozharness: 2017-04-03 11:14:34.888008Z] Finished run-tests step (success) 04:14:34 INFO - Running post-run listener: _resource_record_post_run 04:14:34 INFO - Total resource usage - Wall time: 1203s; CPU: 13.0%; Read bytes: 0; Write bytes: 371822592; Read time: 0; Write time: 219536 04:14:34 INFO - TinderboxPrint: CPU usage
13.3% 04:14:34 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 04:14:34 INFO - TinderboxPrint: I/O write bytes / time
371,822,592 / 219,536 04:14:34 INFO - TinderboxPrint: CPU idle
8,318.4 (86.6%) 04:14:34 INFO - TinderboxPrint: CPU user
1,222.7 (12.7%) 04:14:34 INFO - TinderboxPrint: Swap in / out
0 / 0 04:14:34 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 107077632; Read time: 0; Write time: 91444 04:14:34 INFO - run-tests - Wall time: 1187s; CPU: 13.0%; Read bytes: 0; Write bytes: 263569408; Read time: 0; Write time: 128044 04:14:35 INFO - Running post-run listener: _upload_blobber_files 04:14:35 INFO - Blob upload gear active. 04:14:35 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:14:35 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 04:14:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 04:14:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 04:14:35 INFO - (blobuploader) - INFO - Open directory for files ... 04:14:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 04:14:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:14:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:14:36 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 04:14:36 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:14:36 INFO - (blobuploader) - INFO - Done attempting. 04:14:36 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 04:14:36 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:14:36 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:14:37 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 04:14:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:14:37 INFO - (blobuploader) - INFO - Done attempting. 04:14:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 04:14:37 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:14:38 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:14:38 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 04:14:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:14:38 INFO - (blobuploader) - INFO - Done attempting. 04:14:38 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 04:14:38 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:14:38 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:14:42 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 04:14:42 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:14:42 INFO - (blobuploader) - INFO - Done attempting. 04:14:42 INFO - (blobuploader) - INFO - Iteration through files over. 04:14:42 INFO - Return code: 0 04:14:42 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:14:42 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:14:42 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dd7a3d4217602eb2a3bbb87193406f4e6e4fed82b036149c27002db6123deb7b2fa0e1971fed23a63401738c0e7d9417114efec8ffada1d028704ba06a4ec68c", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/9a231848095bb687a27beffa1d99a119220dbd3b43d5e58c768cbfa4cb33c4c2f9a2723791a5e3ddf653d5b3c71bfddb01a00e960236fe4d451981c012bbac71", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a31e0054c34dbcad56a0fe2b23985656718565717de5b5edb5073ee9304f9b495f995d431e10da73bd93f9fadb91dc0140b6c2f0011cb4e0e3ba2d58f108aff9", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/46893a5c8c79eff74076579b090037e920cf2cb38edba72d3ff7c19682d76fd37a1d4c424269837ef430d9ac38a2ba4bfaff125e7646fbfde4b55f7ad989bbd5"} 04:14:42 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:14:42 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:14:42 INFO - Contents: 04:14:42 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dd7a3d4217602eb2a3bbb87193406f4e6e4fed82b036149c27002db6123deb7b2fa0e1971fed23a63401738c0e7d9417114efec8ffada1d028704ba06a4ec68c", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/9a231848095bb687a27beffa1d99a119220dbd3b43d5e58c768cbfa4cb33c4c2f9a2723791a5e3ddf653d5b3c71bfddb01a00e960236fe4d451981c012bbac71", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a31e0054c34dbcad56a0fe2b23985656718565717de5b5edb5073ee9304f9b495f995d431e10da73bd93f9fadb91dc0140b6c2f0011cb4e0e3ba2d58f108aff9", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/46893a5c8c79eff74076579b090037e920cf2cb38edba72d3ff7c19682d76fd37a1d4c424269837ef430d9ac38a2ba4bfaff125e7646fbfde4b55f7ad989bbd5"} 04:14:42 INFO - Running post-run listener: copy_logs_to_upload_dir 04:14:42 INFO - Copying logs to upload dir... 04:14:42 INFO - mkdir: /builds/slave/test/build/upload/logs 04:14:42 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1263.283943 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 3 secs) (at 2017-04-03 04:14:41.359922) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-04-03 04:14:41.363334) ========= 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=7de08804244eb36560b44971000001c3-1491216816.154123-685521 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dd7a3d4217602eb2a3bbb87193406f4e6e4fed82b036149c27002db6123deb7b2fa0e1971fed23a63401738c0e7d9417114efec8ffada1d028704ba06a4ec68c", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/9a231848095bb687a27beffa1d99a119220dbd3b43d5e58c768cbfa4cb33c4c2f9a2723791a5e3ddf653d5b3c71bfddb01a00e960236fe4d451981c012bbac71", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a31e0054c34dbcad56a0fe2b23985656718565717de5b5edb5073ee9304f9b495f995d431e10da73bd93f9fadb91dc0140b6c2f0011cb4e0e3ba2d58f108aff9", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/46893a5c8c79eff74076579b090037e920cf2cb38edba72d3ff7c19682d76fd37a1d4c424269837ef430d9ac38a2ba4bfaff125e7646fbfde4b55f7ad989bbd5"} build_url:https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011305 build_url: 'https://queue.taskcluster.net/v1/task/RxRNfBRjTxOWjg7ZTcr2NQ/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dd7a3d4217602eb2a3bbb87193406f4e6e4fed82b036149c27002db6123deb7b2fa0e1971fed23a63401738c0e7d9417114efec8ffada1d028704ba06a4ec68c", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/9a231848095bb687a27beffa1d99a119220dbd3b43d5e58c768cbfa4cb33c4c2f9a2723791a5e3ddf653d5b3c71bfddb01a00e960236fe4d451981c012bbac71", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/a31e0054c34dbcad56a0fe2b23985656718565717de5b5edb5073ee9304f9b495f995d431e10da73bd93f9fadb91dc0140b6c2f0011cb4e0e3ba2d58f108aff9", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/46893a5c8c79eff74076579b090037e920cf2cb38edba72d3ff7c19682d76fd37a1d4c424269837ef430d9ac38a2ba4bfaff125e7646fbfde4b55f7ad989bbd5"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-04-03 04:14:41.394105) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-04-03 04:14:41.394527) ========= 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=7de08804244eb36560b44971000001c3-1491216816.154123-685521 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004410 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-04-03 04:14:41.445907) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-04-03 04:14:41.446276) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-04-03 04:14:41.446610) ========= ========= Total master_lag: 0.15 =========