builder: mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s slave: talos-linux64-ix-064 starttime: 1494594989.95 results: success (0) revision: bcb5e1ff13f807387595d5b6b5dbdb4c3b8ad501 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-05-12 06:16:29.950108) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-05-12 06:16:29.950589) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-12 06:16:29.950866) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-12 06:16:29.967023) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-12 06:16:29.967442) ========= 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=a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-05-12 06:16:30-- 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% 42.8M=0s 2017-05-12 06:16:30 (42.8 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.152586 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-12 06:16:30.134614) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-12 06:16:30.134949) ========= 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=a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016195 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-12 06:16:30.184580) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-12 06:16:30.184923) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev bcb5e1ff13f807387595d5b6b5dbdb4c3b8ad501 --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 bcb5e1ff13f807387595d5b6b5dbdb4c3b8ad501 --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=a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-05-12 06:16:30,241 truncating revision to first 12 chars 2017-05-12 06:16:30,241 Setting DEBUG logging. 2017-05-12 06:16:30,241 attempt 1/10 2017-05-12 06:16:30,241 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/bcb5e1ff13f8?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-05-12 06:16:30,737 unpacking tar archive at: mozilla-central-bcb5e1ff13f8/testing/mozharness/ program finished with exit code 0 elapsedTime=0.807371 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-12 06:16:31.006072) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-12 06:16:31.006410) ========= script_repo_revision: bcb5e1ff13f807387595d5b6b5dbdb4c3b8ad501 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-12 06:16:31.006890) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-12 06:16:31.007276) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-12 06:16:31.016956) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 2 secs) (at 2017-05-12 06:16:31.017411) ========= /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=a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 06:16:31 INFO - MultiFileLogger online at 20170512 06:16:31 in /builds/slave/test 06:16:31 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 06:16:31 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 06:16:31 INFO - {'append_to_log': False, 06:16:31 INFO - 'base_work_dir': '/builds/slave/test', 06:16:31 INFO - 'blob_upload_branch': 'Firefox', 06:16:31 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 06:16:31 INFO - 'branch': 'Firefox', 06:16:31 INFO - 'buildbot_json_path': 'buildprops.json', 06:16:31 INFO - 'config_files': ('talos/linux_config.py',), 06:16:31 INFO - 'default_actions': ('clobber', 06:16:31 INFO - 'read-buildbot-config', 06:16:31 INFO - 'download-and-extract', 06:16:31 INFO - 'populate-webroot', 06:16:31 INFO - 'create-virtualenv', 06:16:31 INFO - 'install', 06:16:31 INFO - 'run-tests'), 06:16:31 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 06:16:31 INFO - 'download_minidump_stackwalk': True, 06:16:31 INFO - 'download_symbols': 'ondemand', 06:16:31 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 06:16:31 INFO - 'tooltool.py': '/tools/tooltool.py', 06:16:31 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 06:16:31 INFO - '/tools/misc-python/virtualenv.py')}, 06:16:31 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 06:16:31 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 06:16:31 INFO - 'gecko_profile': False, 06:16:31 INFO - 'gecko_profile_interval': 0, 06:16:31 INFO - 'installer_path': 'installer.exe', 06:16:31 INFO - 'log_level': 'info', 06:16:31 INFO - 'log_name': 'talos', 06:16:31 INFO - 'log_to_console': True, 06:16:31 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 06:16:31 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 06:16:31 INFO - 'opt_config_files': (), 06:16:31 INFO - 'pip_index': False, 06:16:31 INFO - 'suite': 'dromaeojs-e10s', 06:16:31 INFO - 'system_bits': '32', 06:16:31 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 06:16:31 INFO - 'title': 'talos-linux64-ix-064', 06:16:31 INFO - 'tooltool_cache': '/builds/tooltool_cache', 06:16:31 INFO - 'use_talos_json': True, 06:16:31 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 06:16:31 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 06:16:31 INFO - 'work_dir': 'build'} 06:16:31 INFO - [mozharness: 2017-05-12 13:16:31.271415Z] Running clobber step. 06:16:31 INFO - Running pre-action listener: _resource_record_pre_action 06:16:31 INFO - Running main action method: clobber 06:16:31 INFO - rmtree: /builds/slave/test/build 06:16:31 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 06:16:32 INFO - Running post-action listener: _resource_record_post_action 06:16:32 INFO - [mozharness: 2017-05-12 13:16:32.167222Z] Finished clobber step (success) 06:16:32 INFO - [mozharness: 2017-05-12 13:16:32.167612Z] Running read-buildbot-config step. 06:16:32 INFO - Running pre-action listener: _resource_record_pre_action 06:16:32 INFO - Running main action method: read_buildbot_config 06:16:32 INFO - Using buildbot properties: 06:16:32 INFO - { 06:16:32 INFO - "project": "", 06:16:32 INFO - "product": "firefox", 06:16:32 INFO - "who": "cbook@mozilla.com", 06:16:32 INFO - "installer_path": "public/build/target.tar.bz2", 06:16:32 INFO - "builddir": "mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s", 06:16:32 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 06:16:32 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo mozilla-central talos dromaeojs-e10s", 06:16:32 INFO - "stage_platform": "linux64-stylo", 06:16:32 INFO - "basedir": "/builds/slave/test", 06:16:32 INFO - "buildnumber": 84, 06:16:32 INFO - "platform": "ubuntu64_hw_stylo", 06:16:32 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 06:16:32 INFO - "slavebuilddir": "test", 06:16:32 INFO - "taskId": "AxnarVT6RyCVcssQwiY0Pg", 06:16:32 INFO - "branch": "mozilla-central", 06:16:32 INFO - "script_repo_revision": "production", 06:16:32 INFO - "revision": "bcb5e1ff13f807387595d5b6b5dbdb4c3b8ad501", 06:16:32 INFO - "slavename": "talos-linux64-ix-064", 06:16:32 INFO - "repo_path": "mozilla-central" 06:16:32 INFO - } 06:16:32 INFO - Finding installer, test and symbols from parent task. 06:16:32 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/AxnarVT6RyCVcssQwiY0Pg'}, attempt #1 06:16:32 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/AxnarVT6RyCVcssQwiY0Pg'}, attempt #1 06:16:33 INFO - Task dependencies: DlLb7zsgRsSXhnEesCyoMg 06:16:33 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg'}, attempt #1 06:16:33 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.tar.bz2 06:16:33 INFO - Set test_url: https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/test_packages.json 06:16:33 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.crashreporter-symbols.zip 06:16:33 INFO - Running post-action listener: _resource_record_post_action 06:16:33 INFO - [mozharness: 2017-05-12 13:16:33.520816Z] Finished read-buildbot-config step (success) 06:16:33 INFO - [mozharness: 2017-05-12 13:16:33.521032Z] Running download-and-extract step. 06:16:33 INFO - Running pre-action listener: _resource_record_pre_action 06:16:33 INFO - Running main action method: download_and_extract 06:16:33 INFO - mkdir: /builds/slave/test/build/tests 06:16:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:16:33 INFO - trying https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.test_packages.json 06:16:33 INFO - Downloading https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 06:16:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 06:16:34 INFO - Downloaded 986 bytes. 06:16:34 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 06:16:34 INFO - Using the following test package requirements: 06:16:34 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 06:16:34 INFO - u'common': [u'target.common.tests.zip'], 06:16:34 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 06:16:34 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 06:16:34 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 06:16:34 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 06:16:34 INFO - u'mozbase': [u'target.common.tests.zip'], 06:16:34 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 06:16:34 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 06:16:34 INFO - u'web-platform': [u'target.common.tests.zip', 06:16:34 INFO - u'target.web-platform.tests.zip'], 06:16:34 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 06:16:34 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 06:16:34 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.common.tests.zip 06:16:34 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.common.tests.zip'}, attempt #1 06:16:34 INFO - Fetch https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.common.tests.zip into memory 06:16:35 INFO - Content-Length response header: 58596219 06:16:35 INFO - Bytes received: 58596219 06:16:45 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 06:16:45 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.common.tests.zip 06:16:45 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.common.tests.zip'}, attempt #1 06:16:45 INFO - Fetch https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.common.tests.zip into memory 06:16:46 INFO - Content-Length response header: 58596219 06:16:46 INFO - Bytes received: 58596219 06:16:57 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.talos.tests.zip 06:16:57 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.talos.tests.zip'}, attempt #1 06:16:57 INFO - Fetch https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.talos.tests.zip into memory 06:16:58 INFO - Content-Length response header: 14409411 06:16:58 INFO - Bytes received: 14409411 06:16:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:16:58 INFO - trying https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.tar.bz2 06:16:58 INFO - Downloading https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 06:16:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 06:16:59 INFO - Downloaded 65004424 bytes. 06:16:59 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.tar.bz2 06:16:59 INFO - mkdir: /builds/slave/test/properties 06:16:59 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 06:16:59 INFO - Writing to file /builds/slave/test/properties/build_url 06:16:59 INFO - Contents: 06:16:59 INFO - build_url:https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.tar.bz2 06:16:59 INFO - Running post-action listener: _resource_record_post_action 06:16:59 INFO - Running post-action listener: set_extra_try_arguments 06:16:59 INFO - [mozharness: 2017-05-12 13:16:59.574369Z] Finished download-and-extract step (success) 06:16:59 INFO - [mozharness: 2017-05-12 13:16:59.574465Z] Running populate-webroot step. 06:16:59 INFO - Running pre-action listener: _resource_record_pre_action 06:16:59 INFO - Running main action method: populate_webroot 06:16:59 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 06:16:59 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 06:16:59 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 06:16:59 INFO - '--tppagecycles', 06:16:59 INFO - '7'], 06:16:59 INFO - 'tests': ['tsvgm']}}, 06:16:59 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 06:16:59 INFO - 'tests': ['tresize', 'tcanvasmark']}, 06:16:59 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 06:16:59 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 06:16:59 INFO - 'tests': ['dromaeo_css', 'kraken']}, 06:16:59 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 06:16:59 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 06:16:59 INFO - 'talos_options': ['--disable-e10s'], 06:16:59 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:16:59 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 06:16:59 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:16:59 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 06:16:59 INFO - 'talos_options': ['--disable-e10s'], 06:16:59 INFO - 'tests': ['damp', 'tps']}, 06:16:59 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 06:16:59 INFO - 'tests': ['damp', 'tps']}, 06:16:59 INFO - 'g3': {'talos_options': ['--disable-e10s'], 06:16:59 INFO - 'tests': ['dromaeo_dom']}, 06:16:59 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 06:16:59 INFO - 'g4': {'talos_options': ['--disable-e10s'], 06:16:59 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 06:16:59 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 06:16:59 INFO - 'other': {'talos_options': ['--disable-e10s'], 06:16:59 INFO - 'tests': ['a11yr', 06:16:59 INFO - 'ts_paint', 06:16:59 INFO - 'tpaint', 06:16:59 INFO - 'sessionrestore', 06:16:59 INFO - 'sessionrestore_no_auto_restore', 06:16:59 INFO - 'tabpaint']}, 06:16:59 INFO - 'other-e10s': {'tests': ['a11yr', 06:16:59 INFO - 'ts_paint', 06:16:59 INFO - 'tpaint', 06:16:59 INFO - 'sessionrestore', 06:16:59 INFO - 'sessionrestore_no_auto_restore', 06:16:59 INFO - 'tabpaint']}, 06:16:59 INFO - 'other-e10s_l64': {'tests': ['a11yr', 06:16:59 INFO - 'ts_paint', 06:16:59 INFO - 'tpaint', 06:16:59 INFO - 'sessionrestore', 06:16:59 INFO - 'sessionrestore_no_auto_restore', 06:16:59 INFO - 'tabpaint']}, 06:16:59 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 06:16:59 INFO - 'ts_paint', 06:16:59 INFO - 'tpaint', 06:16:59 INFO - 'sessionrestore', 06:16:59 INFO - 'sessionrestore_no_auto_restore', 06:16:59 INFO - 'tabpaint']}, 06:16:59 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 06:16:59 INFO - 'tests': ['a11yr', 06:16:59 INFO - 'ts_paint', 06:16:59 INFO - 'tpaint', 06:16:59 INFO - 'sessionrestore', 06:16:59 INFO - 'sessionrestore_no_auto_restore', 06:16:59 INFO - 'tabpaint']}, 06:16:59 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 06:16:59 INFO - 'tests': ['a11yr', 06:16:59 INFO - 'ts_paint', 06:16:59 INFO - 'tpaint', 06:16:59 INFO - 'sessionrestore', 06:16:59 INFO - 'sessionrestore_no_auto_restore', 06:16:59 INFO - 'tabpaint']}, 06:16:59 INFO - 'perf-reftest': {'tests': ['bloom_basic', 'bloom_basic_ref']}, 06:16:59 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic', 06:16:59 INFO - 'bloom_basic_ref']}, 06:16:59 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 06:16:59 INFO - 'tests': ['tsvgx', 06:16:59 INFO - 'tsvgr_opacity', 06:16:59 INFO - 'tart', 06:16:59 INFO - 'tscrollx', 06:16:59 INFO - 'cart', 06:16:59 INFO - 'tsvg_static']}, 06:16:59 INFO - 'svgr-e10s': {'tests': ['tsvgx', 06:16:59 INFO - 'tsvgr_opacity', 06:16:59 INFO - 'tart', 06:16:59 INFO - 'tscrollx', 06:16:59 INFO - 'cart', 06:16:59 INFO - 'tsvg_static']}, 06:16:59 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 06:16:59 INFO - 'talos_options': ['--disable-e10s'], 06:16:59 INFO - 'tests': ['tp5o']}, 06:16:59 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 06:16:59 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 06:16:59 INFO - 'talos_options': ['--disable-e10s', 06:16:59 INFO - '--xperf_path', 06:16:59 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:16:59 INFO - 'tests': ['tp5n']}, 06:16:59 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 06:16:59 INFO - 'talos_options': ['--xperf_path', 06:16:59 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:16:59 INFO - 'tests': ['tp5n']}}, 06:16:59 INFO - 'talos.zip': {'path': '', 06:16:59 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 06:16:59 INFO - Running post-action listener: _resource_record_post_action 06:16:59 INFO - [mozharness: 2017-05-12 13:16:59.588140Z] Finished populate-webroot step (success) 06:16:59 INFO - [mozharness: 2017-05-12 13:16:59.588228Z] Running create-virtualenv step. 06:16:59 INFO - Running pre-action listener: _resource_record_pre_action 06:16:59 INFO - Running main action method: create_virtualenv 06:16:59 INFO - Creating virtualenv /builds/slave/test/build/venv 06:16:59 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 06:16:59 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 06:16:59 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 06:16:59 INFO - Using real prefix '/usr' 06:16:59 INFO - New python executable in /builds/slave/test/build/venv/bin/python 06:17:00 INFO - Installing distribute.............................................................................................................................................................................................done. 06:17:02 INFO - Installing pip.................done. 06:17:02 INFO - Return code: 0 06:17:02 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 06:17:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 06:17:02 INFO - Reading from file tmpfile_stdout 06:17:02 INFO - Output received: 06:17:02 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) 06:17:02 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 06:17:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:17:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:17:02 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x1f391f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2105a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ab770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a8a30>, '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 0x22a97f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a9ca0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', '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 06:17:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 06:17:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 06:17:02 INFO - Using env: {'DISPLAY': ':0', 06:17:02 INFO - 'HOME': '/home/cltbld', 06:17:02 INFO - 'LANG': 'en_US.UTF-8', 06:17:02 INFO - 'LANGUAGE': 'en_US:en', 06:17:02 INFO - 'LOGNAME': 'cltbld', 06:17:02 INFO - 'MAIL': '/var/mail/cltbld', 06:17:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:17:02 INFO - 'MOZ_NO_REMOTE': '1', 06:17:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:17:02 INFO - 'NO_EM_RESTART': '1', 06:17:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:17:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:17:02 INFO - 'PWD': '/builds/slave/test', 06:17:02 INFO - 'SHELL': '/bin/bash', 06:17:02 INFO - 'SHLVL': '1', 06:17:02 INFO - 'TERM': 'linux', 06:17:02 INFO - 'TMOUT': '86400', 06:17:02 INFO - 'USER': 'cltbld', 06:17:02 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', 06:17:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:17:02 INFO - '_': '/tools/buildbot/bin/python'} 06:17:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:17:02 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 06:17:02 INFO - Cleaning up... 06:17:02 INFO - Return code: 0 06:17:02 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 06:17:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:17:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:17:02 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x1f391f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2105a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ab770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a8a30>, '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 0x22a97f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a9ca0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', '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 06:17:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 06:17:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 06:17:02 INFO - Using env: {'DISPLAY': ':0', 06:17:02 INFO - 'HOME': '/home/cltbld', 06:17:02 INFO - 'LANG': 'en_US.UTF-8', 06:17:02 INFO - 'LANGUAGE': 'en_US:en', 06:17:02 INFO - 'LOGNAME': 'cltbld', 06:17:02 INFO - 'MAIL': '/var/mail/cltbld', 06:17:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:17:02 INFO - 'MOZ_NO_REMOTE': '1', 06:17:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:17:02 INFO - 'NO_EM_RESTART': '1', 06:17:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:17:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:17:02 INFO - 'PWD': '/builds/slave/test', 06:17:02 INFO - 'SHELL': '/bin/bash', 06:17:02 INFO - 'SHLVL': '1', 06:17:02 INFO - 'TERM': 'linux', 06:17:02 INFO - 'TMOUT': '86400', 06:17:02 INFO - 'USER': 'cltbld', 06:17:02 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', 06:17:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:17:02 INFO - '_': '/tools/buildbot/bin/python'} 06:17:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:17:03 INFO - Downloading/unpacking psutil>=3.1.1 06:17:03 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 06:17:03 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 06:17:03 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 06:17:03 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 06:17:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 06:17:05 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:17:05 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:17:05 INFO - Installing collected packages: psutil 06:17:05 INFO - Running setup.py install for psutil 06:17:05 INFO - building 'psutil._psutil_linux' extension 06:17:05 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 06:17:09 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 06:17:10 INFO - building 'psutil._psutil_posix' extension 06:17:10 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 06:17:10 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 06:17:10 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:17:10 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:17:10 INFO - Successfully installed psutil 06:17:10 INFO - Cleaning up... 06:17:10 INFO - Return code: 0 06:17:10 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 06:17:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:17:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:17:10 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/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 0x1f391f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2105a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ab770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a8a30>, '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 0x22a97f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a9ca0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', '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 06:17:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 06:17:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 06:17:10 INFO - Using env: {'DISPLAY': ':0', 06:17:10 INFO - 'HOME': '/home/cltbld', 06:17:10 INFO - 'LANG': 'en_US.UTF-8', 06:17:10 INFO - 'LANGUAGE': 'en_US:en', 06:17:10 INFO - 'LOGNAME': 'cltbld', 06:17:10 INFO - 'MAIL': '/var/mail/cltbld', 06:17:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:17:10 INFO - 'MOZ_NO_REMOTE': '1', 06:17:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:17:10 INFO - 'NO_EM_RESTART': '1', 06:17:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:17:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:17:10 INFO - 'PWD': '/builds/slave/test', 06:17:10 INFO - 'SHELL': '/bin/bash', 06:17:10 INFO - 'SHLVL': '1', 06:17:10 INFO - 'TERM': 'linux', 06:17:10 INFO - 'TMOUT': '86400', 06:17:10 INFO - 'USER': 'cltbld', 06:17:10 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', 06:17:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:17:10 INFO - '_': '/tools/buildbot/bin/python'} 06:17:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:17:10 INFO - Downloading/unpacking mozsystemmonitor==0.3 06:17:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:17:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:17:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:17:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:17:11 INFO - Downloading mozsystemmonitor-0.3.tar.gz 06:17:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 06:17:11 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 06:17:11 INFO - Installing collected packages: mozsystemmonitor 06:17:11 INFO - Running setup.py install for mozsystemmonitor 06:17:11 INFO - Successfully installed mozsystemmonitor 06:17:11 INFO - Cleaning up... 06:17:11 INFO - Return code: 0 06:17:11 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 06:17:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:17:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:17: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/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 0x1f391f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2105a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ab770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a8a30>, '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 0x22a97f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a9ca0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', '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 06:17:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 06:17:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 06:17:11 INFO - Using env: {'DISPLAY': ':0', 06:17:11 INFO - 'HOME': '/home/cltbld', 06:17:11 INFO - 'LANG': 'en_US.UTF-8', 06:17:11 INFO - 'LANGUAGE': 'en_US:en', 06:17:11 INFO - 'LOGNAME': 'cltbld', 06:17:11 INFO - 'MAIL': '/var/mail/cltbld', 06:17:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:17:11 INFO - 'MOZ_NO_REMOTE': '1', 06:17:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:17:11 INFO - 'NO_EM_RESTART': '1', 06:17:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:17:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:17:11 INFO - 'PWD': '/builds/slave/test', 06:17:11 INFO - 'SHELL': '/bin/bash', 06:17:11 INFO - 'SHLVL': '1', 06:17:11 INFO - 'TERM': 'linux', 06:17:11 INFO - 'TMOUT': '86400', 06:17:11 INFO - 'USER': 'cltbld', 06:17:11 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', 06:17:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:17:11 INFO - '_': '/tools/buildbot/bin/python'} 06:17:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:17:12 INFO - Downloading/unpacking jsonschema==2.5.1 06:17:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:17:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:17:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:17:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:17:13 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 06:17:13 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 06:17:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:17:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:17:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:17:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:17:13 INFO - Downloading functools32-3.2.3-2.tar.gz 06:17:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 06:17:13 INFO - warning: no files found matching '*.txt' 06:17:13 INFO - no previously-included directories found matching 'build' 06:17:13 INFO - no previously-included directories found matching 'dist' 06:17:13 INFO - no previously-included directories found matching '.git*' 06:17:13 INFO - Installing collected packages: jsonschema, functools32 06:17:13 INFO - Running setup.py install for functools32 06:17:13 INFO - warning: no files found matching '*.txt' 06:17:13 INFO - no previously-included directories found matching 'build' 06:17:13 INFO - no previously-included directories found matching 'dist' 06:17:13 INFO - no previously-included directories found matching '.git*' 06:17:13 INFO - Successfully installed jsonschema functools32 06:17:13 INFO - Cleaning up... 06:17:13 INFO - Return code: 0 06:17:13 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 06:17:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:17:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:17:13 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/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 0x1f391f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2105a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ab770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a8a30>, '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 0x22a97f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a9ca0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', '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 06:17:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 06:17:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 06:17:13 INFO - Using env: {'DISPLAY': ':0', 06:17:13 INFO - 'HOME': '/home/cltbld', 06:17:13 INFO - 'LANG': 'en_US.UTF-8', 06:17:13 INFO - 'LANGUAGE': 'en_US:en', 06:17:13 INFO - 'LOGNAME': 'cltbld', 06:17:13 INFO - 'MAIL': '/var/mail/cltbld', 06:17:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:17:13 INFO - 'MOZ_NO_REMOTE': '1', 06:17:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:17:13 INFO - 'NO_EM_RESTART': '1', 06:17:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:17:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:17:13 INFO - 'PWD': '/builds/slave/test', 06:17:13 INFO - 'SHELL': '/bin/bash', 06:17:13 INFO - 'SHLVL': '1', 06:17:13 INFO - 'TERM': 'linux', 06:17:13 INFO - 'TMOUT': '86400', 06:17:13 INFO - 'USER': 'cltbld', 06:17:13 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', 06:17:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:17:13 INFO - '_': '/tools/buildbot/bin/python'} 06:17:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:17:14 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 06:17:14 INFO - Cleaning up... 06:17:14 INFO - Return code: 0 06:17:14 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 06:17:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:17:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:17: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/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 0x1f391f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2105a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ab770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a8a30>, '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 0x22a97f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a9ca0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', '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 06:17:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--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 06:17:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 06:17:14 INFO - Using env: {'DISPLAY': ':0', 06:17:14 INFO - 'HOME': '/home/cltbld', 06:17:14 INFO - 'LANG': 'en_US.UTF-8', 06:17:14 INFO - 'LANGUAGE': 'en_US:en', 06:17:14 INFO - 'LOGNAME': 'cltbld', 06:17:14 INFO - 'MAIL': '/var/mail/cltbld', 06:17:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:17:14 INFO - 'MOZ_NO_REMOTE': '1', 06:17:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:17:14 INFO - 'NO_EM_RESTART': '1', 06:17:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:17:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:17:14 INFO - 'PWD': '/builds/slave/test', 06:17:14 INFO - 'SHELL': '/bin/bash', 06:17:14 INFO - 'SHLVL': '1', 06:17:14 INFO - 'TERM': 'linux', 06:17:14 INFO - 'TMOUT': '86400', 06:17:14 INFO - 'USER': 'cltbld', 06:17:14 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', 06:17:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:17:14 INFO - '_': '/tools/buildbot/bin/python'} 06:17:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:17:14 INFO - Downloading/unpacking blobuploader==1.2.4 06:17: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 06:17: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 06:17: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 06:17: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 06:17:15 INFO - Downloading blobuploader-1.2.4.tar.gz 06:17:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 06:17:15 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 06:17:15 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 06:17:15 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 06:17:15 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 06:17:15 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 06:17:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 06:17:15 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 06:17:15 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 06:17:15 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 06:17:15 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 06:17:15 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 06:17:15 INFO - Downloading docopt-0.6.1.tar.gz 06:17:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 06:17:15 INFO - Installing collected packages: blobuploader, requests, docopt 06:17:15 INFO - Running setup.py install for blobuploader 06:17:16 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 06:17:16 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 06:17:16 INFO - Running setup.py install for requests 06:17:16 INFO - Running setup.py install for docopt 06:17:16 INFO - Successfully installed blobuploader requests docopt 06:17:16 INFO - Cleaning up... 06:17:16 INFO - Return code: 0 06:17:16 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:17:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:17:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:17:16 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/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 0x1f391f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2105a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ab770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a8a30>, '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 0x22a97f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a9ca0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', '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 06:17:16 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/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 06:17:16 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/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:17:16 INFO - Using env: {'DISPLAY': ':0', 06:17:16 INFO - 'HOME': '/home/cltbld', 06:17:16 INFO - 'LANG': 'en_US.UTF-8', 06:17:16 INFO - 'LANGUAGE': 'en_US:en', 06:17:16 INFO - 'LOGNAME': 'cltbld', 06:17:16 INFO - 'MAIL': '/var/mail/cltbld', 06:17:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:17:16 INFO - 'MOZ_NO_REMOTE': '1', 06:17:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:17:16 INFO - 'NO_EM_RESTART': '1', 06:17:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:17:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:17:16 INFO - 'PWD': '/builds/slave/test', 06:17:16 INFO - 'SHELL': '/bin/bash', 06:17:16 INFO - 'SHLVL': '1', 06:17:16 INFO - 'TERM': 'linux', 06:17:16 INFO - 'TMOUT': '86400', 06:17:16 INFO - 'USER': 'cltbld', 06:17:16 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', 06:17:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:17:16 INFO - '_': '/tools/buildbot/bin/python'} 06:17:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:17:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:17:16 INFO - Running setup.py (path:/tmp/pip-AWfkBB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:17:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:17:16 INFO - Running setup.py (path:/tmp/pip-7NXhh9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:17:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:17:16 INFO - Running setup.py (path:/tmp/pip-1WNbcy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:17:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:17:16 INFO - Running setup.py (path:/tmp/pip-7LXKd4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:17:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:17:17 INFO - Running setup.py (path:/tmp/pip-KUqDYb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:17:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:17:17 INFO - Running setup.py (path:/tmp/pip-HS0Iux-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:17:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:17:17 INFO - Running setup.py (path:/tmp/pip-nfsvYj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:17:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:17:17 INFO - Running setup.py (path:/tmp/pip-yU_Qcy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:17:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:17:17 INFO - Running setup.py (path:/tmp/pip-1SOCW7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:17:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:17:17 INFO - Running setup.py (path:/tmp/pip-j1LlbY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:17:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:17:17 INFO - Running setup.py (path:/tmp/pip-5n7aaW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:17:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:17:17 INFO - Running setup.py (path:/tmp/pip-hoTcKO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:17:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:17:17 INFO - Running setup.py (path:/tmp/pip-JpydVa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:17:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:17:17 INFO - Running setup.py (path:/tmp/pip-de_5TT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:17:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:17:17 INFO - Running setup.py (path:/tmp/pip-9vhE3b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:17:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:17:17 INFO - Running setup.py (path:/tmp/pip-WQ5HBy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:17:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:17:17 INFO - Running setup.py (path:/tmp/pip-nDxL6G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:17:18 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 06:17:18 INFO - Running setup.py install for manifestparser 06:17:18 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 06:17:18 INFO - Running setup.py install for mozcrash 06:17:18 INFO - Running setup.py install for mozdebug 06:17:18 INFO - Running setup.py install for mozdevice 06:17:18 INFO - Installing dm script to /builds/slave/test/build/venv/bin 06:17:18 INFO - Running setup.py install for mozfile 06:17:18 INFO - Running setup.py install for mozhttpd 06:17:18 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 06:17:18 INFO - Running setup.py install for mozinfo 06:17:18 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 06:17:18 INFO - Running setup.py install for mozInstall 06:17:18 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 06:17:18 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 06:17:18 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 06:17:18 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 06:17:18 INFO - Running setup.py install for mozleak 06:17:18 INFO - Running setup.py install for mozlog 06:17:19 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 06:17:19 INFO - Running setup.py install for moznetwork 06:17:19 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 06:17:19 INFO - Running setup.py install for mozprocess 06:17:19 INFO - Running setup.py install for mozprofile 06:17:19 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 06:17:19 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 06:17:19 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 06:17:19 INFO - Running setup.py install for mozrunner 06:17:19 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 06:17:19 INFO - Running setup.py install for mozscreenshot 06:17:19 INFO - Running setup.py install for moztest 06:17:19 INFO - Running setup.py install for mozversion 06:17:19 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 06:17:19 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 06:17:19 INFO - Cleaning up... 06:17:19 INFO - Return code: 0 06:17:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:17:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:17:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:17:19 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/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 0x1f391f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2105a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ab770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a8a30>, '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 0x22a97f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a9ca0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', '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 06:17:19 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/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 06:17:19 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/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:17:19 INFO - Using env: {'DISPLAY': ':0', 06:17:19 INFO - 'HOME': '/home/cltbld', 06:17:19 INFO - 'LANG': 'en_US.UTF-8', 06:17:19 INFO - 'LANGUAGE': 'en_US:en', 06:17:19 INFO - 'LOGNAME': 'cltbld', 06:17:19 INFO - 'MAIL': '/var/mail/cltbld', 06:17:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:17:19 INFO - 'MOZ_NO_REMOTE': '1', 06:17:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:17:19 INFO - 'NO_EM_RESTART': '1', 06:17:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:17:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:17:19 INFO - 'PWD': '/builds/slave/test', 06:17:19 INFO - 'SHELL': '/bin/bash', 06:17:19 INFO - 'SHLVL': '1', 06:17:19 INFO - 'TERM': 'linux', 06:17:19 INFO - 'TMOUT': '86400', 06:17:19 INFO - 'USER': 'cltbld', 06:17:19 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', 06:17:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:17:19 INFO - '_': '/tools/buildbot/bin/python'} 06:17:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:17:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:17:20 INFO - Running setup.py (path:/tmp/pip-PPsWRY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:17:20 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)) 06:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:17:20 INFO - Running setup.py (path:/tmp/pip-3TfvhR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:17:20 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)) 06:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:17:20 INFO - Running setup.py (path:/tmp/pip-2buAK3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:17:20 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)) 06:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:17:20 INFO - Running setup.py (path:/tmp/pip-ealJ44-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:17:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.50 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)) 06:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:17:20 INFO - Running setup.py (path:/tmp/pip-eeeLP0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:17:20 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)) 06:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:17:20 INFO - Running setup.py (path:/tmp/pip-5BjerJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:17:20 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)) 06:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:17:20 INFO - Running setup.py (path:/tmp/pip-WBZtR7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:17:20 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)) 06:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:17:20 INFO - Running setup.py (path:/tmp/pip-4ht7Fg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:17:20 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)) 06:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:17:20 INFO - Running setup.py (path:/tmp/pip-psv4aU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:17:20 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)) 06:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:17:20 INFO - Running setup.py (path:/tmp/pip-8SYCDz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:17:20 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)) 06:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:17:20 INFO - Running setup.py (path:/tmp/pip-R3oyvp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:17:20 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)) 06:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:17:20 INFO - Running setup.py (path:/tmp/pip-vxehaN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:17:20 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)) 06:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:17:20 INFO - Running setup.py (path:/tmp/pip-xq886w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:17:20 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)) 06:17:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:17:20 INFO - Running setup.py (path:/tmp/pip-RMClrD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:17:21 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)) 06:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:17:21 INFO - Running setup.py (path:/tmp/pip-WuAB3b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:17:21 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)) 06:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:17:21 INFO - Running setup.py (path:/tmp/pip-ACXIOO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:17:21 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)) 06:17:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:17:21 INFO - Running setup.py (path:/tmp/pip-7BtE8v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:17:21 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)) 06:17:21 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)) 06:17:21 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)) 06:17:21 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)) 06:17:21 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:17:21 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:17:21 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 06:17:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:17:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:17:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:17:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:17:22 INFO - Downloading blessings-1.6.tar.gz 06:17:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 06:17:22 INFO - Installing collected packages: blessings 06:17:22 INFO - Running setup.py install for blessings 06:17:22 INFO - Successfully installed blessings 06:17:22 INFO - Cleaning up... 06:17:22 INFO - Return code: 0 06:17:22 INFO - Done creating virtualenv /builds/slave/test/build/venv. 06:17:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:17:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:17:22 INFO - Reading from file tmpfile_stdout 06:17:22 INFO - Current package versions: 06:17:22 INFO - argparse == 1.2.1 06:17:22 INFO - blessings == 1.6 06:17:22 INFO - blobuploader == 1.2.4 06:17:22 INFO - docopt == 0.6.1 06:17:22 INFO - functools32 == 3.2.3-2 06:17:22 INFO - jsonschema == 2.5.1 06:17:22 INFO - manifestparser == 1.1 06:17:22 INFO - mozInstall == 1.12 06:17:22 INFO - mozcrash == 1.0 06:17:22 INFO - mozdebug == 0.1 06:17:22 INFO - mozdevice == 0.50 06:17:22 INFO - mozfile == 1.2 06:17:22 INFO - mozhttpd == 0.7 06:17:22 INFO - mozinfo == 0.9 06:17:22 INFO - mozleak == 0.1 06:17:22 INFO - mozlog == 3.4 06:17:22 INFO - moznetwork == 0.27 06:17:22 INFO - mozprocess == 0.25 06:17:22 INFO - mozprofile == 0.28 06:17:22 INFO - mozrunner == 6.13 06:17:22 INFO - mozscreenshot == 0.1 06:17:22 INFO - mozsystemmonitor == 0.3 06:17:22 INFO - moztest == 0.8 06:17:22 INFO - mozversion == 1.4 06:17:22 INFO - psutil == 3.1.1 06:17:22 INFO - requests == 1.2.3 06:17:22 INFO - wsgiref == 0.1.2 06:17:22 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:17:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:17:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:17:22 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/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 0x1f391f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2105a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ab770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a8a30>, '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 0x22a97f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a9ca0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', '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 06:17:22 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/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 06:17:22 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/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:17:22 INFO - Using env: {'DISPLAY': ':0', 06:17:22 INFO - 'HOME': '/home/cltbld', 06:17:22 INFO - 'LANG': 'en_US.UTF-8', 06:17:22 INFO - 'LANGUAGE': 'en_US:en', 06:17:22 INFO - 'LOGNAME': 'cltbld', 06:17:22 INFO - 'MAIL': '/var/mail/cltbld', 06:17:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:17:22 INFO - 'MOZ_NO_REMOTE': '1', 06:17:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:17:22 INFO - 'NO_EM_RESTART': '1', 06:17:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:17:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:17:22 INFO - 'PWD': '/builds/slave/test', 06:17:22 INFO - 'SHELL': '/bin/bash', 06:17:22 INFO - 'SHLVL': '1', 06:17:22 INFO - 'TERM': 'linux', 06:17:22 INFO - 'TMOUT': '86400', 06:17:22 INFO - 'USER': 'cltbld', 06:17:22 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', 06:17:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:17:22 INFO - '_': '/tools/buildbot/bin/python'} 06:17:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:17:23 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)) 06:17:23 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)) 06:17:23 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)) 06:17:23 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)) 06:17:23 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)) 06:17:23 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)) 06:17:23 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)) 06:17:23 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)) 06:17:23 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)) 06:17:23 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)) 06:17:23 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)) 06:17:23 INFO - Cleaning up... 06:17:23 INFO - Return code: 0 06:17:23 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 06:17:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:17:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:17:23 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/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 0x1f391f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2105a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22ab770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a8a30>, '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 0x22a97f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a9ca0>, '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': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', '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 06:17:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 06:17:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 06:17:23 INFO - Using env: {'DISPLAY': ':0', 06:17:23 INFO - 'HOME': '/home/cltbld', 06:17:23 INFO - 'LANG': 'en_US.UTF-8', 06:17:23 INFO - 'LANGUAGE': 'en_US:en', 06:17:23 INFO - 'LOGNAME': 'cltbld', 06:17:23 INFO - 'MAIL': '/var/mail/cltbld', 06:17:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:17:23 INFO - 'MOZ_NO_REMOTE': '1', 06:17:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:17:23 INFO - 'NO_EM_RESTART': '1', 06:17:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:17:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:17:23 INFO - 'PWD': '/builds/slave/test', 06:17:23 INFO - 'SHELL': '/bin/bash', 06:17:23 INFO - 'SHLVL': '1', 06:17:23 INFO - 'TERM': 'linux', 06:17:23 INFO - 'TMOUT': '86400', 06:17:23 INFO - 'USER': 'cltbld', 06:17:23 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', 06:17:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:17:23 INFO - '_': '/tools/buildbot/bin/python'} 06:17:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:17:23 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 06:17:23 INFO - Cleaning up... 06:17:23 INFO - Return code: 0 06:17:23 INFO - Running post-action listener: _resource_record_post_action 06:17:23 INFO - Running post-action listener: _start_resource_monitoring 06:17:23 INFO - Starting resource monitoring. 06:17:23 INFO - [mozharness: 2017-05-12 13:17:23.273295Z] Finished create-virtualenv step (success) 06:17:23 INFO - [mozharness: 2017-05-12 13:17:23.274241Z] Running install step. 06:17:23 INFO - Running pre-action listener: _resource_record_pre_action 06:17:23 INFO - Running main action method: install 06:17:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:17:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:17:23 INFO - Reading from file tmpfile_stdout 06:17:23 INFO - Detecting whether we're running mozinstall >=1.0... 06:17:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 06:17:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 06:17:23 INFO - Reading from file tmpfile_stdout 06:17:23 INFO - Output received: 06:17:23 INFO - Usage: mozinstall [options] installer 06:17:23 INFO - Options: 06:17:23 INFO - -h, --help show this help message and exit 06:17:23 INFO - -d DEST, --destination=DEST 06:17:23 INFO - Directory to install application into. [default: 06:17:23 INFO - "/builds/slave/test"] 06:17:23 INFO - --app=APP Application being installed. [default: firefox] 06:17:23 INFO - mkdir: /builds/slave/test/build/application 06:17:23 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'] 06:17:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 06:17:39 INFO - Reading from file tmpfile_stdout 06:17:39 INFO - Output received: 06:17:39 INFO - /builds/slave/test/build/application/firefox/firefox 06:17:39 INFO - Running post-action listener: _resource_record_post_action 06:17:39 INFO - [mozharness: 2017-05-12 13:17:39.930367Z] Finished install step (success) 06:17:39 INFO - [mozharness: 2017-05-12 13:17:39.930615Z] Running run-tests step. 06:17:39 INFO - Running pre-action listener: _resource_record_pre_action 06:17:39 INFO - Running main action method: run_tests 06:17:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 06:17:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 06:17:39 INFO - Python 2.7.3 06:17:39 INFO - Return code: 0 06:17:39 INFO - grabbing minidump binary from tooltool 06:17:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.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')]} 06:17:39 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 0x22a8a30>, '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 0x22a97f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22a9ca0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 06:17:39 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 06:17:39 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 06:17:39 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 06:17:40 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 06:17:40 INFO - Return code: 0 06:17:40 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 06:17:40 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 06:17:40 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 06:17:40 INFO - ENV: RUST_BACKTRACE is now 1 06:17:40 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 06:17:40 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 06:17:40 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/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-064', '--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 06:17:40 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/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-064 --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 06:17:40 INFO - Using env: {'DISPLAY': ':0', 06:17:40 INFO - 'HOME': '/home/cltbld', 06:17:40 INFO - 'LANG': 'en_US.UTF-8', 06:17:40 INFO - 'LANGUAGE': 'en_US:en', 06:17:40 INFO - 'LOGNAME': 'cltbld', 06:17:40 INFO - 'MAIL': '/var/mail/cltbld', 06:17:40 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 06:17:40 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 06:17:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:17:40 INFO - 'MOZ_NO_REMOTE': '1', 06:17:40 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 06:17:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:17:40 INFO - 'NO_EM_RESTART': '1', 06:17:40 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:17:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:17:40 INFO - 'PWD': '/builds/slave/test', 06:17:40 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 06:17:40 INFO - 'RUST_BACKTRACE': '1', 06:17:40 INFO - 'SHELL': '/bin/bash', 06:17:40 INFO - 'SHLVL': '1', 06:17:40 INFO - 'TERM': 'linux', 06:17:40 INFO - 'TMOUT': '86400', 06:17:40 INFO - 'USER': 'cltbld', 06:17:40 INFO - 'XDG_SESSION_COOKIE': 'a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315', 06:17:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:17:40 INFO - '_': '/tools/buildbot/bin/python'} 06:17:40 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/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-064', '--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 06:17:40 INFO - mozversion application_buildid: 20170512123443 06:17:40 INFO - mozversion application_changeset: bcb5e1ff13f807387595d5b6b5dbdb4c3b8ad501 06:17:40 INFO - mozversion application_display_name: Nightly 06:17:40 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 06:17:40 INFO - mozversion application_name: Firefox 06:17:40 INFO - mozversion application_remotingname: firefox 06:17:40 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 06:17:40 INFO - mozversion application_vendor: Mozilla 06:17:40 INFO - mozversion application_version: 55.0a1 06:17:40 INFO - mozversion platform_buildid: 20170512123443 06:17:40 INFO - mozversion platform_changeset: bcb5e1ff13f807387595d5b6b5dbdb4c3b8ad501 06:17:40 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 06:17:40 INFO - mozversion platform_version: 55.0a1 06:17:40 INFO - using testdate: 1494595060 06:17:40 INFO - actual date: 1494595060 06:17:40 INFO - starting webserver on 'localhost:47326' 06:17:40 INFO - SUITE-START | Running 2 tests 06:17:40 INFO - TEST-START | dromaeo_css 06:17:40 INFO - operating with platform_type : linux_ 06:17:40 INFO - Initialising browser for dromaeo_css test... 06:17:40 INFO - TEST-INFO | started process 3325 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpc4al84/profile http://localhost:47326/getInfo.html) 06:17:46 INFO - PID 3325 | __metrics Screen width/height:1600/1200 06:17:46 INFO - PID 3325 | colorDepth:24 06:17:46 INFO - PID 3325 | Browser inner width/height: 1024/695 06:17:46 INFO - PID 3325 | __metrics 06:17:48 INFO - TEST-INFO | 3325: exit 0 06:17:48 INFO - Browser initialized. 06:17:48 INFO - Running cycle 1/1 for dromaeo_css test... 06:17:48 INFO - TEST-INFO | started process 3513 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpc4al84/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:18:00 INFO - PID 3513 | RSS: Main: 170291200 06:18:00 INFO - PID 3513 | 06:21:06 INFO - PID 3513 | Cycle 1(1): loaded http://localhost:47326/tests/dromaeo/cssquery-dojo.html (next: http://localhost:47326/tests/dromaeo/cssquery-ext.html) 06:21:07 INFO - PID 3513 | RSS: Main: 184778752 06:21:07 INFO - PID 3513 | 06:24:09 INFO - PID 3513 | Cycle 1(1): loaded http://localhost:47326/tests/dromaeo/cssquery-ext.html (next: http://localhost:47326/tests/dromaeo/cssquery-jquery.html) 06:24:10 INFO - PID 3513 | RSS: Main: 180822016 06:24:10 INFO - PID 3513 | 06:27:12 INFO - PID 3513 | Cycle 1(1): loaded http://localhost:47326/tests/dromaeo/cssquery-jquery.html (next: http://localhost:47326/tests/dromaeo/cssquery-mootools.html) 06:27:12 INFO - PID 3513 | RSS: Main: 190595072 06:27:12 INFO - PID 3513 | 06:30:14 INFO - PID 3513 | Cycle 1(1): loaded http://localhost:47326/tests/dromaeo/cssquery-mootools.html (next: http://localhost:47326/tests/dromaeo/cssquery-prototype.html) 06:30:15 INFO - PID 3513 | RSS: Main: 184455168 06:30:15 INFO - PID 3513 | 06:33:18 INFO - PID 3513 | Cycle 1(1): loaded http://localhost:47326/tests/dromaeo/cssquery-prototype.html (next: http://localhost:47326/tests/dromaeo/cssquery-yui.html) 06:33:18 INFO - PID 3513 | RSS: Main: 189181952 06:33:18 INFO - PID 3513 | 06:36:20 INFO - PID 3513 | Cycle 1(1): loaded http://localhost:47326/tests/dromaeo/cssquery-yui.html (next: http://localhost:47326/tests/dromaeo/cssquery-dojo.html) 06:36:21 INFO - PID 3513 | RSS: Main: 190767104 06:36:21 INFO - PID 3513 | 06:36:21 INFO - PID 3513 | __start_tp_report 06:36:21 INFO - PID 3513 | _x_x_mozilla_page_load 06:36:21 INFO - PID 3513 | _x_x_mozilla_page_load_details 06:36:21 INFO - PID 3513 | |i|pagename|runs| 06:36:21 INFO - PID 3513 | |0;dojo.html;2672.4788666210093;2721.9455610887794;2740.438210166916;2742.9588556171657;2747.629070075538;5108.182690769478;5181.248718935752;5237.790488380465;5261.657992230503;5271.393789714184;5126.897462050766;5143.974280128604;5158.432572417031;5235.895282094365;5247.685138891659;4635.768211589424;4642.883927901813;4663.48701642819;4676.158291507527;4696.225122854725;4687.671862969593;4712.717236965793;4735.195016847144;4737.976310118444;4740.502247264039;4464.17412778637;4545.522720114373;4622.260438329851;4651.488336283006;4684.36761037259;4635.1656701794;4636.397268355092;4644.558766917137;4679.672422930396;4700.224462963607;4577.588017078446;4601.493835678073;4606.239970404879;4612.031473390592;4652.837150699743;5031.496850314976;5086.440491545927;5132.409772876093;5184.637075404723;5185.974070129625;5570.637908535932;5570.693611851347;5572.749226284827;5605.131204663284;5615.354234263031;5590.18942253371;5646.378898321182;5659.179418984266;5666.206731057655;5674.09214525678;5083.034223497523;5189.273501709764;5214.191800270964;5233.031889100491;5282.471752824764;5690.601657883908;5717.113847353667;5756.1653560233535;5759.22250496186;5799.652020878761;5329.440408757025;5410.377806552218;5429.701366424884;5518.834434966958;5534.75093620788;5527.5577953764405;5584.748686309126;5605.159226116115;5610.943890561124;5665.405132461032;5402.6758394496455;5563.443655634404;5567.9977604031665;5591.133374326986;5595.160725891067;5472.863178420492;5526.06056970316;5605.831825045255;5639.548836093103;5646.604737668324;4700.694454860423;4700.788464519105;4705.929411058837;4707.764611769398;4720.173969555314;4010.578889216649;4021.2962731521866;4034.23349563582;4055.5538890721996;4098.200850834059;4748.477667456577;4750.453697824725;4753.524647535219;4757.3577567028005;4787.114383838932;5469.124940009579;5557.944420555824;5577.581681373913;5640;5660.85847853807;4750.928736068892;4786.282057691375;4794.760261986957;4817.566419022305;4832.613390928717;4970.751462426864;5008.6744361616375;5013.047520971004;5021.397432308073;5052.343195384577;5192.532672059533;5223.373195216598;5228.163493840967;5233.869153271199;5235.60732945023;5433.076377015996;5527.53015993645;5557.1386435101;5650.463205995424;5705.286839145107;5213.504717052026;5216.608754343515;5219.060569097599;5226.268322434938;5250.028744682246;5529.032419326521;5529.060059789926;5534;5535.197396377584;5588.748506317144;5477.561795056306;5546;5568.916466252928;5608.07466767995;5640.548756099584;5345.1447768356875;5392.919106213331;5393.8112166074;5397.757100930389;5445.346558413015;5278.551323137576;5301.814436494704;5314.813981510629;5356.866078348073;5393.9730301348245;5342.78628854857;5373.570114390917;5376.327959005124;5403.756830942539;5406.810761623325;5189.92215116766;5275.525202731773;5367.7047762371885;5469.234307196916;5490.615656904138;5278.920816187683;5295.655782374133;5301.390340110936;5307.310049693515;5336.839894803162 06:36:21 INFO - PID 3513 | |1;ext.html;664.6643445060247;710.8862581986881;735.2169939014949;978.9951050244744;982.0915653020954;33363.49954750678;34320.31359372814;34357.31285374291;34372.82813585929;34419.65580344193;34610.826945865236;34898.651013489856;35051.47422788654;35078.82460587694;35172.296554068904;6903.482238832108;6956.165260168774;7075.893861592081;7100.076989991294;7103;7005.719771209146;7019.649017549128;7089.326513981164;7101.573905565657;7104.4671649626225;7084.822879428029;7087.255838136999;7089.7873063808165;7101.218865924744;7116.110486189226;7060.152781666233;7091.82270443243;7101.431885449178;7122.465815063865;7125.9643701781415;6741.93258067418;6834.350736680008;6836;6843.247242803288;6847.726090956356;31844.840775796205;32007;32016.839915800505;32141.678583214103;32160.356792864244;2978.166113488227;2999.550067489872;3003.849807509616;3004.2939909121337;3005.6693763685976;24169.154079607128;24320.635190472156;24331.148409805573;24362.512749745085;24373.63439548408;3124.906252812419;3176.190071531768;3186.1715953851935;3189.521571764231;3207.6631953644996;135993;136086.1956902161;136762.3161884194;146918;150287;40664.1867162661;40978.79510602428;40996.9999999994;41057.38413923793;41067.7946610271;42116;42313.78843105765;42375.36436953448;42589;42608.147837043085;10758.40828754426;10857.619983300547;10858.728531786768;10862.293950893167;10888.564457421615;8470.068292487822;8473.872891906627;8484.40609157353;8491.660333586711;8494.617742201615;12565.685857853445;12725.80911286313;12750.553730619384;12803;12906.29015404143;5324.9733751331;5365.651232669864;5415.377231618414;5437.238786569884;5454.972725136349;854.8717692346073;908.2280061947424;910.8497097978892;916.1754421021134;931.3201363005044;20760.79239207619;21472.892635536722;21513.89243053806;21628.56742865134;21640.350789476342;975.3075316525346;983.2036050798876;994.9950250248847;998.1814911772423;1008.0574662690408;11229.606963756229;11232.719182020352;11404.94297528507;11573.942130289463;11583.420828958519;167734;168672;168745;168892;169164;40315.596844031184;40551;40867.182656346704;40947;41049.58950410518;1191.8775025733698;1231.96920076997;1233.5620854596668;1234.8271242025944;1236;19839.20643174257;19932.50168745793;20628.27801026957;21488.24791132303;21493.892530537247;29451.705482944897;29491.410171796015;29553.704462955095;29561.55657665094;29700.702992969793;141353.2932335332;141843;142185.28907355398;143857;144639;28691.856540717163;29288.560671589516;29366.41267174687;29508.852455737582;29534.11397658074;35386.823065884506;35390.11524711903;35586.46620300749;35740.64259357477;35861.462078068325;25964;26815.865920670272;27091;27454.588181177696;28253.434931300846;26578.335541611614;26734.331641709112;27238.910443582827;28084;28243.679585737067;29196.56205156967;29495.557566636948;29921.70078299189;29963.700362996093;30169.245768855075;26083.608745869205;26164.73835261699;26455.735442645328;26669.19992400231;27692;20045.298414555422;21860;22068.33794986089;22108.2262120825;22123 06:36:21 INFO - PID 3513 | |2;jquery.html;406.89217357400275;411.7262020756197;418.05936642554263;428.92493813582615;433.81996471464345;17264.74102888458;17981.280748770034;17983;18011.189496472656;18664;18467.815321846778;18538.629227415444;18648.440546783586;18778.906105469454;18827.52931176721;5414.675119492823;5457.317835270591;5533.557315414777;5547.611667183299;5662.716864156796;5464.508194262516;5477.917831232535;5484.890302193954;5510.1459273812425;5538.390777014525;5304.389995150549;5435.42927992561;5465.207544905987;5494.752736126884;5502.504774570288;5500.862478438031;5522.502974732253;5547.33431988164;5554;5565.66606003639;4880.975595122001;4947.455779864212;5025.798968041274;5050.065737838475;5051.292819005343;21405.571888562295;21463;21709.67435488469;22286;22415.663765043537;1604.6710424363093;1653.1734132933534;1679.445782891655;1688.9577760555962;1690.9915450422668;14510.782338264935;14665.926670366687;14900.850991490162;14925;15041;1955.7653081630153;1998.540335722792;2027.5640737241417;2028.1988614497338;2038.98980505098;87994;88581;89747;89859.10140898572;90559;10706.411147386969;10749.193810464247;10960.12319014477;11092.778144437227;11112.55523784766;15283;15318.234088295541;15337.395712007668;15347.309371078329;15355.846441535665;7114.466415018895;7160.355567998905;7350.852982940311;7429.145648250413;7489.887651685229;6627.436667883284;6650.626317747737;6738.124043874265;6799.456043516507;6825.2833452486775;6904.965475172592;6951.582905025714;6960.860782784316;6970.686319115652;7047.506674532836;2039.3779897131221;2049.846261530391;2056.8251698605786;2074.875507469557;2179.934601961944;844.9746507604782;873.5282947208436;875.9737207883774;876.8509353409936;904.6381447421085;16997;17116.657666846593;17334.04662743561;17505.12474376276;18053.187606557738;876.9429987050949;877.6357811508152;880.2341962492544;884.1688812516343;896.7399454158221;9127.950285717228;9757.853632195523;9840.261980351503;9846.310758246855;9957.651482198089;357505;362609;364032.0790376293;366772;370240;72670;72689.27310726825;74528.25471745322;76050.61974690201;76483;1017.0693815159046;1031.185363562777;1050.3960222871879;1056.6196169379018;1065.248999455382;15124.319405626553;15138.394464221308;15779.05325680463;18007.369742058963;18394.908025459787;38275;38342.616573833904;38720.41919371268;39472.605273946894;40044.196906217454;49566.75216623894;50315.24527132169;50465;52419;52543.37283135905;11710.531578736754;11805.82291265649;11963.64109076729;12070.215435996632;12423.813642795547;12269;12355.62933112008;12509.311987840392;12531.932231181752;12661.873381266438;11352.94323528377;11517.769644607228;11582.247153934968;11858.822117668415;11950;9670.613175473183;9679.467629280176;9804.313698041355;9931.404115752788;10008.499575021366;11426.714332141762;11523.308601483937;11622;11757.529698811952;11881.5841445549;11498.942505287754;11975;12241.326727030098;12264.080193985308;12388.938055309665;11008.834867476835;11083.224174307721;11124.833127503256;11453.427328633701;11497.425128743696 06:36:21 INFO - PID 3513 | |3;mootools.html;1249.6063739921924;1320.7622627926976;1321.1280554833806;1322.3074464685205;1329.3419757220174;9940.105390514853;10384.896151038496;10397.740056498591;10416.27086103973;10655.307405018668;10485.161187105032;10639.946800265989;10649.09482693972;10650.573977040909;10661.466926653655;2269.4666753313;2307.8038366738847;2315.5716192504356;2322.396176993977;2330.7086614173227;2149.355193441969;2211.3918672365066;2220.4670878989086;2220.911163553456;2222.6666000099954;2188.6060509108356;2192.2765487389124;2241.12596087526;2245.1805091141696;2255.0979608156704;2124.6069477146775;2188.9562208755815;2229.1529218896876;2233.8547994380397;2238.1159442020394;2004.91980320787;2123.50097727034;2239.5185035217505;2244.427670943915;2254.233560589391;10135.493225338703;10207.7448063799;10220.948895255551;10225.590976360936;10237.078662920372;5535;5763.077907534775;5767.307923049219;5772.797952071657;5781.971090144564;3278.229616040229;3281.442154833684;3396.252824378633;3455.775374600643;3459.896203113911;1063.7074804428767;1122.2032357026521;1125.6791814332958;1158.9826152607718;1179.9646010619695;14904.552863414116;15075.396984120622;15211.239438028055;15264.694706105927;15269.694606107927;4634.745089020136;4826.855194344175;5066.544011038951;5075.7969681212335;5093.617978651616;10910.23628346008;10927.781444371227;10947.83578246327;10956.178286628376;10956.233063685466;5700.030994730906;5710.428957104256;5712.485876271073;5717.857053573611;5729.1119876419225;5119.283300337956;5253.527182553588;5298.549623281987;5306.204069389545;5316.202569614511;3851.7496362736892;3993.6206060424215;4023.7183397161916;4033.4554835096887;4050.4936882889638;1192.1118766518998;1192.1535709646075;1202.4048096192441;1202.9338386388833;1211.7697637448857;693.3551796828897;710.2329484157098;714.8248679073556;719.1549928833599;727.989080163798;5256.474352564789;5319.734013299397;5420.214068959979;5489.670619762827;5522.723863806874;527.8310940499081;530.657725766886;532.9493698098674;545.6944111297686;547.2939907519335;3381.323735252959;3591.1919818040733;3637.8181090945345;3707.740458167956;3730.1793605406765;12948.870511294766;13335.533256336175;13429.865701343057;13456.596302110953;13472.461101555828;12770;13081.280529570964;13244.13913095665;13301.334933253298;13431.865681343257;7492.1384040836;7695.730649427243;7796.167900543254;7815.335696465864;7860;5904.9704751475965;5949.672767997802;6020.367861374668;6137.202163718688;6228.56400051992;11399.316041037564;11973.940130299292;12028.63914082579;12178.330191839534;12245.877541224474;12005.279683219034;12477.625671229878;12548.121631485708;12749.362531873554;12751.298678572768;8187.83624327522;8312.709055183039;8342.332613391036;8402.285805706584;8405.15948405179;9246.722598322061;9368.297377696565;9631.133198012212;9696.6121355145;9762.36544624597;7710.11333696632;7907.130215676386;7971.12317645047;8088.272055515032;8132.75601731949;7476.663550140148;7663.770086897402;7718.768436946901;7881.802954925944;7895.6841726332605;7288.781336559911;7291.8177045572165;7306.744263950736;7376.2623737627955;7397.482176247611;4861.927071094007;4908.680935739166;4938.234573640948;4978.701277923336;5011.84964451067;4898.632602554751;5029.170186919264;5090.490950905028;5124.38507379102;5301.9469805303 06:36:21 INFO - PID 3513 | |4;prototype.html;361.9457081437784;375.84966013594567;389.485878640195;389.9064224586098;391.37966323377447;5434.212039254316;5550.666959982404;5557.166425036246;5574.86062848429;5612.186232996213;5349.973250133754;5397.379301380342;5420.186971954209;5444.911017796437;5457.799284157479;4037.253108174982;4044.402461027907;4058.35066389377;4063.7358571692894;4069.6570131856565;3970.6227908348806;4078.7552746835136;4079.061815782372;4084.4485994390675;4094.651954583849;4047.332190188615;4050.8784736457956;4057.884081877478;4061.614146656063;4089.7546147231114;4027.2952233359047;4030.8387664493384;4033.778142202192;4040.838366465338;4081.8367265309353;3556.964430355715;3572.356975744365;3577.3918433866047;3578.838952247129;3582.982085089558;5243.161094224944;5319.867003324909;5351.25082488452;5378.784848606051;5383.865403364908;4760.285957106427;4777.80888764449;4778.784954677048;4779.378680771512;4792.113459010095;5511.669299842022;5734.512566431858;5759.3376761672525;5759.366469688331;5769.596128271022;3914.667253283474;3955.881323560298;3958.762474251554;3964.7422917510557;3979.8408063677416;5949;6060.484858787008;6094.481969032593;6121.540884433641;6169.722362493699;4022.4770779798437;4052.2705912935953;4052.696047796427;4053.0677944073027;4057.4928133983253;4127.33962565994;4138.710290279711;4142.647874930604;4143.357779544175;4148.398482220061;4662.277347011219;4741.454732705714;4745.83389581363;4789;4808.134535783593;5758.683272420057;5762.538996880239;5778.624389414758;5814;5832.329282132524;1407.7330402637708;1423.487544483985;1424.7008128293176;1425.1947649577955;1432.3482815319005;902.3052249767642;944.1172503709054;949.6438835436711;962.3407965543626;964.7298756348234;4917.1149193144865;4917.696810345261;4942.629302802305;4964.35463389757;4968.105740966588;5941.465268125889;5969.522438204933;5972.223610930551;5980.940190598125;5993.460588547052;4802.567768900815;4890.731009794496;4946.455889852114;4956.925646115311;4959.404871415453;3130.6399764026974;3139.7597948810094;3145.9528107078413;3157.494800831856;3166.0976621663176;5390.250972004306;5468.6171967962655;5490.725463726878;5490.972545137249;5492.423295553989;5934.198883150806;6019.458248757633;6021.819345419644;6064.906188322952;6078.270607527125;5454.972725136428;5461.754221060062;5474.698891560923;5488.17677348401;5503.449655034465;5778.971105144447;5906.940930590639;5911.970440147772;5963;5997.220361352996;5855.03856208158;5870;5874.941250587611;5883;5891.3224979127945;5327.9200811987075;5493.258410114743;5540.806071787468;5552.750126244248;5559.916601250903;4036.414719865544;4054.716169868081;4057.695672824491;4074.796260187038;4077.3272410053196;5978.192943952685;6050.90923636137;6051.425114614105;6070.332263450929;6079.1793107931635;5743.971280143573;5744.5978781486565;5744.942550574608;5797.8550536236935;5826;5769.3942136076785;5795.623284486495;5808.39011903744;5813.244278243801;5835.416458354131;5490.313710786152;5683.318001839806;5723.456271654186;5730.484256416942;5738.971305143447;5814.912776308443;5830.271216097988;5842.795502157574;5851.444112809277;5856.94143058581;5533.750981205775;5603.411641777555;5641.12562552805;5646.2942132233475;5720.141978703062 06:36:21 INFO - PID 3513 | |5;yui.html;730.4923078460471;738.4240292571795;746.4327111395338;757.8863170524422;759.5936174146833;12390.628281151558;12888.291143987077;13402.865971340283;13914.582562523128;13991.160530368184;14833.184174870377;15114.244287785621;15148.1668508232;15162;15362.615934601641;809.5992483720552;836.5273620404452;839.9034111077212;840.9453385529952;843.1568431568431;888.0409158109227;890.1721399098835;891.1489527501253;895.3866601378077;898.2723993565234;923.9214666753334;926.2543652359848;930.0931591698074;930.8091841172543;932.6269492203105;911.2026976395654;917.334932174175;922.2529750901791;922.8431166701644;927.332320729074;677.8508728079814;680.3162821364547;680.7481231944213;681.0499353402026;681.7000519771285;14537.418503259856;14587.197704126269;14629.341679624442;14980.925095374563;15107.4712385066;15547.455839045691;15557.688846223125;15657.921710391489;15871.20643967797;15907.681846363008;12268.693282667915;12517.499300027988;12548.686282842911;12724.109312348139;12735.299558524277;2960.185948864058;2960.955585666217;2981.0162646326876;2981.1503721439503;2982.537706655472;66226.3377366225;66317.3368266316;66773.66613166903;67657.66171169162;68268.3173168267;10643.627473038407;10768.569257229623;10784.838227426595;10852.457377131112;10868.782624347468;17055.573610659583;17099.914500427418;17192.22634981429;17236.310547578207;17246.137693115295;6106.1146133811235;6154.630722156685;6520.608763474112;6535.3464653534265;6571.769988050395;3060.9387812244076;3104.1929098434116;3109.9844500777804;3114.4549703801745;3124.390743804982;3313.5361049452613;3391.4743214801747;3393.9151521212166;3404.812735299533;3408.761386702907;723.1719680965265;746.1307576673115;748.9625518724042;756.1719916691214;757.7461550380684;596.2933923300902;597.9820605381846;602.4186659873243;622.0358444411145;631.5358211714387;9545;9987.500624968723;10194.439305838101;10281.845772313422;10477.580896764197;584.6579750845802;589.4842013238416;597.49511662645;602.3494625804121;607.7872744539465;4555.610538785702;4617.376654151713;4658.161530924398;4695.81216751333;4732.574068333866;60929;61918.38081619216;62251.688741556005;63387;64396;50424;51201.487985119675;52436;55460;58248.417515825146;44255.55744442515;44561.77719111449;45292.77353613211;45583.31625025627;46283;9898.10917017443;10194.796104077728;10276.126529245097;10299.176065914859;10313.793724125626;24794.628080579165;24838.130665426623;25415.110471133423;26027.73972260253;26171.476570468105;41484;41656.3751543721;42663.57336426596;43373.78313108414;43415;13611.183328999896;13897;14032.579022629337;14321;14328.856711433169;14288.785668215192;14822;15093.54719358421;15351.692966140838;16646.833531665012;13887.722245555235;14014;14850.40598376053;15350.846491534941;15603.687926241639;15365.385384584939;15768.92115539415;15878.60303492422;16027.919860400623;16072.678546428771;14160.221187834768;14747.262636868329;15165.393384264506;15655.84344156544;15908.522744317688;10178.643747468803;10424.113950314308;10517.368957862553;10701.143908487458;10824.783504329711;11765.294082354743;12559.37203139821;12601.495940162291;12613.558525451564;12623.495060197856 06:36:21 INFO - PID 3513 | __end_tp_report 06:36:21 INFO - PID 3513 | __start_cc_report 06:36:21 INFO - PID 3513 | _x_x_mozilla_cycle_collect,350 06:36:21 INFO - PID 3513 | __end_cc_report 06:36:21 INFO - PID 3513 | __startTimestamp1494596181017__endTimestamp 06:36:21 INFO - PID 3513 | 06:36:21 INFO - PID 3513 | ------- Summary: start ------- 06:36:21 INFO - PID 3513 | Number of tests: 6 06:36:21 INFO - PID 3513 | 06:36:21 INFO - PID 3513 | [#0] dojo.html Cycles:165 Average:5110.30 Median:5250.03 stddev:585.18 (11.1%) stddev-sans-first:554.85 06:36:21 INFO - PID 3513 | Values: 2672.5 2721.9 2740.4 2743.0 2747.6 5108.2 5181.2 5237.8 5261.7 5271.4 5126.9 5144.0 5158.4 5235.9 5247.7 4635.8 4642.9 4663.5 4676.2 4696.2 4687.7 4712.7 4735.2 4738.0 4740.5 4464.2 4545.5 4622.3 4651.5 4684.4 4635.2 4636.4 4644.6 4679.7 4700.2 4577.6 4601.5 4606.2 4612.0 4652.8 5031.5 5086.4 5132.4 5184.6 5186.0 5570.6 5570.7 5572.7 5605.1 5615.4 5590.2 5646.4 5659.2 5666.2 5674.1 5083.0 5189.3 5214.2 5233.0 5282.5 5690.6 5717.1 5756.2 5759.2 5799.7 5329.4 5410.4 5429.7 5518.8 5534.8 5527.6 5584.7 5605.2 5610.9 5665.4 5402.7 5563.4 5568.0 5591.1 5595.2 5472.9 5526.1 5605.8 5639.5 5646.6 4700.7 4700.8 4705.9 4707.8 4720.2 4010.6 4021.3 4034.2 4055.6 4098.2 4748.5 4750.5 4753.5 4757.4 4787.1 5469.1 5557.9 5577.6 5640.0 5660.9 4750.9 4786.3 4794.8 4817.6 4832.6 4970.8 5008.7 5013.0 5021.4 5052.3 5192.5 5223.4 5228.2 5233.9 5235.6 5433.1 5527.5 5557.1 5650.5 5705.3 5213.5 5216.6 5219.1 5226.3 5250.0 5529.0 5529.1 5534.0 5535.2 5588.7 5477.6 5546.0 5568.9 5608.1 5640.5 5345.1 5392.9 5393.8 5397.8 5445.3 5278.6 5301.8 5314.8 5356.9 5394.0 5342.8 5373.6 5376.3 5403.8 5406.8 5189.9 5275.5 5367.7 5469.2 5490.6 5278.9 5295.7 5301.4 5307.3 5336.8 06:36:21 INFO - PID 3513 | 06:36:21 INFO - PID 3513 | [#1] ext.html Cycles:180 Average:29591.70 Median:16647.08 stddev:39065.91 (234.7%) stddev-sans-first:39115.11 06:36:21 INFO - PID 3513 | Values: 664.7 710.9 735.2 979.0 982.1 33363.5 34320.3 34357.3 34372.8 34419.7 34610.8 34898.7 35051.5 35078.8 35172.3 6903.5 6956.2 7075.9 7100.1 7103.0 7005.7 7019.6 7089.3 7101.6 7104.5 7084.8 7087.3 7089.8 7101.2 7116.1 7060.2 7091.8 7101.4 7122.5 7126.0 6741.9 6834.4 6836.0 6843.2 6847.7 31844.8 32007.0 32016.8 32141.7 32160.4 2978.2 2999.6 3003.8 3004.3 3005.7 24169.2 24320.6 24331.1 24362.5 24373.6 3124.9 3176.2 3186.2 3189.5 3207.7 135993.0 136086.2 136762.3 146918.0 150287.0 40664.2 40978.8 40997.0 41057.4 41067.8 42116.0 42313.8 42375.4 42589.0 42608.1 10758.4 10857.6 10858.7 10862.3 10888.6 8470.1 8473.9 8484.4 8491.7 8494.6 12565.7 12725.8 12750.6 12803.0 12906.3 5325.0 5365.7 5415.4 5437.2 5455.0 854.9 908.2 910.8 916.2 931.3 20760.8 21472.9 21513.9 21628.6 21640.4 975.3 983.2 995.0 998.2 1008.1 11229.6 11232.7 11404.9 11573.9 11583.4 167734.0 168672.0 168745.0 168892.0 169164.0 40315.6 40551.0 40867.2 40947.0 41049.6 1191.9 1232.0 1233.6 1234.8 1236.0 19839.2 19932.5 20628.3 21488.2 21493.9 29451.7 29491.4 29553.7 29561.6 29700.7 141353.3 141843.0 142185.3 143857.0 144639.0 28691.9 29288.6 29366.4 29508.9 29534.1 35386.8 35390.1 35586.5 35740.6 35861.5 25964.0 26815.9 27091.0 27454.6 28253.4 26578.3 26734.3 27238.9 28084.0 28243.7 29196.6 29495.6 29921.7 29963.7 30169.2 26083.6 26164.7 26455.7 26669.2 27692.0 20045.3 21860.0 22068.3 22108.2 22123.0 06:36:21 INFO - PID 3513 | 06:36:21 INFO - PID 3513 | [#2] jquery.html Cycles:180 Average:24974.78 Median:189960.33 stddev:60613.94 (31.9%) stddev-sans-first:60755.91 06:36:21 INFO - PID 3513 | Values: 406.9 411.7 418.1 428.9 433.8 17264.7 17981.3 17983.0 18011.2 18664.0 18467.8 18538.6 18648.4 18778.9 18827.5 5414.7 5457.3 5533.6 5547.6 5662.7 5464.5 5477.9 5484.9 5510.1 5538.4 5304.4 5435.4 5465.2 5494.8 5502.5 5500.9 5522.5 5547.3 5554.0 5565.7 4881.0 4947.5 5025.8 5050.1 5051.3 21405.6 21463.0 21709.7 22286.0 22415.7 1604.7 1653.2 1679.4 1689.0 1691.0 14510.8 14665.9 14900.9 14925.0 15041.0 1955.8 1998.5 2027.6 2028.2 2039.0 87994.0 88581.0 89747.0 89859.1 90559.0 10706.4 10749.2 10960.1 11092.8 11112.6 15283.0 15318.2 15337.4 15347.3 15355.8 7114.5 7160.4 7350.9 7429.1 7489.9 6627.4 6650.6 6738.1 6799.5 6825.3 6905.0 6951.6 6960.9 6970.7 7047.5 2039.4 2049.8 2056.8 2074.9 2179.9 845.0 873.5 876.0 876.9 904.6 16997.0 17116.7 17334.0 17505.1 18053.2 876.9 877.6 880.2 884.2 896.7 9128.0 9757.9 9840.3 9846.3 9957.7 357505.0 362609.0 364032.1 366772.0 370240.0 72670.0 72689.3 74528.3 76050.6 76483.0 1017.1 1031.2 1050.4 1056.6 1065.2 15124.3 15138.4 15779.1 18007.4 18394.9 38275.0 38342.6 38720.4 39472.6 40044.2 49566.8 50315.2 50465.0 52419.0 52543.4 11710.5 11805.8 11963.6 12070.2 12423.8 12269.0 12355.6 12509.3 12531.9 12661.9 11352.9 11517.8 11582.2 11858.8 11950.0 9670.6 9679.5 9804.3 9931.4 10008.5 11426.7 11523.3 11622.0 11757.5 11881.6 11498.9 11975.0 12241.3 12264.1 12388.9 11008.8 11083.2 11124.8 11453.4 11497.4 06:36:21 INFO - PID 3513 | 06:36:21 INFO - PID 3513 | [#3] mootools.html Cycles:180 Average:6304.17 Median:3614.51 stddev:4075.15 (112.7%) stddev-sans-first:4068.88 06:36:21 INFO - PID 3513 | Values: 1249.6 1320.8 1321.1 1322.3 1329.3 9940.1 10384.9 10397.7 10416.3 10655.3 10485.2 10639.9 10649.1 10650.6 10661.5 2269.5 2307.8 2315.6 2322.4 2330.7 2149.4 2211.4 2220.5 2220.9 2222.7 2188.6 2192.3 2241.1 2245.2 2255.1 2124.6 2189.0 2229.2 2233.9 2238.1 2004.9 2123.5 2239.5 2244.4 2254.2 10135.5 10207.7 10220.9 10225.6 10237.1 5535.0 5763.1 5767.3 5772.8 5782.0 3278.2 3281.4 3396.3 3455.8 3459.9 1063.7 1122.2 1125.7 1159.0 1180.0 14904.6 15075.4 15211.2 15264.7 15269.7 4634.7 4826.9 5066.5 5075.8 5093.6 10910.2 10927.8 10947.8 10956.2 10956.2 5700.0 5710.4 5712.5 5717.9 5729.1 5119.3 5253.5 5298.5 5306.2 5316.2 3851.7 3993.6 4023.7 4033.5 4050.5 1192.1 1192.2 1202.4 1202.9 1211.8 693.4 710.2 714.8 719.2 728.0 5256.5 5319.7 5420.2 5489.7 5522.7 527.8 530.7 532.9 545.7 547.3 3381.3 3591.2 3637.8 3707.7 3730.2 12948.9 13335.5 13429.9 13456.6 13472.5 12770.0 13081.3 13244.1 13301.3 13431.9 7492.1 7695.7 7796.2 7815.3 7860.0 5905.0 5949.7 6020.4 6137.2 6228.6 11399.3 11973.9 12028.6 12178.3 12245.9 12005.3 12477.6 12548.1 12749.4 12751.3 8187.8 8312.7 8342.3 8402.3 8405.2 9246.7 9368.3 9631.1 9696.6 9762.4 7710.1 7907.1 7971.1 8088.3 8132.8 7476.7 7663.8 7718.8 7881.8 7895.7 7288.8 7291.8 7306.7 7376.3 7397.5 4861.9 4908.7 4938.2 4978.7 5011.8 4898.6 5029.2 5090.5 5124.4 5301.9 06:36:21 INFO - PID 3513 | 06:36:21 INFO - PID 3513 | [#4] prototype.html Cycles:180 Average:4725.78 Median:5439.56 stddev:1415.70 (26.0%) stddev-sans-first:1381.27 06:36:21 INFO - PID 3513 | Values: 361.9 375.8 389.5 389.9 391.4 5434.2 5550.7 5557.2 5574.9 5612.2 5350.0 5397.4 5420.2 5444.9 5457.8 4037.3 4044.4 4058.4 4063.7 4069.7 3970.6 4078.8 4079.1 4084.4 4094.7 4047.3 4050.9 4057.9 4061.6 4089.8 4027.3 4030.8 4033.8 4040.8 4081.8 3557.0 3572.4 3577.4 3578.8 3583.0 5243.2 5319.9 5351.3 5378.8 5383.9 4760.3 4777.8 4778.8 4779.4 4792.1 5511.7 5734.5 5759.3 5759.4 5769.6 3914.7 3955.9 3958.8 3964.7 3979.8 5949.0 6060.5 6094.5 6121.5 6169.7 4022.5 4052.3 4052.7 4053.1 4057.5 4127.3 4138.7 4142.6 4143.4 4148.4 4662.3 4741.5 4745.8 4789.0 4808.1 5758.7 5762.5 5778.6 5814.0 5832.3 1407.7 1423.5 1424.7 1425.2 1432.3 902.3 944.1 949.6 962.3 964.7 4917.1 4917.7 4942.6 4964.4 4968.1 5941.5 5969.5 5972.2 5980.9 5993.5 4802.6 4890.7 4946.5 4956.9 4959.4 3130.6 3139.8 3146.0 3157.5 3166.1 5390.3 5468.6 5490.7 5491.0 5492.4 5934.2 6019.5 6021.8 6064.9 6078.3 5455.0 5461.8 5474.7 5488.2 5503.4 5779.0 5906.9 5912.0 5963.0 5997.2 5855.0 5870.0 5874.9 5883.0 5891.3 5327.9 5493.3 5540.8 5552.8 5559.9 4036.4 4054.7 4057.7 4074.8 4077.3 5978.2 6050.9 6051.4 6070.3 6079.2 5744.0 5744.6 5744.9 5797.9 5826.0 5769.4 5795.6 5808.4 5813.2 5835.4 5490.3 5683.3 5723.5 5730.5 5739.0 5814.9 5830.3 5842.8 5851.4 5856.9 5533.8 5603.4 5641.1 5646.3 5720.1 06:36:21 INFO - PID 3513 | 06:36:21 INFO - PID 3513 | [#5] yui.html Cycles:180 Average:15039.95 Median:3119.42 stddev:17355.45 (556.4%) stddev-sans-first:17370.87 06:36:21 INFO - PID 3513 | Values: 730.5 738.4 746.4 757.9 759.6 12390.6 12888.3 13402.9 13914.6 13991.2 14833.2 15114.2 15148.2 15162.0 15362.6 809.6 836.5 839.9 840.9 843.2 888.0 890.2 891.1 895.4 898.3 923.9 926.3 930.1 930.8 932.6 911.2 917.3 922.3 922.8 927.3 677.9 680.3 680.7 681.0 681.7 14537.4 14587.2 14629.3 14980.9 15107.5 15547.5 15557.7 15657.9 15871.2 15907.7 12268.7 12517.5 12548.7 12724.1 12735.3 2960.2 2961.0 2981.0 2981.2 2982.5 66226.3 66317.3 66773.7 67657.7 68268.3 10643.6 10768.6 10784.8 10852.5 10868.8 17055.6 17099.9 17192.2 17236.3 17246.1 6106.1 6154.6 6520.6 6535.3 6571.8 3060.9 3104.2 3110.0 3114.5 3124.4 3313.5 3391.5 3393.9 3404.8 3408.8 723.2 746.1 749.0 756.2 757.7 596.3 598.0 602.4 622.0 631.5 9545.0 9987.5 10194.4 10281.8 10477.6 584.7 589.5 597.5 602.3 607.8 4555.6 4617.4 4658.2 4695.8 4732.6 60929.0 61918.4 62251.7 63387.0 64396.0 50424.0 51201.5 52436.0 55460.0 58248.4 44255.6 44561.8 45292.8 45583.3 46283.0 9898.1 10194.8 10276.1 10299.2 10313.8 24794.6 24838.1 25415.1 26027.7 26171.5 41484.0 41656.4 42663.6 43373.8 43415.0 13611.2 13897.0 14032.6 14321.0 14328.9 14288.8 14822.0 15093.5 15351.7 16646.8 13887.7 14014.0 14850.4 15350.8 15603.7 15365.4 15768.9 15878.6 16027.9 16072.7 14160.2 14747.3 15165.4 15655.8 15908.5 10178.6 10424.1 10517.4 10701.1 10824.8 11765.3 12559.4 12601.5 12613.6 12623.5 06:36:21 INFO - PID 3513 | -------- Summary: end -------- 06:36:21 INFO - PID 3513 | 06:36:21 INFO - TEST-INFO | 3513: exit 0 06:36:21 INFO - TEST-OK | dromaeo_css | took 1121523ms 06:36:21 INFO - TEST-START | kraken 06:36:21 INFO - operating with platform_type : linux_ 06:36:21 INFO - Initialising browser for kraken test... 06:36:21 INFO - TEST-INFO | started process 3947 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpsjbyYW/profile http://localhost:47326/getInfo.html) 06:36:26 INFO - PID 3947 | __metrics Screen width/height:1600/1200 06:36:26 INFO - PID 3947 | colorDepth:24 06:36:26 INFO - PID 3947 | Browser inner width/height: 1024/695 06:36:26 INFO - PID 3947 | __metrics 06:36:28 INFO - TEST-INFO | 3947: exit 0 06:36:28 INFO - Browser initialized. 06:36:28 INFO - Running cycle 1/1 for kraken test... 06:36:28 INFO - TEST-INFO | started process 4137 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpsjbyYW/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:36:40 INFO - PID 4137 | RSS: Main: 169684992 06:36:40 INFO - PID 4137 | 06:36:42 INFO - PID 4137 | Cycle 1(1): loaded http://localhost:47326/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:47326/tests/kraken/driver.html?testName=audio-beat-detection) 06:36:43 INFO - PID 4137 | RSS: Main: 178216960 06:36:43 INFO - PID 4137 | 06:36:46 INFO - PID 4137 | Cycle 1(1): loaded http://localhost:47326/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:47326/tests/kraken/driver.html?testName=audio-dft) 06:36:47 INFO - PID 4137 | RSS: Main: 177225728 06:36:47 INFO - PID 4137 | 06:36:50 INFO - PID 4137 | Cycle 1(1): loaded http://localhost:47326/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:47326/tests/kraken/driver.html?testName=audio-fft) 06:36:50 INFO - PID 4137 | RSS: Main: 175599616 06:36:50 INFO - PID 4137 | 06:36:52 INFO - PID 4137 | Cycle 1(1): loaded http://localhost:47326/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:47326/tests/kraken/driver.html?testName=audio-oscillator) 06:36:53 INFO - PID 4137 | RSS: Main: 174657536 06:36:53 INFO - PID 4137 | 06:36:55 INFO - PID 4137 | Cycle 1(1): loaded http://localhost:47326/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:47326/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:36:56 INFO - PID 4137 | RSS: Main: 174927872 06:36:56 INFO - PID 4137 | 06:36:59 INFO - PID 4137 | Cycle 1(1): loaded http://localhost:47326/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:47326/tests/kraken/driver.html?testName=imaging-darkroom) 06:37:00 INFO - PID 4137 | RSS: Main: 179150848 06:37:00 INFO - PID 4137 | 06:37:03 INFO - PID 4137 | Cycle 1(1): loaded http://localhost:47326/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:47326/tests/kraken/driver.html?testName=imaging-desaturate) 06:37:04 INFO - PID 4137 | RSS: Main: 177577984 06:37:04 INFO - PID 4137 | 06:37:07 INFO - PID 4137 | Cycle 1(1): loaded http://localhost:47326/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:47326/tests/kraken/driver.html?testName=json-parse-financial) 06:37:07 INFO - PID 4137 | RSS: Main: 178933760 06:37:07 INFO - PID 4137 | 06:37:09 INFO - PID 4137 | Cycle 1(1): loaded http://localhost:47326/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:47326/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:37:10 INFO - PID 4137 | RSS: Main: 180432896 06:37:10 INFO - PID 4137 | 06:37:11 INFO - PID 4137 | Cycle 1(1): loaded http://localhost:47326/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:47326/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:37:12 INFO - PID 4137 | RSS: Main: 180588544 06:37:12 INFO - PID 4137 | 06:37:14 INFO - PID 4137 | Cycle 1(1): loaded http://localhost:47326/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:47326/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:37:15 INFO - PID 4137 | RSS: Main: 181346304 06:37:15 INFO - PID 4137 | 06:37:17 INFO - PID 4137 | Cycle 1(1): loaded http://localhost:47326/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:47326/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:37:18 INFO - PID 4137 | RSS: Main: 180502528 06:37:18 INFO - PID 4137 | 06:37:21 INFO - PID 4137 | Cycle 1(1): loaded http://localhost:47326/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:47326/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:37:22 INFO - PID 4137 | RSS: Main: 181645312 06:37:22 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | Cycle 1(1): loaded http://localhost:47326/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:47326/tests/kraken/driver.html?testName=ai-astar) 06:37:24 INFO - PID 4137 | RSS: Main: 183345152 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | __start_tp_report 06:37:24 INFO - PID 4137 | _x_x_mozilla_page_load 06:37:24 INFO - PID 4137 | _x_x_mozilla_page_load_details 06:37:24 INFO - PID 4137 | |i|pagename|runs| 06:37:24 INFO - PID 4137 | |0;ai-astar;103;112;111;111;113;114;116;112;111;113 06:37:24 INFO - PID 4137 | |1;audio-beat-detection;155;129;122;166;127;128;122;123;156;128 06:37:24 INFO - PID 4137 | |2;audio-dft;164;163;166;165;169;180;164;163;163;163 06:37:24 INFO - PID 4137 | |3;audio-fft;75;74;74;105;74;76;75;75;94;77 06:37:24 INFO - PID 4137 | |4;audio-oscillator;84;83;108;84;83;86;95;84;84;110 06:37:24 INFO - PID 4137 | |5;imaging-gaussian-blur;115;114;114;113;113;114;114;117;114;115 06:37:24 INFO - PID 4137 | |6;imaging-darkroom;151;151;151;151;150;153;150;150;152;151 06:37:24 INFO - PID 4137 | |7;imaging-desaturate;94;96;95;94;94;99;95;95;94;95 06:37:24 INFO - PID 4137 | |8;json-parse-financial;55;56;60;57;61;55;55;55;56;56 06:37:24 INFO - PID 4137 | |9;json-stringify-tinderbox;56;55;56;56;56;56;56;56;56;57 06:37:24 INFO - PID 4137 | |10;stanford-crypto-aes;91;82;83;82;84;81;83;81;87;82 06:37:24 INFO - PID 4137 | |11;stanford-crypto-ccm;134;139;132;136;138;132;135;132;181;130 06:37:24 INFO - PID 4137 | |12;stanford-crypto-pbkdf2;187;191;192;191;200;189;198;195;194;189 06:37:24 INFO - PID 4137 | |13;stanford-crypto-sha256-iterative;79;70;76;77;71;75;73;71;76;75 06:37:24 INFO - PID 4137 | __end_tp_report 06:37:24 INFO - PID 4137 | __start_cc_report 06:37:24 INFO - PID 4137 | _x_x_mozilla_cycle_collect,864 06:37:24 INFO - PID 4137 | __end_cc_report 06:37:24 INFO - PID 4137 | __startTimestamp1494596244613__endTimestamp 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | ------- Summary: start ------- 06:37:24 INFO - PID 4137 | Number of tests: 14 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | [#0] ai-astar Cycles:10 Average:111.60 Median:112.50 stddev:3.41 (3.0%) stddev-sans-first:1.67 06:37:24 INFO - PID 4137 | Values: 103.0 112.0 111.0 111.0 113.0 114.0 116.0 112.0 111.0 113.0 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | [#1] audio-beat-detection Cycles:10 Average:135.60 Median:128.50 stddev:16.59 (12.9%) stddev-sans-first:16.05 06:37:24 INFO - PID 4137 | Values: 155.0 129.0 122.0 166.0 127.0 128.0 122.0 123.0 156.0 128.0 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | [#2] audio-dft Cycles:10 Average:166.00 Median:164.50 stddev:5.27 (3.2%) stddev-sans-first:5.54 06:37:24 INFO - PID 4137 | Values: 164.0 163.0 166.0 165.0 169.0 180.0 164.0 163.0 163.0 163.0 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | [#3] audio-fft Cycles:10 Average:79.90 Median:75.00 stddev:10.69 (14.3%) stddev-sans-first:11.19 06:37:24 INFO - PID 4137 | Values: 75.0 74.0 74.0 105.0 74.0 76.0 75.0 75.0 94.0 77.0 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | [#4] audio-oscillator Cycles:10 Average:90.10 Median:84.00 stddev:10.58 (12.6%) stddev-sans-first:10.99 06:37:24 INFO - PID 4137 | Values: 84.0 83.0 108.0 84.0 83.0 86.0 95.0 84.0 84.0 110.0 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | [#5] imaging-gaussian-blur Cycles:10 Average:114.30 Median:114.00 stddev:1.16 (1.0%) stddev-sans-first:1.20 06:37:24 INFO - PID 4137 | Values: 115.0 114.0 114.0 113.0 113.0 114.0 114.0 117.0 114.0 115.0 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | [#6] imaging-darkroom Cycles:10 Average:151.00 Median:151.00 stddev:0.94 (0.6%) stddev-sans-first:1.00 06:37:24 INFO - PID 4137 | Values: 151.0 151.0 151.0 151.0 150.0 153.0 150.0 150.0 152.0 151.0 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | [#7] imaging-desaturate Cycles:10 Average:95.10 Median:95.00 stddev:1.52 (1.6%) stddev-sans-first:1.56 06:37:24 INFO - PID 4137 | Values: 94.0 96.0 95.0 94.0 94.0 99.0 95.0 95.0 94.0 95.0 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | [#8] json-parse-financial Cycles:10 Average:56.60 Median:56.00 stddev:2.17 (3.9%) stddev-sans-first:2.22 06:37:24 INFO - PID 4137 | Values: 55.0 56.0 60.0 57.0 61.0 55.0 55.0 55.0 56.0 56.0 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | [#9] json-stringify-tinderbox Cycles:10 Average:56.00 Median:56.00 stddev:0.47 (0.8%) stddev-sans-first:0.50 06:37:24 INFO - PID 4137 | Values: 56.0 55.0 56.0 56.0 56.0 56.0 56.0 56.0 56.0 57.0 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | [#10] stanford-crypto-aes Cycles:10 Average:83.60 Median:83.00 stddev:3.13 (3.8%) stddev-sans-first:1.86 06:37:24 INFO - PID 4137 | Values: 91.0 82.0 83.0 82.0 84.0 81.0 83.0 81.0 87.0 82.0 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | [#11] stanford-crypto-ccm Cycles:10 Average:138.90 Median:135.50 stddev:15.07 (11.1%) stddev-sans-first:15.88 06:37:24 INFO - PID 4137 | Values: 134.0 139.0 132.0 136.0 138.0 132.0 135.0 132.0 181.0 130.0 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:192.60 Median:193.00 stddev:4.14 (2.1%) stddev-sans-first:3.87 06:37:24 INFO - PID 4137 | Values: 187.0 191.0 192.0 191.0 200.0 189.0 198.0 195.0 194.0 189.0 06:37:24 INFO - PID 4137 | 06:37:24 INFO - PID 4137 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:74.30 Median:75.50 stddev:2.95 (3.9%) stddev-sans-first:2.59 06:37:24 INFO - PID 4137 | Values: 79.0 70.0 76.0 77.0 71.0 75.0 73.0 71.0 76.0 75.0 06:37:24 INFO - PID 4137 | -------- Summary: end -------- 06:37:24 INFO - PID 4137 | 06:37:25 INFO - TEST-INFO | 4137: exit 0 06:37:25 INFO - TEST-OK | kraken | took 63918ms 06:37:25 INFO - SUITE-END | took 1185s 06:37:26 INFO - Completed test suite (00:19:45) 06:37:26 INFO - javascript benchmark 06:37:26 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6695.5224398472765, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2672.4788666210093, 2721.9455610887794, 2740.438210166916, 2742.9588556171657, 2747.629070075538, 5108.182690769478, 5181.248718935752, 5237.790488380465, 5261.657992230503, 5271.393789714184, 5126.897462050766, 5143.974280128604, 5158.432572417031, 5235.895282094365, 5247.685138891659, 4635.768211589424, 4642.883927901813, 4663.48701642819, 4676.158291507527, 4696.225122854725, 4687.671862969593, 4712.717236965793, 4735.195016847144, 4737.976310118444, 4740.502247264039, 4464.17412778637, 4545.522720114373, 4622.260438329851, 4651.488336283006, 4684.36761037259, 4635.1656701794, 4636.397268355092, 4644.558766917137, 4679.672422930396, 4700.224462963607, 4577.588017078446, 4601.493835678073, 4606.239970404879, 4612.031473390592, 4652.837150699743, 5031.496850314976, 5086.440491545927, 5132.409772876093, 5184.637075404723, 5185.974070129625, 5570.637908535932, 5570.693611851347, 5572.749226284827, 5605.131204663284, 5615.354234263031, 5590.18942253371, 5646.378898321182, 5659.179418984266, 5666.206731057655, 5674.09214525678, 5083.034223497523, 5189.273501709764, 5214.191800270964, 5233.031889100491, 5282.471752824764, 5690.601657883908, 5717.113847353667, 5756.1653560233535, 5759.22250496186, 5799.652020878761, 5329.440408757025, 5410.377806552218, 5429.701366424884, 5518.834434966958, 5534.75093620788, 5527.5577953764405, 5584.748686309126, 5605.159226116115, 5610.943890561124, 5665.405132461032, 5402.6758394496455, 5563.443655634404, 5567.9977604031665, 5591.133374326986, 5595.160725891067, 5472.863178420492, 5526.06056970316, 5605.831825045255, 5639.548836093103, 5646.604737668324, 4700.694454860423, 4700.788464519105, 4705.929411058837, 4707.764611769398, 4720.173969555314, 4010.578889216649, 4021.2962731521866, 4034.23349563582, 4055.5538890721996, 4098.200850834059, 4748.477667456577, 4750.453697824725, 4753.524647535219, 4757.3577567028005, 4787.114383838932, 5469.124940009579, 5557.944420555824, 5577.581681373913, 5640.0, 5660.85847853807, 4750.928736068892, 4786.282057691375, 4794.760261986957, 4817.566419022305, 4832.613390928717, 4970.751462426864, 5008.6744361616375, 5013.047520971004, 5021.397432308073, 5052.343195384577, 5192.532672059533, 5223.373195216598, 5228.163493840967, 5233.869153271199, 5235.60732945023, 5433.076377015996, 5527.53015993645, 5557.1386435101, 5650.463205995424, 5705.286839145107, 5213.504717052026, 5216.608754343515, 5219.060569097599, 5226.268322434938, 5250.028744682246, 5529.032419326521, 5529.060059789926, 5534.0, 5535.197396377584, 5588.748506317144, 5477.561795056306, 5546.0, 5568.916466252928, 5608.07466767995, 5640.548756099584, 5345.1447768356875, 5392.919106213331, 5393.8112166074, 5397.757100930389, 5445.346558413015, 5278.551323137576, 5301.814436494704, 5314.813981510629, 5356.866078348073, 5393.9730301348245, 5342.78628854857, 5373.570114390917, 5376.327959005124, 5403.756830942539, 5406.810761623325, 5189.92215116766, 5275.525202731773, 5367.7047762371885, 5469.234307196916, 5490.615656904138, 5278.920816187683, 5295.655782374133, 5301.390340110936, 5307.310049693515, 5336.839894803162], "value": 5068.844372855202, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [664.6643445060247, 710.8862581986881, 735.2169939014949, 978.9951050244744, 982.0915653020954, 33363.49954750678, 34320.31359372814, 34357.31285374291, 34372.82813585929, 34419.65580344193, 34610.826945865236, 34898.651013489856, 35051.47422788654, 35078.82460587694, 35172.296554068904, 6903.482238832108, 6956.165260168774, 7075.893861592081, 7100.076989991294, 7103.0, 7005.719771209146, 7019.649017549128, 7089.326513981164, 7101.573905565657, 7104.4671649626225, 7084.822879428029, 7087.255838136999, 7089.7873063808165, 7101.218865924744, 7116.110486189226, 7060.152781666233, 7091.82270443243, 7101.431885449178, 7122.465815063865, 7125.9643701781415, 6741.93258067418, 6834.350736680008, 6836.0, 6843.247242803288, 6847.726090956356, 31844.840775796205, 32007.0, 32016.839915800505, 32141.678583214103, 32160.356792864244, 2978.166113488227, 2999.550067489872, 3003.849807509616, 3004.2939909121337, 3005.6693763685976, 24169.154079607128, 24320.635190472156, 24331.148409805573, 24362.512749745085, 24373.63439548408, 3124.906252812419, 3176.190071531768, 3186.1715953851935, 3189.521571764231, 3207.6631953644996, 135993.0, 136086.1956902161, 136762.3161884194, 146918.0, 150287.0, 40664.1867162661, 40978.79510602428, 40996.9999999994, 41057.38413923793, 41067.7946610271, 42116.0, 42313.78843105765, 42375.36436953448, 42589.0, 42608.147837043085, 10758.40828754426, 10857.619983300547, 10858.728531786768, 10862.293950893167, 10888.564457421615, 8470.068292487822, 8473.872891906627, 8484.40609157353, 8491.660333586711, 8494.617742201615, 12565.685857853445, 12725.80911286313, 12750.553730619384, 12803.0, 12906.29015404143, 5324.9733751331, 5365.651232669864, 5415.377231618414, 5437.238786569884, 5454.972725136349, 854.8717692346073, 908.2280061947424, 910.8497097978892, 916.1754421021134, 931.3201363005044, 20760.79239207619, 21472.892635536722, 21513.89243053806, 21628.56742865134, 21640.350789476342, 975.3075316525346, 983.2036050798876, 994.9950250248847, 998.1814911772423, 1008.0574662690408, 11229.606963756229, 11232.719182020352, 11404.94297528507, 11573.942130289463, 11583.420828958519, 167734.0, 168672.0, 168745.0, 168892.0, 169164.0, 40315.596844031184, 40551.0, 40867.182656346704, 40947.0, 41049.58950410518, 1191.8775025733698, 1231.96920076997, 1233.5620854596668, 1234.8271242025944, 1236.0, 19839.20643174257, 19932.50168745793, 20628.27801026957, 21488.24791132303, 21493.892530537247, 29451.705482944897, 29491.410171796015, 29553.704462955095, 29561.55657665094, 29700.702992969793, 141353.2932335332, 141843.0, 142185.28907355398, 143857.0, 144639.0, 28691.856540717163, 29288.560671589516, 29366.41267174687, 29508.852455737582, 29534.11397658074, 35386.823065884506, 35390.11524711903, 35586.46620300749, 35740.64259357477, 35861.462078068325, 25964.0, 26815.865920670272, 27091.0, 27454.588181177696, 28253.434931300846, 26578.335541611614, 26734.331641709112, 27238.910443582827, 28084.0, 28243.679585737067, 29196.56205156967, 29495.557566636948, 29921.70078299189, 29963.700362996093, 30169.245768855075, 26083.608745869205, 26164.73835261699, 26455.735442645328, 26669.19992400231, 27692.0, 20045.298414555422, 21860.0, 22068.33794986089, 22108.2262120825, 22123.0], "value": 14318.354411845363, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [406.89217357400275, 411.7262020756197, 418.05936642554263, 428.92493813582615, 433.81996471464345, 17264.74102888458, 17981.280748770034, 17983.0, 18011.189496472656, 18664.0, 18467.815321846778, 18538.629227415444, 18648.440546783586, 18778.906105469454, 18827.52931176721, 5414.675119492823, 5457.317835270591, 5533.557315414777, 5547.611667183299, 5662.716864156796, 5464.508194262516, 5477.917831232535, 5484.890302193954, 5510.1459273812425, 5538.390777014525, 5304.389995150549, 5435.42927992561, 5465.207544905987, 5494.752736126884, 5502.504774570288, 5500.862478438031, 5522.502974732253, 5547.33431988164, 5554.0, 5565.66606003639, 4880.975595122001, 4947.455779864212, 5025.798968041274, 5050.065737838475, 5051.292819005343, 21405.571888562295, 21463.0, 21709.67435488469, 22286.0, 22415.663765043537, 1604.6710424363093, 1653.1734132933534, 1679.445782891655, 1688.9577760555962, 1690.9915450422668, 14510.782338264935, 14665.926670366687, 14900.850991490162, 14925.0, 15041.0, 1955.7653081630153, 1998.540335722792, 2027.5640737241417, 2028.1988614497338, 2038.98980505098, 87994.0, 88581.0, 89747.0, 89859.10140898572, 90559.0, 10706.411147386969, 10749.193810464247, 10960.12319014477, 11092.778144437227, 11112.55523784766, 15283.0, 15318.234088295541, 15337.395712007668, 15347.309371078329, 15355.846441535665, 7114.466415018895, 7160.355567998905, 7350.852982940311, 7429.145648250413, 7489.887651685229, 6627.436667883284, 6650.626317747737, 6738.124043874265, 6799.456043516507, 6825.2833452486775, 6904.965475172592, 6951.582905025714, 6960.860782784316, 6970.686319115652, 7047.506674532836, 2039.3779897131221, 2049.846261530391, 2056.8251698605786, 2074.875507469557, 2179.934601961944, 844.9746507604782, 873.5282947208436, 875.9737207883774, 876.8509353409936, 904.6381447421085, 16997.0, 17116.657666846593, 17334.04662743561, 17505.12474376276, 18053.187606557738, 876.9429987050949, 877.6357811508152, 880.2341962492544, 884.1688812516343, 896.7399454158221, 9127.950285717228, 9757.853632195523, 9840.261980351503, 9846.310758246855, 9957.651482198089, 357505.0, 362609.0, 364032.0790376293, 366772.0, 370240.0, 72670.0, 72689.27310726825, 74528.25471745322, 76050.61974690201, 76483.0, 1017.0693815159046, 1031.185363562777, 1050.3960222871879, 1056.6196169379018, 1065.248999455382, 15124.319405626553, 15138.394464221308, 15779.05325680463, 18007.369742058963, 18394.908025459787, 38275.0, 38342.616573833904, 38720.41919371268, 39472.605273946894, 40044.196906217454, 49566.75216623894, 50315.24527132169, 50465.0, 52419.0, 52543.37283135905, 11710.531578736754, 11805.82291265649, 11963.64109076729, 12070.215435996632, 12423.813642795547, 12269.0, 12355.62933112008, 12509.311987840392, 12531.932231181752, 12661.873381266438, 11352.94323528377, 11517.769644607228, 11582.247153934968, 11858.822117668415, 11950.0, 9670.613175473183, 9679.467629280176, 9804.313698041355, 9931.404115752788, 10008.499575021366, 11426.714332141762, 11523.308601483937, 11622.0, 11757.529698811952, 11881.5841445549, 11498.942505287754, 11975.0, 12241.326727030098, 12264.080193985308, 12388.938055309665, 11008.834867476835, 11083.224174307721, 11124.833127503256, 11453.427328633701, 11497.425128743696], "value": 9020.461761081882, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1249.6063739921924, 1320.7622627926976, 1321.1280554833806, 1322.3074464685205, 1329.3419757220174, 9940.105390514853, 10384.896151038496, 10397.740056498591, 10416.27086103973, 10655.307405018668, 10485.161187105032, 10639.946800265989, 10649.09482693972, 10650.573977040909, 10661.466926653655, 2269.4666753313, 2307.8038366738847, 2315.5716192504356, 2322.396176993977, 2330.7086614173227, 2149.355193441969, 2211.3918672365066, 2220.4670878989086, 2220.911163553456, 2222.6666000099954, 2188.6060509108356, 2192.2765487389124, 2241.12596087526, 2245.1805091141696, 2255.0979608156704, 2124.6069477146775, 2188.9562208755815, 2229.1529218896876, 2233.8547994380397, 2238.1159442020394, 2004.91980320787, 2123.50097727034, 2239.5185035217505, 2244.427670943915, 2254.233560589391, 10135.493225338703, 10207.7448063799, 10220.948895255551, 10225.590976360936, 10237.078662920372, 5535.0, 5763.077907534775, 5767.307923049219, 5772.797952071657, 5781.971090144564, 3278.229616040229, 3281.442154833684, 3396.252824378633, 3455.775374600643, 3459.896203113911, 1063.7074804428767, 1122.2032357026521, 1125.6791814332958, 1158.9826152607718, 1179.9646010619695, 14904.552863414116, 15075.396984120622, 15211.239438028055, 15264.694706105927, 15269.694606107927, 4634.745089020136, 4826.855194344175, 5066.544011038951, 5075.7969681212335, 5093.617978651616, 10910.23628346008, 10927.781444371227, 10947.83578246327, 10956.178286628376, 10956.233063685466, 5700.030994730906, 5710.428957104256, 5712.485876271073, 5717.857053573611, 5729.1119876419225, 5119.283300337956, 5253.527182553588, 5298.549623281987, 5306.204069389545, 5316.202569614511, 3851.7496362736892, 3993.6206060424215, 4023.7183397161916, 4033.4554835096887, 4050.4936882889638, 1192.1118766518998, 1192.1535709646075, 1202.4048096192441, 1202.9338386388833, 1211.7697637448857, 693.3551796828897, 710.2329484157098, 714.8248679073556, 719.1549928833599, 727.989080163798, 5256.474352564789, 5319.734013299397, 5420.214068959979, 5489.670619762827, 5522.723863806874, 527.8310940499081, 530.657725766886, 532.9493698098674, 545.6944111297686, 547.2939907519335, 3381.323735252959, 3591.1919818040733, 3637.8181090945345, 3707.740458167956, 3730.1793605406765, 12948.870511294766, 13335.533256336175, 13429.865701343057, 13456.596302110953, 13472.461101555828, 12770.0, 13081.280529570964, 13244.13913095665, 13301.334933253298, 13431.865681343257, 7492.1384040836, 7695.730649427243, 7796.167900543254, 7815.335696465864, 7860.0, 5904.9704751475965, 5949.672767997802, 6020.367861374668, 6137.202163718688, 6228.56400051992, 11399.316041037564, 11973.940130299292, 12028.63914082579, 12178.330191839534, 12245.877541224474, 12005.279683219034, 12477.625671229878, 12548.121631485708, 12749.362531873554, 12751.298678572768, 8187.83624327522, 8312.709055183039, 8342.332613391036, 8402.285805706584, 8405.15948405179, 9246.722598322061, 9368.297377696565, 9631.133198012212, 9696.6121355145, 9762.36544624597, 7710.11333696632, 7907.130215676386, 7971.12317645047, 8088.272055515032, 8132.75601731949, 7476.663550140148, 7663.770086897402, 7718.768436946901, 7881.802954925944, 7895.6841726332605, 7288.781336559911, 7291.8177045572165, 7306.744263950736, 7376.2623737627955, 7397.482176247611, 4861.927071094007, 4908.680935739166, 4938.234573640948, 4978.701277923336, 5011.84964451067, 4898.632602554751, 5029.170186919264, 5090.490950905028, 5124.38507379102, 5301.9469805303], "value": 4710.435272475132, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [361.9457081437784, 375.84966013594567, 389.485878640195, 389.9064224586098, 391.37966323377447, 5434.212039254316, 5550.666959982404, 5557.166425036246, 5574.86062848429, 5612.186232996213, 5349.973250133754, 5397.379301380342, 5420.186971954209, 5444.911017796437, 5457.799284157479, 4037.253108174982, 4044.402461027907, 4058.35066389377, 4063.7358571692894, 4069.6570131856565, 3970.6227908348806, 4078.7552746835136, 4079.061815782372, 4084.4485994390675, 4094.651954583849, 4047.332190188615, 4050.8784736457956, 4057.884081877478, 4061.614146656063, 4089.7546147231114, 4027.2952233359047, 4030.8387664493384, 4033.778142202192, 4040.838366465338, 4081.8367265309353, 3556.964430355715, 3572.356975744365, 3577.3918433866047, 3578.838952247129, 3582.982085089558, 5243.161094224944, 5319.867003324909, 5351.25082488452, 5378.784848606051, 5383.865403364908, 4760.285957106427, 4777.80888764449, 4778.784954677048, 4779.378680771512, 4792.113459010095, 5511.669299842022, 5734.512566431858, 5759.3376761672525, 5759.366469688331, 5769.596128271022, 3914.667253283474, 3955.881323560298, 3958.762474251554, 3964.7422917510557, 3979.8408063677416, 5949.0, 6060.484858787008, 6094.481969032593, 6121.540884433641, 6169.722362493699, 4022.4770779798437, 4052.2705912935953, 4052.696047796427, 4053.0677944073027, 4057.4928133983253, 4127.33962565994, 4138.710290279711, 4142.647874930604, 4143.357779544175, 4148.398482220061, 4662.277347011219, 4741.454732705714, 4745.83389581363, 4789.0, 4808.134535783593, 5758.683272420057, 5762.538996880239, 5778.624389414758, 5814.0, 5832.329282132524, 1407.7330402637708, 1423.487544483985, 1424.7008128293176, 1425.1947649577955, 1432.3482815319005, 902.3052249767642, 944.1172503709054, 949.6438835436711, 962.3407965543626, 964.7298756348234, 4917.1149193144865, 4917.696810345261, 4942.629302802305, 4964.35463389757, 4968.105740966588, 5941.465268125889, 5969.522438204933, 5972.223610930551, 5980.940190598125, 5993.460588547052, 4802.567768900815, 4890.731009794496, 4946.455889852114, 4956.925646115311, 4959.404871415453, 3130.6399764026974, 3139.7597948810094, 3145.9528107078413, 3157.494800831856, 3166.0976621663176, 5390.250972004306, 5468.6171967962655, 5490.725463726878, 5490.972545137249, 5492.423295553989, 5934.198883150806, 6019.458248757633, 6021.819345419644, 6064.906188322952, 6078.270607527125, 5454.972725136428, 5461.754221060062, 5474.698891560923, 5488.17677348401, 5503.449655034465, 5778.971105144447, 5906.940930590639, 5911.970440147772, 5963.0, 5997.220361352996, 5855.03856208158, 5870.0, 5874.941250587611, 5883.0, 5891.3224979127945, 5327.9200811987075, 5493.258410114743, 5540.806071787468, 5552.750126244248, 5559.916601250903, 4036.414719865544, 4054.716169868081, 4057.695672824491, 4074.796260187038, 4077.3272410053196, 5978.192943952685, 6050.90923636137, 6051.425114614105, 6070.332263450929, 6079.1793107931635, 5743.971280143573, 5744.5978781486565, 5744.942550574608, 5797.8550536236935, 5826.0, 5769.3942136076785, 5795.623284486495, 5808.39011903744, 5813.244278243801, 5835.416458354131, 5490.313710786152, 5683.318001839806, 5723.456271654186, 5730.484256416942, 5738.971305143447, 5814.912776308443, 5830.271216097988, 5842.795502157574, 5851.444112809277, 5856.94143058581, 5533.750981205775, 5603.411641777555, 5641.12562552805, 5646.2942132233475, 5720.141978703062], "value": 4288.437550946687, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [730.4923078460471, 738.4240292571795, 746.4327111395338, 757.8863170524422, 759.5936174146833, 12390.628281151558, 12888.291143987077, 13402.865971340283, 13914.582562523128, 13991.160530368184, 14833.184174870377, 15114.244287785621, 15148.1668508232, 15162.0, 15362.615934601641, 809.5992483720552, 836.5273620404452, 839.9034111077212, 840.9453385529952, 843.1568431568431, 888.0409158109227, 890.1721399098835, 891.1489527501253, 895.3866601378077, 898.2723993565234, 923.9214666753334, 926.2543652359848, 930.0931591698074, 930.8091841172543, 932.6269492203105, 911.2026976395654, 917.334932174175, 922.2529750901791, 922.8431166701644, 927.332320729074, 677.8508728079814, 680.3162821364547, 680.7481231944213, 681.0499353402026, 681.7000519771285, 14537.418503259856, 14587.197704126269, 14629.341679624442, 14980.925095374563, 15107.4712385066, 15547.455839045691, 15557.688846223125, 15657.921710391489, 15871.20643967797, 15907.681846363008, 12268.693282667915, 12517.499300027988, 12548.686282842911, 12724.109312348139, 12735.299558524277, 2960.185948864058, 2960.955585666217, 2981.0162646326876, 2981.1503721439503, 2982.537706655472, 66226.3377366225, 66317.3368266316, 66773.66613166903, 67657.66171169162, 68268.3173168267, 10643.627473038407, 10768.569257229623, 10784.838227426595, 10852.457377131112, 10868.782624347468, 17055.573610659583, 17099.914500427418, 17192.22634981429, 17236.310547578207, 17246.137693115295, 6106.1146133811235, 6154.630722156685, 6520.608763474112, 6535.3464653534265, 6571.769988050395, 3060.9387812244076, 3104.1929098434116, 3109.9844500777804, 3114.4549703801745, 3124.390743804982, 3313.5361049452613, 3391.4743214801747, 3393.9151521212166, 3404.812735299533, 3408.761386702907, 723.1719680965265, 746.1307576673115, 748.9625518724042, 756.1719916691214, 757.7461550380684, 596.2933923300902, 597.9820605381846, 602.4186659873243, 622.0358444411145, 631.5358211714387, 9545.0, 9987.500624968723, 10194.439305838101, 10281.845772313422, 10477.580896764197, 584.6579750845802, 589.4842013238416, 597.49511662645, 602.3494625804121, 607.7872744539465, 4555.610538785702, 4617.376654151713, 4658.161530924398, 4695.81216751333, 4732.574068333866, 60929.0, 61918.38081619216, 62251.688741556005, 63387.0, 64396.0, 50424.0, 51201.487985119675, 52436.0, 55460.0, 58248.417515825146, 44255.55744442515, 44561.77719111449, 45292.77353613211, 45583.31625025627, 46283.0, 9898.10917017443, 10194.796104077728, 10276.126529245097, 10299.176065914859, 10313.793724125626, 24794.628080579165, 24838.130665426623, 25415.110471133423, 26027.73972260253, 26171.476570468105, 41484.0, 41656.3751543721, 42663.57336426596, 43373.78313108414, 43415.0, 13611.183328999896, 13897.0, 14032.579022629337, 14321.0, 14328.856711433169, 14288.785668215192, 14822.0, 15093.54719358421, 15351.692966140838, 16646.833531665012, 13887.722245555235, 14014.0, 14850.40598376053, 15350.846491534941, 15603.687926241639, 15365.385384584939, 15768.92115539415, 15878.60303492422, 16027.919860400623, 16072.678546428771, 14160.221187834768, 14747.262636868329, 15165.393384264506, 15655.84344156544, 15908.522744317688, 10178.643747468803, 10424.113950314308, 10517.368957862553, 10701.143908487458, 10824.783504329711, 11765.294082354743, 12559.37203139821, 12601.495940162291, 12613.558525451564, 12623.495060197856], "value": 6812.141573715898, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1545.6, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 112.0, 111.0, 111.0, 113.0, 114.0, 116.0, 112.0, 111.0, 113.0], "value": 111.6, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [155.0, 129.0, 122.0, 166.0, 127.0, 128.0, 122.0, 123.0, 156.0, 128.0], "value": 135.6, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 163.0, 166.0, 165.0, 169.0, 180.0, 164.0, 163.0, 163.0, 163.0], "value": 166.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 74.0, 74.0, 105.0, 74.0, 76.0, 75.0, 75.0, 94.0, 77.0], "value": 79.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 83.0, 108.0, 84.0, 83.0, 86.0, 95.0, 84.0, 84.0, 110.0], "value": 90.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [115.0, 114.0, 114.0, 113.0, 113.0, 114.0, 114.0, 117.0, 114.0, 115.0], "value": 114.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 151.0, 151.0, 151.0, 150.0, 153.0, 150.0, 150.0, 152.0, 151.0], "value": 151.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 96.0, 95.0, 94.0, 94.0, 99.0, 95.0, 95.0, 94.0, 95.0], "value": 95.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 56.0, 60.0, 57.0, 61.0, 55.0, 55.0, 55.0, 56.0, 56.0], "value": 56.6, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 55.0, 56.0, 56.0, 56.0, 56.0, 56.0, 56.0, 56.0, 57.0], "value": 56.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [91.0, 82.0, 83.0, 82.0, 84.0, 81.0, 83.0, 81.0, 87.0, 82.0], "value": 83.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [134.0, 139.0, 132.0, 136.0, 138.0, 132.0, 135.0, 132.0, 181.0, 130.0], "value": 138.9, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [187.0, 191.0, 192.0, 191.0, 200.0, 189.0, 198.0, 195.0, 194.0, 189.0], "value": 192.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 70.0, 76.0, 77.0, 71.0, 75.0, 73.0, 71.0, 76.0, 75.0], "value": 74.3, "unit": "score"}]}]} 06:37:26 INFO - Return code: 0 06:37:26 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 06:37:26 INFO - # TBPL SUCCESS # 06:37:26 INFO - Running post-action listener: _resource_record_post_action 06:37:26 INFO - [mozharness: 2017-05-12 13:37:26.426269Z] Finished run-tests step (success) 06:37:26 INFO - Running post-run listener: _resource_record_post_run 06:37:26 INFO - Total resource usage - Wall time: 1203s; CPU: 13.0%; Read bytes: 7962624; Write bytes: 383164416; Read time: 1924; Write time: 368332 06:37:26 INFO - TinderboxPrint: CPU usage
13.3% 06:37:26 INFO - TinderboxPrint: I/O read bytes / time
7,962,624 / 1,924 06:37:26 INFO - TinderboxPrint: I/O write bytes / time
383,164,416 / 368,332 06:37:26 INFO - TinderboxPrint: CPU idle
8,319.5 (86.7%) 06:37:26 INFO - TinderboxPrint: CPU user
1,219.8 (12.7%) 06:37:26 INFO - TinderboxPrint: Swap in / out
0 / 0 06:37:26 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 116240384; Read time: 0; Write time: 140296 06:37:26 INFO - run-tests - Wall time: 1186s; CPU: 13.0%; Read bytes: 5931008; Write bytes: 266342400; Read time: 1816; Write time: 228008 06:37:27 INFO - Running post-run listener: _upload_blobber_files 06:37:27 INFO - Blob upload gear active. 06:37:27 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 06:37:27 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 06:37:27 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'] 06:37:27 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 06:37:27 INFO - (blobuploader) - INFO - Open directory for files ... 06:37:27 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 06:37:27 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:37:27 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:37:28 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 06:37:28 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:37:28 INFO - (blobuploader) - INFO - Done attempting. 06:37:28 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 06:37:28 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:37:28 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:37:29 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 06:37:29 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:37:29 INFO - (blobuploader) - INFO - Done attempting. 06:37:29 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 06:37:29 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:37:29 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:37:32 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 06:37:32 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:37:32 INFO - (blobuploader) - INFO - Done attempting. 06:37:32 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 06:37:32 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:37:32 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:37:33 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 06:37:33 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:37:33 INFO - (blobuploader) - INFO - Done attempting. 06:37:33 INFO - (blobuploader) - INFO - Iteration through files over. 06:37:33 INFO - Return code: 0 06:37:33 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 06:37:33 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 06:37:33 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4ac0f176c697a8500a9f7e43e7d7cafafc7b83c8b885310aa31252a3c05c2bd69e621f5716c4398e569a920e99a0b90f632b5e091c0590d2268d2e4380357be6", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e98e84e74878cce83269561ef8d29f0758c9132ff43ba7e9219db3c305b902c40379765f158e0a031eab124b9855d52b0f88984284bc24073a576accaf170aaa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/89427221b0bcb4222731b8cb4cc679bd311c08c3cb8f9f9e83c2c1ce8b94ed4b4df052a6ca686433cb2210766bf4d4fb42ca5b7bbc5c4c804f925f3a497fa3d9", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/cf505e7f6131797a0274e8893da1e484cc8961d154a228dff3fbf4222bbe0f1cb5d8c55475d2102c9cd8aafd6e0782d0c7ccf092b1c4d27be64bce970a7a2c3e"} 06:37:33 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 06:37:33 INFO - Writing to file /builds/slave/test/properties/blobber_files 06:37:33 INFO - Contents: 06:37:33 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4ac0f176c697a8500a9f7e43e7d7cafafc7b83c8b885310aa31252a3c05c2bd69e621f5716c4398e569a920e99a0b90f632b5e091c0590d2268d2e4380357be6", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e98e84e74878cce83269561ef8d29f0758c9132ff43ba7e9219db3c305b902c40379765f158e0a031eab124b9855d52b0f88984284bc24073a576accaf170aaa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/89427221b0bcb4222731b8cb4cc679bd311c08c3cb8f9f9e83c2c1ce8b94ed4b4df052a6ca686433cb2210766bf4d4fb42ca5b7bbc5c4c804f925f3a497fa3d9", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/cf505e7f6131797a0274e8893da1e484cc8961d154a228dff3fbf4222bbe0f1cb5d8c55475d2102c9cd8aafd6e0782d0c7ccf092b1c4d27be64bce970a7a2c3e"} 06:37:33 INFO - Running post-run listener: copy_logs_to_upload_dir 06:37:33 INFO - Copying logs to upload dir... 06:37:33 INFO - mkdir: /builds/slave/test/build/upload/logs 06:37:33 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1262.396989 ========= master_lag: -0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 2 secs) (at 2017-05-12 06:37:33.402442) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-12 06:37:33.406852) ========= 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=a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315 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/4ac0f176c697a8500a9f7e43e7d7cafafc7b83c8b885310aa31252a3c05c2bd69e621f5716c4398e569a920e99a0b90f632b5e091c0590d2268d2e4380357be6", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e98e84e74878cce83269561ef8d29f0758c9132ff43ba7e9219db3c305b902c40379765f158e0a031eab124b9855d52b0f88984284bc24073a576accaf170aaa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/89427221b0bcb4222731b8cb4cc679bd311c08c3cb8f9f9e83c2c1ce8b94ed4b4df052a6ca686433cb2210766bf4d4fb42ca5b7bbc5c4c804f925f3a497fa3d9", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/cf505e7f6131797a0274e8893da1e484cc8961d154a228dff3fbf4222bbe0f1cb5d8c55475d2102c9cd8aafd6e0782d0c7ccf092b1c4d27be64bce970a7a2c3e"} build_url:https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011205 build_url: 'https://queue.taskcluster.net/v1/task/DlLb7zsgRsSXhnEesCyoMg/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4ac0f176c697a8500a9f7e43e7d7cafafc7b83c8b885310aa31252a3c05c2bd69e621f5716c4398e569a920e99a0b90f632b5e091c0590d2268d2e4380357be6", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/e98e84e74878cce83269561ef8d29f0758c9132ff43ba7e9219db3c305b902c40379765f158e0a031eab124b9855d52b0f88984284bc24073a576accaf170aaa", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/89427221b0bcb4222731b8cb4cc679bd311c08c3cb8f9f9e83c2c1ce8b94ed4b4df052a6ca686433cb2210766bf4d4fb42ca5b7bbc5c4c804f925f3a497fa3d9", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/cf505e7f6131797a0274e8893da1e484cc8961d154a228dff3fbf4222bbe0f1cb5d8c55475d2102c9cd8aafd6e0782d0c7ccf092b1c4d27be64bce970a7a2c3e"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-12 06:37:33.432190) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-12 06:37:33.432533) ========= 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=a12cd81e0ef515edd9e0d800000001bb-1494594988.815479-1200647315 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004519 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-12 06:37:33.517534) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-12 06:37:33.517843) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-12 06:37:33.518212) ========= ========= Total master_lag: 0.14 =========